renaissance-philosophers_0
[2025-11-20T00:42:41.032Z] Running test renaissance-philosophers_0 ...
[2025-11-20T00:42:41.032Z] ===============================================
[2025-11-20T00:42:41.032Z] renaissance-philosophers_0 Start Time: Thu Nov 20 00:42:40 2025 Epoch Time (ms): 1763599360837
[2025-11-20T00:42:41.032Z] variation: NoOptions
[2025-11-20T00:42:41.032Z] JVM_OPTIONS:
[2025-11-20T00:42:41.032Z] { \
[2025-11-20T00:42:41.032Z] echo ""; echo "TEST SETUP:"; \
[2025-11-20T00:42:41.032Z] echo "Nothing to be done for setup."; \
[2025-11-20T00:42:41.032Z] mkdir -p "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../TKG/output_17635980277696/renaissance-philosophers_0"; \
[2025-11-20T00:42:41.032Z] cd "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../TKG/output_17635980277696/renaissance-philosophers_0"; \
[2025-11-20T00:42:41.032Z] echo ""; echo "TESTING:"; \
[2025-11-20T00:42:41.033Z] "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/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_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../TKG/output_17635980277696/renaissance-philosophers_0"/philosophers.json" philosophers; \
[2025-11-20T00:42:41.033Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-philosophers_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../TKG/output_17635980277696/renaissance-philosophers_0"; else echo "-----------------------------------"; echo "renaissance-philosophers_0""_FAILED"; echo "-----------------------------------"; fi; \
[2025-11-20T00:42:41.033Z] echo ""; echo "TEST TEARDOWN:"; \
[2025-11-20T00:42:41.033Z] echo "Nothing to be done for teardown."; \
[2025-11-20T00:42:41.033Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_x86-64_linux_testList_1/aqa-tests/TKG/../TKG/output_17635980277696/TestTargetResult";
[2025-11-20T00:42:41.033Z]
[2025-11-20T00:42:41.033Z] TEST SETUP:
[2025-11-20T00:42:41.033Z] Nothing to be done for setup.
[2025-11-20T00:42:41.033Z]
[2025-11-20T00:42:41.033Z] TESTING:
[2025-11-20T00:42:42.206Z] ====== philosophers (scala) [default], iteration 0 started ======
[2025-11-20T00:42:42.206Z] GC before operation: completed in 12.456 ms, heap usage 4.920 MB -> 4.188 MB.
[2025-11-20T00:42:43.899Z] Camera thread performed 122 scans.
[2025-11-20T00:42:43.899Z] ====== philosophers (scala) [default], iteration 0 completed (1920.050 ms) ======
[2025-11-20T00:42:43.899Z] ====== philosophers (scala) [default], iteration 1 started ======
[2025-11-20T00:42:43.899Z] GC before operation: completed in 15.308 ms, heap usage 25.463 MB -> 4.613 MB.
[2025-11-20T00:42:44.615Z] Camera thread performed 122 scans.
[2025-11-20T00:42:44.615Z] ====== philosophers (scala) [default], iteration 1 completed (782.159 ms) ======
[2025-11-20T00:42:44.615Z] ====== philosophers (scala) [default], iteration 2 started ======
[2025-11-20T00:42:44.615Z] GC before operation: completed in 12.781 ms, heap usage 43.462 MB -> 4.613 MB.
[2025-11-20T00:42:45.808Z] Camera thread performed 122 scans.
[2025-11-20T00:42:45.808Z] ====== philosophers (scala) [default], iteration 2 completed (796.716 ms) ======
[2025-11-20T00:42:45.808Z] ====== philosophers (scala) [default], iteration 3 started ======
[2025-11-20T00:42:45.808Z] GC before operation: completed in 12.514 ms, heap usage 15.942 MB -> 4.613 MB.
[2025-11-20T00:42:46.148Z] Camera thread performed 122 scans.
[2025-11-20T00:42:46.148Z] ====== philosophers (scala) [default], iteration 3 completed (700.790 ms) ======
[2025-11-20T00:42:46.148Z] ====== philosophers (scala) [default], iteration 4 started ======
[2025-11-20T00:42:46.148Z] GC before operation: completed in 14.074 ms, heap usage 8.954 MB -> 4.614 MB.
[2025-11-20T00:42:46.905Z] Camera thread performed 122 scans.
[2025-11-20T00:42:46.905Z] ====== philosophers (scala) [default], iteration 4 completed (707.793 ms) ======
[2025-11-20T00:42:46.905Z] ====== philosophers (scala) [default], iteration 5 started ======
[2025-11-20T00:42:46.905Z] GC before operation: completed in 13.266 ms, heap usage 18.355 MB -> 4.617 MB.
[2025-11-20T00:42:47.642Z] Camera thread performed 122 scans.
[2025-11-20T00:42:47.642Z] ====== philosophers (scala) [default], iteration 5 completed (690.611 ms) ======
[2025-11-20T00:42:47.642Z] ====== philosophers (scala) [default], iteration 6 started ======
[2025-11-20T00:42:47.642Z] GC before operation: completed in 15.189 ms, heap usage 62.313 MB -> 4.618 MB.
[2025-11-20T00:42:48.357Z] Camera thread performed 122 scans.
[2025-11-20T00:42:48.357Z] ====== philosophers (scala) [default], iteration 6 completed (714.349 ms) ======
[2025-11-20T00:42:48.357Z] ====== philosophers (scala) [default], iteration 7 started ======
[2025-11-20T00:42:48.357Z] GC before operation: completed in 14.214 ms, heap usage 17.781 MB -> 4.618 MB.
[2025-11-20T00:42:49.063Z] Camera thread performed 122 scans.
[2025-11-20T00:42:49.063Z] ====== philosophers (scala) [default], iteration 7 completed (692.427 ms) ======
[2025-11-20T00:42:49.063Z] ====== philosophers (scala) [default], iteration 8 started ======
[2025-11-20T00:42:49.063Z] GC before operation: completed in 13.981 ms, heap usage 49.757 MB -> 4.618 MB.
[2025-11-20T00:42:49.768Z] Camera thread performed 122 scans.
[2025-11-20T00:42:49.768Z] ====== philosophers (scala) [default], iteration 8 completed (694.689 ms) ======
[2025-11-20T00:42:49.768Z] ====== philosophers (scala) [default], iteration 9 started ======
[2025-11-20T00:42:49.768Z] GC before operation: completed in 14.887 ms, heap usage 42.751 MB -> 4.619 MB.
[2025-11-20T00:42:50.476Z] Camera thread performed 122 scans.
[2025-11-20T00:42:50.476Z] ====== philosophers (scala) [default], iteration 9 completed (667.302 ms) ======
[2025-11-20T00:42:50.476Z] ====== philosophers (scala) [default], iteration 10 started ======
[2025-11-20T00:42:50.476Z] GC before operation: completed in 12.482 ms, heap usage 29.246 MB -> 4.619 MB.
[2025-11-20T00:42:51.187Z] Camera thread performed 122 scans.
[2025-11-20T00:42:51.187Z] ====== philosophers (scala) [default], iteration 10 completed (669.972 ms) ======
[2025-11-20T00:42:51.187Z] ====== philosophers (scala) [default], iteration 11 started ======
[2025-11-20T00:42:51.187Z] GC before operation: completed in 14.045 ms, heap usage 48.746 MB -> 4.620 MB.
[2025-11-20T00:42:51.892Z] Camera thread performed 122 scans.
[2025-11-20T00:42:51.892Z] ====== philosophers (scala) [default], iteration 11 completed (702.776 ms) ======
[2025-11-20T00:42:51.892Z] ====== philosophers (scala) [default], iteration 12 started ======
[2025-11-20T00:42:51.892Z] GC before operation: completed in 17.398 ms, heap usage 62.251 MB -> 4.620 MB.
[2025-11-20T00:42:52.605Z] Camera thread performed 122 scans.
[2025-11-20T00:42:52.605Z] ====== philosophers (scala) [default], iteration 12 completed (697.131 ms) ======
[2025-11-20T00:42:52.605Z] ====== philosophers (scala) [default], iteration 13 started ======
[2025-11-20T00:42:52.605Z] GC before operation: completed in 14.430 ms, heap usage 54.749 MB -> 4.621 MB.
[2025-11-20T00:42:53.346Z] Camera thread performed 122 scans.
[2025-11-20T00:42:53.346Z] ====== philosophers (scala) [default], iteration 13 completed (686.209 ms) ======
[2025-11-20T00:42:53.346Z] ====== philosophers (scala) [default], iteration 14 started ======
[2025-11-20T00:42:53.346Z] GC before operation: completed in 17.120 ms, heap usage 20.705 MB -> 4.621 MB.
[2025-11-20T00:42:54.053Z] Camera thread performed 122 scans.
[2025-11-20T00:42:54.053Z] ====== philosophers (scala) [default], iteration 14 completed (695.894 ms) ======
[2025-11-20T00:42:54.053Z] ====== philosophers (scala) [default], iteration 15 started ======
[2025-11-20T00:42:54.053Z] GC before operation: completed in 16.393 ms, heap usage 15.707 MB -> 4.621 MB.
[2025-11-20T00:42:54.847Z] Camera thread performed 122 scans.
[2025-11-20T00:42:54.847Z] ====== philosophers (scala) [default], iteration 15 completed (694.165 ms) ======
[2025-11-20T00:42:54.847Z] ====== philosophers (scala) [default], iteration 16 started ======
[2025-11-20T00:42:54.847Z] GC before operation: completed in 13.778 ms, heap usage 42.245 MB -> 4.620 MB.
[2025-11-20T00:42:55.551Z] Camera thread performed 122 scans.
[2025-11-20T00:42:55.551Z] ====== philosophers (scala) [default], iteration 16 completed (677.854 ms) ======
[2025-11-20T00:42:55.551Z] ====== philosophers (scala) [default], iteration 17 started ======
[2025-11-20T00:42:55.551Z] GC before operation: completed in 14.094 ms, heap usage 24.221 MB -> 4.621 MB.
[2025-11-20T00:42:56.254Z] Camera thread performed 122 scans.
[2025-11-20T00:42:56.254Z] ====== philosophers (scala) [default], iteration 17 completed (700.189 ms) ======
[2025-11-20T00:42:56.254Z] ====== philosophers (scala) [default], iteration 18 started ======
[2025-11-20T00:42:56.255Z] GC before operation: completed in 13.551 ms, heap usage 24.250 MB -> 4.621 MB.
[2025-11-20T00:42:56.958Z] Camera thread performed 122 scans.
[2025-11-20T00:42:56.958Z] ====== philosophers (scala) [default], iteration 18 completed (705.066 ms) ======
[2025-11-20T00:42:56.958Z] ====== philosophers (scala) [default], iteration 19 started ======
[2025-11-20T00:42:56.958Z] GC before operation: completed in 13.699 ms, heap usage 15.752 MB -> 4.621 MB.
[2025-11-20T00:42:57.662Z] Camera thread performed 122 scans.
[2025-11-20T00:42:57.662Z] ====== philosophers (scala) [default], iteration 19 completed (681.482 ms) ======
[2025-11-20T00:42:57.662Z] ====== philosophers (scala) [default], iteration 20 started ======
[2025-11-20T00:42:57.662Z] GC before operation: completed in 13.311 ms, heap usage 29.712 MB -> 4.621 MB.
[2025-11-20T00:42:58.364Z] Camera thread performed 122 scans.
[2025-11-20T00:42:58.364Z] ====== philosophers (scala) [default], iteration 20 completed (676.542 ms) ======
[2025-11-20T00:42:58.364Z] ====== philosophers (scala) [default], iteration 21 started ======
[2025-11-20T00:42:58.364Z] GC before operation: completed in 12.686 ms, heap usage 11.216 MB -> 4.622 MB.
[2025-11-20T00:42:59.069Z] Camera thread performed 122 scans.
[2025-11-20T00:42:59.069Z] ====== philosophers (scala) [default], iteration 21 completed (701.113 ms) ======
[2025-11-20T00:42:59.069Z] ====== philosophers (scala) [default], iteration 22 started ======
[2025-11-20T00:42:59.069Z] GC before operation: completed in 15.047 ms, heap usage 74.244 MB -> 4.622 MB.
[2025-11-20T00:42:59.778Z] Camera thread performed 122 scans.
[2025-11-20T00:42:59.778Z] ====== philosophers (scala) [default], iteration 22 completed (695.260 ms) ======
[2025-11-20T00:42:59.778Z] ====== philosophers (scala) [default], iteration 23 started ======
[2025-11-20T00:42:59.778Z] GC before operation: completed in 14.938 ms, heap usage 40.248 MB -> 4.622 MB.
[2025-11-20T00:43:00.484Z] Camera thread performed 122 scans.
[2025-11-20T00:43:00.484Z] ====== philosophers (scala) [default], iteration 23 completed (681.150 ms) ======
[2025-11-20T00:43:00.484Z] ====== philosophers (scala) [default], iteration 24 started ======
[2025-11-20T00:43:00.484Z] GC before operation: completed in 14.566 ms, heap usage 81.241 MB -> 4.622 MB.
[2025-11-20T00:43:01.188Z] Camera thread performed 122 scans.
[2025-11-20T00:43:01.188Z] ====== philosophers (scala) [default], iteration 24 completed (689.147 ms) ======
[2025-11-20T00:43:01.188Z] ====== philosophers (scala) [default], iteration 25 started ======
[2025-11-20T00:43:01.188Z] GC before operation: completed in 13.736 ms, heap usage 15.753 MB -> 4.622 MB.
[2025-11-20T00:43:01.893Z] Camera thread performed 122 scans.
[2025-11-20T00:43:01.893Z] ====== philosophers (scala) [default], iteration 25 completed (678.386 ms) ======
[2025-11-20T00:43:01.893Z] ====== philosophers (scala) [default], iteration 26 started ======
[2025-11-20T00:43:01.893Z] GC before operation: completed in 13.916 ms, heap usage 64.248 MB -> 4.622 MB.
[2025-11-20T00:43:02.606Z] Camera thread performed 122 scans.
[2025-11-20T00:43:02.606Z] ====== philosophers (scala) [default], iteration 26 completed (671.530 ms) ======
[2025-11-20T00:43:02.606Z] ====== philosophers (scala) [default], iteration 27 started ======
[2025-11-20T00:43:02.606Z] GC before operation: completed in 14.664 ms, heap usage 9.753 MB -> 4.623 MB.
[2025-11-20T00:43:03.310Z] Camera thread performed 122 scans.
[2025-11-20T00:43:03.310Z] ====== philosophers (scala) [default], iteration 27 completed (676.210 ms) ======
[2025-11-20T00:43:03.310Z] ====== philosophers (scala) [default], iteration 28 started ======
[2025-11-20T00:43:03.310Z] GC before operation: completed in 14.350 ms, heap usage 51.245 MB -> 4.623 MB.
[2025-11-20T00:43:04.015Z] Camera thread performed 122 scans.
[2025-11-20T00:43:04.015Z] ====== philosophers (scala) [default], iteration 28 completed (684.108 ms) ======
[2025-11-20T00:43:04.015Z] ====== philosophers (scala) [default], iteration 29 started ======
[2025-11-20T00:43:04.015Z] GC before operation: completed in 14.671 ms, heap usage 36.249 MB -> 4.623 MB.
[2025-11-20T00:43:04.725Z] Camera thread performed 122 scans.
[2025-11-20T00:43:04.725Z] ====== philosophers (scala) [default], iteration 29 completed (674.711 ms) ======
[2025-11-20T00:43:04.725Z] -----------------------------------
[2025-11-20T00:43:04.725Z] renaissance-philosophers_0_PASSED
[2025-11-20T00:43:04.725Z] -----------------------------------
[2025-11-20T00:43:04.725Z]
[2025-11-20T00:43:04.725Z] TEST TEARDOWN:
[2025-11-20T00:43:04.725Z] Nothing to be done for teardown.
[2025-11-20T00:43:04.725Z] renaissance-philosophers_0 Finish Time: Thu Nov 20 00:43:04 2025 Epoch Time (ms): 1763599384578