[2026-01-03T13:43:06.869Z] Running test renaissance-philosophers_0 ... [2026-01-03T13:43:06.869Z] =============================================== [2026-01-03T13:43:06.869Z] renaissance-philosophers_0 Start Time: Sat Jan 3 13:43:06 2026 Epoch Time (ms): 1767447786655 [2026-01-03T13:43:06.869Z] variation: NoOptions [2026-01-03T13:43:06.869Z] JVM_OPTIONS: [2026-01-03T13:43:06.869Z] { \ [2026-01-03T13:43:06.869Z] echo ""; echo "TEST SETUP:"; \ [2026-01-03T13:43:06.869Z] echo "Nothing to be done for setup."; \ [2026-01-03T13:43:06.869Z] mkdir -p "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17674459487498/renaissance-philosophers_0"; \ [2026-01-03T13:43:06.869Z] cd "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17674459487498/renaissance-philosophers_0"; \ [2026-01-03T13:43:06.869Z] echo ""; echo "TESTING:"; \ [2026-01-03T13:43:06.869Z] "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/jdkbinary/j2sdk-image/bin/java" --add-opens java.base/java.lang=ALL-UNNAMED --add-opens java.base/java.util=ALL-UNNAMED --add-opens java.base/java.util.concurrent=ALL-UNNAMED --add-opens java.base/java.nio=ALL-UNNAMED --add-opens java.base/sun.nio.ch=ALL-UNNAMED --add-opens java.base/java.lang.invoke=ALL-UNNAMED -jar "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17674459487498/renaissance-philosophers_0"/philosophers.json" philosophers; \ [2026-01-03T13:43:06.869Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17674459487498/renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-01-03T13:43:06.869Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-01-03T13:43:06.869Z] echo "Nothing to be done for teardown."; \ [2026-01-03T13:43:06.869Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17674459487498/TestTargetResult"; [2026-01-03T13:43:06.869Z] [2026-01-03T13:43:06.869Z] TEST SETUP: [2026-01-03T13:43:06.869Z] Nothing to be done for setup. [2026-01-03T13:43:06.869Z] [2026-01-03T13:43:06.869Z] TESTING: [2026-01-03T13:43:07.827Z] WARNING: A terminally deprecated method in sun.misc.Unsafe has been called [2026-01-03T13:43:07.827Z] WARNING: sun.misc.Unsafe::objectFieldOffset has been called by scala.runtime.LazyVals$ (file:/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/output_17674459487498/renaissance-philosophers_0/launcher-134306-12303251101705990988/renaissance-harness_3/lib/scala3-library_3-3.3.4.jar) [2026-01-03T13:43:07.827Z] WARNING: Please consider reporting this to the maintainers of class scala.runtime.LazyVals$ [2026-01-03T13:43:07.827Z] WARNING: sun.misc.Unsafe::objectFieldOffset will be removed in a future release [2026-01-03T13:43:07.827Z] ====== philosophers (scala) [default], iteration 0 started ====== [2026-01-03T13:43:07.827Z] GC before operation: completed in 16.477 ms, heap usage 27.127 MB -> 4.800 MB. [2026-01-03T13:43:13.218Z] Camera thread performed 122 scans. [2026-01-03T13:43:13.218Z] ====== philosophers (scala) [default], iteration 0 completed (4496.121 ms) ====== [2026-01-03T13:43:13.218Z] ====== philosophers (scala) [default], iteration 1 started ====== [2026-01-03T13:43:13.218Z] GC before operation: completed in 13.093 ms, heap usage 44.459 MB -> 5.142 MB. [2026-01-03T13:43:18.586Z] Camera thread performed 122 scans. [2026-01-03T13:43:18.586Z] ====== philosophers (scala) [default], iteration 1 completed (5260.260 ms) ====== [2026-01-03T13:43:18.586Z] ====== philosophers (scala) [default], iteration 2 started ====== [2026-01-03T13:43:18.586Z] GC before operation: completed in 12.957 ms, heap usage 6.071 MB -> 5.142 MB. [2026-01-03T13:43:22.754Z] Camera thread performed 122 scans. [2026-01-03T13:43:22.754Z] ====== philosophers (scala) [default], iteration 2 completed (5077.378 ms) ====== [2026-01-03T13:43:22.754Z] ====== philosophers (scala) [default], iteration 3 started ====== [2026-01-03T13:43:22.754Z] GC before operation: completed in 11.189 ms, heap usage 21.353 MB -> 5.143 MB. [2026-01-03T13:43:28.151Z] Camera thread performed 122 scans. [2026-01-03T13:43:28.151Z] ====== philosophers (scala) [default], iteration 3 completed (4735.832 ms) ====== [2026-01-03T13:43:28.151Z] ====== philosophers (scala) [default], iteration 4 started ====== [2026-01-03T13:43:28.151Z] GC before operation: completed in 10.996 ms, heap usage 32.721 MB -> 5.144 MB. [2026-01-03T13:43:32.387Z] Camera thread performed 122 scans. [2026-01-03T13:43:32.387Z] ====== philosophers (scala) [default], iteration 4 completed (5046.255 ms) ====== [2026-01-03T13:43:32.387Z] ====== philosophers (scala) [default], iteration 5 started ====== [2026-01-03T13:43:32.387Z] GC before operation: completed in 12.228 ms, heap usage 37.350 MB -> 5.144 MB. [2026-01-03T13:43:37.755Z] Camera thread performed 122 scans. [2026-01-03T13:43:37.755Z] ====== philosophers (scala) [default], iteration 5 completed (4742.151 ms) ====== [2026-01-03T13:43:37.755Z] ====== philosophers (scala) [default], iteration 6 started ====== [2026-01-03T13:43:37.755Z] GC before operation: completed in 10.011 ms, heap usage 19.392 MB -> 5.144 MB. [2026-01-03T13:43:41.899Z] Camera thread performed 122 scans. [2026-01-03T13:43:41.899Z] ====== philosophers (scala) [default], iteration 6 completed (4764.363 ms) ====== [2026-01-03T13:43:41.899Z] ====== philosophers (scala) [default], iteration 7 started ====== [2026-01-03T13:43:41.899Z] GC before operation: completed in 10.025 ms, heap usage 23.010 MB -> 5.145 MB. [2026-01-03T13:43:47.294Z] Camera thread performed 122 scans. [2026-01-03T13:43:47.294Z] ====== philosophers (scala) [default], iteration 7 completed (5085.124 ms) ====== [2026-01-03T13:43:47.294Z] ====== philosophers (scala) [default], iteration 8 started ====== [2026-01-03T13:43:47.294Z] GC before operation: completed in 9.949 ms, heap usage 17.252 MB -> 5.145 MB. [2026-01-03T13:43:52.661Z] Camera thread performed 122 scans. [2026-01-03T13:43:52.661Z] ====== philosophers (scala) [default], iteration 8 completed (4693.827 ms) ====== [2026-01-03T13:43:52.661Z] ====== philosophers (scala) [default], iteration 9 started ====== [2026-01-03T13:43:52.661Z] GC before operation: completed in 10.064 ms, heap usage 18.794 MB -> 5.146 MB. [2026-01-03T13:43:56.810Z] Camera thread performed 122 scans. [2026-01-03T13:43:56.810Z] ====== philosophers (scala) [default], iteration 9 completed (4804.119 ms) ====== [2026-01-03T13:43:56.810Z] ====== philosophers (scala) [default], iteration 10 started ====== [2026-01-03T13:43:56.810Z] GC before operation: completed in 12.140 ms, heap usage 23.369 MB -> 5.145 MB. [2026-01-03T13:44:02.189Z] Camera thread performed 122 scans. [2026-01-03T13:44:02.189Z] ====== philosophers (scala) [default], iteration 10 completed (4889.186 ms) ====== [2026-01-03T13:44:02.189Z] ====== philosophers (scala) [default], iteration 11 started ====== [2026-01-03T13:44:02.189Z] GC before operation: completed in 12.537 ms, heap usage 41.682 MB -> 5.146 MB. [2026-01-03T13:44:07.558Z] Camera thread performed 122 scans. [2026-01-03T13:44:07.558Z] ====== philosophers (scala) [default], iteration 11 completed (5192.345 ms) ====== [2026-01-03T13:44:07.558Z] ====== philosophers (scala) [default], iteration 12 started ====== [2026-01-03T13:44:07.558Z] GC before operation: completed in 10.339 ms, heap usage 9.833 MB -> 5.146 MB. [2026-01-03T13:44:11.705Z] Camera thread performed 122 scans. [2026-01-03T13:44:11.705Z] ====== philosophers (scala) [default], iteration 12 completed (4629.173 ms) ====== [2026-01-03T13:44:11.705Z] ====== philosophers (scala) [default], iteration 13 started ====== [2026-01-03T13:44:11.705Z] GC before operation: completed in 13.037 ms, heap usage 7.367 MB -> 5.147 MB. [2026-01-03T13:44:15.856Z] Camera thread performed 122 scans. [2026-01-03T13:44:15.856Z] ====== philosophers (scala) [default], iteration 13 completed (4320.576 ms) ====== [2026-01-03T13:44:15.856Z] ====== philosophers (scala) [default], iteration 14 started ====== [2026-01-03T13:44:15.856Z] GC before operation: completed in 11.212 ms, heap usage 14.324 MB -> 5.147 MB. [2026-01-03T13:44:21.223Z] Camera thread performed 122 scans. [2026-01-03T13:44:21.223Z] ====== philosophers (scala) [default], iteration 14 completed (5213.154 ms) ====== [2026-01-03T13:44:21.223Z] ====== philosophers (scala) [default], iteration 15 started ====== [2026-01-03T13:44:21.223Z] GC before operation: completed in 10.683 ms, heap usage 7.094 MB -> 5.147 MB. [2026-01-03T13:44:25.370Z] Camera thread performed 122 scans. [2026-01-03T13:44:25.370Z] ====== philosophers (scala) [default], iteration 15 completed (4574.517 ms) ====== [2026-01-03T13:44:25.370Z] ====== philosophers (scala) [default], iteration 16 started ====== [2026-01-03T13:44:25.370Z] GC before operation: completed in 11.451 ms, heap usage 24.009 MB -> 5.147 MB. [2026-01-03T13:44:30.776Z] Camera thread performed 122 scans. [2026-01-03T13:44:30.776Z] ====== philosophers (scala) [default], iteration 16 completed (4405.798 ms) ====== [2026-01-03T13:44:30.776Z] ====== philosophers (scala) [default], iteration 17 started ====== [2026-01-03T13:44:30.776Z] GC before operation: completed in 14.221 ms, heap usage 52.167 MB -> 5.147 MB. [2026-01-03T13:44:34.949Z] Camera thread performed 122 scans. [2026-01-03T13:44:34.949Z] ====== philosophers (scala) [default], iteration 17 completed (4975.164 ms) ====== [2026-01-03T13:44:34.949Z] ====== philosophers (scala) [default], iteration 18 started ====== [2026-01-03T13:44:34.949Z] GC before operation: completed in 14.027 ms, heap usage 20.740 MB -> 5.147 MB. [2026-01-03T13:44:40.319Z] Camera thread performed 122 scans. [2026-01-03T13:44:40.319Z] ====== philosophers (scala) [default], iteration 18 completed (4865.755 ms) ====== [2026-01-03T13:44:40.319Z] ====== philosophers (scala) [default], iteration 19 started ====== [2026-01-03T13:44:40.319Z] GC before operation: completed in 11.965 ms, heap usage 17.725 MB -> 5.147 MB. [2026-01-03T13:44:44.498Z] Camera thread performed 122 scans. [2026-01-03T13:44:44.498Z] ====== philosophers (scala) [default], iteration 19 completed (4692.977 ms) ====== [2026-01-03T13:44:44.498Z] ====== philosophers (scala) [default], iteration 20 started ====== [2026-01-03T13:44:44.498Z] GC before operation: completed in 11.694 ms, heap usage 10.387 MB -> 5.147 MB. [2026-01-03T13:44:49.866Z] Camera thread performed 122 scans. [2026-01-03T13:44:49.866Z] ====== philosophers (scala) [default], iteration 20 completed (4846.886 ms) ====== [2026-01-03T13:44:49.866Z] ====== philosophers (scala) [default], iteration 21 started ====== [2026-01-03T13:44:49.866Z] GC before operation: completed in 12.120 ms, heap usage 45.918 MB -> 5.147 MB. [2026-01-03T13:44:54.056Z] Camera thread performed 122 scans. [2026-01-03T13:44:54.056Z] ====== philosophers (scala) [default], iteration 21 completed (4788.912 ms) ====== [2026-01-03T13:44:54.056Z] ====== philosophers (scala) [default], iteration 22 started ====== [2026-01-03T13:44:54.056Z] GC before operation: completed in 12.006 ms, heap usage 45.718 MB -> 5.147 MB. [2026-01-03T13:44:59.428Z] Camera thread performed 122 scans. [2026-01-03T13:44:59.428Z] ====== philosophers (scala) [default], iteration 22 completed (4500.027 ms) ====== [2026-01-03T13:44:59.428Z] ====== philosophers (scala) [default], iteration 23 started ====== [2026-01-03T13:44:59.428Z] GC before operation: completed in 10.848 ms, heap usage 32.748 MB -> 5.148 MB. [2026-01-03T13:45:03.579Z] Camera thread performed 122 scans. [2026-01-03T13:45:03.579Z] ====== philosophers (scala) [default], iteration 23 completed (4945.442 ms) ====== [2026-01-03T13:45:03.579Z] ====== philosophers (scala) [default], iteration 24 started ====== [2026-01-03T13:45:03.579Z] GC before operation: completed in 10.961 ms, heap usage 13.367 MB -> 5.147 MB. [2026-01-03T13:45:09.109Z] Camera thread performed 122 scans. [2026-01-03T13:45:09.109Z] ====== philosophers (scala) [default], iteration 24 completed (4783.553 ms) ====== [2026-01-03T13:45:09.109Z] ====== philosophers (scala) [default], iteration 25 started ====== [2026-01-03T13:45:09.109Z] GC before operation: completed in 11.142 ms, heap usage 49.701 MB -> 5.148 MB. [2026-01-03T13:45:13.276Z] Camera thread performed 122 scans. [2026-01-03T13:45:13.276Z] ====== philosophers (scala) [default], iteration 25 completed (4332.657 ms) ====== [2026-01-03T13:45:13.276Z] ====== philosophers (scala) [default], iteration 26 started ====== [2026-01-03T13:45:13.276Z] GC before operation: completed in 11.173 ms, heap usage 23.424 MB -> 5.147 MB. [2026-01-03T13:45:17.446Z] Camera thread performed 122 scans. [2026-01-03T13:45:17.446Z] ====== philosophers (scala) [default], iteration 26 completed (4471.171 ms) ====== [2026-01-03T13:45:17.446Z] ====== philosophers (scala) [default], iteration 27 started ====== [2026-01-03T13:45:17.446Z] GC before operation: completed in 12.022 ms, heap usage 40.666 MB -> 5.148 MB. [2026-01-03T13:45:21.622Z] Camera thread performed 122 scans. [2026-01-03T13:45:21.622Z] ====== philosophers (scala) [default], iteration 27 completed (3678.819 ms) ====== [2026-01-03T13:45:21.622Z] ====== philosophers (scala) [default], iteration 28 started ====== [2026-01-03T13:45:21.622Z] GC before operation: completed in 11.509 ms, heap usage 36.791 MB -> 5.147 MB. [2026-01-03T13:45:25.776Z] Camera thread performed 122 scans. [2026-01-03T13:45:25.776Z] ====== philosophers (scala) [default], iteration 28 completed (4899.163 ms) ====== [2026-01-03T13:45:25.776Z] ====== philosophers (scala) [default], iteration 29 started ====== [2026-01-03T13:45:25.776Z] GC before operation: completed in 13.974 ms, heap usage 43.388 MB -> 5.148 MB. [2026-01-03T13:45:30.970Z] Camera thread performed 122 scans. [2026-01-03T13:45:30.970Z] ====== philosophers (scala) [default], iteration 29 completed (5061.655 ms) ====== [2026-01-03T13:45:31.923Z] ----------------------------------- [2026-01-03T13:45:31.923Z] renaissance-philosophers_0_PASSED [2026-01-03T13:45:31.923Z] ----------------------------------- [2026-01-03T13:45:31.923Z] [2026-01-03T13:45:31.923Z] TEST TEARDOWN: [2026-01-03T13:45:31.923Z] Nothing to be done for teardown. [2026-01-03T13:45:31.923Z] renaissance-philosophers_0 Finish Time: Sat Jan 3 13:45:30 2026 Epoch Time (ms): 1767447930929