[2026-01-20T23:21:58.867Z] Running test renaissance-philosophers_0 ... [2026-01-20T23:21:58.867Z] =============================================== [2026-01-20T23:21:58.867Z] renaissance-philosophers_0 Start Time: Tue Jan 20 23:21:57 2026 Epoch Time (ms): 1768951317608 [2026-01-20T23:21:58.867Z] variation: NoOptions [2026-01-20T23:21:58.867Z] JVM_OPTIONS: [2026-01-20T23:21:58.867Z] { \ [2026-01-20T23:21:58.867Z] echo ""; echo "TEST SETUP:"; \ [2026-01-20T23:21:58.867Z] echo "Nothing to be done for setup."; \ [2026-01-20T23:21:58.867Z] mkdir -p "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-philosophers_0"; \ [2026-01-20T23:21:58.867Z] cd "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-philosophers_0"; \ [2026-01-20T23:21:58.867Z] echo ""; echo "TESTING:"; \ [2026-01-20T23:21:58.867Z] "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_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_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-philosophers_0"/philosophers.json" philosophers; \ [2026-01-20T23:21:58.867Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-01-20T23:21:58.867Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-01-20T23:21:58.867Z] echo "Nothing to be done for teardown."; \ [2026-01-20T23:21:58.867Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/TestTargetResult"; [2026-01-20T23:21:58.867Z] [2026-01-20T23:21:58.867Z] TEST SETUP: [2026-01-20T23:21:58.867Z] Nothing to be done for setup. [2026-01-20T23:21:58.867Z] [2026-01-20T23:21:58.867Z] TESTING: [2026-01-20T23:21:58.867Z] ====== philosophers (scala) [default], iteration 0 started ====== [2026-01-20T23:21:58.867Z] GC before operation: completed in 11.277 ms, heap usage 14.051 MB -> 4.642 MB. [2026-01-20T23:22:04.441Z] Camera thread performed 122 scans. [2026-01-20T23:22:04.441Z] ====== philosophers (scala) [default], iteration 0 completed (5441.118 ms) ====== [2026-01-20T23:22:04.441Z] ====== philosophers (scala) [default], iteration 1 started ====== [2026-01-20T23:22:04.441Z] GC before operation: completed in 15.144 ms, heap usage 11.212 MB -> 4.992 MB. [2026-01-20T23:22:07.048Z] Camera thread performed 122 scans. [2026-01-20T23:22:07.048Z] ====== philosophers (scala) [default], iteration 1 completed (2682.790 ms) ====== [2026-01-20T23:22:07.048Z] ====== philosophers (scala) [default], iteration 2 started ====== [2026-01-20T23:22:07.048Z] GC before operation: completed in 11.705 ms, heap usage 28.202 MB -> 4.991 MB. [2026-01-20T23:22:09.514Z] Camera thread performed 122 scans. [2026-01-20T23:22:09.514Z] ====== philosophers (scala) [default], iteration 2 completed (2052.811 ms) ====== [2026-01-20T23:22:09.514Z] ====== philosophers (scala) [default], iteration 3 started ====== [2026-01-20T23:22:09.514Z] GC before operation: completed in 11.565 ms, heap usage 40.714 MB -> 4.991 MB. [2026-01-20T23:22:11.355Z] Camera thread performed 122 scans. [2026-01-20T23:22:11.355Z] ====== philosophers (scala) [default], iteration 3 completed (1960.994 ms) ====== [2026-01-20T23:22:11.355Z] ====== philosophers (scala) [default], iteration 4 started ====== [2026-01-20T23:22:11.355Z] GC before operation: completed in 11.573 ms, heap usage 57.475 MB -> 4.992 MB. [2026-01-20T23:22:13.184Z] Camera thread performed 122 scans. [2026-01-20T23:22:13.184Z] ====== philosophers (scala) [default], iteration 4 completed (1972.403 ms) ====== [2026-01-20T23:22:13.184Z] ====== philosophers (scala) [default], iteration 5 started ====== [2026-01-20T23:22:13.184Z] GC before operation: completed in 11.655 ms, heap usage 48.308 MB -> 4.992 MB. [2026-01-20T23:22:15.022Z] Camera thread performed 122 scans. [2026-01-20T23:22:15.022Z] ====== philosophers (scala) [default], iteration 5 completed (1930.698 ms) ====== [2026-01-20T23:22:15.022Z] ====== philosophers (scala) [default], iteration 6 started ====== [2026-01-20T23:22:15.022Z] GC before operation: completed in 11.837 ms, heap usage 40.264 MB -> 4.993 MB. [2026-01-20T23:22:17.497Z] Camera thread performed 122 scans. [2026-01-20T23:22:17.497Z] ====== philosophers (scala) [default], iteration 6 completed (2155.907 ms) ====== [2026-01-20T23:22:17.497Z] ====== philosophers (scala) [default], iteration 7 started ====== [2026-01-20T23:22:17.497Z] GC before operation: completed in 11.636 ms, heap usage 25.583 MB -> 4.993 MB. [2026-01-20T23:22:19.332Z] Camera thread performed 122 scans. [2026-01-20T23:22:19.332Z] ====== philosophers (scala) [default], iteration 7 completed (2005.311 ms) ====== [2026-01-20T23:22:19.332Z] ====== philosophers (scala) [default], iteration 8 started ====== [2026-01-20T23:22:19.332Z] GC before operation: completed in 11.692 ms, heap usage 25.211 MB -> 4.994 MB. [2026-01-20T23:22:21.190Z] Camera thread performed 122 scans. [2026-01-20T23:22:21.190Z] ====== philosophers (scala) [default], iteration 8 completed (1902.640 ms) ====== [2026-01-20T23:22:21.190Z] ====== philosophers (scala) [default], iteration 9 started ====== [2026-01-20T23:22:21.190Z] GC before operation: completed in 11.841 ms, heap usage 40.233 MB -> 4.994 MB. [2026-01-20T23:22:23.020Z] Camera thread performed 122 scans. [2026-01-20T23:22:23.020Z] ====== philosophers (scala) [default], iteration 9 completed (1965.611 ms) ====== [2026-01-20T23:22:23.020Z] ====== philosophers (scala) [default], iteration 10 started ====== [2026-01-20T23:22:23.020Z] GC before operation: completed in 13.529 ms, heap usage 64.628 MB -> 4.994 MB. [2026-01-20T23:22:25.487Z] Camera thread performed 122 scans. [2026-01-20T23:22:25.487Z] ====== philosophers (scala) [default], iteration 10 completed (1999.072 ms) ====== [2026-01-20T23:22:25.487Z] ====== philosophers (scala) [default], iteration 11 started ====== [2026-01-20T23:22:25.487Z] GC before operation: completed in 12.101 ms, heap usage 63.239 MB -> 4.994 MB. [2026-01-20T23:22:27.314Z] Camera thread performed 122 scans. [2026-01-20T23:22:27.314Z] ====== philosophers (scala) [default], iteration 11 completed (1971.411 ms) ====== [2026-01-20T23:22:27.314Z] ====== philosophers (scala) [default], iteration 12 started ====== [2026-01-20T23:22:27.314Z] GC before operation: completed in 11.647 ms, heap usage 35.951 MB -> 4.994 MB. [2026-01-20T23:22:29.155Z] Camera thread performed 122 scans. [2026-01-20T23:22:29.155Z] ====== philosophers (scala) [default], iteration 12 completed (1964.810 ms) ====== [2026-01-20T23:22:29.155Z] ====== philosophers (scala) [default], iteration 13 started ====== [2026-01-20T23:22:29.155Z] GC before operation: completed in 12.107 ms, heap usage 43.601 MB -> 4.995 MB. [2026-01-20T23:22:31.089Z] Camera thread performed 122 scans. [2026-01-20T23:22:31.089Z] ====== philosophers (scala) [default], iteration 13 completed (2021.068 ms) ====== [2026-01-20T23:22:31.089Z] ====== philosophers (scala) [default], iteration 14 started ====== [2026-01-20T23:22:31.089Z] GC before operation: completed in 12.024 ms, heap usage 60.015 MB -> 4.995 MB. [2026-01-20T23:22:33.558Z] Camera thread performed 122 scans. [2026-01-20T23:22:33.558Z] ====== philosophers (scala) [default], iteration 14 completed (2032.627 ms) ====== [2026-01-20T23:22:33.558Z] ====== philosophers (scala) [default], iteration 15 started ====== [2026-01-20T23:22:33.558Z] GC before operation: completed in 12.060 ms, heap usage 52.113 MB -> 4.995 MB. [2026-01-20T23:22:35.456Z] Camera thread performed 122 scans. [2026-01-20T23:22:35.456Z] ====== philosophers (scala) [default], iteration 15 completed (2023.241 ms) ====== [2026-01-20T23:22:35.456Z] ====== philosophers (scala) [default], iteration 16 started ====== [2026-01-20T23:22:35.456Z] GC before operation: completed in 11.876 ms, heap usage 42.604 MB -> 4.995 MB. [2026-01-20T23:22:37.287Z] Camera thread performed 122 scans. [2026-01-20T23:22:37.287Z] ====== philosophers (scala) [default], iteration 16 completed (1953.185 ms) ====== [2026-01-20T23:22:37.287Z] ====== philosophers (scala) [default], iteration 17 started ====== [2026-01-20T23:22:37.287Z] GC before operation: completed in 12.109 ms, heap usage 55.205 MB -> 4.996 MB. [2026-01-20T23:22:39.120Z] Camera thread performed 122 scans. [2026-01-20T23:22:39.120Z] ====== philosophers (scala) [default], iteration 17 completed (2063.739 ms) ====== [2026-01-20T23:22:39.120Z] ====== philosophers (scala) [default], iteration 18 started ====== [2026-01-20T23:22:39.120Z] GC before operation: completed in 12.333 ms, heap usage 46.216 MB -> 4.995 MB. [2026-01-20T23:22:41.594Z] Camera thread performed 122 scans. [2026-01-20T23:22:41.594Z] ====== philosophers (scala) [default], iteration 18 completed (2044.570 ms) ====== [2026-01-20T23:22:41.594Z] ====== philosophers (scala) [default], iteration 19 started ====== [2026-01-20T23:22:41.594Z] GC before operation: completed in 12.559 ms, heap usage 58.629 MB -> 4.995 MB. [2026-01-20T23:22:43.428Z] Camera thread performed 122 scans. [2026-01-20T23:22:43.428Z] ====== philosophers (scala) [default], iteration 19 completed (2021.444 ms) ====== [2026-01-20T23:22:43.428Z] ====== philosophers (scala) [default], iteration 20 started ====== [2026-01-20T23:22:43.428Z] GC before operation: completed in 12.054 ms, heap usage 53.912 MB -> 4.995 MB. [2026-01-20T23:22:45.255Z] Camera thread performed 122 scans. [2026-01-20T23:22:45.255Z] ====== philosophers (scala) [default], iteration 20 completed (2065.246 ms) ====== [2026-01-20T23:22:45.255Z] ====== philosophers (scala) [default], iteration 21 started ====== [2026-01-20T23:22:45.255Z] GC before operation: completed in 12.360 ms, heap usage 24.977 MB -> 4.996 MB. [2026-01-20T23:22:47.728Z] Camera thread performed 122 scans. [2026-01-20T23:22:47.728Z] ====== philosophers (scala) [default], iteration 21 completed (1937.320 ms) ====== [2026-01-20T23:22:47.728Z] ====== philosophers (scala) [default], iteration 22 started ====== [2026-01-20T23:22:47.728Z] GC before operation: completed in 12.250 ms, heap usage 69.908 MB -> 4.996 MB. [2026-01-20T23:22:49.570Z] Camera thread performed 122 scans. [2026-01-20T23:22:49.570Z] ====== philosophers (scala) [default], iteration 22 completed (2035.256 ms) ====== [2026-01-20T23:22:49.570Z] ====== philosophers (scala) [default], iteration 23 started ====== [2026-01-20T23:22:49.570Z] GC before operation: completed in 12.356 ms, heap usage 61.052 MB -> 4.996 MB. [2026-01-20T23:22:51.484Z] Camera thread performed 122 scans. [2026-01-20T23:22:51.484Z] ====== philosophers (scala) [default], iteration 23 completed (2130.073 ms) ====== [2026-01-20T23:22:51.484Z] ====== philosophers (scala) [default], iteration 24 started ====== [2026-01-20T23:22:51.484Z] GC before operation: completed in 11.996 ms, heap usage 13.668 MB -> 4.996 MB. [2026-01-20T23:22:53.955Z] Camera thread performed 122 scans. [2026-01-20T23:22:53.955Z] ====== philosophers (scala) [default], iteration 24 completed (1973.392 ms) ====== [2026-01-20T23:22:53.955Z] ====== philosophers (scala) [default], iteration 25 started ====== [2026-01-20T23:22:53.955Z] GC before operation: completed in 12.456 ms, heap usage 44.644 MB -> 4.996 MB. [2026-01-20T23:22:55.799Z] Camera thread performed 122 scans. [2026-01-20T23:22:55.799Z] ====== philosophers (scala) [default], iteration 25 completed (2015.860 ms) ====== [2026-01-20T23:22:55.799Z] ====== philosophers (scala) [default], iteration 26 started ====== [2026-01-20T23:22:55.799Z] GC before operation: completed in 12.186 ms, heap usage 59.599 MB -> 4.996 MB. [2026-01-20T23:22:57.637Z] Camera thread performed 122 scans. [2026-01-20T23:22:57.637Z] ====== philosophers (scala) [default], iteration 26 completed (2066.972 ms) ====== [2026-01-20T23:22:57.637Z] ====== philosophers (scala) [default], iteration 27 started ====== [2026-01-20T23:22:57.637Z] GC before operation: completed in 12.105 ms, heap usage 45.246 MB -> 4.996 MB. [2026-01-20T23:23:00.126Z] Camera thread performed 122 scans. [2026-01-20T23:23:00.126Z] ====== philosophers (scala) [default], iteration 27 completed (2059.132 ms) ====== [2026-01-20T23:23:00.126Z] ====== philosophers (scala) [default], iteration 28 started ====== [2026-01-20T23:23:00.126Z] GC before operation: completed in 11.805 ms, heap usage 8.228 MB -> 4.996 MB. [2026-01-20T23:23:02.132Z] Camera thread performed 122 scans. [2026-01-20T23:23:02.132Z] ====== philosophers (scala) [default], iteration 28 completed (2120.269 ms) ====== [2026-01-20T23:23:02.132Z] ====== philosophers (scala) [default], iteration 29 started ====== [2026-01-20T23:23:02.132Z] GC before operation: completed in 12.059 ms, heap usage 68.935 MB -> 4.996 MB. [2026-01-20T23:23:04.037Z] Camera thread performed 122 scans. [2026-01-20T23:23:04.037Z] ====== philosophers (scala) [default], iteration 29 completed (2103.247 ms) ====== [2026-01-20T23:23:04.037Z] ----------------------------------- [2026-01-20T23:23:04.037Z] renaissance-philosophers_0_PASSED [2026-01-20T23:23:04.037Z] ----------------------------------- [2026-01-20T23:23:04.405Z] [2026-01-20T23:23:04.405Z] TEST TEARDOWN: [2026-01-20T23:23:04.405Z] Nothing to be done for teardown. [2026-01-20T23:23:04.405Z] renaissance-philosophers_0 Finish Time: Tue Jan 20 23:23:04 2026 Epoch Time (ms): 1768951384038