[2025-12-09T23:28:36.711Z] Running test renaissance-philosophers_0 ... [2025-12-09T23:28:36.711Z] =============================================== [2025-12-09T23:28:36.711Z] renaissance-philosophers_0 Start Time: Tue Dec 9 23:28:35 2025 Epoch Time (ms): 1765322915918 [2025-12-09T23:28:36.711Z] variation: NoOptions [2025-12-09T23:28:36.711Z] JVM_OPTIONS: [2025-12-09T23:28:36.711Z] { \ [2025-12-09T23:28:36.711Z] echo ""; echo "TEST SETUP:"; \ [2025-12-09T23:28:36.711Z] echo "Nothing to be done for setup."; \ [2025-12-09T23:28:36.711Z] mkdir -p "/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17653225035866/renaissance-philosophers_0"; \ [2025-12-09T23:28:36.712Z] cd "/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17653225035866/renaissance-philosophers_0"; \ [2025-12-09T23:28:36.712Z] echo ""; echo "TESTING:"; \ [2025-12-09T23:28:36.712Z] "/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-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_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17653225035866/renaissance-philosophers_0"/philosophers.json" philosophers; \ [2025-12-09T23:28:36.712Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17653225035866/renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-12-09T23:28:36.712Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-12-09T23:28:36.712Z] echo "Nothing to be done for teardown."; \ [2025-12-09T23:28:36.712Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17653225035866/TestTargetResult"; [2025-12-09T23:28:36.712Z] [2025-12-09T23:28:36.712Z] TEST SETUP: [2025-12-09T23:28:36.712Z] Nothing to be done for setup. [2025-12-09T23:28:36.712Z] [2025-12-09T23:28:36.712Z] TESTING: [2025-12-09T23:28:36.712Z] WARNING: A terminally deprecated method in sun.misc.Unsafe has been called [2025-12-09T23:28:36.712Z] WARNING: sun.misc.Unsafe::objectFieldOffset has been called by scala.runtime.LazyVals$ (file:/home/jenkins/workspace/Test_openjdk26_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/output_17653225035866/renaissance-philosophers_0/launcher-232836-9868624341740165026/renaissance-harness_3/lib/scala3-library_3-3.3.4.jar) [2025-12-09T23:28:36.712Z] WARNING: Please consider reporting this to the maintainers of class scala.runtime.LazyVals$ [2025-12-09T23:28:36.712Z] WARNING: sun.misc.Unsafe::objectFieldOffset will be removed in a future release [2025-12-09T23:28:37.682Z] ====== philosophers (scala) [default], iteration 0 started ====== [2025-12-09T23:28:37.682Z] GC before operation: completed in 21.154 ms, heap usage 9.167 MB -> 4.847 MB. [2025-12-09T23:28:41.889Z] Camera thread performed 122 scans. [2025-12-09T23:28:41.889Z] ====== philosophers (scala) [default], iteration 0 completed (4012.992 ms) ====== [2025-12-09T23:28:41.889Z] ====== philosophers (scala) [default], iteration 1 started ====== [2025-12-09T23:28:41.889Z] GC before operation: completed in 27.124 ms, heap usage 87.312 MB -> 5.191 MB. [2025-12-09T23:28:44.909Z] Camera thread performed 122 scans. [2025-12-09T23:28:44.909Z] ====== philosophers (scala) [default], iteration 1 completed (3247.765 ms) ====== [2025-12-09T23:28:44.909Z] ====== philosophers (scala) [default], iteration 2 started ====== [2025-12-09T23:28:44.909Z] GC before operation: completed in 24.818 ms, heap usage 118.313 MB -> 5.190 MB. [2025-12-09T23:28:47.930Z] Camera thread performed 122 scans. [2025-12-09T23:28:47.930Z] ====== philosophers (scala) [default], iteration 2 completed (3245.937 ms) ====== [2025-12-09T23:28:47.930Z] ====== philosophers (scala) [default], iteration 3 started ====== [2025-12-09T23:28:47.930Z] GC before operation: completed in 26.795 ms, heap usage 15.708 MB -> 5.191 MB. [2025-12-09T23:28:50.951Z] Camera thread performed 122 scans. [2025-12-09T23:28:50.951Z] ====== philosophers (scala) [default], iteration 3 completed (2987.077 ms) ====== [2025-12-09T23:28:50.951Z] ====== philosophers (scala) [default], iteration 4 started ====== [2025-12-09T23:28:50.951Z] GC before operation: completed in 21.913 ms, heap usage 104.317 MB -> 5.192 MB. [2025-12-09T23:28:55.110Z] Camera thread performed 122 scans. [2025-12-09T23:28:55.110Z] ====== philosophers (scala) [default], iteration 4 completed (3477.876 ms) ====== [2025-12-09T23:28:55.110Z] ====== philosophers (scala) [default], iteration 5 started ====== [2025-12-09T23:28:55.110Z] GC before operation: completed in 21.290 ms, heap usage 58.455 MB -> 5.192 MB. [2025-12-09T23:28:58.132Z] Camera thread performed 122 scans. [2025-12-09T23:28:58.132Z] ====== philosophers (scala) [default], iteration 5 completed (2928.036 ms) ====== [2025-12-09T23:28:58.132Z] ====== philosophers (scala) [default], iteration 6 started ====== [2025-12-09T23:28:58.132Z] GC before operation: completed in 22.595 ms, heap usage 123.935 MB -> 5.193 MB. [2025-12-09T23:29:00.092Z] Camera thread performed 122 scans. [2025-12-09T23:29:00.092Z] ====== philosophers (scala) [default], iteration 6 completed (2842.264 ms) ====== [2025-12-09T23:29:00.092Z] ====== philosophers (scala) [default], iteration 7 started ====== [2025-12-09T23:29:00.092Z] GC before operation: completed in 23.117 ms, heap usage 65.363 MB -> 5.193 MB. [2025-12-09T23:29:04.248Z] Camera thread performed 122 scans. [2025-12-09T23:29:04.248Z] ====== philosophers (scala) [default], iteration 7 completed (3559.773 ms) ====== [2025-12-09T23:29:04.248Z] ====== philosophers (scala) [default], iteration 8 started ====== [2025-12-09T23:29:04.248Z] GC before operation: completed in 22.799 ms, heap usage 133.879 MB -> 5.193 MB. [2025-12-09T23:29:07.297Z] Camera thread performed 122 scans. [2025-12-09T23:29:07.297Z] ====== philosophers (scala) [default], iteration 8 completed (3368.403 ms) ====== [2025-12-09T23:29:07.297Z] ====== philosophers (scala) [default], iteration 9 started ====== [2025-12-09T23:29:07.297Z] GC before operation: completed in 24.330 ms, heap usage 38.310 MB -> 5.194 MB. [2025-12-09T23:29:10.320Z] Camera thread performed 122 scans. [2025-12-09T23:29:10.320Z] ====== philosophers (scala) [default], iteration 9 completed (3041.911 ms) ====== [2025-12-09T23:29:10.320Z] ====== philosophers (scala) [default], iteration 10 started ====== [2025-12-09T23:29:10.320Z] GC before operation: completed in 21.481 ms, heap usage 73.335 MB -> 5.194 MB. [2025-12-09T23:29:12.279Z] Camera thread performed 122 scans. [2025-12-09T23:29:12.279Z] ====== philosophers (scala) [default], iteration 10 completed (2184.644 ms) ====== [2025-12-09T23:29:12.279Z] ====== philosophers (scala) [default], iteration 11 started ====== [2025-12-09T23:29:12.279Z] GC before operation: completed in 21.189 ms, heap usage 28.367 MB -> 5.194 MB. [2025-12-09T23:29:15.305Z] Camera thread performed 122 scans. [2025-12-09T23:29:15.305Z] ====== philosophers (scala) [default], iteration 11 completed (2674.029 ms) ====== [2025-12-09T23:29:15.305Z] ====== philosophers (scala) [default], iteration 12 started ====== [2025-12-09T23:29:15.305Z] GC before operation: completed in 33.065 ms, heap usage 103.359 MB -> 5.195 MB. [2025-12-09T23:29:18.335Z] Camera thread performed 122 scans. [2025-12-09T23:29:18.335Z] ====== philosophers (scala) [default], iteration 12 completed (2846.792 ms) ====== [2025-12-09T23:29:18.335Z] ====== philosophers (scala) [default], iteration 13 started ====== [2025-12-09T23:29:18.335Z] GC before operation: completed in 22.434 ms, heap usage 123.333 MB -> 5.195 MB. [2025-12-09T23:29:21.358Z] Camera thread performed 122 scans. [2025-12-09T23:29:21.358Z] ====== philosophers (scala) [default], iteration 13 completed (2845.737 ms) ====== [2025-12-09T23:29:21.358Z] ====== philosophers (scala) [default], iteration 14 started ====== [2025-12-09T23:29:21.358Z] GC before operation: completed in 22.282 ms, heap usage 73.827 MB -> 5.195 MB. [2025-12-09T23:29:24.398Z] Camera thread performed 122 scans. [2025-12-09T23:29:24.398Z] ====== philosophers (scala) [default], iteration 14 completed (2842.007 ms) ====== [2025-12-09T23:29:24.398Z] ====== philosophers (scala) [default], iteration 15 started ====== [2025-12-09T23:29:24.398Z] GC before operation: completed in 20.440 ms, heap usage 17.834 MB -> 5.195 MB. [2025-12-09T23:29:26.364Z] Camera thread performed 122 scans. [2025-12-09T23:29:26.364Z] ====== philosophers (scala) [default], iteration 15 completed (2104.872 ms) ====== [2025-12-09T23:29:26.364Z] ====== philosophers (scala) [default], iteration 16 started ====== [2025-12-09T23:29:26.364Z] GC before operation: completed in 22.214 ms, heap usage 32.812 MB -> 5.195 MB. [2025-12-09T23:29:29.396Z] Camera thread performed 122 scans. [2025-12-09T23:29:29.396Z] ====== philosophers (scala) [default], iteration 16 completed (2795.456 ms) ====== [2025-12-09T23:29:29.396Z] ====== philosophers (scala) [default], iteration 17 started ====== [2025-12-09T23:29:29.396Z] GC before operation: completed in 23.983 ms, heap usage 124.860 MB -> 5.195 MB. [2025-12-09T23:29:32.439Z] Camera thread performed 122 scans. [2025-12-09T23:29:32.439Z] ====== philosophers (scala) [default], iteration 17 completed (2874.077 ms) ====== [2025-12-09T23:29:32.439Z] ====== philosophers (scala) [default], iteration 18 started ====== [2025-12-09T23:29:32.439Z] GC before operation: completed in 25.022 ms, heap usage 118.360 MB -> 5.195 MB. [2025-12-09T23:29:35.133Z] Camera thread performed 122 scans. [2025-12-09T23:29:35.133Z] ====== philosophers (scala) [default], iteration 18 completed (3414.650 ms) ====== [2025-12-09T23:29:35.133Z] ====== philosophers (scala) [default], iteration 19 started ====== [2025-12-09T23:29:35.133Z] GC before operation: completed in 21.513 ms, heap usage 53.896 MB -> 5.195 MB. [2025-12-09T23:29:38.158Z] Camera thread performed 122 scans. [2025-12-09T23:29:38.158Z] ====== philosophers (scala) [default], iteration 19 completed (2686.050 ms) ====== [2025-12-09T23:29:38.158Z] ====== philosophers (scala) [default], iteration 20 started ====== [2025-12-09T23:29:38.158Z] GC before operation: completed in 24.337 ms, heap usage 88.400 MB -> 5.195 MB. [2025-12-09T23:29:42.320Z] Camera thread performed 122 scans. [2025-12-09T23:29:42.320Z] ====== philosophers (scala) [default], iteration 20 completed (3680.128 ms) ====== [2025-12-09T23:29:42.320Z] ====== philosophers (scala) [default], iteration 21 started ====== [2025-12-09T23:29:42.320Z] GC before operation: completed in 31.326 ms, heap usage 95.895 MB -> 5.195 MB. [2025-12-09T23:29:46.477Z] Camera thread performed 122 scans. [2025-12-09T23:29:46.477Z] ====== philosophers (scala) [default], iteration 21 completed (4670.862 ms) ====== [2025-12-09T23:29:46.477Z] ====== philosophers (scala) [default], iteration 22 started ====== [2025-12-09T23:29:46.477Z] GC before operation: completed in 31.614 ms, heap usage 103.833 MB -> 5.196 MB. [2025-12-09T23:29:49.503Z] Camera thread performed 122 scans. [2025-12-09T23:29:49.503Z] ====== philosophers (scala) [default], iteration 22 completed (3457.026 ms) ====== [2025-12-09T23:29:49.503Z] ====== philosophers (scala) [default], iteration 23 started ====== [2025-12-09T23:29:49.503Z] GC before operation: completed in 35.466 ms, heap usage 44.337 MB -> 5.196 MB. [2025-12-09T23:29:53.666Z] Camera thread performed 122 scans. [2025-12-09T23:29:53.666Z] ====== philosophers (scala) [default], iteration 23 completed (3405.325 ms) ====== [2025-12-09T23:29:53.666Z] ====== philosophers (scala) [default], iteration 24 started ====== [2025-12-09T23:29:53.666Z] GC before operation: completed in 33.657 ms, heap usage 96.304 MB -> 5.196 MB. [2025-12-09T23:29:56.696Z] Camera thread performed 122 scans. [2025-12-09T23:29:56.696Z] ====== philosophers (scala) [default], iteration 24 completed (3496.833 ms) ====== [2025-12-09T23:29:56.696Z] ====== philosophers (scala) [default], iteration 25 started ====== [2025-12-09T23:29:56.696Z] GC before operation: completed in 34.327 ms, heap usage 23.302 MB -> 5.196 MB. [2025-12-09T23:30:00.864Z] Camera thread performed 122 scans. [2025-12-09T23:30:00.864Z] ====== philosophers (scala) [default], iteration 25 completed (3945.067 ms) ====== [2025-12-09T23:30:00.864Z] ====== philosophers (scala) [default], iteration 26 started ====== [2025-12-09T23:30:00.864Z] GC before operation: completed in 29.377 ms, heap usage 36.870 MB -> 5.196 MB. [2025-12-09T23:30:03.908Z] Camera thread performed 122 scans. [2025-12-09T23:30:03.908Z] ====== philosophers (scala) [default], iteration 26 completed (3111.801 ms) ====== [2025-12-09T23:30:03.908Z] ====== philosophers (scala) [default], iteration 27 started ====== [2025-12-09T23:30:03.908Z] GC before operation: completed in 23.989 ms, heap usage 102.322 MB -> 5.196 MB. [2025-12-09T23:30:08.072Z] Camera thread performed 122 scans. [2025-12-09T23:30:08.072Z] ====== philosophers (scala) [default], iteration 27 completed (3897.607 ms) ====== [2025-12-09T23:30:08.072Z] ====== philosophers (scala) [default], iteration 28 started ====== [2025-12-09T23:30:08.072Z] GC before operation: completed in 28.787 ms, heap usage 75.394 MB -> 5.196 MB. [2025-12-09T23:30:11.164Z] Camera thread performed 122 scans. [2025-12-09T23:30:11.164Z] ====== philosophers (scala) [default], iteration 28 completed (3403.957 ms) ====== [2025-12-09T23:30:11.164Z] ====== philosophers (scala) [default], iteration 29 started ====== [2025-12-09T23:30:11.164Z] GC before operation: completed in 22.213 ms, heap usage 92.796 MB -> 5.196 MB. [2025-12-09T23:30:15.328Z] Camera thread performed 122 scans. [2025-12-09T23:30:15.328Z] ====== philosophers (scala) [default], iteration 29 completed (4027.562 ms) ====== [2025-12-09T23:30:16.984Z] ----------------------------------- [2025-12-09T23:30:16.984Z] renaissance-philosophers_0_PASSED [2025-12-09T23:30:16.984Z] ----------------------------------- [2025-12-09T23:30:16.984Z] [2025-12-09T23:30:16.984Z] TEST TEARDOWN: [2025-12-09T23:30:16.984Z] Nothing to be done for teardown. [2025-12-09T23:30:16.984Z] renaissance-philosophers_0 Finish Time: Tue Dec 9 23:30:15 2025 Epoch Time (ms): 1765323015414