[2026-02-26T15:07:57.301Z] Running test renaissance-als_0 ... [2026-02-26T15:07:57.301Z] =============================================== [2026-02-26T15:07:57.301Z] renaissance-als_0 Start Time: Thu Feb 26 15:07:57 2026 Epoch Time (ms): 1772118477128 [2026-02-26T15:07:57.301Z] variation: NoOptions [2026-02-26T15:07:57.301Z] JVM_OPTIONS: [2026-02-26T15:07:57.301Z] { \ [2026-02-26T15:07:57.301Z] echo ""; echo "TEST SETUP:"; \ [2026-02-26T15:07:57.301Z] echo "Nothing to be done for setup."; \ [2026-02-26T15:07:57.301Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17721184767070/renaissance-als_0"; \ [2026-02-26T15:07:57.301Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17721184767070/renaissance-als_0"; \ [2026-02-26T15:07:57.301Z] echo ""; echo "TESTING:"; \ [2026-02-26T15:07:57.302Z] "/home/jenkins/workspace/Test_openjdk21_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_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17721184767070/renaissance-als_0"/als.json" als; \ [2026-02-26T15:07:57.302Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-als_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17721184767070/renaissance-als_0"; else echo "-----------------------------------"; echo "renaissance-als_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-02-26T15:07:57.302Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-02-26T15:07:57.302Z] echo "Nothing to be done for teardown."; \ [2026-02-26T15:07:57.302Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_alpine-linux/aqa-tests/TKG/../TKG/output_17721184767070/TestTargetResult"; [2026-02-26T15:07:57.302Z] [2026-02-26T15:07:57.302Z] TEST SETUP: [2026-02-26T15:07:57.302Z] Nothing to be done for setup. [2026-02-26T15:07:57.302Z] [2026-02-26T15:07:57.302Z] TESTING: [2026-02-26T15:08:07.345Z] NOTE: 'als' benchmark uses Spark local executor with 4 (out of 4) threads. [2026-02-26T15:08:12.807Z] ====== als (apache-spark) [default], iteration 0 started ====== [2026-02-26T15:08:13.781Z] GC before operation: completed in 79.791 ms, heap usage 50.000 MB -> 35.143 MB. [2026-02-26T15:08:42.589Z] ====== als (apache-spark) [default], iteration 0 completed (26397.050 ms) ====== [2026-02-26T15:08:42.589Z] ====== als (apache-spark) [default], iteration 1 started ====== [2026-02-26T15:08:42.589Z] GC before operation: completed in 175.829 ms, heap usage 142.279 MB -> 61.794 MB. [2026-02-26T15:08:52.496Z] ====== als (apache-spark) [default], iteration 1 completed (10421.050 ms) ====== [2026-02-26T15:08:52.496Z] ====== als (apache-spark) [default], iteration 2 started ====== [2026-02-26T15:08:52.496Z] GC before operation: completed in 137.834 ms, heap usage 299.043 MB -> 62.745 MB. [2026-02-26T15:09:02.470Z] ====== als (apache-spark) [default], iteration 2 completed (9567.857 ms) ====== [2026-02-26T15:09:02.470Z] ====== als (apache-spark) [default], iteration 3 started ====== [2026-02-26T15:09:02.470Z] GC before operation: completed in 201.004 ms, heap usage 444.107 MB -> 63.654 MB. [2026-02-26T15:09:12.423Z] ====== als (apache-spark) [default], iteration 3 completed (9636.475 ms) ====== [2026-02-26T15:09:12.423Z] ====== als (apache-spark) [default], iteration 4 started ====== [2026-02-26T15:09:12.423Z] GC before operation: completed in 165.104 ms, heap usage 442.172 MB -> 64.250 MB. [2026-02-26T15:09:22.311Z] ====== als (apache-spark) [default], iteration 4 completed (9027.801 ms) ====== [2026-02-26T15:09:22.311Z] ====== als (apache-spark) [default], iteration 5 started ====== [2026-02-26T15:09:22.311Z] GC before operation: completed in 230.915 ms, heap usage 358.713 MB -> 64.532 MB. [2026-02-26T15:09:32.190Z] ====== als (apache-spark) [default], iteration 5 completed (9413.086 ms) ====== [2026-02-26T15:09:32.190Z] ====== als (apache-spark) [default], iteration 6 started ====== [2026-02-26T15:09:32.190Z] GC before operation: completed in 183.341 ms, heap usage 436.159 MB -> 65.321 MB. [2026-02-26T15:09:40.425Z] ====== als (apache-spark) [default], iteration 6 completed (8379.020 ms) ====== [2026-02-26T15:09:40.425Z] ====== als (apache-spark) [default], iteration 7 started ====== [2026-02-26T15:09:40.425Z] GC before operation: completed in 172.300 ms, heap usage 405.499 MB -> 65.692 MB. [2026-02-26T15:09:49.403Z] ====== als (apache-spark) [default], iteration 7 completed (7558.025 ms) ====== [2026-02-26T15:09:49.403Z] ====== als (apache-spark) [default], iteration 8 started ====== [2026-02-26T15:09:49.403Z] GC before operation: completed in 161.791 ms, heap usage 324.241 MB -> 66.232 MB. [2026-02-26T15:09:56.227Z] ====== als (apache-spark) [default], iteration 8 completed (7287.102 ms) ====== [2026-02-26T15:09:56.227Z] ====== als (apache-spark) [default], iteration 9 started ====== [2026-02-26T15:09:56.227Z] GC before operation: completed in 176.955 ms, heap usage 247.439 MB -> 66.696 MB. [2026-02-26T15:10:04.514Z] ====== als (apache-spark) [default], iteration 9 completed (6950.323 ms) ====== [2026-02-26T15:10:04.514Z] ====== als (apache-spark) [default], iteration 10 started ====== [2026-02-26T15:10:04.514Z] GC before operation: completed in 171.552 ms, heap usage 190.198 MB -> 66.812 MB. [2026-02-26T15:10:12.791Z] ====== als (apache-spark) [default], iteration 10 completed (7363.713 ms) ====== [2026-02-26T15:10:12.791Z] ====== als (apache-spark) [default], iteration 11 started ====== [2026-02-26T15:10:12.791Z] GC before operation: completed in 183.798 ms, heap usage 142.244 MB -> 67.055 MB. [2026-02-26T15:10:21.075Z] ====== als (apache-spark) [default], iteration 11 completed (7750.009 ms) ====== [2026-02-26T15:10:21.075Z] ====== als (apache-spark) [default], iteration 12 started ====== [2026-02-26T15:10:21.075Z] GC before operation: completed in 193.239 ms, heap usage 185.582 MB -> 67.315 MB. [2026-02-26T15:10:29.360Z] ====== als (apache-spark) [default], iteration 12 completed (7959.229 ms) ====== [2026-02-26T15:10:29.360Z] ====== als (apache-spark) [default], iteration 13 started ====== [2026-02-26T15:10:29.360Z] GC before operation: completed in 211.037 ms, heap usage 127.943 MB -> 67.583 MB. [2026-02-26T15:10:37.597Z] ====== als (apache-spark) [default], iteration 13 completed (8463.470 ms) ====== [2026-02-26T15:10:37.597Z] ====== als (apache-spark) [default], iteration 14 started ====== [2026-02-26T15:10:37.597Z] GC before operation: completed in 215.192 ms, heap usage 133.911 MB -> 67.858 MB. [2026-02-26T15:10:45.853Z] ====== als (apache-spark) [default], iteration 14 completed (7698.708 ms) ====== [2026-02-26T15:10:45.853Z] ====== als (apache-spark) [default], iteration 15 started ====== [2026-02-26T15:10:45.853Z] GC before operation: completed in 181.464 ms, heap usage 415.639 MB -> 68.456 MB. [2026-02-26T15:10:52.747Z] ====== als (apache-spark) [default], iteration 15 completed (6438.953 ms) ====== [2026-02-26T15:10:52.747Z] ====== als (apache-spark) [default], iteration 16 started ====== [2026-02-26T15:10:52.747Z] GC before operation: completed in 158.381 ms, heap usage 335.524 MB -> 68.568 MB. [2026-02-26T15:11:03.556Z] ====== als (apache-spark) [default], iteration 16 completed (9469.167 ms) ====== [2026-02-26T15:11:03.556Z] ====== als (apache-spark) [default], iteration 17 started ====== [2026-02-26T15:11:03.556Z] GC before operation: completed in 225.397 ms, heap usage 522.675 MB -> 69.043 MB. [2026-02-26T15:11:10.384Z] ====== als (apache-spark) [default], iteration 17 completed (7363.880 ms) ====== [2026-02-26T15:11:10.384Z] ====== als (apache-spark) [default], iteration 18 started ====== [2026-02-26T15:11:10.384Z] GC before operation: completed in 181.780 ms, heap usage 515.294 MB -> 69.355 MB. [2026-02-26T15:11:17.168Z] ====== als (apache-spark) [default], iteration 18 completed (6439.395 ms) ====== [2026-02-26T15:11:17.168Z] ====== als (apache-spark) [default], iteration 19 started ====== [2026-02-26T15:11:17.168Z] GC before operation: completed in 178.536 ms, heap usage 285.550 MB -> 69.322 MB. [2026-02-26T15:11:23.959Z] ====== als (apache-spark) [default], iteration 19 completed (6437.395 ms) ====== [2026-02-26T15:11:23.959Z] ====== als (apache-spark) [default], iteration 20 started ====== [2026-02-26T15:11:23.959Z] GC before operation: completed in 206.417 ms, heap usage 161.951 MB -> 69.387 MB. [2026-02-26T15:11:34.040Z] ====== als (apache-spark) [default], iteration 20 completed (9296.439 ms) ====== [2026-02-26T15:11:34.041Z] ====== als (apache-spark) [default], iteration 21 started ====== [2026-02-26T15:11:34.041Z] GC before operation: completed in 264.180 ms, heap usage 607.677 MB -> 70.164 MB. [2026-02-26T15:11:42.441Z] ====== als (apache-spark) [default], iteration 21 completed (8011.120 ms) ====== [2026-02-26T15:11:42.441Z] ====== als (apache-spark) [default], iteration 22 started ====== [2026-02-26T15:11:42.441Z] GC before operation: completed in 185.902 ms, heap usage 433.219 MB -> 70.378 MB. [2026-02-26T15:11:50.831Z] ====== als (apache-spark) [default], iteration 22 completed (7644.257 ms) ====== [2026-02-26T15:11:50.831Z] ====== als (apache-spark) [default], iteration 23 started ====== [2026-02-26T15:11:50.831Z] GC before operation: completed in 457.692 ms, heap usage 362.134 MB -> 70.420 MB. [2026-02-26T15:11:59.603Z] ====== als (apache-spark) [default], iteration 23 completed (8406.974 ms) ====== [2026-02-26T15:11:59.603Z] ====== als (apache-spark) [default], iteration 24 started ====== [2026-02-26T15:11:59.603Z] GC before operation: completed in 181.177 ms, heap usage 149.780 MB -> 70.199 MB. [2026-02-26T15:12:08.122Z] ====== als (apache-spark) [default], iteration 24 completed (7451.719 ms) ====== [2026-02-26T15:12:08.122Z] ====== als (apache-spark) [default], iteration 25 started ====== [2026-02-26T15:12:08.122Z] GC before operation: completed in 189.561 ms, heap usage 567.196 MB -> 71.295 MB. [2026-02-26T15:12:15.614Z] ====== als (apache-spark) [default], iteration 25 completed (7206.080 ms) ====== [2026-02-26T15:12:15.614Z] ====== als (apache-spark) [default], iteration 26 started ====== [2026-02-26T15:12:15.614Z] GC before operation: completed in 176.858 ms, heap usage 406.842 MB -> 71.307 MB. [2026-02-26T15:12:22.625Z] ====== als (apache-spark) [default], iteration 26 completed (6812.332 ms) ====== [2026-02-26T15:12:22.625Z] ====== als (apache-spark) [default], iteration 27 started ====== [2026-02-26T15:12:22.625Z] GC before operation: completed in 164.988 ms, heap usage 216.688 MB -> 71.323 MB. [2026-02-26T15:12:31.212Z] ====== als (apache-spark) [default], iteration 27 completed (7012.769 ms) ====== [2026-02-26T15:12:31.212Z] ====== als (apache-spark) [default], iteration 28 started ====== [2026-02-26T15:12:31.212Z] GC before operation: completed in 158.031 ms, heap usage 482.655 MB -> 72.026 MB. [2026-02-26T15:12:39.890Z] ====== als (apache-spark) [default], iteration 28 completed (8588.817 ms) ====== [2026-02-26T15:12:39.890Z] ====== als (apache-spark) [default], iteration 29 started ====== [2026-02-26T15:12:39.890Z] GC before operation: completed in 147.226 ms, heap usage 131.777 MB -> 71.802 MB. [2026-02-26T15:12:48.265Z] ====== als (apache-spark) [default], iteration 29 completed (8104.526 ms) ====== [2026-02-26T15:12:49.227Z] ----------------------------------- [2026-02-26T15:12:49.227Z] renaissance-als_0_PASSED [2026-02-26T15:12:49.227Z] ----------------------------------- [2026-02-26T15:12:49.227Z] [2026-02-26T15:12:49.227Z] TEST TEARDOWN: [2026-02-26T15:12:49.227Z] Nothing to be done for teardown. [2026-02-26T15:12:49.227Z] renaissance-als_0 Finish Time: Thu Feb 26 15:12:48 2026 Epoch Time (ms): 1772118768299