[2023-11-13T19:06:55.324Z] Running test NioLoadTest_5m_1 ... [2023-11-13T19:06:55.324Z] =============================================== [2023-11-13T19:06:55.324Z] NioLoadTest_5m_1 Start Time: Mon Nov 13 13:06:54 2023 Epoch Time (ms): 1699902414543 [2023-11-13T19:06:55.324Z] variation: Mode650 [2023-11-13T19:06:55.324Z] JVM_OPTIONS: -XX:-UseCompressedOops [2023-11-13T19:06:55.324Z] { \ [2023-11-13T19:06:55.324Z] echo ""; echo "TEST SETUP:"; \ [2023-11-13T19:06:55.324Z] echo "Nothing to be done for setup."; \ [2023-11-13T19:06:55.324Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1"; \ [2023-11-13T19:06:55.324Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1"; \ [2023-11-13T19:06:55.324Z] echo ""; echo "TESTING:"; \ [2023-11-13T19:06:55.324Z] perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//STF/stf.core/scripts/stf.pl -test-root="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//STF;/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//aqa-systemtest""" -systemtest-prereqs="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//systemtest_prereqs" -java-args=' -XX:-UseCompressedOops ' -results-root="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1" -test=NioLoadTest -test-args="timeLimit=5m"; \ [2023-11-13T19:06:55.324Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "NioLoadTest_5m_1""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1"; else echo "-----------------------------------"; echo "NioLoadTest_5m_1""_FAILED"; echo "-----------------------------------"; fi; \ [2023-11-13T19:06:55.324Z] echo ""; echo "TEST TEARDOWN:"; \ [2023-11-13T19:06:55.324Z] echo "Nothing to be done for teardown."; \ [2023-11-13T19:06:55.324Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/TestTargetResult"; [2023-11-13T19:06:55.324Z] [2023-11-13T19:06:55.324Z] TEST SETUP: [2023-11-13T19:06:55.324Z] Nothing to be done for setup. [2023-11-13T19:06:55.324Z] [2023-11-13T19:06:55.324Z] TESTING: [2023-11-13T19:06:55.324Z] STF 13:06:54.615 - ========================= S T F ========================= [2023-11-13T19:06:55.324Z] systemtest-prereqs has been processed, and set to: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqsRetrieving amount of free space on drive containing /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1 [2023-11-13T19:06:55.324Z] There is 84719 Mb free [2023-11-13T19:06:55.324Z] STF 13:06:54.620 - ================== G E N E R A T I O N ================== [2023-11-13T19:06:55.324Z] STF 13:06:54.621 - Checking JVM: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/openjdkbinary/j2sdk-image [2023-11-13T19:06:55.324Z] STF 13:06:54.621 - Starting process to generate scripts: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/openjdkbinary/j2sdk-image/bin/java -Dlog4j.skipJansi=true -Djava.system.class.loader=net.adoptopenjdk.stf.runner.StfClassLoader -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//systemtest_prereqs/log4j/log4j-api.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../../jvmtest/system/otherLoadTest/..//systemtest_prereqs/log4j/log4j-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.core/scripts/../bin net.adoptopenjdk.stf.runner.StfRunner -properties "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/stf_parameters.properties, , /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest" [2023-11-13T19:06:55.324Z] GEN stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow [2023-11-13T19:06:55.324Z] GEN [0.105s][warning][cds] Archived non-system classes are disabled because the java.system.class.loader property is specified (value = "net.adoptopenjdk.stf.runner.StfClassLoader"). To use archived non-system classes, this property must not be set [2023-11-13T19:06:57.559Z] GEN 13:06:56.676 - Found test. Project: 'openjdk.test.load' class: 'NioLoadTest.class' Dir: '/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/aqa-systemtest/openjdk.test.load/bin' [2023-11-13T19:06:57.559Z] GEN 13:06:56.692 - Found test. Project: 'openjdk.test.load' class: 'net.adoptopenjdk.stf.NioLoadTest' [2023-11-13T19:06:57.559Z] GEN Classpath directories used by project 'openjdk.test.load': [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/aqa-systemtest/openjdk.test.load/bin [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.core/bin [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.load/bin [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/log4j/log4j-api.jar [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/log4j/log4j-core.jar [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/junit/junit.jar [2023-11-13T19:06:57.559Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/junit/hamcrest-core.jar [2023-11-13T19:06:57.559Z] GEN 13:06:56.916 - Using Mode NoOptions. Values = '' [2023-11-13T19:06:57.559Z] GEN 13:06:57.020 - [2023-11-13T19:06:57.559Z] GEN 13:06:57.020 - Test command summary: [2023-11-13T19:06:57.559Z] GEN 13:06:57.021 - Step Stage Command Description [2023-11-13T19:06:57.559Z] GEN 13:06:57.021 - -----+--------+-----------------+------------ [2023-11-13T19:06:57.559Z] GEN 13:06:57.021 - 1 execute Run java Run nio load test [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - Script generation completed [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - ======================= S E T U P ======================= [2023-11-13T19:06:57.559Z] STF 13:06:57.068 - Running setup: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/setUp.pl [2023-11-13T19:06:57.559Z] STF 13:06:57.122 - SETUP stage completed [2023-11-13T19:06:57.559Z] STF 13:06:57.125 - [2023-11-13T19:06:57.559Z] STF 13:06:57.125 - ==================== E X E C U T E - ==================== [2023-11-13T19:06:57.559Z] STF 13:06:57.125 - Running execute: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/execute.pl [2023-11-13T19:06:57.559Z] STF 13:06:57.213 - [2023-11-13T19:06:57.559Z] STF 13:06:57.213 - Java version [2023-11-13T19:06:57.559Z] STF 13:06:57.213 - Running: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/openjdkbinary/j2sdk-image/bin/java -version [2023-11-13T19:06:57.559Z] Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow [2023-11-13T19:06:58.206Z] openjdk version "21.0.1" 2023-10-17 LTS [2023-11-13T19:06:58.206Z] OpenJDK Runtime Environment Temurin-21.0.1+12.1 (build 21.0.1+12-LTS) [2023-11-13T19:06:58.206Z] OpenJDK 64-Bit Server VM Temurin-21.0.1+12.1 (build 21.0.1+12-LTS, mixed mode, sharing) [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - +------ Step 1 - Run nio load test [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | Run foreground process [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | Program: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/openjdkbinary/j2sdk-image/bin/java [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | Mnemonic: NLT [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | Echo: ECHO_ON [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | Expectation: CLEAN_RUN within 1h5m [2023-11-13T19:06:58.206Z] STF 13:06:57.525 - | [2023-11-13T19:06:58.206Z] STF 13:06:57.526 - Running command: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/openjdkbinary/j2sdk-image/bin/java -XX:-UseCompressedOops -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.load/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.core/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/log4j/log4j-api.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/log4j/log4j-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/junit/junit.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/systemtest_prereqs/junit/hamcrest-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/aqa-systemtest/openjdk.test.nio/bin/lib/filesystem.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/aqa-systemtest/openjdk.test.nio/bin net.adoptopenjdk.loadTest.LoadTest -resultsDir /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results -resultsPrefix 1.NLT. -timeLimit 5m -abortIfOutOfMemory false -reportFailureLimit 1 -abortAtFailureLimit 10 -maxTotalLogFileSpace 200M -maxSingleLogSize 1/25 -suite.nio.threadCount 2 -suite.nio.inventoryFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results/1.NLT.inventory/openjdk.test.load/config/inventories/nio/nio.xml -suite.nio.inventoryExcludeFile none -suite.nio.selection random -suite.nio.seed -1 -suite.nio.repeatCount 1 -suite.nio.thinkingTime 0ms..0ms [2023-11-13T19:06:58.206Z] STF 13:06:57.526 - Redirecting stderr to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results/1.NLT.stderr [2023-11-13T19:06:58.206Z] STF 13:06:57.526 - Redirecting stdout to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results/1.NLT.stdout [2023-11-13T19:06:58.206Z] STF 13:06:57.541 - Monitoring processes: NLT [2023-11-13T19:06:58.206Z] NLT stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow [2023-11-13T19:07:01.463Z] NLT 13:07:01.284 - Load test parameters [2023-11-13T19:07:01.463Z] NLT 13:07:01.288 - Time limited = true [2023-11-13T19:07:01.463Z] NLT 13:07:01.288 - Time limit = 5m [2023-11-13T19:07:02.209Z] NLT 13:07:01.412 - abortIfOutOfMemory = false [2023-11-13T19:07:02.209Z] NLT 13:07:01.413 - reportFailureLimit = 1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.413 - abortAtFailureLimit = 10 [2023-11-13T19:07:02.209Z] NLT 13:07:01.460 - maxTotalLogFileSpace = 209715200 [2023-11-13T19:07:02.209Z] NLT 13:07:01.461 - maxSingleLogSize = 8388608 [2023-11-13T19:07:02.209Z] NLT 13:07:01.462 - Parameters for suite 0 [2023-11-13T19:07:02.209Z] NLT 13:07:01.463 - Suite name = nio [2023-11-13T19:07:02.209Z] NLT 13:07:01.463 - Number threads = 2 [2023-11-13T19:07:02.209Z] NLT 13:07:01.464 - Supplied seed = -1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.464 - Inventory file = /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results/1.NLT.inventory/openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:02.209Z] NLT 13:07:01.465 - Exclude file = none [2023-11-13T19:07:02.209Z] NLT 13:07:01.465 - Number tests = -1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.466 - Repeat count = 1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.466 - Thinking time = 0ms..0ms [2023-11-13T19:07:02.209Z] NLT 13:07:01.467 - Selection mode = random [2023-11-13T19:07:02.209Z] NLT 13:07:01.468 - Actual seed = 1701348827024 [2023-11-13T19:07:02.209Z] NLT 13:07:01.592 - Parsing inventory file. Root=/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/results/1.NLT.inventory File=openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:02.209Z] NLT 13:07:01.626 - Final test list: [2023-11-13T19:07:02.209Z] NLT 13:07:01.645 - 0 ArbitraryJava[net.adoptopenjdk.test.nio.WordCount run] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.680 - 1 ArbitraryJava[net.adoptopenjdk.test.nio.NioApp run] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.680 - 2 ArbitraryJava[net.adoptopenjdk.test.nio.NioBuffers run] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.681 - 3 ArbitraryJava[net.adoptopenjdk.test.nio.NioBuffersTest run] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.682 - 4 JUnit[net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.682 - 5 JUnit[net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectAsyncTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.682 - 6 JUnit[net.adoptopenjdk.test.nio2.asyncio.client.MultipleReadWriteAsyncTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.683 - 7 JUnit[net.adoptopenjdk.test.nio2.asyncio.client.MultipleReadWriteFutureTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.683 - 8 JUnit[net.adoptopenjdk.test.nio2.asyncio.file.AsynchronousFileChannelTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.683 - 9 JUnit[net.adoptopenjdk.test.nio2.mxbean.ByteBufferMXBeanTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.684 - 10 JUnit[net.adoptopenjdk.test.nio2.filesystem.FileSystemsTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.684 - 11 JUnit[net.adoptopenjdk.test.nio2.path.PathDeleteDirectoryTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.684 - 12 JUnit[net.adoptopenjdk.test.nio2.path.PathDirectoryStreamTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.684 - 13 JUnit[net.adoptopenjdk.test.nio2.path.ScannerTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT 13:07:01.685 - 14 JUnit[net.adoptopenjdk.test.nio2.path.WalkFileTreeTest] Weighting=1 [2023-11-13T19:07:02.209Z] NLT stderr WARNING: A terminally deprecated method in java.lang.System has been called [2023-11-13T19:07:02.209Z] NLT stderr WARNING: System::setSecurityManager has been called by net.adoptopenjdk.loadTest.LoadTest (file:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/jvmtest/system/STF/stf.load/bin/) [2023-11-13T19:07:02.209Z] NLT stderr WARNING: Please consider reporting this to the maintainers of net.adoptopenjdk.loadTest.LoadTest [2023-11-13T19:07:02.209Z] NLT stderr WARNING: System::setSecurityManager will be removed in a future release [2023-11-13T19:07:02.209Z] NLT 13:07:01.770 - Starting thread. Suite=0 thread=0 [2023-11-13T19:07:02.209Z] NLT 13:07:01.771 - Starting thread. Suite=0 thread=1 [2023-11-13T19:07:03.720Z] NLT 13:07:03.607 - First failure detected by thread: load-0. Not creating dumps as no dump generation is requested for this load test [2023-11-13T19:07:05.081Z] NLT 13:07:04.620 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:05.081Z] NLT 13:07:04.621 - suite.isCreateDump() : false [2023-11-13T19:07:05.081Z] NLT 13:07:04.652 - Test failed [2023-11-13T19:07:05.081Z] NLT Failure num. = 1 [2023-11-13T19:07:05.081Z] NLT Test number = 4 [2023-11-13T19:07:05.081Z] NLT Test details = 'JUnit[net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest]' [2023-11-13T19:07:05.081Z] NLT Suite number = 0 [2023-11-13T19:07:05.081Z] NLT Thread number = 0 [2023-11-13T19:07:05.081Z] NLT >>> Captured test output >>> [2023-11-13T19:07:05.081Z] NLT Starting up Asynchronous Echo Server instance. [2023-11-13T19:07:05.081Z] NLT Echo Server log available at EchoServer.log [2023-11-13T19:07:05.081Z] NLT EchoServer Using channel group - sun.nio.ch.EPollPort@73540fac [2023-11-13T19:07:05.081Z] NLT Completed Asynchronous Echo Server startup - available at /148.100.74.92:34094 [2023-11-13T19:07:05.081Z] NLT testStarted : testMultipleConnectSequential(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest) [2023-11-13T19:07:05.081Z] NLT MultipleConnectFutureTest.testMultipleConnectSequential() creating 1 connections [2023-11-13T19:07:05.081Z] NLT testFailure: testMultipleConnectSequential(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest): java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.081Z] NLT java.util.concurrent.ExecutionException: java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.PendingFuture.get(PendingFuture.java:200) [2023-11-13T19:07:05.081Z] NLT at net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest.testMultipleConnectSequential(MultipleConnectFutureTest.java:83) [2023-11-13T19:07:05.081Z] NLT at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2023-11-13T19:07:05.081Z] NLT at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestCase.runTest(TestCase.java:176) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestCase.runBare(TestCase.java:141) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestResult$1.protect(TestResult.java:122) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestResult.runProtected(TestResult.java:142) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestResult.run(TestResult.java:125) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestCase.run(TestCase.java:129) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestSuite.runTest(TestSuite.java:252) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestSuite.run(TestSuite.java:247) [2023-11-13T19:07:05.081Z] NLT at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:86) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.Suite.runChild(Suite.java:128) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.Suite.runChild(Suite.java:27) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner$3.run(ParentRunner.java:290) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:71) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:288) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner.access$000(ParentRunner.java:58) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:268) [2023-11-13T19:07:05.081Z] NLT at org.junit.runners.ParentRunner.run(ParentRunner.java:363) [2023-11-13T19:07:05.081Z] NLT at org.junit.runner.JUnitCore.run(JUnitCore.java:137) [2023-11-13T19:07:05.081Z] NLT at org.junit.runner.JUnitCore.run(JUnitCore.java:115) [2023-11-13T19:07:05.081Z] NLT at net.adoptopenjdk.loadTest.adaptors.JUnitAdaptor.executeTest(JUnitAdaptor.java:130) [2023-11-13T19:07:05.081Z] NLT at net.adoptopenjdk.loadTest.LoadTestRunner$2.run(LoadTestRunner.java:182) [2023-11-13T19:07:05.081Z] NLT at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2023-11-13T19:07:05.081Z] NLT at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2023-11-13T19:07:05.081Z] NLT at java.base/java.lang.Thread.run(Thread.java:1583) [2023-11-13T19:07:05.081Z] NLT Caused by: java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.checkConnect(Native Method) [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.finishConnect(UnixAsynchronousSocketChannelImpl.java:256) [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.finish(UnixAsynchronousSocketChannelImpl.java:202) [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.onEvent(UnixAsynchronousSocketChannelImpl.java:217) [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.EPollPort$EventHandlerTask.run(EPollPort.java:305) [2023-11-13T19:07:05.081Z] NLT at java.base/java.lang.Thread.run(Thread.java:1583) [2023-11-13T19:07:05.081Z] NLT at java.base/jdk.internal.misc.InnocuousThread.run(InnocuousThread.java:186) [2023-11-13T19:07:05.081Z] NLT testFinished: testMultipleConnectSequential(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest) [2023-11-13T19:07:05.081Z] NLT testStarted : testSingleConnect(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest) [2023-11-13T19:07:05.081Z] NLT testFailure: testSingleConnect(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest): java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.081Z] NLT java.util.concurrent.ExecutionException: java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.081Z] NLT at java.base/sun.nio.ch.PendingFuture.get(PendingFuture.java:200) [2023-11-13T19:07:05.081Z] NLT at net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest.testSingleConnect(MultipleConnectFutureTest.java:123) [2023-11-13T19:07:05.081Z] NLT at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2023-11-13T19:07:05.081Z] NLT at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestCase.runTest(TestCase.java:176) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestCase.runBare(TestCase.java:141) [2023-11-13T19:07:05.081Z] NLT at junit.framework.TestResult$1.protect(TestResult.java:122) [2023-11-13T19:07:05.082Z] NLT at junit.framework.TestResult.runProtected(TestResult.java:142) [2023-11-13T19:07:05.082Z] NLT at junit.framework.TestResult.run(TestResult.java:125) [2023-11-13T19:07:05.082Z] NLT at junit.framework.TestCase.run(TestCase.java:129) [2023-11-13T19:07:05.082Z] NLT at junit.framework.TestSuite.runTest(TestSuite.java:252) [2023-11-13T19:07:05.082Z] NLT at junit.framework.TestSuite.run(TestSuite.java:247) [2023-11-13T19:07:05.082Z] NLT at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:86) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.Suite.runChild(Suite.java:128) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.Suite.runChild(Suite.java:27) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner$3.run(ParentRunner.java:290) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:71) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:288) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner.access$000(ParentRunner.java:58) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:268) [2023-11-13T19:07:05.082Z] NLT at org.junit.runners.ParentRunner.run(ParentRunner.java:363) [2023-11-13T19:07:05.082Z] NLT at org.junit.runner.JUnitCore.run(JUnitCore.java:137) [2023-11-13T19:07:05.082Z] NLT at org.junit.runner.JUnitCore.run(JUnitCore.java:115) [2023-11-13T19:07:05.082Z] NLT at net.adoptopenjdk.loadTest.adaptors.JUnitAdaptor.executeTest(JUnitAdaptor.java:130) [2023-11-13T19:07:05.082Z] NLT at net.adoptopenjdk.loadTest.LoadTestRunner$2.run(LoadTestRunner.java:182) [2023-11-13T19:07:05.082Z] NLT at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2023-11-13T19:07:05.082Z] NLT at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2023-11-13T19:07:05.082Z] NLT at java.base/java.lang.Thread.run(Thread.java:1583) [2023-11-13T19:07:05.082Z] NLT Caused by: java.net.NoRouteToHostException: No route to host [2023-11-13T19:07:05.082Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.checkConnect(Native Method) [2023-11-13T19:07:05.082Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.finishConnect(UnixAsynchronousSocketChannelImpl.java:256) [2023-11-13T19:07:05.082Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.finish(UnixAsynchronousSocketChannelImpl.java:202) [2023-11-13T19:07:05.082Z] NLT at java.base/sun.nio.ch.UnixAsynchronousSocketChannelImpl.onEvent(UnixAsynchronousSocketChannelImpl.java:217) [2023-11-13T19:07:05.082Z] NLT at java.base/sun.nio.ch.EPollPort$EventHandlerTask.run(EPollPort.java:305) [2023-11-13T19:07:05.082Z] NLT at java.base/java.lang.Thread.run(Thread.java:1583) [2023-11-13T19:07:05.082Z] NLT at java.base/jdk.internal.misc.InnocuousThread.run(InnocuousThread.java:186) [2023-11-13T19:07:05.082Z] NLT testFinished: testSingleConnect(net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest) [2023-11-13T19:07:05.082Z] NLT [2023-11-13T19:07:05.082Z] NLT JUnit Test Results for: net.adoptopenjdk.test.nio2.asyncio.client.MultipleConnectFutureTest [2023-11-13T19:07:05.082Z] NLT Ran : 2 [2023-11-13T19:07:05.082Z] NLT Passed : 0 [2023-11-13T19:07:05.082Z] NLT Failed : 2 [2023-11-13T19:07:05.082Z] NLT Ignored: 0 [2023-11-13T19:07:05.082Z] NLT Result : FAILED [2023-11-13T19:07:05.082Z] NLT <<< [2023-11-13T19:07:05.082Z] NLT [2023-11-13T19:07:07.969Z] NLT 13:07:07.201 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:07.969Z] NLT 13:07:07.202 - suite.isCreateDump() : false [2023-11-13T19:07:07.969Z] NLT 13:07:07.203 - Test failed. Details recorded in execution log. [2023-11-13T19:07:10.015Z] NLT 13:07:09.223 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:10.015Z] NLT 13:07:09.223 - suite.isCreateDump() : false [2023-11-13T19:07:10.015Z] NLT 13:07:09.224 - Test failed. Details recorded in execution log. [2023-11-13T19:07:12.064Z] NLT 13:07:11.462 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:12.064Z] NLT 13:07:11.462 - suite.isCreateDump() : false [2023-11-13T19:07:12.064Z] NLT 13:07:11.462 - Test failed. Details recorded in execution log. [2023-11-13T19:07:17.787Z] NLT 13:07:17.114 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:17.787Z] NLT 13:07:17.114 - suite.isCreateDump() : false [2023-11-13T19:07:17.787Z] NLT 13:07:17.114 - Test failed. Details recorded in execution log. [2023-11-13T19:07:22.482Z] NLT 13:07:21.797 - Completed 6.7%. Number of tests started=25 (with 5 failure(s)) [2023-11-13T19:07:22.482Z] NLT 13:07:22.301 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:22.482Z] NLT 13:07:22.302 - suite.isCreateDump() : false [2023-11-13T19:07:22.482Z] NLT 13:07:22.302 - Test failed. Details recorded in execution log. [2023-11-13T19:07:23.993Z] NLT 13:07:23.642 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:23.993Z] NLT 13:07:23.643 - suite.isCreateDump() : false [2023-11-13T19:07:23.993Z] NLT 13:07:23.643 - Test failed. Details recorded in execution log. [2023-11-13T19:07:28.617Z] NLT 13:07:27.691 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:28.617Z] NLT 13:07:27.691 - suite.isCreateDump() : false [2023-11-13T19:07:28.617Z] NLT 13:07:27.692 - Test failed. Details recorded in execution log. [2023-11-13T19:07:29.225Z] NLT 13:07:28.020 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:29.225Z] NLT 13:07:28.021 - suite.isCreateDump() : false [2023-11-13T19:07:29.225Z] NLT 13:07:28.021 - Test failed. Details recorded in execution log. [2023-11-13T19:07:31.205Z] NLT 13:07:30.021 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:31.205Z] NLT 13:07:30.021 - suite.isCreateDump() : false [2023-11-13T19:07:31.205Z] NLT 13:07:30.021 - Test failed. Details recorded in execution log. [2023-11-13T19:07:31.205Z] NLT 13:07:30.022 - Number of test failures has reached 'AbortAtFailureLimit' (10). Terminating load test [2023-11-13T19:07:31.205Z] NLT 13:07:30.023 - Thread completed. Suite=0 thread=1 [2023-11-13T19:07:31.205Z] NLT 13:07:30.621 - suite.getInventory().getInventoryFileRef(): openjdk.test.load/config/inventories/nio/nio.xml [2023-11-13T19:07:31.205Z] NLT 13:07:30.621 - suite.isCreateDump() : false [2023-11-13T19:07:31.205Z] NLT 13:07:30.622 - Test failed. Details recorded in execution log. [2023-11-13T19:07:31.205Z] NLT 13:07:30.622 - Thread completed. Suite=0 thread=0 [2023-11-13T19:07:31.205Z] NLT 13:07:30.701 - Load test completed [2023-11-13T19:07:31.205Z] NLT 13:07:30.701 - Ran : 44 [2023-11-13T19:07:31.205Z] NLT 13:07:30.702 - Passed : 33 [2023-11-13T19:07:31.205Z] NLT 13:07:30.702 - Failed : 11 [2023-11-13T19:07:31.205Z] NLT 13:07:30.702 - Result : FAILED [2023-11-13T19:07:31.205Z] NLT 13:07:30.703 - Note that only the first 1 failures have been reported [2023-11-13T19:07:31.823Z] STF 13:07:31.191 - **FAILED** Process NLT ended with exit code (1) and not the expected exit code/s (0) [2023-11-13T19:07:31.823Z] STF 13:07:31.191 - Monitoring Report Summary: [2023-11-13T19:07:31.823Z] STF 13:07:31.191 - o Process NLT ended with exit code (1) and not the expected exit code/s (0) [2023-11-13T19:07:31.823Z] STF 13:07:31.191 - Killing processes: NLT [2023-11-13T19:07:31.823Z] STF 13:07:31.191 - o Process NLT pid 24235 is not running [2023-11-13T19:07:31.823Z] **FAILED** at step 1 (Run nio load test). Expected return value=0 Actual=1 at /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/execute.pl line 93. [2023-11-13T19:07:31.823Z] STF 13:07:31.491 - **FAILED** execute script failed. Expected return value=0 Actual=1 [2023-11-13T19:07:31.823Z] STF 13:07:31.491 - [2023-11-13T19:07:31.823Z] STF 13:07:31.491 - ==================== T E A R D O W N ==================== [2023-11-13T19:07:31.823Z] STF 13:07:31.491 - Running teardown: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_s390x_linux/aqa-tests/TKG/../TKG/output_16998936667644/NioLoadTest_5m_1/20231113-130654-NioLoadTest/tearDown.pl [2023-11-13T19:07:31.823Z] STF 13:07:31.579 - TEARDOWN stage completed [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - ===================== R E S U L T S ===================== [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - Stage results: [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - setUp: pass [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - execute: *fail* [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - teardown: pass [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - [2023-11-13T19:07:31.823Z] STF 13:07:31.582 - Overall result: **FAILED** [2023-11-13T19:07:31.823Z] ----------------------------------- [2023-11-13T19:07:31.823Z] NioLoadTest_5m_1_FAILED [2023-11-13T19:07:31.823Z] ----------------------------------- [2023-11-13T19:07:31.823Z] [2023-11-13T19:07:31.823Z] TEST TEARDOWN: [2023-11-13T19:07:31.823Z] Nothing to be done for teardown. [2023-11-13T19:07:31.823Z] NioLoadTest_5m_1 Finish Time: Mon Nov 13 13:07:31 2023 Epoch Time (ms): 1699902451600