[2026-02-18T23:55:22.429Z] Running test renaissance-philosophers_0 ... [2026-02-18T23:55:22.756Z] =============================================== [2026-02-18T23:55:22.756Z] renaissance-philosophers_0 Start Time: Wed Feb 18 23:55:22 2026 Epoch Time (ms): 1771458922579 [2026-02-18T23:55:22.756Z] variation: NoOptions [2026-02-18T23:55:23.090Z] JVM_OPTIONS: [2026-02-18T23:55:23.090Z] { \ [2026-02-18T23:55:23.090Z] echo ""; echo "TEST SETUP:"; \ [2026-02-18T23:55:23.090Z] echo "Nothing to be done for setup."; \ [2026-02-18T23:55:23.090Z] mkdir -p "C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17714559327200\\renaissance-philosophers_0"; \ [2026-02-18T23:55:23.090Z] cd "C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17714559327200\\renaissance-philosophers_0"; \ [2026-02-18T23:55:23.090Z] echo ""; echo "TESTING:"; \ [2026-02-18T23:55:23.090Z] "c:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_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:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests///..//jvmtest\\perf\\renaissance\\renaissance.jar" --json ""C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17714559327200\\renaissance-philosophers_0"\\philosophers.json" philosophers; \ [2026-02-18T23:55:23.090Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/; rm -f -r "C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17714559327200\\renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-02-18T23:55:23.090Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-02-18T23:55:23.090Z] echo "Nothing to be done for teardown."; \ [2026-02-18T23:55:23.090Z] } 2>&1 | tee -a "C:/jenkins/workspace/Test_openjdk21_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17714559327200\\TestTargetResult"; [2026-02-18T23:55:23.090Z] [2026-02-18T23:55:23.090Z] TEST SETUP: [2026-02-18T23:55:23.090Z] Nothing to be done for setup. [2026-02-18T23:55:23.090Z] [2026-02-18T23:55:23.090Z] TESTING: [2026-02-18T23:55:26.032Z] ====== philosophers (scala) [default], iteration 0 started ====== [2026-02-18T23:55:26.032Z] GC before operation: completed in 17.907 ms, heap usage 8.658 MB -> 4.538 MB. [2026-02-18T23:55:27.979Z] Camera thread performed 122 scans. [2026-02-18T23:55:27.979Z] ====== philosophers (scala) [default], iteration 0 completed (3091.680 ms) ====== [2026-02-18T23:55:27.979Z] ====== philosophers (scala) [default], iteration 1 started ====== [2026-02-18T23:55:27.979Z] GC before operation: completed in 14.515 ms, heap usage 9.001 MB -> 4.914 MB. [2026-02-18T23:55:29.132Z] Camera thread performed 122 scans. [2026-02-18T23:55:29.132Z] ====== philosophers (scala) [default], iteration 1 completed (1322.993 ms) ====== [2026-02-18T23:55:29.132Z] ====== philosophers (scala) [default], iteration 2 started ====== [2026-02-18T23:55:29.132Z] GC before operation: completed in 13.066 ms, heap usage 13.999 MB -> 4.915 MB. [2026-02-18T23:55:29.861Z] Camera thread performed 122 scans. [2026-02-18T23:55:29.861Z] ====== philosophers (scala) [default], iteration 2 completed (891.546 ms) ====== [2026-02-18T23:55:29.861Z] ====== philosophers (scala) [default], iteration 3 started ====== [2026-02-18T23:55:29.861Z] GC before operation: completed in 13.261 ms, heap usage 44.664 MB -> 4.916 MB. [2026-02-18T23:55:31.104Z] Camera thread performed 122 scans. [2026-02-18T23:55:31.104Z] ====== philosophers (scala) [default], iteration 3 completed (1026.484 ms) ====== [2026-02-18T23:55:31.104Z] ====== philosophers (scala) [default], iteration 4 started ====== [2026-02-18T23:55:31.104Z] GC before operation: completed in 13.250 ms, heap usage 7.917 MB -> 4.916 MB. [2026-02-18T23:55:31.795Z] Camera thread performed 122 scans. [2026-02-18T23:55:31.795Z] ====== philosophers (scala) [default], iteration 4 completed (977.387 ms) ====== [2026-02-18T23:55:31.795Z] ====== philosophers (scala) [default], iteration 5 started ====== [2026-02-18T23:55:31.795Z] GC before operation: completed in 13.241 ms, heap usage 33.072 MB -> 4.917 MB. [2026-02-18T23:55:33.071Z] Camera thread performed 122 scans. [2026-02-18T23:55:33.071Z] ====== philosophers (scala) [default], iteration 5 completed (920.405 ms) ====== [2026-02-18T23:55:33.071Z] ====== philosophers (scala) [default], iteration 6 started ====== [2026-02-18T23:55:33.071Z] GC before operation: completed in 12.734 ms, heap usage 27.482 MB -> 4.918 MB. [2026-02-18T23:55:33.764Z] Camera thread performed 122 scans. [2026-02-18T23:55:33.765Z] ====== philosophers (scala) [default], iteration 6 completed (1098.065 ms) ====== [2026-02-18T23:55:33.765Z] ====== philosophers (scala) [default], iteration 7 started ====== [2026-02-18T23:55:33.765Z] GC before operation: completed in 13.118 ms, heap usage 39.929 MB -> 4.918 MB. [2026-02-18T23:55:34.897Z] Camera thread performed 122 scans. [2026-02-18T23:55:34.897Z] ====== philosophers (scala) [default], iteration 7 completed (981.439 ms) ====== [2026-02-18T23:55:34.897Z] ====== philosophers (scala) [default], iteration 8 started ====== [2026-02-18T23:55:34.897Z] GC before operation: completed in 12.880 ms, heap usage 40.472 MB -> 4.918 MB. [2026-02-18T23:55:36.009Z] Camera thread performed 122 scans. [2026-02-18T23:55:36.009Z] ====== philosophers (scala) [default], iteration 8 completed (956.258 ms) ====== [2026-02-18T23:55:36.009Z] ====== philosophers (scala) [default], iteration 9 started ====== [2026-02-18T23:55:36.009Z] GC before operation: completed in 12.413 ms, heap usage 7.460 MB -> 4.918 MB. [2026-02-18T23:55:36.697Z] Camera thread performed 122 scans. [2026-02-18T23:55:36.697Z] ====== philosophers (scala) [default], iteration 9 completed (955.436 ms) ====== [2026-02-18T23:55:36.697Z] ====== philosophers (scala) [default], iteration 10 started ====== [2026-02-18T23:55:36.697Z] GC before operation: completed in 12.416 ms, heap usage 14.694 MB -> 4.918 MB. [2026-02-18T23:55:37.856Z] Camera thread performed 122 scans. [2026-02-18T23:55:37.856Z] ====== philosophers (scala) [default], iteration 10 completed (965.397 ms) ====== [2026-02-18T23:55:37.856Z] ====== philosophers (scala) [default], iteration 11 started ====== [2026-02-18T23:55:37.856Z] GC before operation: completed in 14.199 ms, heap usage 15.917 MB -> 4.922 MB. [2026-02-18T23:55:38.966Z] Camera thread performed 122 scans. [2026-02-18T23:55:38.966Z] ====== philosophers (scala) [default], iteration 11 completed (961.657 ms) ====== [2026-02-18T23:55:38.966Z] ====== philosophers (scala) [default], iteration 12 started ====== [2026-02-18T23:55:38.966Z] GC before operation: completed in 13.694 ms, heap usage 32.043 MB -> 4.923 MB. [2026-02-18T23:55:39.655Z] Camera thread performed 122 scans. [2026-02-18T23:55:39.655Z] ====== philosophers (scala) [default], iteration 12 completed (972.947 ms) ====== [2026-02-18T23:55:39.655Z] ====== philosophers (scala) [default], iteration 13 started ====== [2026-02-18T23:55:39.655Z] GC before operation: completed in 16.719 ms, heap usage 51.544 MB -> 4.924 MB. [2026-02-18T23:55:40.769Z] Camera thread performed 122 scans. [2026-02-18T23:55:40.769Z] ====== philosophers (scala) [default], iteration 13 completed (932.482 ms) ====== [2026-02-18T23:55:40.769Z] ====== philosophers (scala) [default], iteration 14 started ====== [2026-02-18T23:55:40.769Z] GC before operation: completed in 12.503 ms, heap usage 40.905 MB -> 4.923 MB. [2026-02-18T23:55:41.886Z] Camera thread performed 122 scans. [2026-02-18T23:55:41.886Z] ====== philosophers (scala) [default], iteration 14 completed (952.898 ms) ====== [2026-02-18T23:55:41.886Z] ====== philosophers (scala) [default], iteration 15 started ====== [2026-02-18T23:55:41.886Z] GC before operation: completed in 13.040 ms, heap usage 44.897 MB -> 4.924 MB. [2026-02-18T23:55:42.576Z] Camera thread performed 122 scans. [2026-02-18T23:55:42.576Z] ====== philosophers (scala) [default], iteration 15 completed (982.951 ms) ====== [2026-02-18T23:55:42.576Z] ====== philosophers (scala) [default], iteration 16 started ====== [2026-02-18T23:55:42.576Z] GC before operation: completed in 12.332 ms, heap usage 9.547 MB -> 4.924 MB. [2026-02-18T23:55:43.688Z] Camera thread performed 122 scans. [2026-02-18T23:55:43.688Z] ====== philosophers (scala) [default], iteration 16 completed (948.590 ms) ====== [2026-02-18T23:55:43.688Z] ====== philosophers (scala) [default], iteration 17 started ====== [2026-02-18T23:55:43.688Z] GC before operation: completed in 12.414 ms, heap usage 9.467 MB -> 4.924 MB. [2026-02-18T23:55:44.808Z] Camera thread performed 122 scans. [2026-02-18T23:55:44.808Z] ====== philosophers (scala) [default], iteration 17 completed (962.213 ms) ====== [2026-02-18T23:55:44.808Z] ====== philosophers (scala) [default], iteration 18 started ====== [2026-02-18T23:55:44.808Z] GC before operation: completed in 13.775 ms, heap usage 54.041 MB -> 4.924 MB. [2026-02-18T23:55:45.498Z] Camera thread performed 122 scans. [2026-02-18T23:55:45.499Z] ====== philosophers (scala) [default], iteration 18 completed (982.586 ms) ====== [2026-02-18T23:55:45.499Z] ====== philosophers (scala) [default], iteration 19 started ====== [2026-02-18T23:55:45.499Z] GC before operation: completed in 12.971 ms, heap usage 8.048 MB -> 4.925 MB. [2026-02-18T23:55:46.617Z] Camera thread performed 122 scans. [2026-02-18T23:55:46.617Z] ====== philosophers (scala) [default], iteration 19 completed (937.804 ms) ====== [2026-02-18T23:55:46.617Z] ====== philosophers (scala) [default], iteration 20 started ====== [2026-02-18T23:55:46.617Z] GC before operation: completed in 12.899 ms, heap usage 14.918 MB -> 4.925 MB. [2026-02-18T23:55:47.741Z] Camera thread performed 122 scans. [2026-02-18T23:55:47.741Z] ====== philosophers (scala) [default], iteration 20 completed (1134.092 ms) ====== [2026-02-18T23:55:47.741Z] ====== philosophers (scala) [default], iteration 21 started ====== [2026-02-18T23:55:47.741Z] GC before operation: completed in 12.426 ms, heap usage 12.528 MB -> 4.925 MB. [2026-02-18T23:55:48.850Z] Camera thread performed 122 scans. [2026-02-18T23:55:48.850Z] ====== philosophers (scala) [default], iteration 21 completed (896.552 ms) ====== [2026-02-18T23:55:48.850Z] ====== philosophers (scala) [default], iteration 22 started ====== [2026-02-18T23:55:48.850Z] GC before operation: completed in 12.843 ms, heap usage 44.402 MB -> 4.925 MB. [2026-02-18T23:55:49.540Z] Camera thread performed 122 scans. [2026-02-18T23:55:49.540Z] ====== philosophers (scala) [default], iteration 22 completed (1000.970 ms) ====== [2026-02-18T23:55:49.540Z] ====== philosophers (scala) [default], iteration 23 started ====== [2026-02-18T23:55:49.540Z] GC before operation: completed in 12.735 ms, heap usage 20.516 MB -> 4.926 MB. [2026-02-18T23:55:50.652Z] Camera thread performed 122 scans. [2026-02-18T23:55:50.652Z] ====== philosophers (scala) [default], iteration 23 completed (1004.083 ms) ====== [2026-02-18T23:55:50.652Z] ====== philosophers (scala) [default], iteration 24 started ====== [2026-02-18T23:55:50.652Z] GC before operation: completed in 12.306 ms, heap usage 4.954 MB -> 4.926 MB. [2026-02-18T23:55:51.938Z] Camera thread performed 122 scans. [2026-02-18T23:55:51.938Z] ====== philosophers (scala) [default], iteration 24 completed (1267.673 ms) ====== [2026-02-18T23:55:51.938Z] ====== philosophers (scala) [default], iteration 25 started ====== [2026-02-18T23:55:51.938Z] GC before operation: completed in 12.657 ms, heap usage 9.485 MB -> 4.926 MB. [2026-02-18T23:55:53.052Z] Camera thread performed 122 scans. [2026-02-18T23:55:53.052Z] ====== philosophers (scala) [default], iteration 25 completed (918.845 ms) ====== [2026-02-18T23:55:53.052Z] ====== philosophers (scala) [default], iteration 26 started ====== [2026-02-18T23:55:53.052Z] GC before operation: completed in 13.042 ms, heap usage 54.544 MB -> 4.926 MB. [2026-02-18T23:55:53.742Z] Camera thread performed 122 scans. [2026-02-18T23:55:53.742Z] ====== philosophers (scala) [default], iteration 26 completed (949.158 ms) ====== [2026-02-18T23:55:53.743Z] ====== philosophers (scala) [default], iteration 27 started ====== [2026-02-18T23:55:53.743Z] GC before operation: completed in 13.621 ms, heap usage 31.889 MB -> 4.926 MB. [2026-02-18T23:55:54.851Z] Camera thread performed 122 scans. [2026-02-18T23:55:54.851Z] ====== philosophers (scala) [default], iteration 27 completed (961.566 ms) ====== [2026-02-18T23:55:54.851Z] ====== philosophers (scala) [default], iteration 28 started ====== [2026-02-18T23:55:54.851Z] GC before operation: completed in 12.540 ms, heap usage 42.546 MB -> 4.926 MB. [2026-02-18T23:55:55.983Z] Camera thread performed 122 scans. [2026-02-18T23:55:55.983Z] ====== philosophers (scala) [default], iteration 28 completed (910.280 ms) ====== [2026-02-18T23:55:55.983Z] ====== philosophers (scala) [default], iteration 29 started ====== [2026-02-18T23:55:55.983Z] GC before operation: completed in 13.075 ms, heap usage 39.445 MB -> 4.926 MB. [2026-02-18T23:55:56.689Z] Camera thread performed 122 scans. [2026-02-18T23:55:56.689Z] ====== philosophers (scala) [default], iteration 29 completed (973.832 ms) ====== [2026-02-18T23:55:57.021Z] ----------------------------------- [2026-02-18T23:55:57.021Z] renaissance-philosophers_0_PASSED [2026-02-18T23:55:57.021Z] ----------------------------------- [2026-02-18T23:55:57.021Z] [2026-02-18T23:55:57.021Z] TEST TEARDOWN: [2026-02-18T23:55:57.021Z] Nothing to be done for teardown. [2026-02-18T23:55:57.021Z] renaissance-philosophers_0 Finish Time: Wed Feb 18 23:55:56 2026 Epoch Time (ms): 1771458956917