[2024-08-16T17:21:13.292Z] Running test renaissance-als_0 ... [2024-08-16T17:21:13.292Z] =============================================== [2024-08-16T17:21:13.292Z] renaissance-als_0 Start Time: Fri Aug 16 17:21:12 2024 Epoch Time (ms): 1723828872220 [2024-08-16T17:21:13.292Z] variation: NoOptions [2024-08-16T17:21:13.292Z] JVM_OPTIONS: [2024-08-16T17:21:13.292Z] { \ [2024-08-16T17:21:13.292Z] echo ""; echo "TEST SETUP:"; \ [2024-08-16T17:21:13.292Z] echo "Nothing to be done for setup."; \ [2024-08-16T17:21:13.292Z] mkdir -p "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/../TKG/output_17238288279794/renaissance-als_0"; \ [2024-08-16T17:21:13.292Z] cd "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/../TKG/output_17238288279794/renaissance-als_0"; \ [2024-08-16T17:21:13.292Z] echo ""; echo "TESTING:"; \ [2024-08-16T17:21:13.292Z] "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/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_ppc64le_linux_testList_0/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/../TKG/output_17238288279794/renaissance-als_0"/als.json" als; \ [2024-08-16T17:21:13.292Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-als_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/../TKG/output_17238288279794/renaissance-als_0"; else echo "-----------------------------------"; echo "renaissance-als_0""_FAILED"; echo "-----------------------------------"; fi; \ [2024-08-16T17:21:13.292Z] echo ""; echo "TEST TEARDOWN:"; \ [2024-08-16T17:21:13.292Z] echo "Nothing to be done for teardown."; \ [2024-08-16T17:21:13.292Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/../TKG/output_17238288279794/TestTargetResult"; [2024-08-16T17:21:13.292Z] [2024-08-16T17:21:13.292Z] TEST SETUP: [2024-08-16T17:21:13.292Z] Nothing to be done for setup. [2024-08-16T17:21:13.292Z] [2024-08-16T17:21:13.292Z] TESTING: [2024-08-16T17:21:16.242Z] Using Spark's default log4j profile: org/apache/spark/log4j-defaults.properties [2024-08-16T17:21:18.157Z] NOTE: 'als' benchmark uses Spark local executor with 4 (out of 4) threads. [2024-08-16T17:21:21.745Z] WARNING: An illegal reflective access operation has occurred [2024-08-16T17:21:21.745Z] WARNING: Illegal reflective access by org.apache.spark.util.SizeEstimator$ (file:/home/jenkins/workspace/Test_openjdk11_hs_extended.perf_ppc64le_linux_testList_0/aqa-tests/TKG/output_17238288279794/renaissance-als_0/harness-172112-11471635860804886453/apache-spark/lib/spark-core_2.13-3.2.0.jar) to field java.net.URI.scheme [2024-08-16T17:21:21.745Z] WARNING: Please consider reporting this to the maintainers of org.apache.spark.util.SizeEstimator$ [2024-08-16T17:21:21.745Z] WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations [2024-08-16T17:21:21.745Z] WARNING: All illegal access operations will be denied in a future release [2024-08-16T17:21:22.710Z] ====== als (apache-spark) [default], iteration 0 started ====== [2024-08-16T17:21:23.644Z] GC before operation: completed in 54.508 ms, heap usage 72.502 MB -> 33.804 MB. [2024-08-16T17:21:41.757Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:21:41.757Z] There is no way to check that no silent failure occurred. [2024-08-16T17:21:41.757Z] ====== als (apache-spark) [default], iteration 0 completed (17513.360 ms) ====== [2024-08-16T17:21:41.757Z] ====== als (apache-spark) [default], iteration 1 started ====== [2024-08-16T17:21:41.757Z] GC before operation: completed in 125.959 ms, heap usage 333.300 MB -> 56.100 MB. [2024-08-16T17:21:49.754Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:21:49.754Z] There is no way to check that no silent failure occurred. [2024-08-16T17:21:49.754Z] ====== als (apache-spark) [default], iteration 1 completed (8283.595 ms) ====== [2024-08-16T17:21:49.754Z] ====== als (apache-spark) [default], iteration 2 started ====== [2024-08-16T17:21:49.754Z] GC before operation: completed in 106.549 ms, heap usage 493.862 MB -> 58.920 MB. [2024-08-16T17:21:57.747Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:21:57.747Z] There is no way to check that no silent failure occurred. [2024-08-16T17:21:57.747Z] ====== als (apache-spark) [default], iteration 2 completed (7827.552 ms) ====== [2024-08-16T17:21:57.747Z] ====== als (apache-spark) [default], iteration 3 started ====== [2024-08-16T17:21:57.747Z] GC before operation: completed in 108.450 ms, heap usage 476.719 MB -> 59.283 MB. [2024-08-16T17:22:05.785Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:05.785Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:05.785Z] ====== als (apache-spark) [default], iteration 3 completed (7714.934 ms) ====== [2024-08-16T17:22:05.785Z] ====== als (apache-spark) [default], iteration 4 started ====== [2024-08-16T17:22:05.785Z] GC before operation: completed in 114.600 ms, heap usage 621.003 MB -> 59.814 MB. [2024-08-16T17:22:12.345Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:12.345Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:12.345Z] ====== als (apache-spark) [default], iteration 4 completed (7669.152 ms) ====== [2024-08-16T17:22:12.345Z] ====== als (apache-spark) [default], iteration 5 started ====== [2024-08-16T17:22:12.345Z] GC before operation: completed in 109.752 ms, heap usage 330.048 MB -> 59.803 MB. [2024-08-16T17:22:20.545Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:20.545Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:20.545Z] ====== als (apache-spark) [default], iteration 5 completed (7618.604 ms) ====== [2024-08-16T17:22:20.545Z] ====== als (apache-spark) [default], iteration 6 started ====== [2024-08-16T17:22:20.545Z] GC before operation: completed in 106.509 ms, heap usage 261.127 MB -> 59.955 MB. [2024-08-16T17:22:28.546Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:28.547Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:28.547Z] ====== als (apache-spark) [default], iteration 6 completed (7422.025 ms) ====== [2024-08-16T17:22:28.547Z] ====== als (apache-spark) [default], iteration 7 started ====== [2024-08-16T17:22:28.547Z] GC before operation: completed in 115.310 ms, heap usage 241.516 MB -> 60.450 MB. [2024-08-16T17:22:36.550Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:36.550Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:36.551Z] ====== als (apache-spark) [default], iteration 7 completed (7596.841 ms) ====== [2024-08-16T17:22:36.551Z] ====== als (apache-spark) [default], iteration 8 started ====== [2024-08-16T17:22:36.551Z] GC before operation: completed in 114.283 ms, heap usage 413.553 MB -> 60.942 MB. [2024-08-16T17:22:43.120Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:43.120Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:43.121Z] ====== als (apache-spark) [default], iteration 8 completed (7595.411 ms) ====== [2024-08-16T17:22:43.121Z] ====== als (apache-spark) [default], iteration 9 started ====== [2024-08-16T17:22:43.121Z] GC before operation: completed in 105.237 ms, heap usage 308.583 MB -> 61.103 MB. [2024-08-16T17:22:52.717Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:52.717Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:52.717Z] ====== als (apache-spark) [default], iteration 9 completed (8237.817 ms) ====== [2024-08-16T17:22:52.717Z] ====== als (apache-spark) [default], iteration 10 started ====== [2024-08-16T17:22:52.717Z] GC before operation: completed in 143.661 ms, heap usage 280.385 MB -> 61.437 MB. [2024-08-16T17:22:59.291Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:22:59.291Z] There is no way to check that no silent failure occurred. [2024-08-16T17:22:59.291Z] ====== als (apache-spark) [default], iteration 10 completed (7569.107 ms) ====== [2024-08-16T17:22:59.291Z] ====== als (apache-spark) [default], iteration 11 started ====== [2024-08-16T17:22:59.291Z] GC before operation: completed in 114.307 ms, heap usage 392.021 MB -> 61.871 MB. [2024-08-16T17:23:08.014Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:08.014Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:08.014Z] ====== als (apache-spark) [default], iteration 11 completed (7719.149 ms) ====== [2024-08-16T17:23:08.014Z] ====== als (apache-spark) [default], iteration 12 started ====== [2024-08-16T17:23:08.014Z] GC before operation: completed in 129.409 ms, heap usage 261.576 MB -> 62.122 MB. [2024-08-16T17:23:14.584Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:14.584Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:14.584Z] ====== als (apache-spark) [default], iteration 12 completed (7653.062 ms) ====== [2024-08-16T17:23:14.584Z] ====== als (apache-spark) [default], iteration 13 started ====== [2024-08-16T17:23:15.517Z] GC before operation: completed in 122.414 ms, heap usage 396.266 MB -> 62.569 MB. [2024-08-16T17:23:23.630Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:23.630Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:23.630Z] ====== als (apache-spark) [default], iteration 13 completed (7583.564 ms) ====== [2024-08-16T17:23:23.630Z] ====== als (apache-spark) [default], iteration 14 started ====== [2024-08-16T17:23:23.630Z] GC before operation: completed in 115.117 ms, heap usage 151.118 MB -> 62.624 MB. [2024-08-16T17:23:30.217Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:30.218Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:30.218Z] ====== als (apache-spark) [default], iteration 14 completed (7608.898 ms) ====== [2024-08-16T17:23:30.218Z] ====== als (apache-spark) [default], iteration 15 started ====== [2024-08-16T17:23:30.218Z] GC before operation: completed in 134.062 ms, heap usage 504.703 MB -> 63.435 MB. [2024-08-16T17:23:38.227Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:38.227Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:38.227Z] ====== als (apache-spark) [default], iteration 15 completed (7402.842 ms) ====== [2024-08-16T17:23:38.227Z] ====== als (apache-spark) [default], iteration 16 started ====== [2024-08-16T17:23:38.227Z] GC before operation: completed in 113.746 ms, heap usage 466.934 MB -> 63.844 MB. [2024-08-16T17:23:46.241Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:46.241Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:46.241Z] ====== als (apache-spark) [default], iteration 16 completed (7301.538 ms) ====== [2024-08-16T17:23:46.241Z] ====== als (apache-spark) [default], iteration 17 started ====== [2024-08-16T17:23:46.241Z] GC before operation: completed in 123.508 ms, heap usage 503.445 MB -> 64.129 MB. [2024-08-16T17:23:52.811Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:23:52.811Z] There is no way to check that no silent failure occurred. [2024-08-16T17:23:52.811Z] ====== als (apache-spark) [default], iteration 17 completed (7349.988 ms) ====== [2024-08-16T17:23:52.811Z] ====== als (apache-spark) [default], iteration 18 started ====== [2024-08-16T17:23:52.811Z] GC before operation: completed in 117.106 ms, heap usage 567.259 MB -> 64.603 MB. [2024-08-16T17:24:00.799Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:00.799Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:00.799Z] ====== als (apache-spark) [default], iteration 18 completed (7421.120 ms) ====== [2024-08-16T17:24:00.799Z] ====== als (apache-spark) [default], iteration 19 started ====== [2024-08-16T17:24:00.799Z] GC before operation: completed in 119.674 ms, heap usage 313.136 MB -> 64.467 MB. [2024-08-16T17:24:08.810Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:08.811Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:08.811Z] ====== als (apache-spark) [default], iteration 19 completed (7438.552 ms) ====== [2024-08-16T17:24:08.811Z] ====== als (apache-spark) [default], iteration 20 started ====== [2024-08-16T17:24:08.811Z] GC before operation: completed in 123.909 ms, heap usage 376.063 MB -> 64.698 MB. [2024-08-16T17:24:15.374Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:15.374Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:15.374Z] ====== als (apache-spark) [default], iteration 20 completed (7426.574 ms) ====== [2024-08-16T17:24:15.374Z] ====== als (apache-spark) [default], iteration 21 started ====== [2024-08-16T17:24:15.374Z] GC before operation: completed in 126.233 ms, heap usage 248.978 MB -> 64.560 MB. [2024-08-16T17:24:23.460Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:23.460Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:23.461Z] ====== als (apache-spark) [default], iteration 21 completed (7452.879 ms) ====== [2024-08-16T17:24:23.461Z] ====== als (apache-spark) [default], iteration 22 started ====== [2024-08-16T17:24:23.461Z] GC before operation: completed in 127.427 ms, heap usage 558.427 MB -> 65.304 MB. [2024-08-16T17:24:31.448Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:31.448Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:31.448Z] ====== als (apache-spark) [default], iteration 22 completed (7537.143 ms) ====== [2024-08-16T17:24:31.448Z] ====== als (apache-spark) [default], iteration 23 started ====== [2024-08-16T17:24:31.448Z] GC before operation: completed in 126.594 ms, heap usage 289.331 MB -> 65.087 MB. [2024-08-16T17:24:39.459Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:39.459Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:39.459Z] ====== als (apache-spark) [default], iteration 23 completed (7933.322 ms) ====== [2024-08-16T17:24:39.459Z] ====== als (apache-spark) [default], iteration 24 started ====== [2024-08-16T17:24:39.459Z] GC before operation: completed in 125.589 ms, heap usage 517.273 MB -> 65.710 MB. [2024-08-16T17:24:46.739Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:46.739Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:46.739Z] ====== als (apache-spark) [default], iteration 24 completed (7405.174 ms) ====== [2024-08-16T17:24:46.739Z] ====== als (apache-spark) [default], iteration 25 started ====== [2024-08-16T17:24:46.739Z] GC before operation: completed in 119.276 ms, heap usage 194.141 MB -> 65.347 MB. [2024-08-16T17:24:53.392Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:24:53.392Z] There is no way to check that no silent failure occurred. [2024-08-16T17:24:53.392Z] ====== als (apache-spark) [default], iteration 25 completed (7304.912 ms) ====== [2024-08-16T17:24:53.392Z] ====== als (apache-spark) [default], iteration 26 started ====== [2024-08-16T17:24:54.334Z] GC before operation: completed in 122.890 ms, heap usage 250.691 MB -> 65.429 MB. [2024-08-16T17:25:02.336Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:25:02.336Z] There is no way to check that no silent failure occurred. [2024-08-16T17:25:02.336Z] ====== als (apache-spark) [default], iteration 26 completed (7459.541 ms) ====== [2024-08-16T17:25:02.336Z] ====== als (apache-spark) [default], iteration 27 started ====== [2024-08-16T17:25:02.336Z] GC before operation: completed in 119.399 ms, heap usage 217.993 MB -> 65.754 MB. [2024-08-16T17:25:10.332Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:25:10.332Z] There is no way to check that no silent failure occurred. [2024-08-16T17:25:10.332Z] ====== als (apache-spark) [default], iteration 27 completed (7968.210 ms) ====== [2024-08-16T17:25:10.332Z] ====== als (apache-spark) [default], iteration 28 started ====== [2024-08-16T17:25:10.332Z] GC before operation: completed in 122.360 ms, heap usage 357.727 MB -> 66.194 MB. [2024-08-16T17:25:16.951Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:25:16.951Z] There is no way to check that no silent failure occurred. [2024-08-16T17:25:16.951Z] ====== als (apache-spark) [default], iteration 28 completed (7351.785 ms) ====== [2024-08-16T17:25:16.951Z] ====== als (apache-spark) [default], iteration 29 started ====== [2024-08-16T17:25:16.951Z] GC before operation: completed in 125.046 ms, heap usage 524.909 MB -> 66.653 MB. [2024-08-16T17:25:24.953Z] WARNING: This benchmark provides no result that can be validated. [2024-08-16T17:25:24.953Z] There is no way to check that no silent failure occurred. [2024-08-16T17:25:24.953Z] ====== als (apache-spark) [default], iteration 29 completed (7286.250 ms) ====== [2024-08-16T17:25:24.953Z] ----------------------------------- [2024-08-16T17:25:24.953Z] renaissance-als_0_PASSED [2024-08-16T17:25:24.953Z] ----------------------------------- [2024-08-16T17:25:24.953Z] [2024-08-16T17:25:24.953Z] TEST TEARDOWN: [2024-08-16T17:25:24.953Z] Nothing to be done for teardown. [2024-08-16T17:25:24.953Z] renaissance-als_0 Finish Time: Fri Aug 16 17:25:24 2024 Epoch Time (ms): 1723829124259