[2026-02-04T23:24:55.931Z] Running test renaissance-philosophers_0 ... [2026-02-04T23:24:55.931Z] =============================================== [2026-02-04T23:24:56.230Z] renaissance-philosophers_0 Start Time: Wed Feb 4 23:24:56 2026 Epoch Time (ms): 1770247496067 [2026-02-04T23:24:56.528Z] variation: NoOptions [2026-02-04T23:24:56.528Z] JVM_OPTIONS: [2026-02-04T23:24:56.528Z] { \ [2026-02-04T23:24:56.528Z] echo ""; echo "TEST SETUP:"; \ [2026-02-04T23:24:56.528Z] echo "Nothing to be done for setup."; \ [2026-02-04T23:24:56.528Z] mkdir -p "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/\\TKG\\output_17702465894529\\renaissance-philosophers_0"; \ [2026-02-04T23:24:56.528Z] cd "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/\\TKG\\output_17702465894529\\renaissance-philosophers_0"; \ [2026-02-04T23:24:56.528Z] echo ""; echo "TESTING:"; \ [2026-02-04T23:24:56.529Z] "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/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 "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests///..//jvmtest\\perf\\renaissance\\renaissance.jar" --json ""C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/\\TKG\\output_17702465894529\\renaissance-philosophers_0"\\philosophers.json" philosophers; \ [2026-02-04T23:24:56.529Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/; rm -f -r "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/\\TKG\\output_17702465894529\\renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-02-04T23:24:56.529Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-02-04T23:24:56.529Z] echo "Nothing to be done for teardown."; \ [2026-02-04T23:24:56.529Z] } 2>&1 | tee -a "C:/Users/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_windows/aqa-tests/\\TKG\\output_17702465894529\\TestTargetResult"; [2026-02-04T23:24:56.827Z] [2026-02-04T23:24:56.827Z] TEST SETUP: [2026-02-04T23:24:56.827Z] Nothing to be done for setup. [2026-02-04T23:24:56.827Z] [2026-02-04T23:24:56.827Z] TESTING: [2026-02-04T23:24:57.895Z] ====== philosophers (scala) [default], iteration 0 started ====== [2026-02-04T23:24:57.895Z] GC before operation: completed in 10.883 ms, heap usage 15.964 MB -> 4.559 MB. [2026-02-04T23:25:00.039Z] Camera thread performed 122 scans. [2026-02-04T23:25:00.039Z] ====== philosophers (scala) [default], iteration 0 completed (2016.857 ms) ====== [2026-02-04T23:25:00.039Z] ====== philosophers (scala) [default], iteration 1 started ====== [2026-02-04T23:25:00.039Z] GC before operation: completed in 14.066 ms, heap usage 62.711 MB -> 4.933 MB. [2026-02-04T23:25:01.583Z] Camera thread performed 122 scans. [2026-02-04T23:25:01.583Z] ====== philosophers (scala) [default], iteration 1 completed (1736.299 ms) ====== [2026-02-04T23:25:01.583Z] ====== philosophers (scala) [default], iteration 2 started ====== [2026-02-04T23:25:01.583Z] GC before operation: completed in 11.021 ms, heap usage 16.734 MB -> 4.933 MB. [2026-02-04T23:25:03.706Z] Camera thread performed 122 scans. [2026-02-04T23:25:03.706Z] ====== philosophers (scala) [default], iteration 2 completed (1707.855 ms) ====== [2026-02-04T23:25:03.706Z] ====== philosophers (scala) [default], iteration 3 started ====== [2026-02-04T23:25:03.706Z] GC before operation: completed in 9.505 ms, heap usage 27.061 MB -> 4.934 MB. [2026-02-04T23:25:04.765Z] Camera thread performed 122 scans. [2026-02-04T23:25:04.765Z] ====== philosophers (scala) [default], iteration 3 completed (1326.585 ms) ====== [2026-02-04T23:25:04.765Z] ====== philosophers (scala) [default], iteration 4 started ====== [2026-02-04T23:25:04.765Z] GC before operation: completed in 9.706 ms, heap usage 43.279 MB -> 4.934 MB. [2026-02-04T23:25:06.341Z] Camera thread performed 122 scans. [2026-02-04T23:25:06.341Z] ====== philosophers (scala) [default], iteration 4 completed (1391.633 ms) ====== [2026-02-04T23:25:06.341Z] ====== philosophers (scala) [default], iteration 5 started ====== [2026-02-04T23:25:06.341Z] GC before operation: completed in 9.147 ms, heap usage 49.460 MB -> 4.935 MB. [2026-02-04T23:25:07.905Z] Camera thread performed 122 scans. [2026-02-04T23:25:07.905Z] ====== philosophers (scala) [default], iteration 5 completed (1706.230 ms) ====== [2026-02-04T23:25:07.905Z] ====== philosophers (scala) [default], iteration 6 started ====== [2026-02-04T23:25:07.905Z] GC before operation: completed in 9.480 ms, heap usage 58.540 MB -> 4.938 MB. [2026-02-04T23:25:10.048Z] Camera thread performed 122 scans. [2026-02-04T23:25:10.048Z] ====== philosophers (scala) [default], iteration 6 completed (1760.702 ms) ====== [2026-02-04T23:25:10.048Z] ====== philosophers (scala) [default], iteration 7 started ====== [2026-02-04T23:25:10.048Z] GC before operation: completed in 9.401 ms, heap usage 55.125 MB -> 4.939 MB. [2026-02-04T23:25:11.591Z] Camera thread performed 122 scans. [2026-02-04T23:25:11.591Z] ====== philosophers (scala) [default], iteration 7 completed (1770.076 ms) ====== [2026-02-04T23:25:11.591Z] ====== philosophers (scala) [default], iteration 8 started ====== [2026-02-04T23:25:11.591Z] GC before operation: completed in 9.314 ms, heap usage 51.042 MB -> 4.940 MB. [2026-02-04T23:25:13.136Z] Camera thread performed 122 scans. [2026-02-04T23:25:13.136Z] ====== philosophers (scala) [default], iteration 8 completed (1789.332 ms) ====== [2026-02-04T23:25:13.136Z] ====== philosophers (scala) [default], iteration 9 started ====== [2026-02-04T23:25:13.136Z] GC before operation: completed in 9.163 ms, heap usage 13.873 MB -> 4.940 MB. [2026-02-04T23:25:15.265Z] Camera thread performed 122 scans. [2026-02-04T23:25:15.265Z] ====== philosophers (scala) [default], iteration 9 completed (1769.781 ms) ====== [2026-02-04T23:25:15.266Z] ====== philosophers (scala) [default], iteration 10 started ====== [2026-02-04T23:25:15.266Z] GC before operation: completed in 9.266 ms, heap usage 50.774 MB -> 4.940 MB. [2026-02-04T23:25:16.803Z] Camera thread performed 122 scans. [2026-02-04T23:25:16.803Z] ====== philosophers (scala) [default], iteration 10 completed (1567.074 ms) ====== [2026-02-04T23:25:16.803Z] ====== philosophers (scala) [default], iteration 11 started ====== [2026-02-04T23:25:16.803Z] GC before operation: completed in 9.585 ms, heap usage 29.101 MB -> 4.940 MB. [2026-02-04T23:25:18.339Z] Camera thread performed 122 scans. [2026-02-04T23:25:18.339Z] ====== philosophers (scala) [default], iteration 11 completed (1686.882 ms) ====== [2026-02-04T23:25:18.339Z] ====== philosophers (scala) [default], iteration 12 started ====== [2026-02-04T23:25:18.339Z] GC before operation: completed in 8.997 ms, heap usage 6.585 MB -> 4.941 MB. [2026-02-04T23:25:19.905Z] Camera thread performed 122 scans. [2026-02-04T23:25:19.905Z] ====== philosophers (scala) [default], iteration 12 completed (1511.394 ms) ====== [2026-02-04T23:25:19.905Z] ====== philosophers (scala) [default], iteration 13 started ====== [2026-02-04T23:25:19.905Z] GC before operation: completed in 9.285 ms, heap usage 8.021 MB -> 4.941 MB. [2026-02-04T23:25:21.462Z] Camera thread performed 122 scans. [2026-02-04T23:25:21.462Z] ====== philosophers (scala) [default], iteration 13 completed (1776.980 ms) ====== [2026-02-04T23:25:21.462Z] ====== philosophers (scala) [default], iteration 14 started ====== [2026-02-04T23:25:21.762Z] GC before operation: completed in 9.145 ms, heap usage 27.151 MB -> 4.941 MB. [2026-02-04T23:25:23.298Z] Camera thread performed 122 scans. [2026-02-04T23:25:23.298Z] ====== philosophers (scala) [default], iteration 14 completed (1536.154 ms) ====== [2026-02-04T23:25:23.298Z] ====== philosophers (scala) [default], iteration 15 started ====== [2026-02-04T23:25:23.299Z] GC before operation: completed in 9.331 ms, heap usage 63.082 MB -> 4.941 MB. [2026-02-04T23:25:24.362Z] Camera thread performed 122 scans. [2026-02-04T23:25:24.362Z] ====== philosophers (scala) [default], iteration 15 completed (1196.914 ms) ====== [2026-02-04T23:25:24.362Z] ====== philosophers (scala) [default], iteration 16 started ====== [2026-02-04T23:25:24.362Z] GC before operation: completed in 8.940 ms, heap usage 22.850 MB -> 4.941 MB. [2026-02-04T23:25:26.474Z] Camera thread performed 122 scans. [2026-02-04T23:25:26.474Z] ====== philosophers (scala) [default], iteration 16 completed (1706.590 ms) ====== [2026-02-04T23:25:26.474Z] ====== philosophers (scala) [default], iteration 17 started ====== [2026-02-04T23:25:26.474Z] GC before operation: completed in 9.086 ms, heap usage 37.530 MB -> 4.941 MB. [2026-02-04T23:25:27.549Z] Camera thread performed 122 scans. [2026-02-04T23:25:27.549Z] ====== philosophers (scala) [default], iteration 17 completed (1602.484 ms) ====== [2026-02-04T23:25:27.549Z] ====== philosophers (scala) [default], iteration 18 started ====== [2026-02-04T23:25:27.853Z] GC before operation: completed in 9.033 ms, heap usage 11.492 MB -> 4.941 MB. [2026-02-04T23:25:29.397Z] Camera thread performed 122 scans. [2026-02-04T23:25:29.397Z] ====== philosophers (scala) [default], iteration 18 completed (1576.012 ms) ====== [2026-02-04T23:25:29.397Z] ====== philosophers (scala) [default], iteration 19 started ====== [2026-02-04T23:25:29.397Z] GC before operation: completed in 8.811 ms, heap usage 6.008 MB -> 4.942 MB. [2026-02-04T23:25:34.065Z] Camera thread performed 122 scans. [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 19 completed (1680.855 ms) ====== [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 20 started ====== [2026-02-04T23:25:34.065Z] GC before operation: completed in 9.014 ms, heap usage 32.158 MB -> 4.942 MB. [2026-02-04T23:25:34.065Z] Camera thread performed 122 scans. [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 20 completed (1432.296 ms) ====== [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 21 started ====== [2026-02-04T23:25:34.065Z] GC before operation: completed in 9.127 ms, heap usage 31.894 MB -> 4.942 MB. [2026-02-04T23:25:34.065Z] Camera thread performed 122 scans. [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 21 completed (1749.746 ms) ====== [2026-02-04T23:25:34.065Z] ====== philosophers (scala) [default], iteration 22 started ====== [2026-02-04T23:25:34.065Z] GC before operation: completed in 9.871 ms, heap usage 40.475 MB -> 4.942 MB. [2026-02-04T23:25:35.605Z] Camera thread performed 122 scans. [2026-02-04T23:25:35.605Z] ====== philosophers (scala) [default], iteration 22 completed (1225.231 ms) ====== [2026-02-04T23:25:35.605Z] ====== philosophers (scala) [default], iteration 23 started ====== [2026-02-04T23:25:35.605Z] GC before operation: completed in 9.309 ms, heap usage 27.844 MB -> 4.942 MB. [2026-02-04T23:25:37.147Z] Camera thread performed 122 scans. [2026-02-04T23:25:37.147Z] ====== philosophers (scala) [default], iteration 23 completed (1565.489 ms) ====== [2026-02-04T23:25:37.147Z] ====== philosophers (scala) [default], iteration 24 started ====== [2026-02-04T23:25:37.147Z] GC before operation: completed in 9.136 ms, heap usage 22.051 MB -> 4.942 MB. [2026-02-04T23:25:38.685Z] Camera thread performed 122 scans. [2026-02-04T23:25:38.685Z] ====== philosophers (scala) [default], iteration 24 completed (1537.607 ms) ====== [2026-02-04T23:25:38.685Z] ====== philosophers (scala) [default], iteration 25 started ====== [2026-02-04T23:25:38.685Z] GC before operation: completed in 9.389 ms, heap usage 67.461 MB -> 4.942 MB. [2026-02-04T23:25:40.227Z] Camera thread performed 122 scans. [2026-02-04T23:25:40.227Z] ====== philosophers (scala) [default], iteration 25 completed (1392.177 ms) ====== [2026-02-04T23:25:40.227Z] ====== philosophers (scala) [default], iteration 26 started ====== [2026-02-04T23:25:40.227Z] GC before operation: completed in 9.313 ms, heap usage 20.143 MB -> 4.942 MB. [2026-02-04T23:25:41.282Z] Camera thread performed 122 scans. [2026-02-04T23:25:41.282Z] ====== philosophers (scala) [default], iteration 26 completed (1457.061 ms) ====== [2026-02-04T23:25:41.282Z] ====== philosophers (scala) [default], iteration 27 started ====== [2026-02-04T23:25:41.282Z] GC before operation: completed in 9.601 ms, heap usage 19.159 MB -> 4.942 MB. [2026-02-04T23:25:42.822Z] Camera thread performed 122 scans. [2026-02-04T23:25:42.822Z] ====== philosophers (scala) [default], iteration 27 completed (1466.046 ms) ====== [2026-02-04T23:25:42.822Z] ====== philosophers (scala) [default], iteration 28 started ====== [2026-02-04T23:25:42.822Z] GC before operation: completed in 9.575 ms, heap usage 5.981 MB -> 4.942 MB. [2026-02-04T23:25:44.926Z] Camera thread performed 122 scans. [2026-02-04T23:25:44.926Z] ====== philosophers (scala) [default], iteration 28 completed (1737.543 ms) ====== [2026-02-04T23:25:44.926Z] ====== philosophers (scala) [default], iteration 29 started ====== [2026-02-04T23:25:44.926Z] GC before operation: completed in 9.222 ms, heap usage 26.593 MB -> 4.943 MB. [2026-02-04T23:25:46.462Z] Camera thread performed 122 scans. [2026-02-04T23:25:46.462Z] ====== philosophers (scala) [default], iteration 29 completed (1702.629 ms) ====== [2026-02-04T23:25:46.462Z] ----------------------------------- [2026-02-04T23:25:46.462Z] renaissance-philosophers_0_PASSED [2026-02-04T23:25:46.462Z] ----------------------------------- [2026-02-04T23:25:46.462Z] [2026-02-04T23:25:46.462Z] TEST TEARDOWN: [2026-02-04T23:25:46.462Z] Nothing to be done for teardown. [2026-02-04T23:25:46.761Z] renaissance-philosophers_0 Finish Time: Wed Feb 4 23:25:46 2026 Epoch Time (ms): 1770247546549