[2026-02-11T23:08:27.426Z] Running test renaissance-als_0 ... [2026-02-11T23:08:27.426Z] =============================================== [2026-02-11T23:08:27.426Z] renaissance-als_0 Start Time: Wed Feb 11 23:08:27 2026 Epoch Time (ms): 1770851307192 [2026-02-11T23:08:27.426Z] variation: NoOptions [2026-02-11T23:08:27.426Z] JVM_OPTIONS: [2026-02-11T23:08:27.426Z] { \ [2026-02-11T23:08:27.426Z] echo ""; echo "TEST SETUP:"; \ [2026-02-11T23:08:27.426Z] echo "Nothing to be done for setup."; \ [2026-02-11T23:08:27.427Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17708511469403/renaissance-als_0"; \ [2026-02-11T23:08:27.427Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17708511469403/renaissance-als_0"; \ [2026-02-11T23:08:27.427Z] echo ""; echo "TESTING:"; \ [2026-02-11T23:08:27.427Z] "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_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_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17708511469403/renaissance-als_0"/als.json" als; \ [2026-02-11T23:08:27.427Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-als_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17708511469403/renaissance-als_0"; else echo "-----------------------------------"; echo "renaissance-als_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-02-11T23:08:27.427Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-02-11T23:08:27.427Z] echo "Nothing to be done for teardown."; \ [2026-02-11T23:08:27.427Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17708511469403/TestTargetResult"; [2026-02-11T23:08:27.427Z] [2026-02-11T23:08:27.427Z] TEST SETUP: [2026-02-11T23:08:27.427Z] Nothing to be done for setup. [2026-02-11T23:08:27.427Z] [2026-02-11T23:08:27.427Z] TESTING: [2026-02-11T23:08:32.829Z] NOTE: 'als' benchmark uses Spark local executor with 4 (out of 4) threads. [2026-02-11T23:08:37.802Z] ====== als (apache-spark) [default], iteration 0 started ====== [2026-02-11T23:08:37.802Z] GC before operation: completed in 37.482 ms, heap usage 277.832 MB -> 35.103 MB. [2026-02-11T23:08:53.729Z] ====== als (apache-spark) [default], iteration 0 completed (15369.336 ms) ====== [2026-02-11T23:08:53.729Z] ====== als (apache-spark) [default], iteration 1 started ====== [2026-02-11T23:08:53.729Z] GC before operation: completed in 90.902 ms, heap usage 293.195 MB -> 62.218 MB. [2026-02-11T23:09:01.946Z] ====== als (apache-spark) [default], iteration 1 completed (7388.613 ms) ====== [2026-02-11T23:09:01.946Z] ====== als (apache-spark) [default], iteration 2 started ====== [2026-02-11T23:09:01.946Z] GC before operation: completed in 87.412 ms, heap usage 293.456 MB -> 63.068 MB. [2026-02-11T23:09:08.703Z] ====== als (apache-spark) [default], iteration 2 completed (7145.571 ms) ====== [2026-02-11T23:09:08.703Z] ====== als (apache-spark) [default], iteration 3 started ====== [2026-02-11T23:09:08.703Z] GC before operation: completed in 88.008 ms, heap usage 379.329 MB -> 63.781 MB. [2026-02-11T23:09:16.947Z] ====== als (apache-spark) [default], iteration 3 completed (6869.327 ms) ====== [2026-02-11T23:09:16.947Z] ====== als (apache-spark) [default], iteration 4 started ====== [2026-02-11T23:09:16.947Z] GC before operation: completed in 83.212 ms, heap usage 232.166 MB -> 64.122 MB. [2026-02-11T23:09:23.706Z] ====== als (apache-spark) [default], iteration 4 completed (6795.584 ms) ====== [2026-02-11T23:09:23.706Z] ====== als (apache-spark) [default], iteration 5 started ====== [2026-02-11T23:09:23.706Z] GC before operation: completed in 81.491 ms, heap usage 438.254 MB -> 64.995 MB. [2026-02-11T23:09:30.442Z] ====== als (apache-spark) [default], iteration 5 completed (6697.356 ms) ====== [2026-02-11T23:09:30.442Z] ====== als (apache-spark) [default], iteration 6 started ====== [2026-02-11T23:09:30.442Z] GC before operation: completed in 81.918 ms, heap usage 259.053 MB -> 65.262 MB. [2026-02-11T23:09:37.182Z] ====== als (apache-spark) [default], iteration 6 completed (6545.106 ms) ====== [2026-02-11T23:09:37.182Z] ====== als (apache-spark) [default], iteration 7 started ====== [2026-02-11T23:09:37.182Z] GC before operation: completed in 84.320 ms, heap usage 233.535 MB -> 65.767 MB. [2026-02-11T23:09:43.919Z] ====== als (apache-spark) [default], iteration 7 completed (6574.389 ms) ====== [2026-02-11T23:09:43.919Z] ====== als (apache-spark) [default], iteration 8 started ====== [2026-02-11T23:09:43.919Z] GC before operation: completed in 90.861 ms, heap usage 114.825 MB -> 66.202 MB. [2026-02-11T23:09:51.571Z] ====== als (apache-spark) [default], iteration 8 completed (6682.786 ms) ====== [2026-02-11T23:09:51.571Z] ====== als (apache-spark) [default], iteration 9 started ====== [2026-02-11T23:09:51.571Z] GC before operation: completed in 96.478 ms, heap usage 484.986 MB -> 67.210 MB. [2026-02-11T23:09:58.307Z] ====== als (apache-spark) [default], iteration 9 completed (6674.112 ms) ====== [2026-02-11T23:09:58.307Z] ====== als (apache-spark) [default], iteration 10 started ====== [2026-02-11T23:09:58.307Z] GC before operation: completed in 95.913 ms, heap usage 403.250 MB -> 67.619 MB. [2026-02-11T23:10:05.077Z] ====== als (apache-spark) [default], iteration 10 completed (6679.285 ms) ====== [2026-02-11T23:10:05.077Z] ====== als (apache-spark) [default], iteration 11 started ====== [2026-02-11T23:10:05.077Z] GC before operation: completed in 98.394 ms, heap usage 360.808 MB -> 67.430 MB. [2026-02-11T23:10:11.828Z] ====== als (apache-spark) [default], iteration 11 completed (6567.253 ms) ====== [2026-02-11T23:10:11.828Z] ====== als (apache-spark) [default], iteration 12 started ====== [2026-02-11T23:10:11.828Z] GC before operation: completed in 99.195 ms, heap usage 240.893 MB -> 67.566 MB. [2026-02-11T23:10:18.600Z] ====== als (apache-spark) [default], iteration 12 completed (6560.560 ms) ====== [2026-02-11T23:10:18.600Z] ====== als (apache-spark) [default], iteration 13 started ====== [2026-02-11T23:10:18.600Z] GC before operation: completed in 88.109 ms, heap usage 438.404 MB -> 68.237 MB. [2026-02-11T23:10:25.374Z] ====== als (apache-spark) [default], iteration 13 completed (6609.391 ms) ====== [2026-02-11T23:10:25.374Z] ====== als (apache-spark) [default], iteration 14 started ====== [2026-02-11T23:10:26.383Z] GC before operation: completed in 98.744 ms, heap usage 161.150 MB -> 68.046 MB. [2026-02-11T23:10:33.185Z] ====== als (apache-spark) [default], iteration 14 completed (6581.821 ms) ====== [2026-02-11T23:10:33.185Z] ====== als (apache-spark) [default], iteration 15 started ====== [2026-02-11T23:10:33.185Z] GC before operation: completed in 101.609 ms, heap usage 117.920 MB -> 67.863 MB. [2026-02-11T23:10:39.978Z] ====== als (apache-spark) [default], iteration 15 completed (6514.456 ms) ====== [2026-02-11T23:10:39.978Z] ====== als (apache-spark) [default], iteration 16 started ====== [2026-02-11T23:10:39.978Z] GC before operation: completed in 106.517 ms, heap usage 127.212 MB -> 68.616 MB. [2026-02-11T23:10:48.005Z] ====== als (apache-spark) [default], iteration 16 completed (6513.879 ms) ====== [2026-02-11T23:10:48.005Z] ====== als (apache-spark) [default], iteration 17 started ====== [2026-02-11T23:10:48.005Z] GC before operation: completed in 102.267 ms, heap usage 343.828 MB -> 69.040 MB. [2026-02-11T23:10:53.415Z] ====== als (apache-spark) [default], iteration 17 completed (6437.716 ms) ====== [2026-02-11T23:10:53.415Z] ====== als (apache-spark) [default], iteration 18 started ====== [2026-02-11T23:10:53.415Z] GC before operation: completed in 109.119 ms, heap usage 163.380 MB -> 69.100 MB. [2026-02-11T23:11:00.312Z] ====== als (apache-spark) [default], iteration 18 completed (6569.117 ms) ====== [2026-02-11T23:11:00.312Z] ====== als (apache-spark) [default], iteration 19 started ====== [2026-02-11T23:11:00.312Z] GC before operation: completed in 122.731 ms, heap usage 477.875 MB -> 69.840 MB. [2026-02-11T23:11:07.049Z] ====== als (apache-spark) [default], iteration 19 completed (6693.059 ms) ====== [2026-02-11T23:11:07.049Z] ====== als (apache-spark) [default], iteration 20 started ====== [2026-02-11T23:11:07.049Z] GC before operation: completed in 96.218 ms, heap usage 206.332 MB -> 69.668 MB. [2026-02-11T23:11:13.782Z] ====== als (apache-spark) [default], iteration 20 completed (6475.521 ms) ====== [2026-02-11T23:11:13.782Z] ====== als (apache-spark) [default], iteration 21 started ====== [2026-02-11T23:11:13.782Z] GC before operation: completed in 96.532 ms, heap usage 547.599 MB -> 70.390 MB. [2026-02-11T23:11:20.545Z] ====== als (apache-spark) [default], iteration 21 completed (6467.672 ms) ====== [2026-02-11T23:11:20.545Z] ====== als (apache-spark) [default], iteration 22 started ====== [2026-02-11T23:11:20.545Z] GC before operation: completed in 100.827 ms, heap usage 158.437 MB -> 70.122 MB. [2026-02-11T23:11:27.334Z] ====== als (apache-spark) [default], iteration 22 completed (6372.087 ms) ====== [2026-02-11T23:11:27.334Z] ====== als (apache-spark) [default], iteration 23 started ====== [2026-02-11T23:11:27.334Z] GC before operation: completed in 88.817 ms, heap usage 115.922 MB -> 70.438 MB. [2026-02-11T23:11:34.085Z] ====== als (apache-spark) [default], iteration 23 completed (6432.374 ms) ====== [2026-02-11T23:11:34.085Z] ====== als (apache-spark) [default], iteration 24 started ====== [2026-02-11T23:11:34.085Z] GC before operation: completed in 103.503 ms, heap usage 495.075 MB -> 71.130 MB. [2026-02-11T23:11:40.851Z] ====== als (apache-spark) [default], iteration 24 completed (6458.392 ms) ====== [2026-02-11T23:11:40.851Z] ====== als (apache-spark) [default], iteration 25 started ====== [2026-02-11T23:11:40.851Z] GC before operation: completed in 103.854 ms, heap usage 169.616 MB -> 70.981 MB. [2026-02-11T23:11:47.590Z] ====== als (apache-spark) [default], iteration 25 completed (6433.149 ms) ====== [2026-02-11T23:11:47.590Z] ====== als (apache-spark) [default], iteration 26 started ====== [2026-02-11T23:11:47.590Z] GC before operation: completed in 117.657 ms, heap usage 539.177 MB -> 71.832 MB. [2026-02-11T23:11:54.097Z] ====== als (apache-spark) [default], iteration 26 completed (6263.797 ms) ====== [2026-02-11T23:11:54.097Z] ====== als (apache-spark) [default], iteration 27 started ====== [2026-02-11T23:11:54.097Z] GC before operation: completed in 104.461 ms, heap usage 512.802 MB -> 71.974 MB. [2026-02-11T23:12:00.831Z] ====== als (apache-spark) [default], iteration 27 completed (6408.271 ms) ====== [2026-02-11T23:12:00.831Z] ====== als (apache-spark) [default], iteration 28 started ====== [2026-02-11T23:12:00.831Z] GC before operation: completed in 98.896 ms, heap usage 286.331 MB -> 71.879 MB. [2026-02-11T23:12:07.624Z] ====== als (apache-spark) [default], iteration 28 completed (6461.762 ms) ====== [2026-02-11T23:12:07.624Z] ====== als (apache-spark) [default], iteration 29 started ====== [2026-02-11T23:12:07.624Z] GC before operation: completed in 108.913 ms, heap usage 252.478 MB -> 71.630 MB. [2026-02-11T23:12:14.394Z] ====== als (apache-spark) [default], iteration 29 completed (6408.370 ms) ====== [2026-02-11T23:12:14.394Z] ----------------------------------- [2026-02-11T23:12:14.394Z] renaissance-als_0_PASSED [2026-02-11T23:12:14.394Z] ----------------------------------- [2026-02-11T23:12:14.394Z] [2026-02-11T23:12:14.394Z] TEST TEARDOWN: [2026-02-11T23:12:14.394Z] Nothing to be done for teardown. [2026-02-11T23:12:14.394Z] renaissance-als_0 Finish Time: Wed Feb 11 23:12:14 2026 Epoch Time (ms): 1770851534090