renaissance-als_0
[2026-02-15T12:38:37.070Z] Running test renaissance-als_0 ...
[2026-02-15T12:38:37.070Z] ===============================================
[2026-02-15T12:38:37.070Z] renaissance-als_0 Start Time: Sun Feb 15 12:38:36 2026 Epoch Time (ms): 1771159116943
[2026-02-15T12:38:37.070Z] variation: NoOptions
[2026-02-15T12:38:37.070Z] JVM_OPTIONS:
[2026-02-15T12:38:37.070Z] { \
[2026-02-15T12:38:37.070Z] echo ""; echo "TEST SETUP:"; \
[2026-02-15T12:38:37.070Z] echo "Nothing to be done for setup."; \
[2026-02-15T12:38:37.070Z] mkdir -p "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../TKG/output_17711591158023/renaissance-als_0"; \
[2026-02-15T12:38:37.070Z] cd "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../TKG/output_17711591158023/renaissance-als_0"; \
[2026-02-15T12:38:37.070Z] echo ""; echo "TESTING:"; \
[2026-02-15T12:38:37.070Z] "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/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_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../TKG/output_17711591158023/renaissance-als_0"/als.json" als; \
[2026-02-15T12:38:37.070Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-als_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../TKG/output_17711591158023/renaissance-als_0"; else echo "-----------------------------------"; echo "renaissance-als_0""_FAILED"; echo "-----------------------------------"; fi; \
[2026-02-15T12:38:37.070Z] echo ""; echo "TEST TEARDOWN:"; \
[2026-02-15T12:38:37.070Z] echo "Nothing to be done for teardown."; \
[2026-02-15T12:38:37.070Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/../TKG/output_17711591158023/TestTargetResult";
[2026-02-15T12:38:37.070Z]
[2026-02-15T12:38:37.070Z] TEST SETUP:
[2026-02-15T12:38:37.070Z] Nothing to be done for setup.
[2026-02-15T12:38:37.070Z]
[2026-02-15T12:38:37.070Z] TESTING:
[2026-02-15T12:38:40.115Z] WARNING: A terminally deprecated method in sun.misc.Unsafe has been called
[2026-02-15T12:38:40.115Z] WARNING: sun.misc.Unsafe::objectFieldOffset has been called by scala.runtime.LazyVals$ (file:/home/jenkins/workspace/Test_openjdk25_hs_extended.perf_riscv64_linux_testList_2/aqa-tests/TKG/output_17711591158023/renaissance-als_0/launcher-123837-5079175196638922173/renaissance-harness_3/lib/scala3-library_3-3.3.4.jar)
[2026-02-15T12:38:40.115Z] WARNING: Please consider reporting this to the maintainers of class scala.runtime.LazyVals$
[2026-02-15T12:38:40.115Z] WARNING: sun.misc.Unsafe::objectFieldOffset will be removed in a future release
[2026-02-15T12:39:03.417Z] NOTE: 'als' benchmark uses Spark local executor with 4 (out of 4) threads.
[2026-02-15T12:39:19.828Z] ====== als (apache-spark) [default], iteration 0 started ======
[2026-02-15T12:39:19.828Z] GC before operation: completed in 205.079 ms, heap usage 62.628 MB -> 35.355 MB.
[2026-02-15T12:40:43.375Z] ====== als (apache-spark) [default], iteration 0 completed (68213.479 ms) ======
[2026-02-15T12:40:43.375Z] ====== als (apache-spark) [default], iteration 1 started ======
[2026-02-15T12:40:43.375Z] GC before operation: completed in 611.993 ms, heap usage 145.741 MB -> 74.940 MB.
[2026-02-15T12:40:59.511Z] ====== als (apache-spark) [default], iteration 1 completed (25472.629 ms) ======
[2026-02-15T12:40:59.511Z] ====== als (apache-spark) [default], iteration 2 started ======
[2026-02-15T12:40:59.511Z] GC before operation: completed in 632.682 ms, heap usage 303.618 MB -> 75.910 MB.
[2026-02-15T12:41:22.827Z] ====== als (apache-spark) [default], iteration 2 completed (22727.890 ms) ======
[2026-02-15T12:41:22.828Z] ====== als (apache-spark) [default], iteration 3 started ======
[2026-02-15T12:41:23.177Z] GC before operation: completed in 700.487 ms, heap usage 228.628 MB -> 76.589 MB.
[2026-02-15T12:41:51.301Z] ====== als (apache-spark) [default], iteration 3 completed (22750.210 ms) ======
[2026-02-15T12:41:51.301Z] ====== als (apache-spark) [default], iteration 4 started ======
[2026-02-15T12:41:51.301Z] GC before operation: completed in 729.507 ms, heap usage 195.556 MB -> 77.008 MB.
[2026-02-15T12:42:10.666Z] ====== als (apache-spark) [default], iteration 4 completed (21317.834 ms) ======
[2026-02-15T12:42:10.666Z] ====== als (apache-spark) [default], iteration 5 started ======
[2026-02-15T12:42:11.016Z] GC before operation: completed in 737.332 ms, heap usage 299.925 MB -> 77.790 MB.
[2026-02-15T12:42:34.352Z] ====== als (apache-spark) [default], iteration 5 completed (20994.266 ms) ======
[2026-02-15T12:42:34.352Z] ====== als (apache-spark) [default], iteration 6 started ======
[2026-02-15T12:42:34.352Z] GC before operation: completed in 756.212 ms, heap usage 248.351 MB -> 78.412 MB.
[2026-02-15T12:42:57.682Z] ====== als (apache-spark) [default], iteration 6 completed (21691.368 ms) ======
[2026-02-15T12:42:57.682Z] ====== als (apache-spark) [default], iteration 7 started ======
[2026-02-15T12:42:57.682Z] GC before operation: completed in 803.756 ms, heap usage 321.711 MB -> 78.982 MB.
[2026-02-15T12:43:21.011Z] ====== als (apache-spark) [default], iteration 7 completed (20600.102 ms) ======
[2026-02-15T12:43:21.011Z] ====== als (apache-spark) [default], iteration 8 started ======
[2026-02-15T12:43:21.011Z] GC before operation: completed in 852.004 ms, heap usage 271.846 MB -> 79.453 MB.
[2026-02-15T12:43:44.379Z] ====== als (apache-spark) [default], iteration 8 completed (20439.589 ms) ======
[2026-02-15T12:43:44.379Z] ====== als (apache-spark) [default], iteration 9 started ======
[2026-02-15T12:43:44.379Z] GC before operation: completed in 802.784 ms, heap usage 168.045 MB -> 79.795 MB.
[2026-02-15T12:44:03.747Z] ====== als (apache-spark) [default], iteration 9 completed (20992.209 ms) ======
[2026-02-15T12:44:03.747Z] ====== als (apache-spark) [default], iteration 10 started ======
[2026-02-15T12:44:04.504Z] GC before operation: completed in 823.787 ms, heap usage 419.045 MB -> 80.109 MB.
[2026-02-15T12:44:28.058Z] ====== als (apache-spark) [default], iteration 10 completed (20082.597 ms) ======
[2026-02-15T12:44:28.058Z] ====== als (apache-spark) [default], iteration 11 started ======
[2026-02-15T12:44:28.058Z] GC before operation: completed in 864.135 ms, heap usage 235.134 MB -> 80.445 MB.
[2026-02-15T12:44:51.538Z] ====== als (apache-spark) [default], iteration 11 completed (21008.778 ms) ======
[2026-02-15T12:44:51.538Z] ====== als (apache-spark) [default], iteration 12 started ======
[2026-02-15T12:44:51.538Z] GC before operation: completed in 864.446 ms, heap usage 360.853 MB -> 80.714 MB.
[2026-02-15T12:45:14.842Z] ====== als (apache-spark) [default], iteration 12 completed (20701.164 ms) ======
[2026-02-15T12:45:14.842Z] ====== als (apache-spark) [default], iteration 13 started ======
[2026-02-15T12:45:14.842Z] GC before operation: completed in 869.697 ms, heap usage 154.209 MB -> 80.944 MB.
[2026-02-15T12:45:34.264Z] ====== als (apache-spark) [default], iteration 13 completed (20165.628 ms) ======
[2026-02-15T12:45:34.264Z] ====== als (apache-spark) [default], iteration 14 started ======
[2026-02-15T12:45:34.264Z] GC before operation: completed in 861.995 ms, heap usage 232.163 MB -> 81.146 MB.
[2026-02-15T12:45:57.576Z] ====== als (apache-spark) [default], iteration 14 completed (19862.078 ms) ======
[2026-02-15T12:45:57.576Z] ====== als (apache-spark) [default], iteration 15 started ======
[2026-02-15T12:45:57.576Z] GC before operation: completed in 882.691 ms, heap usage 468.956 MB -> 81.790 MB.
[2026-02-15T12:46:17.092Z] ====== als (apache-spark) [default], iteration 15 completed (20034.075 ms) ======
[2026-02-15T12:46:17.092Z] ====== als (apache-spark) [default], iteration 16 started ======
[2026-02-15T12:46:17.092Z] GC before operation: completed in 891.303 ms, heap usage 326.475 MB -> 81.942 MB.
[2026-02-15T12:46:40.446Z] ====== als (apache-spark) [default], iteration 16 completed (20041.080 ms) ======
[2026-02-15T12:46:40.446Z] ====== als (apache-spark) [default], iteration 17 started ======
[2026-02-15T12:46:40.446Z] GC before operation: completed in 909.771 ms, heap usage 218.531 MB -> 82.005 MB.
[2026-02-15T12:46:59.856Z] ====== als (apache-spark) [default], iteration 17 completed (19828.388 ms) ======
[2026-02-15T12:46:59.856Z] ====== als (apache-spark) [default], iteration 18 started ======
[2026-02-15T12:47:00.205Z] GC before operation: completed in 913.664 ms, heap usage 442.322 MB -> 82.657 MB.
[2026-02-15T12:47:23.621Z] ====== als (apache-spark) [default], iteration 18 completed (19634.942 ms) ======
[2026-02-15T12:47:23.621Z] ====== als (apache-spark) [default], iteration 19 started ======
[2026-02-15T12:47:23.621Z] GC before operation: completed in 907.620 ms, heap usage 248.721 MB -> 82.506 MB.
[2026-02-15T12:47:43.228Z] ====== als (apache-spark) [default], iteration 19 completed (19645.347 ms) ======
[2026-02-15T12:47:43.228Z] ====== als (apache-spark) [default], iteration 20 started ======
[2026-02-15T12:47:43.228Z] GC before operation: completed in 907.322 ms, heap usage 250.662 MB -> 82.701 MB.
[2026-02-15T12:48:06.535Z] ====== als (apache-spark) [default], iteration 20 completed (19967.387 ms) ======
[2026-02-15T12:48:06.535Z] ====== als (apache-spark) [default], iteration 21 started ======
[2026-02-15T12:48:06.535Z] GC before operation: completed in 919.006 ms, heap usage 541.147 MB -> 83.500 MB.
[2026-02-15T12:48:25.930Z] ====== als (apache-spark) [default], iteration 21 completed (19243.187 ms) ======
[2026-02-15T12:48:25.930Z] ====== als (apache-spark) [default], iteration 22 started ======
[2026-02-15T12:48:25.930Z] GC before operation: completed in 936.329 ms, heap usage 268.409 MB -> 83.323 MB.
[2026-02-15T12:48:49.263Z] ====== als (apache-spark) [default], iteration 22 completed (19936.952 ms) ======
[2026-02-15T12:48:49.263Z] ====== als (apache-spark) [default], iteration 23 started ======
[2026-02-15T12:48:49.263Z] GC before operation: completed in 926.525 ms, heap usage 255.460 MB -> 83.523 MB.
[2026-02-15T12:49:08.828Z] ====== als (apache-spark) [default], iteration 23 completed (19543.202 ms) ======
[2026-02-15T12:49:08.828Z] ====== als (apache-spark) [default], iteration 24 started ======
[2026-02-15T12:49:08.828Z] GC before operation: completed in 937.217 ms, heap usage 461.719 MB -> 84.114 MB.
[2026-02-15T12:49:32.170Z] ====== als (apache-spark) [default], iteration 24 completed (19759.979 ms) ======
[2026-02-15T12:49:32.170Z] ====== als (apache-spark) [default], iteration 25 started ======
[2026-02-15T12:49:32.170Z] GC before operation: completed in 939.764 ms, heap usage 521.452 MB -> 84.368 MB.
[2026-02-15T12:49:51.574Z] ====== als (apache-spark) [default], iteration 25 completed (19475.588 ms) ======
[2026-02-15T12:49:51.574Z] ====== als (apache-spark) [default], iteration 26 started ======
[2026-02-15T12:49:51.574Z] GC before operation: completed in 960.480 ms, heap usage 444.573 MB -> 84.704 MB.
[2026-02-15T12:50:10.959Z] ====== als (apache-spark) [default], iteration 26 completed (19000.810 ms) ======
[2026-02-15T12:50:10.959Z] ====== als (apache-spark) [default], iteration 27 started ======
[2026-02-15T12:50:11.724Z] GC before operation: completed in 972.898 ms, heap usage 504.629 MB -> 84.885 MB.
[2026-02-15T12:50:35.045Z] ====== als (apache-spark) [default], iteration 27 completed (18944.394 ms) ======
[2026-02-15T12:50:35.045Z] ====== als (apache-spark) [default], iteration 28 started ======
[2026-02-15T12:50:35.045Z] GC before operation: completed in 958.579 ms, heap usage 326.187 MB -> 84.320 MB.
[2026-02-15T12:50:55.164Z] ====== als (apache-spark) [default], iteration 28 completed (19571.237 ms) ======
[2026-02-15T12:50:55.164Z] ====== als (apache-spark) [default], iteration 29 started ======
[2026-02-15T12:50:55.164Z] GC before operation: completed in 964.965 ms, heap usage 445.755 MB -> 84.991 MB.
[2026-02-15T12:51:14.533Z] ====== als (apache-spark) [default], iteration 29 completed (19419.443 ms) ======
[2026-02-15T12:51:16.255Z] -----------------------------------
[2026-02-15T12:51:16.255Z] renaissance-als_0_PASSED
[2026-02-15T12:51:16.255Z] -----------------------------------
[2026-02-15T12:51:16.255Z]
[2026-02-15T12:51:16.255Z] TEST TEARDOWN:
[2026-02-15T12:51:16.255Z] Nothing to be done for teardown.
[2026-02-15T12:51:16.255Z] renaissance-als_0 Finish Time: Sun Feb 15 12:51:16 2026 Epoch Time (ms): 1771159876102