[2025-11-06T00:24:39.684Z] Running test jdk_net_1 ... [2025-11-06T00:24:39.684Z] =============================================== [2025-11-06T00:24:39.684Z] jdk_net_1 Start Time: Thu Nov 6 00:24:38 2025 Epoch Time (ms): 1762388678722 [2025-11-06T00:24:39.684Z] variation: Mode650 [2025-11-06T00:24:39.684Z] JVM_OPTIONS: -XX:-UseCompressedOops [2025-11-06T00:24:39.684Z] { \ [2025-11-06T00:24:39.684Z] echo ""; echo "TEST SETUP:"; \ [2025-11-06T00:24:39.684Z] echo "Nothing to be done for setup."; \ [2025-11-06T00:24:39.684Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1"; \ [2025-11-06T00:24:39.684Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1"; \ [2025-11-06T00:24:39.684Z] echo ""; echo "TESTING:"; \ [2025-11-06T00:24:39.684Z] "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image/bin/java" -Xmx512m -jar "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../../jvmtest/openjdk/jtreg/lib/jtreg.jar" \ [2025-11-06T00:24:39.684Z] -agentvm -a -ea -esa -v:fail,error,time,nopass -retain:fail,error,*.dmp,javacore.*,heapdump.*,*.trc -ignore:quiet -timeoutFactor:12 -xml:verify -concurrency:3 -nativepath:"/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/openjdk-test-image/jdk/jtreg/native" -vmoptions:"-Xmx512m -XX:-UseCompressedOops " \ [2025-11-06T00:24:39.684Z] -w ""/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1"/work" \ [2025-11-06T00:24:39.684Z] -r ""/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1"/report" \ [2025-11-06T00:24:39.684Z] -jdk:"/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image" \ [2025-11-06T00:24:39.684Z] -exclude:"/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../openjdk/openjdk-jdk/test/jdk/ProblemList.txt" \ [2025-11-06T00:24:39.684Z] -exclude:"/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../../jvmtest/openjdk/excludes/ProblemList_openjdk21.txt" \ [2025-11-06T00:24:39.684Z] \ [2025-11-06T00:24:39.684Z] -exclude:"/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../openjdk/excludes/vendors/eclipse/ProblemList_openjdk21.txt" \ [2025-11-06T00:24:39.684Z] "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../openjdk/openjdk-jdk/test/jdk:jdk_net"; \ [2025-11-06T00:24:39.684Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "jdk_net_1""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/..; else echo "-----------------------------------"; echo "jdk_net_1""_FAILED"; echo "-----------------------------------"; fi; \ [2025-11-06T00:24:39.684Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-11-06T00:24:39.684Z] echo "Nothing to be done for teardown."; \ [2025-11-06T00:24:39.684Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/TestTargetResult"; [2025-11-06T00:24:39.684Z] [2025-11-06T00:24:39.684Z] TEST SETUP: [2025-11-06T00:24:39.684Z] Nothing to be done for setup. [2025-11-06T00:24:39.684Z] [2025-11-06T00:24:39.684Z] TESTING: [2025-11-06T00:24:39.684Z] Directory "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1/work" not found: creating [2025-11-06T00:24:39.684Z] Directory "/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/../TKG/output_17623859943816/jdk_net_1/report" not found: creating [2025-11-06T00:24:47.933Z] XML output with verification to /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work [2025-11-06T00:40:36.175Z] -------------------------------------------------- [2025-11-06T00:40:36.175Z] TEST: java/net/httpclient/AggregateRequestBodyTest.java [2025-11-06T00:40:36.175Z] TEST JDK: /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] ACTION: build -- Passed. Build successful [2025-11-06T00:40:36.175Z] REASON: User specified action: run build jdk.test.lib.net.SimpleSSLContext jdk.httpclient.test.lib.common.HttpServerAdapters ReferenceTracker AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] TIME: 0.833 seconds [2025-11-06T00:40:36.175Z] messages: [2025-11-06T00:40:36.175Z] command: build jdk.test.lib.net.SimpleSSLContext jdk.httpclient.test.lib.common.HttpServerAdapters ReferenceTracker AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] reason: User specified action: run build jdk.test.lib.net.SimpleSSLContext jdk.httpclient.test.lib.common.HttpServerAdapters ReferenceTracker AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] started: Thu Nov 06 00:39:43 UTC 2025 [2025-11-06T00:40:36.175Z] Test directory: [2025-11-06T00:40:36.175Z] compile: ReferenceTracker, AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] finished: Thu Nov 06 00:39:44 UTC 2025 [2025-11-06T00:40:36.175Z] elapsed time (seconds): 0.833 [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] ACTION: compile -- Passed. Compilation successful [2025-11-06T00:40:36.175Z] REASON: .class file out of date or does not exist [2025-11-06T00:40:36.175Z] TIME: 0.828 seconds [2025-11-06T00:40:36.175Z] messages: [2025-11-06T00:40:36.175Z] command: compile /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/ReferenceTracker.java /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/AggregateRequestBodyTest.java [2025-11-06T00:40:36.175Z] reason: .class file out of date or does not exist [2025-11-06T00:40:36.175Z] started: Thu Nov 06 00:39:43 UTC 2025 [2025-11-06T00:40:36.175Z] Additional options from @modules: --add-modules java.base,java.net.http,java.logging,jdk.httpserver --add-exports java.base/sun.net.www.http=ALL-UNNAMED --add-exports java.base/sun.net.www=ALL-UNNAMED --add-exports java.base/sun.net=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.common=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.frame=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.hpack=ALL-UNNAMED [2025-11-06T00:40:36.175Z] Mode: agentvm [2025-11-06T00:40:36.175Z] Agent id: 2 [2025-11-06T00:40:36.175Z] finished: Thu Nov 06 00:39:44 UTC 2025 [2025-11-06T00:40:36.175Z] elapsed time (seconds): 0.828 [2025-11-06T00:40:36.175Z] configuration: [2025-11-06T00:40:36.175Z] Boot Layer (javac runtime environment) [2025-11-06T00:40:36.175Z] class path: /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/javatest.jar [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/jtreg.jar [2025-11-06T00:40:36.175Z] patch: java.base /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/patches/java.base [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] javac compilation environment [2025-11-06T00:40:36.175Z] add modules: java.base java.net.http java.logging jdk.httpserver [2025-11-06T00:40:36.175Z] add exports: java.base/sun.net ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.base/sun.net.www ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.base/sun.net.www.http ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.common ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.frame ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.hpack ALL-UNNAMED [2025-11-06T00:40:36.175Z] source path: /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/lib [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/lib [2025-11-06T00:40:36.175Z] class path: /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/testng-7.3.0.jar [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/guice-5.1.0.jar [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/jcommander-1.82.jar [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] rerun: [2025-11-06T00:40:36.175Z] cd /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/scratch/1 && \ [2025-11-06T00:40:36.175Z] DISPLAY=:0 \ [2025-11-06T00:40:36.175Z] HOME=/home/jenkins \ [2025-11-06T00:40:36.175Z] LANG=C.UTF-8 \ [2025-11-06T00:40:36.175Z] PATH=/bin:/usr/bin:/usr/sbin \ [2025-11-06T00:40:36.175Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image/bin/javac \ [2025-11-06T00:40:36.175Z] -J-ea \ [2025-11-06T00:40:36.175Z] -J-esa \ [2025-11-06T00:40:36.175Z] -J-Xmx512m \ [2025-11-06T00:40:36.175Z] -J-XX:-UseCompressedOops \ [2025-11-06T00:40:36.175Z] -J-Dtest.vm.opts='-ea -esa -Xmx512m -XX:-UseCompressedOops' \ [2025-11-06T00:40:36.175Z] -J-Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m -J-XX:-UseCompressedOops' \ [2025-11-06T00:40:36.175Z] -J-Dtest.compiler.opts= \ [2025-11-06T00:40:36.175Z] -J-Dtest.java.opts= \ [2025-11-06T00:40:36.175Z] -J-Dtest.jdk=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image \ [2025-11-06T00:40:36.175Z] -J-Dcompile.jdk=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image \ [2025-11-06T00:40:36.175Z] -J-Dtest.timeout.factor=12.0 \ [2025-11-06T00:40:36.175Z] -J-Dtest.nativepath=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/openjdk-test-image/jdk/jtreg/native \ [2025-11-06T00:40:36.175Z] -J-Dtest.root=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk \ [2025-11-06T00:40:36.175Z] -J-Dtest.name=java/net/httpclient/AggregateRequestBodyTest.java \ [2025-11-06T00:40:36.175Z] -J-Dtest.file=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/AggregateRequestBodyTest.java \ [2025-11-06T00:40:36.175Z] -J-Dtest.src=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient \ [2025-11-06T00:40:36.175Z] -J-Dtest.src.path=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.175Z] -J-Dtest.classes=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d \ [2025-11-06T00:40:36.175Z] -J-Dtest.class.path=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.175Z] -J-Dtest.class.path.prefix=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.175Z] -J-Dtest.modules='java.base/sun.net.www.http java.base/sun.net.www java.base/sun.net java.net.http/jdk.internal.net.http.common java.net.http/jdk.internal.net.http.frame java.net.http/jdk.internal.net.http.hpack java.logging jdk.httpserver' \ [2025-11-06T00:40:36.175Z] --add-modules java.base,java.net.http,java.logging,jdk.httpserver \ [2025-11-06T00:40:36.175Z] --add-exports java.base/sun.net.www.http=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] --add-exports java.base/sun.net.www=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] --add-exports java.base/sun.net=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] --add-exports java.net.http/jdk.internal.net.http.common=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] --add-exports java.net.http/jdk.internal.net.http.frame=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] --add-exports java.net.http/jdk.internal.net.http.hpack=ALL-UNNAMED \ [2025-11-06T00:40:36.175Z] -d /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d \ [2025-11-06T00:40:36.175Z] -sourcepath /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.175Z] -classpath /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/testng-7.3.0.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/guice-5.1.0.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/jcommander-1.82.jar /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/ReferenceTracker.java /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/AggregateRequestBodyTest.java [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] ACTION: build -- Passed. All files up to date [2025-11-06T00:40:36.175Z] REASON: Named class compiled on demand [2025-11-06T00:40:36.175Z] TIME: 0.0 seconds [2025-11-06T00:40:36.175Z] messages: [2025-11-06T00:40:36.175Z] command: build AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] reason: Named class compiled on demand [2025-11-06T00:40:36.175Z] started: Thu Nov 06 00:39:44 UTC 2025 [2025-11-06T00:40:36.175Z] finished: Thu Nov 06 00:39:44 UTC 2025 [2025-11-06T00:40:36.175Z] elapsed time (seconds): 0.0 [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] ACTION: testng -- Failed. Execution failed: `main' threw exception: java.lang.Exception: failures: 1 [2025-11-06T00:40:36.175Z] REASON: User specified action: run testng/othervm -Djdk.internal.httpclient.debug=true -Djdk.httpclient.HttpClient.log=requests,responses,errors AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] TIME: 50.358 seconds [2025-11-06T00:40:36.175Z] messages: [2025-11-06T00:40:36.175Z] command: testng -Djdk.internal.httpclient.debug=true -Djdk.httpclient.HttpClient.log=requests,responses,errors AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] reason: User specified action: run testng/othervm -Djdk.internal.httpclient.debug=true -Djdk.httpclient.HttpClient.log=requests,responses,errors AggregateRequestBodyTest [2025-11-06T00:40:36.175Z] started: Thu Nov 06 00:39:44 UTC 2025 [2025-11-06T00:40:36.175Z] Mode: othervm [/othervm specified] [2025-11-06T00:40:36.175Z] Additional options from @modules: --add-modules java.base,java.net.http,java.logging,jdk.httpserver --add-exports java.base/sun.net.www.http=ALL-UNNAMED --add-exports java.base/sun.net.www=ALL-UNNAMED --add-exports java.base/sun.net=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.common=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.frame=ALL-UNNAMED --add-exports java.net.http/jdk.internal.net.http.hpack=ALL-UNNAMED [2025-11-06T00:40:36.175Z] finished: Thu Nov 06 00:40:35 UTC 2025 [2025-11-06T00:40:36.175Z] elapsed time (seconds): 50.358 [2025-11-06T00:40:36.175Z] configuration: [2025-11-06T00:40:36.175Z] Boot Layer [2025-11-06T00:40:36.175Z] add modules: java.base java.net.http java.logging jdk.httpserver [2025-11-06T00:40:36.175Z] add exports: java.base/sun.net ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.base/sun.net.www ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.base/sun.net.www.http ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.common ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.frame ALL-UNNAMED [2025-11-06T00:40:36.175Z] java.net.http/jdk.internal.net.http.hpack ALL-UNNAMED [2025-11-06T00:40:36.175Z] [2025-11-06T00:40:36.175Z] STDOUT: [2025-11-06T00:40:36.175Z] Http1TestServer[localhost/127.0.0.1:33471]::addHandler jdk.httpclient.test.lib.common.HttpServerAdapters$HttpTestEchoHandler@3d2aa83f, /http1/echo/ [2025-11-06T00:40:36.175Z] Http1TestServer[localhost/127.0.0.1:35211]::addHandler jdk.httpclient.test.lib.common.HttpServerAdapters$HttpTestEchoHandler@3d2aa83f, /https1/echo/ [2025-11-06T00:40:36.175Z] Http2TestServerImpl[localhost/127.0.0.1:36991]::addHandler jdk.httpclient.test.lib.common.HttpServerAdapters$HttpTestEchoHandler@3d2aa83f, /http2/echo/ [2025-11-06T00:40:36.175Z] Http2TestServerImpl[localhost/127.0.0.1:56913]::addHandler jdk.httpclient.test.lib.common.HttpServerAdapters$HttpTestEchoHandler@3d2aa83f, /https2/echo/ [2025-11-06T00:40:36.175Z] Http1TestServer: start [2025-11-06T00:40:36.175Z] Http1TestServer: start [2025-11-06T00:40:36.175Z] Http2TestServerImpl: start [2025-11-06T00:40:36.175Z] Http2TestServerImpl: start [2025-11-06T00:40:36.175Z] config AggregateRequestBodyTest.setup(): success [2025-11-06T00:40:36.175Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.175Z] Request to http://127.0.0.1:33471/http1/echo/x [2025-11-06T00:40:36.175Z] Iteration: 0 [2025-11-06T00:40:36.175Z] test AggregateRequestBodyTest.test("http://127.0.0.1:33471/http1/echo/x", false): failure [2025-11-06T00:40:36.175Z] java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.HttpClientImpl.send(HttpClientImpl.java:970) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.HttpClientFacade.send(HttpClientFacade.java:133) [2025-11-06T00:40:36.175Z] at AggregateRequestBodyTest.test(AggregateRequestBodyTest.java:806) [2025-11-06T00:40:36.175Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.175Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.175Z] at org.testng.internal.MethodInvocationHelper.invokeMethod(MethodInvocationHelper.java:132) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestInvoker.invokeMethod(TestInvoker.java:599) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestInvoker.invokeTestMethod(TestInvoker.java:174) [2025-11-06T00:40:36.175Z] at org.testng.internal.MethodRunner.runInSequence(MethodRunner.java:46) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestInvoker$MethodInvocationAgent.invoke(TestInvoker.java:822) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestInvoker.invokeTestMethods(TestInvoker.java:147) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestMethodWorker.invokeTestMethods(TestMethodWorker.java:146) [2025-11-06T00:40:36.175Z] at org.testng.internal.TestMethodWorker.run(TestMethodWorker.java:128) [2025-11-06T00:40:36.175Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.175Z] at org.testng.TestRunner.privateRun(TestRunner.java:764) [2025-11-06T00:40:36.175Z] at org.testng.TestRunner.run(TestRunner.java:585) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunner.runTest(SuiteRunner.java:384) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunner.runSequentially(SuiteRunner.java:378) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunner.privateRun(SuiteRunner.java:337) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunner.run(SuiteRunner.java:286) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunnerWorker.runSuite(SuiteRunnerWorker.java:53) [2025-11-06T00:40:36.175Z] at org.testng.SuiteRunnerWorker.run(SuiteRunnerWorker.java:96) [2025-11-06T00:40:36.175Z] at org.testng.TestNG.runSuitesSequentially(TestNG.java:1218) [2025-11-06T00:40:36.175Z] at org.testng.TestNG.runSuitesLocally(TestNG.java:1140) [2025-11-06T00:40:36.175Z] at org.testng.TestNG.runSuites(TestNG.java:1069) [2025-11-06T00:40:36.175Z] at org.testng.TestNG.run(TestNG.java:1037) [2025-11-06T00:40:36.175Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:102) [2025-11-06T00:40:36.175Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:58) [2025-11-06T00:40:36.175Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.175Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.175Z] at com.sun.javatest.regtest.agent.MainWrapper$MainTask.run(MainWrapper.java:138) [2025-11-06T00:40:36.175Z] at java.base/java.lang.Thread.run(Thread.java:1583) [2025-11-06T00:40:36.175Z] Caused by: java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.Utils.wrapWithExtraDetail(Utils.java:412) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.Http1Response$HeadersReader.onReadError(Http1Response.java:590) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.checkForErrors(Http1AsyncReceiver.java:302) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.flush(Http1AsyncReceiver.java:268) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$LockingRestartableTask.run(SequentialScheduler.java:182) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$CompleteRestartableTask.run(SequentialScheduler.java:149) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.175Z] at AggregateRequestBodyTest$TestExecutor.lambda$execute$0(AggregateRequestBodyTest.java:142) [2025-11-06T00:40:36.175Z] at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2025-11-06T00:40:36.175Z] at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2025-11-06T00:40:36.175Z] ... 1 more [2025-11-06T00:40:36.175Z] Caused by: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber.onComplete(Http1AsyncReceiver.java:601) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadSubscription.signalCompletion(SocketTube.java:648) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.read(SocketTube.java:853) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowTask.run(SocketTube.java:181) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.175Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:280) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:233) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.signalReadable(SocketTube.java:782) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent.signalEvent(SocketTube.java:965) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowEvent.handle(SocketTube.java:253) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.handleEvent(HttpClientImpl.java:1477) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.lambda$run$3(HttpClientImpl.java:1422) [2025-11-06T00:40:36.176Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.run(HttpClientImpl.java:1422) [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("https://127.0.0.1:35211/https1/echo/x", false): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("http://127.0.0.1:36991/http2/echo/x", false): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("https://127.0.0.1:56913/https2/echo/x", false): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("http://127.0.0.1:33471/http1/echo/x", true): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("https://127.0.0.1:35211/https1/echo/x", true): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("http://127.0.0.1:36991/http2/echo/x", true): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.test("https://127.0.0.1:56913/https2/echo/x", true): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testCancel(): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testCancelSubscription(): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [-1]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-42, [-42]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(42, [42]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(42, [10, 0, 20, 0, 12]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [10, 0, 20, -1, 12]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [-1, 0, 20, 10, 12]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [10, 0, 20, 12, -1]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [10, 0, 20, -10, 12]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [-10, 0, 20, 10, 12]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, [10, 0, 20, 12, -10]): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@7a60f232): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@546ad3c5): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@4ff0adff): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(9223372036854775807, java.util.ArrayList@bd95b78): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@377eaeba): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@3678ccb2): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@33279295): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@21faaf2f): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@7ebe033d): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@2546e18b): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@5099c4b8): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testContentLength(-1, java.util.ArrayList@4c23a78c): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testEmpty(): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNegativeRequest(0): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNegativeRequest(-1): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNegativeRequest(-2): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNegativeRequest(-9223372036854775807): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNegativeRequest(-9223372036854775808): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null array", null): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null element", [Ljava.lang.String;@66bc1f37): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null first element", [Ljava.lang.String;@45a1f3c9): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null second element", [Ljava.lang.String;@59e4f677): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null third element", [Ljava.lang.String;@2971d44f): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null fourth element", [Ljava.lang.String;@7670fc90): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testNullPointerException("null random element", [Ljava.lang.String;@4ac42f94): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null array", null): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null element", [Ljava.lang.String;@2812a464): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null first element", [Ljava.lang.String;@7a4cc38f): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null second element", [Ljava.lang.String;@3a9d0940): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null third element", [Ljava.lang.String;@59552ac8): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null fourth element", [Ljava.lang.String;@2516eed8): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testOnError("null random element", [Ljava.lang.String;@71b4d3f8): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testPositiveRequests(): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null array", null): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null element", [Ljava.lang.String;@2a82cbcb): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null first element", [Ljava.lang.String;@5d8579c1): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null second element", [Ljava.lang.String;@2ec424f2): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null third element", [Ljava.lang.String;@4281e229): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null fourth element", [Ljava.lang.String;@22540380): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.beforeMethod(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] test AggregateRequestBodyTest.testUnknownContentLength("null random element", [Ljava.lang.String;@503c24b6): skip [2025-11-06T00:40:36.176Z] org.testng.SkipException: some tests failed [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] ========================= [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] [41 s, 289 ms, 389912 ns] Created 4 servers and 1 clients [2025-11-06T00:40:36.176Z] Failed tests: [2025-11-06T00:40:36.176Z] test[http://127.0.0.1:33471/http1/echo/x, false]: java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.176Z] java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl.send(HttpClientImpl.java:970) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientFacade.send(HttpClientFacade.java:133) [2025-11-06T00:40:36.176Z] at AggregateRequestBodyTest.test(AggregateRequestBodyTest.java:806) [2025-11-06T00:40:36.176Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.176Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.176Z] at org.testng.internal.MethodInvocationHelper.invokeMethod(MethodInvocationHelper.java:132) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestInvoker.invokeMethod(TestInvoker.java:599) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestInvoker.invokeTestMethod(TestInvoker.java:174) [2025-11-06T00:40:36.176Z] at org.testng.internal.MethodRunner.runInSequence(MethodRunner.java:46) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestInvoker$MethodInvocationAgent.invoke(TestInvoker.java:822) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestInvoker.invokeTestMethods(TestInvoker.java:147) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestMethodWorker.invokeTestMethods(TestMethodWorker.java:146) [2025-11-06T00:40:36.176Z] at org.testng.internal.TestMethodWorker.run(TestMethodWorker.java:128) [2025-11-06T00:40:36.176Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.176Z] at org.testng.TestRunner.privateRun(TestRunner.java:764) [2025-11-06T00:40:36.176Z] at org.testng.TestRunner.run(TestRunner.java:585) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunner.runTest(SuiteRunner.java:384) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunner.runSequentially(SuiteRunner.java:378) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunner.privateRun(SuiteRunner.java:337) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunner.run(SuiteRunner.java:286) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunnerWorker.runSuite(SuiteRunnerWorker.java:53) [2025-11-06T00:40:36.176Z] at org.testng.SuiteRunnerWorker.run(SuiteRunnerWorker.java:96) [2025-11-06T00:40:36.176Z] at org.testng.TestNG.runSuitesSequentially(TestNG.java:1218) [2025-11-06T00:40:36.176Z] at org.testng.TestNG.runSuitesLocally(TestNG.java:1140) [2025-11-06T00:40:36.176Z] at org.testng.TestNG.runSuites(TestNG.java:1069) [2025-11-06T00:40:36.176Z] at org.testng.TestNG.run(TestNG.java:1037) [2025-11-06T00:40:36.176Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:102) [2025-11-06T00:40:36.176Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:58) [2025-11-06T00:40:36.176Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.176Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.176Z] at com.sun.javatest.regtest.agent.MainWrapper$MainTask.run(MainWrapper.java:138) [2025-11-06T00:40:36.176Z] at java.base/java.lang.Thread.run(Thread.java:1583) [2025-11-06T00:40:36.176Z] Caused by: java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.Utils.wrapWithExtraDetail(Utils.java:412) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.Http1Response$HeadersReader.onReadError(Http1Response.java:590) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.checkForErrors(Http1AsyncReceiver.java:302) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.flush(Http1AsyncReceiver.java:268) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$LockingRestartableTask.run(SequentialScheduler.java:182) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$CompleteRestartableTask.run(SequentialScheduler.java:149) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.176Z] at AggregateRequestBodyTest$TestExecutor.lambda$execute$0(AggregateRequestBodyTest.java:142) [2025-11-06T00:40:36.176Z] at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2025-11-06T00:40:36.176Z] at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2025-11-06T00:40:36.176Z] ... 1 more [2025-11-06T00:40:36.176Z] Caused by: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber.onComplete(Http1AsyncReceiver.java:601) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadSubscription.signalCompletion(SocketTube.java:648) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.read(SocketTube.java:853) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowTask.run(SocketTube.java:181) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:280) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:233) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.signalReadable(SocketTube.java:782) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent.signalEvent(SocketTube.java:965) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowEvent.handle(SocketTube.java:253) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.handleEvent(HttpClientImpl.java:1477) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.lambda$run$3(HttpClientImpl.java:1422) [2025-11-06T00:40:36.176Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.176Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.run(HttpClientImpl.java:1422) [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] ========================= [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.printFailedTests(org.testng.TestRunner@11c13a1b): success [2025-11-06T00:40:36.176Z] No outstanding HTTP operations remaining after 0/50 iterations and 0/500 ms, (wait/iteration 10 ms) [2025-11-06T00:40:36.176Z] PASSED: No outstanding operations or unreleased resources found in 1 clients in 18 ms [2025-11-06T00:40:36.176Z] Http1TestServer: stop [2025-11-06T00:40:36.176Z] Http1TestServer: stop [2025-11-06T00:40:36.176Z] Http2TestServerImpl: stop [2025-11-06T00:40:36.176Z] Http2TestServerImpl: stop [2025-11-06T00:40:36.176Z] config AggregateRequestBodyTest.teardown(): success [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] =============================================== [2025-11-06T00:40:36.176Z] java/net/httpclient/AggregateRequestBodyTest.java [2025-11-06T00:40:36.176Z] Total tests run: 60, Passes: 0, Failures: 1, Skips: 59 [2025-11-06T00:40:36.176Z] =============================================== [2025-11-06T00:40:36.176Z] [2025-11-06T00:40:36.176Z] STDERR: [2025-11-06T00:40:36.176Z] TestServer(1): accepting connections [2025-11-06T00:40:36.176Z] TestServer(2): accepting connections [2025-11-06T00:40:36.176Z] DEBUG: [MainThread] [38ms] HttpClientImpl(1) proxySelector is java.net.ProxySelector$StaticProxySelector@21ed83aa (user-supplied=true) [2025-11-06T00:40:36.176Z] DEBUG: [MainThread] [98ms] HttpClientImpl(1) ClientImpl (async) send http://127.0.0.1:33471/http1/echo/x POST [2025-11-06T00:40:36.176Z] DEBUG: [MainThread] [125ms] Exchange establishing exchange for http://127.0.0.1:33471/http1/echo/x POST, [2025-11-06T00:40:36.176Z] proxy=null [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [150ms] Http2ClientImpl not found in connection pool [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [150ms] ExchangeImpl get: Trying to get HTTP/2 connection [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [150ms] ExchangeImpl handling HTTP/2 connection creation result [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [151ms] ExchangeImpl new Http1Exchange, try to upgrade [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [173ms] PlainHttpConnection(?) Initial receive buffer size is: 65536 [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [173ms] PlainHttpConnection(?) Initial send buffer size is: 8192 [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [200ms] Exchange checkFor407: all clear [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [200ms] Http1Exchange Sending headers only [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [213ms] Http1AsyncReceiver(SocketTube(1)) Subscribed pending jdk.internal.net.http.Http1Response$HeadersReader@6111e77f queue.isEmpty: true [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [247ms] Http1AsyncReceiver(SocketTube(1)) delegate is now jdk.internal.net.http.Http1Response$HeadersReader@6111e77f, demand=1, canRequestMore=true, queue.isEmpty=true [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [247ms] Http1AsyncReceiver(SocketTube(1)) downstream subscription demand is 1 [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [256ms] Http1AsyncReceiver(SocketTube(1)) checkRequestMore: canRequestMore=true, hasDemand=true [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [256ms] Http1AsyncReceiver(SocketTube(1)) downstream subscription demand is 1 [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [256ms] Http1AsyncReceiver(SocketTube(1)) checkRequestMore: canRequestMore=true, hasDemand=true [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [256ms] Http1Exchange response created in advance [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [256ms] Http1Exchange initiating connect async [2025-11-06T00:40:36.177Z] DEBUG: [MainThread] [258ms] PlainHttpConnection(SocketTube(1)) registering connect event [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [269ms] SelectorAttachment Registering jdk.internal.net.http.PlainHttpConnection$ConnectEvent@5375c5ab for 8 (true) [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [288ms] PlainHttpConnection(SocketTube(1)) ConnectEvent: finishing connect [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [292ms] PlainHttpConnection(SocketTube(1)) ConnectEvent: connect finished: true, cancelled: false, Local addr: /127.0.0.1:54304 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [315ms] PlainHttpConnection(SocketTube(1)) finishConnect, setting connected=true [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [316ms] Http1Exchange SocketTube(1) connecting flows [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [316ms] SocketTube(1) connecting flows [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [317ms] SocketTube(1) read publisher got subscriber [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [317ms] SocketTube(1) registering subscribe event [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [317ms] SocketTube(1) leaving read.subscribe: Reading: [ops=0, demand=0, stopped=false], Writing: [ops=0, demand=0] [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [318ms] Http1Publisher(SocketTube(1)) got subscriber: SocketTube(1) [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [320ms] SocketTube(1) subscribed for writing [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [322ms] SocketTube(1) write: registering startSubscription event [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [322ms] Http1Exchange requestAction.headers [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [323ms] SocketTube(1) subscribe event raised [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [324ms] SocketTube(1) handling pending subscription for jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber@760d0095 [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [324ms] SocketTube(1) read demand reset to 0 [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [324ms] SocketTube(1) calling onSubscribe [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [324ms] Http1AsyncReceiver(SocketTube(1)) Received onSubscribed from upstream [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [328ms] SocketTube(1) onSubscribe called [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [328ms] SocketTube(1) pending subscriber subscribed [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [328ms] Http1AsyncReceiver(SocketTube(1)) downstream subscription demand is 1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [329ms] Http1AsyncReceiver(SocketTube(1)) checkRequestMore: canRequestMore=true, hasDemand=true [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [329ms] Http1AsyncReceiver(SocketTube(1)) Http1TubeSubscriber: requesting one more from upstream [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [329ms] SocketTube(1) got some demand for reading [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [329ms] SocketTube(1) resuming read event [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [330ms] SocketTube(1) leaving request(1): Reading: [ops=1, demand=1, stopped=false], Writing: [ops=0, demand=0] [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [328ms] SocketTube(1) write: starting subscription [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [331ms] SocketTube(1) write: offloading requestMore [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [332ms] SelectorAttachment Registering jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent@26009efd for 1 (true) [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [343ms] SocketTube(1) write: requesting more... [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [344ms] Http1Publisher(SocketTube(1)) subscription request(1), demand=1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [344ms] Http1Publisher(SocketTube(1)) WriteTask [2025-11-06T00:40:36.177Z] Nov 06, 2025 12:39:48 AM jdk.internal.net.http.Http1Request headers [2025-11-06T00:40:36.177Z] INFO: REQUEST: http://127.0.0.1:33471/http1/echo/x POST [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [384ms] Http1Publisher(SocketTube(1)) hasOutgoing = false, demand = 1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [384ms] SocketTube(1) leaving requestMore: Reading: [ops=1, demand=1, stopped=false], Writing: [ops=0, demand=1] [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 392ms] SelectorAttachment Registering jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent@26009efd for 0 (false) [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 393ms] SocketTube(1) got read EOF [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 393ms] SocketTube(1) pausing read event [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 394ms] SelectorAttachment Registering jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent@26009efd for 0 (false) [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 394ms] SocketTube(1) completing subscriber [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 394ms] Http1AsyncReceiver(SocketTube(1)) onError: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [31s 406ms] Http1AsyncReceiver(SocketTube(1)) recorded jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] delegate: jdk.internal.net.http.Http1Response$HeadersReader@6111e77f [2025-11-06T00:40:36.177Z] queue.isEmpty: true [2025-11-06T00:40:36.177Z] stopRequested: false jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.onReadError(Http1AsyncReceiver.java:494) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber.onComplete(Http1AsyncReceiver.java:601) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadSubscription.signalCompletion(SocketTube.java:648) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.read(SocketTube.java:853) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowTask.run(SocketTube.java:181) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:280) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:233) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.signalReadable(SocketTube.java:782) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent.signalEvent(SocketTube.java:965) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowEvent.handle(SocketTube.java:253) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.handleEvent(HttpClientImpl.java:1477) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.lambda$run$3(HttpClientImpl.java:1422) [2025-11-06T00:40:36.177Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.run(HttpClientImpl.java:1422) [2025-11-06T00:40:36.177Z] Caused by: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.177Z] ... 14 more [2025-11-06T00:40:36.177Z] Nov 06, 2025 12:40:27 AM jdk.internal.net.http.Http1AsyncReceiver onReadError [2025-11-06T00:40:36.177Z] INFO: ERROR: HTTP/1 read subscriber recorded error: http://127.0.0.1:33471/http1/echo/x POST - jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] Nov 06, 2025 12:40:27 AM jdk.internal.net.http.Http1AsyncReceiver onReadError [2025-11-06T00:40:36.177Z] INFO: ERROR: HTTP/1 propagating recorded error: http://127.0.0.1:33471/http1/echo/x POST - jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [38s 952ms] SocketTube(1) Stopping read scheduler [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [38s 952ms] SocketTube(1) leaving read() loop after EOF: Reading: [ops=0, demand=0, stopped=true], Writing: [ops=0, demand=1] [2025-11-06T00:40:36.177Z] DEBUG: [HttpClient-1-SelectorManager] [38s 952ms] SocketTube(1) Read scheduler stopped [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 952ms] Http1Exchange setting outgoing with headers [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 953ms] Http1Exchange appending to outgoing DataPair [data=[java.nio.HeapByteBuffer[pos=0 lim=235 cap=235]], throwable=null] [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 953ms] Http1Publisher(SocketTube(1)) WriteTask [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 954ms] Http1Publisher(SocketTube(1)) hasOutgoing = true, demand = 1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 954ms] Http1Exchange initiating completion of headersSentCF [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 955ms] Http1Publisher(SocketTube(1)) outgoing: DataPair [data=[java.nio.HeapByteBuffer[pos=0 lim=235 cap=235]], throwable=null] [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [38s 955ms] Http1AsyncReceiver(SocketTube(1)) downstream subscription demand is 1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [38s 955ms] Http1AsyncReceiver(SocketTube(1)) checkRequestMore: canRequestMore=false, hasDemand=true [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [38s 955ms] Http1AsyncReceiver(SocketTube(1)) Http1TubeSubscriber: no need to request more [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 955ms] Http1Publisher(SocketTube(1)) onNext with 235 bytes [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 956ms] SocketTube(1) trying to write: 235 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-2] [38s 956ms] Http1AsyncReceiver(SocketTube(1)) flushing jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] delegate: jdk.internal.net.http.Http1Response$HeadersReader@6111e77f queue.isEmpty: true [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 957ms] SocketTube(1) wrote: 235 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] SocketTube(1) write: requesting more... [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Http1Publisher(SocketTube(1)) subscription request(1), demand=1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] SocketTube(1) leaving requestMore: Reading: [ops=0, demand=0, stopped=true], Writing: [ops=0, demand=1] [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] SocketTube(1) leaving w.onNext Reading: [ops=0, demand=0, stopped=true], Writing: [ops=0, demand=1] [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Http1Publisher(SocketTube(1)) WriteTask [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Http1Publisher(SocketTube(1)) hasOutgoing = false, demand = 1 [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Exchange checkFor407: all clear [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Exchange sendRequestBody [2025-11-06T00:40:36.177Z] DEBUG: [pool-1-thread-1] [38s 958ms] Http1Exchange sendBodyAsync [2025-11-06T00:40:36.177Z] Nov 06, 2025 12:40:27 AM jdk.internal.net.http.Http1Response onReadError [2025-11-06T00:40:36.177Z] INFO: ERROR: jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.common.Utils.wrapWithExtraDetail(Utils.java:413) [2025-11-06T00:40:36.177Z] at java.net.http/jdk.internal.net.http.Http1Response$HeadersReader.onReadError(Http1Response.java:590) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.checkForErrors(Http1AsyncReceiver.java:302) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.flush(Http1AsyncReceiver.java:268) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$LockingRestartableTask.run(SequentialScheduler.java:182) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$CompleteRestartableTask.run(SequentialScheduler.java:149) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.180Z] at AggregateRequestBodyTest$TestExecutor.lambda$execute$0(AggregateRequestBodyTest.java:142) [2025-11-06T00:40:36.180Z] at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2025-11-06T00:40:36.180Z] at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2025-11-06T00:40:36.180Z] at java.base/java.lang.Thread.run(Thread.java:1583) [2025-11-06T00:40:36.180Z] Caused by: java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.Utils.wrapWithExtraDetail(Utils.java:412) [2025-11-06T00:40:36.180Z] ... 10 more [2025-11-06T00:40:36.180Z] Caused by: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber.onComplete(Http1AsyncReceiver.java:601) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadSubscription.signalCompletion(SocketTube.java:648) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.read(SocketTube.java:853) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowTask.run(SocketTube.java:181) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:280) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:233) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.signalReadable(SocketTube.java:782) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent.signalEvent(SocketTube.java:965) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowEvent.handle(SocketTube.java:253) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.handleEvent(HttpClientImpl.java:1477) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.lambda$run$3(HttpClientImpl.java:1422) [2025-11-06T00:40:36.180Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.run(HttpClientImpl.java:1422) [2025-11-06T00:40:36.180Z] [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 960ms] Http1Exchange bodySubscriber is class jdk.internal.net.http.Http1Request$FixedContentSubscriber [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 962ms] Http1Exchange requesting more request body from the subscriber [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 962ms] jdk.internal.net.http.Http1Request@493361cd Http1BodySubscriber requesting 1, from jdk.internal.net.http.RequestPublishers$AggregateSubscription@161062b [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 966ms] jdk.internal.net.http.Http1Request@493361cd onNext [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 967ms] Http1Exchange appending to outgoing DataPair [data=[java.nio.HeapByteBuffer[pos=0 lim=11 cap=11]], throwable=null] [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 967ms] Http1Publisher(SocketTube(1)) WriteTask [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 967ms] Http1Publisher(SocketTube(1)) hasOutgoing = true, demand = 1 [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 968ms] Http1Exchange requesting more request body from the subscriber [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 968ms] jdk.internal.net.http.Http1Request@493361cd Http1BodySubscriber requesting 1, from jdk.internal.net.http.RequestPublishers$AggregateSubscription@161062b [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 968ms] Http1Publisher(SocketTube(1)) outgoing: DataPair [data=[java.nio.HeapByteBuffer[pos=0 lim=11 cap=11]], throwable=null] [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 968ms] Http1Publisher(SocketTube(1)) onNext with 11 bytes [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 968ms] SocketTube(1) trying to write: 11 [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 969ms] SocketTube(1) write error: java.io.IOException: Broken pipe [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] SocketTube(1) error signalled java.io.IOException: Broken pipe [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] SocketTube(1) write: cancel [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] SocketTube(1) write: resetting demand to 0 [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] Http1Publisher(SocketTube(1)) subscription cancelled [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] SocketTube(1) leaving w.onNext Reading: [ops=0, demand=0, stopped=true], Writing: [ops=0, demand=0] [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] Http1Publisher(SocketTube(1)) WriteTask [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] Http1Publisher(SocketTube(1)) handling cancellation [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 970ms] Http1Exchange cancelling upstream publisher [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 970ms] Http1Response(id=1, PlainHttpConnection(SocketTube(1))) onReadError: cf is not yet completed [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 974ms] Http1Response(id=1, PlainHttpConnection(SocketTube(1))) closing connection: cause is jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 979ms] PlainHttpConnection(SocketTube(1)) Closing channel: channel registered with selector, key.interestOps=0, sa.interestOps=0 [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 979ms] Http1Exchange sendBodyAsync completed successfully [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 979ms] SocketTube(1) signal read error: java.io.IOException: connection closed locally [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 980ms] Http1Exchange asyncReceiver finished (failed=jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished) [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 980ms] Http1Exchange reading headers [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-2] [38s 980ms] Http1Exchange asyncReceiver finished (failed=jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished) [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 980ms] Http1Response(id=1, PlainHttpConnection(SocketTube(1))) Reading Headers: (remaining: 0) READING_HEADERS [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 980ms] Http1Response(id=1, PlainHttpConnection(SocketTube(1))) First time around [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 981ms] Http1Response(id=1, PlainHttpConnection(SocketTube(1))) headersReader is already completed [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [38s 982ms] Http1Exchange getResponseAsync completed java.util.concurrent.CompletionException: jdk.internal.net.http.common.ConnectionExpiredException: subscription is finished [2025-11-06T00:40:36.180Z] DEBUG: [pool-1-thread-1] [39s 1ms] HttpClientImpl(1) ClientImpl (async) elapsed 38886 millis for POST to http://127.0.0.1:33471/http1/echo/x [2025-11-06T00:40:36.180Z] DEBUG: [HttpClient-1-SelectorManager] [39s 159ms] HttpClientImpl(1) SelectorManager shutting down [2025-11-06T00:40:36.180Z] DEBUG: [HttpClient-1-SelectorManager] [39s 161ms] Http2ClientImpl stopping [2025-11-06T00:40:36.180Z] java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl.send(HttpClientImpl.java:970) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientFacade.send(HttpClientFacade.java:133) [2025-11-06T00:40:36.180Z] at AggregateRequestBodyTest.test(AggregateRequestBodyTest.java:806) [2025-11-06T00:40:36.180Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.180Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.180Z] at org.testng.internal.MethodInvocationHelper.invokeMethod(MethodInvocationHelper.java:132) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestInvoker.invokeMethod(TestInvoker.java:599) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestInvoker.invokeTestMethod(TestInvoker.java:174) [2025-11-06T00:40:36.180Z] at org.testng.internal.MethodRunner.runInSequence(MethodRunner.java:46) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestInvoker$MethodInvocationAgent.invoke(TestInvoker.java:822) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestInvoker.invokeTestMethods(TestInvoker.java:147) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestMethodWorker.invokeTestMethods(TestMethodWorker.java:146) [2025-11-06T00:40:36.180Z] at org.testng.internal.TestMethodWorker.run(TestMethodWorker.java:128) [2025-11-06T00:40:36.180Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.180Z] at org.testng.TestRunner.privateRun(TestRunner.java:764) [2025-11-06T00:40:36.180Z] at org.testng.TestRunner.run(TestRunner.java:585) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunner.runTest(SuiteRunner.java:384) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunner.runSequentially(SuiteRunner.java:378) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunner.privateRun(SuiteRunner.java:337) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunner.run(SuiteRunner.java:286) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunnerWorker.runSuite(SuiteRunnerWorker.java:53) [2025-11-06T00:40:36.180Z] at org.testng.SuiteRunnerWorker.run(SuiteRunnerWorker.java:96) [2025-11-06T00:40:36.180Z] at org.testng.TestNG.runSuitesSequentially(TestNG.java:1218) [2025-11-06T00:40:36.180Z] at org.testng.TestNG.runSuitesLocally(TestNG.java:1140) [2025-11-06T00:40:36.180Z] at org.testng.TestNG.runSuites(TestNG.java:1069) [2025-11-06T00:40:36.180Z] at org.testng.TestNG.run(TestNG.java:1037) [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:102) [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:58) [2025-11-06T00:40:36.180Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.180Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.MainWrapper$MainTask.run(MainWrapper.java:138) [2025-11-06T00:40:36.180Z] at java.base/java.lang.Thread.run(Thread.java:1583) [2025-11-06T00:40:36.180Z] Caused by: java.io.IOException: HTTP/1.1 header parser received no bytes [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.Utils.wrapWithExtraDetail(Utils.java:412) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1Response$HeadersReader.onReadError(Http1Response.java:590) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.checkForErrors(Http1AsyncReceiver.java:302) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver.flush(Http1AsyncReceiver.java:268) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$LockingRestartableTask.run(SequentialScheduler.java:182) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$CompleteRestartableTask.run(SequentialScheduler.java:149) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.180Z] at AggregateRequestBodyTest$TestExecutor.lambda$execute$0(AggregateRequestBodyTest.java:142) [2025-11-06T00:40:36.180Z] at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1144) [2025-11-06T00:40:36.180Z] at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:642) [2025-11-06T00:40:36.180Z] ... 1 more [2025-11-06T00:40:36.180Z] Caused by: java.io.EOFException: EOF reached while reading [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.Http1AsyncReceiver$Http1TubeSubscriber.onComplete(Http1AsyncReceiver.java:601) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadSubscription.signalCompletion(SocketTube.java:648) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.read(SocketTube.java:853) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowTask.run(SocketTube.java:181) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler$SchedulableTask.run(SequentialScheduler.java:207) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:280) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.common.SequentialScheduler.runOrSchedule(SequentialScheduler.java:233) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$InternalReadSubscription.signalReadable(SocketTube.java:782) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$InternalReadPublisher$ReadEvent.signalEvent(SocketTube.java:965) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.SocketTube$SocketFlowEvent.handle(SocketTube.java:253) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.handleEvent(HttpClientImpl.java:1477) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.lambda$run$3(HttpClientImpl.java:1422) [2025-11-06T00:40:36.180Z] at java.base/java.util.ArrayList.forEach(ArrayList.java:1596) [2025-11-06T00:40:36.180Z] at java.net.http/jdk.internal.net.http.HttpClientImpl$SelectorManager.run(HttpClientImpl.java:1422) [2025-11-06T00:40:36.180Z] TestServer(1): stopping 0 connections [2025-11-06T00:40:36.180Z] TestServer(2): stopping 0 connections [2025-11-06T00:40:36.180Z] TestServer(2): finished [2025-11-06T00:40:36.180Z] TestServer(1): finished [2025-11-06T00:40:36.180Z] java.lang.Exception: failures: 1 [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:104) [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.TestNGRunner.main(TestNGRunner.java:58) [2025-11-06T00:40:36.180Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:103) [2025-11-06T00:40:36.180Z] at java.base/java.lang.reflect.Method.invoke(Method.java:580) [2025-11-06T00:40:36.180Z] at com.sun.javatest.regtest.agent.MainWrapper$MainTask.run(MainWrapper.java:138) [2025-11-06T00:40:36.180Z] at java.base/java.lang.Thread.run(Thread.java:1583) [2025-11-06T00:40:36.180Z] [2025-11-06T00:40:36.180Z] JavaTest Message: Test threw exception: java.lang.Exception: failures: 1 [2025-11-06T00:40:36.180Z] JavaTest Message: shutting down test [2025-11-06T00:40:36.180Z] [2025-11-06T00:40:36.180Z] STATUS:Failed.`main' threw exception: java.lang.Exception: failures: 1 [2025-11-06T00:40:36.180Z] rerun: [2025-11-06T00:40:36.180Z] cd /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/scratch/1 && \ [2025-11-06T00:40:36.180Z] DISPLAY=:0 \ [2025-11-06T00:40:36.180Z] HOME=/home/jenkins \ [2025-11-06T00:40:36.180Z] LANG=C.UTF-8 \ [2025-11-06T00:40:36.180Z] PATH=/bin:/usr/bin:/usr/sbin \ [2025-11-06T00:40:36.180Z] CLASSPATH=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/testng-7.3.0.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/guice-5.1.0.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/jcommander-1.82.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/javatest.jar:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jvmtest/openjdk/jtreg/lib/jtreg.jar \ [2025-11-06T00:40:36.180Z] /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image/bin/java \ [2025-11-06T00:40:36.180Z] -Dtest.vm.opts='-ea -esa -Xmx512m -XX:-UseCompressedOops' \ [2025-11-06T00:40:36.180Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m -J-XX:-UseCompressedOops' \ [2025-11-06T00:40:36.180Z] -Dtest.compiler.opts= \ [2025-11-06T00:40:36.180Z] -Dtest.java.opts= \ [2025-11-06T00:40:36.180Z] -Dtest.jdk=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image \ [2025-11-06T00:40:36.180Z] -Dcompile.jdk=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/j2sdk-image \ [2025-11-06T00:40:36.180Z] -Dtest.timeout.factor=12.0 \ [2025-11-06T00:40:36.180Z] -Dtest.nativepath=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/openjdk-test-image/jdk/jtreg/native \ [2025-11-06T00:40:36.180Z] -Dtest.root=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk \ [2025-11-06T00:40:36.180Z] -Dtest.name=java/net/httpclient/AggregateRequestBodyTest.java \ [2025-11-06T00:40:36.180Z] -Dtest.file=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/AggregateRequestBodyTest.java \ [2025-11-06T00:40:36.180Z] -Dtest.src=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient \ [2025-11-06T00:40:36.181Z] -Dtest.src.path=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.181Z] -Dtest.classes=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d \ [2025-11-06T00:40:36.181Z] -Dtest.class.path=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.181Z] -Dtest.class.path.prefix=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/java/net/httpclient/AggregateRequestBodyTest.d:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/net/httpclient:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/lib:/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/classes/0/test/jdk/java/net/httpclient/lib \ [2025-11-06T00:40:36.181Z] -Dtest.modules='java.base/sun.net.www.http java.base/sun.net.www java.base/sun.net java.net.http/jdk.internal.net.http.common java.net.http/jdk.internal.net.http.frame java.net.http/jdk.internal.net.http.hpack java.logging jdk.httpserver' \ [2025-11-06T00:40:36.181Z] --add-modules java.base,java.net.http,java.logging,jdk.httpserver \ [2025-11-06T00:40:36.181Z] --add-exports java.base/sun.net.www.http=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] --add-exports java.base/sun.net.www=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] --add-exports java.base/sun.net=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] --add-exports java.net.http/jdk.internal.net.http.common=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] --add-exports java.net.http/jdk.internal.net.http.frame=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] --add-exports java.net.http/jdk.internal.net.http.hpack=ALL-UNNAMED \ [2025-11-06T00:40:36.181Z] -ea \ [2025-11-06T00:40:36.181Z] -esa \ [2025-11-06T00:40:36.181Z] -Xmx512m \ [2025-11-06T00:40:36.181Z] -XX:-UseCompressedOops \ [2025-11-06T00:40:36.181Z] -Djava.library.path=/home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/jdkbinary/openjdk-test-image/jdk/jtreg/native \ [2025-11-06T00:40:36.181Z] -Djdk.internal.httpclient.debug=true \ [2025-11-06T00:40:36.181Z] -Djdk.httpclient.HttpClient.log=requests,responses,errors \ [2025-11-06T00:40:36.181Z] com.sun.javatest.regtest.agent.MainWrapper /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7/aqa-tests/TKG/output_17623859943816/jdk_net_1/work/java/net/httpclient/AggregateRequestBodyTest.d/testng.0.jta java/net/httpclient/AggregateRequestBodyTest.java false AggregateRequestBodyTest [2025-11-06T00:40:36.181Z] [2025-11-06T00:40:36.181Z] TEST RESULT: Failed. Execution failed: `main' threw exception: java.lang.Exception: failures: 1 [2025-11-06T00:40:36.181Z] -------------------------------------------------- [2025-11-06T01:00:36.552Z] test-docker-ubuntu2404-armv8-4 seems to be removed or offline (hudson.remoting.ChannelClosedException: Channel "hudson.remoting.Channel@b88267c:test-docker-ubuntu2404-armv8-4": Remote call on test-docker-ubuntu2404-armv8-4 failed. The channel is closing down or has closed down); will wait for 5 min 0 sec for it to come back online [2025-11-06T01:02:27.547Z] test-docker-ubuntu2404-armv8-4 is back online [2025-11-06T01:08:16.787Z] wrapper script does not seem to be touching the log file in /home/jenkins/workspace/Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7@tmp/durable-040b1e7f [2025-11-06T01:08:16.787Z] (JENKINS-48300: if on an extremely laggy filesystem, consider -Dorg.jenkinsci.plugins.durabletask.BourneShellScript.HEARTBEAT_CHECK_INTERVAL=86400) [Pipeline] sh [2025-11-06T01:08:28.776Z] + uname [2025-11-06T01:08:28.776Z] + [ Linux = AIX ] [2025-11-06T01:08:28.776Z] + uname [2025-11-06T01:08:28.776Z] + [ Linux = SunOS ] [2025-11-06T01:08:28.776Z] + uname [2025-11-06T01:08:28.776Z] + [ Linux = *BSD ] [2025-11-06T01:08:28.776Z] + MAKE=make [2025-11-06T01:08:28.776Z] + make -f ./aqa-tests/TKG/testEnv.mk testEnvTeardown [2025-11-06T01:08:28.776Z] make: Nothing to be done for 'testEnvTeardown'. [Pipeline] } [2025-11-06T01:08:29.415Z] $ ssh-agent -k [2025-11-06T01:08:29.486Z] kill: No such process [Pipeline] // sshagent [Pipeline] } [2025-11-06T01:08:30.330Z] Xvfb stopping [Pipeline] // wrap [Pipeline] } [Pipeline] // stage [Pipeline] stage [Pipeline] { (Post) [Pipeline] echo [2025-11-06T01:08:31.634Z] Saving aqa-tests/testenv/testenv.properties file on jenkins. [Pipeline] archiveArtifacts [2025-11-06T01:08:31.821Z] Archiving artifacts [2025-11-06T01:08:46.783Z] Recording fingerprints [Pipeline] echo [2025-11-06T01:08:47.377Z] Saving aqa-tests/TKG/**/*.tap file on jenkins. [Pipeline] archiveArtifacts [2025-11-06T01:08:47.567Z] Archiving artifacts [2025-11-06T01:08:49.160Z] No artifacts found that match the file pattern "aqa-tests/TKG/**/*.tap". Configuration error? [Pipeline] sh [2025-11-06T01:08:51.223Z] + tar -cf - ./aqa-tests/TKG/output_17623859943816 [2025-11-06T01:08:51.223Z] + pigz -9 [2025-11-06T01:08:51.223Z] + gzip -9 [Pipeline] echo [2025-11-06T01:11:17.295Z] ARTIFACTORY_SERVER is not set. Saving artifacts on jenkins. [Pipeline] archiveArtifacts [2025-11-06T01:11:17.482Z] Archiving artifacts [2025-11-06T01:11:25.308Z] Recording fingerprints [Pipeline] findFiles [Pipeline] junit [2025-11-06T01:11:30.683Z] Recording test results [2025-11-06T01:12:02.081Z] [Checks API] No suitable checks publisher found. [Pipeline] } [Pipeline] // stage [Pipeline] echo [2025-11-06T01:12:02.111Z] PROCESSCATCH: Terminating any hung/left over test processes: [Pipeline] sh [2025-11-06T01:12:04.175Z] + aqa-tests/terminateTestProcesses.sh jenkins [2025-11-06T01:12:04.176Z] Unix type machine.. [2025-11-06T01:12:04.176Z] Running on a Linux host [2025-11-06T01:12:04.176Z] Woohoo - no rogue processes detected! [Pipeline] retry [Pipeline] { [Pipeline] cleanWs [2025-11-06T01:12:05.110Z] [WS-CLEANUP] Deleting project workspace... [2025-11-06T01:12:05.110Z] [WS-CLEANUP] Deferred wipeout is disabled by the job configuration... [2025-11-06T01:12:53.932Z] [WS-CLEANUP] done [Pipeline] } [Pipeline] // retry [Pipeline] sh [2025-11-06T01:12:56.046Z] + find /tmp -name *core* -print -exec rm -f {} ; [Pipeline] } [Pipeline] // timeout [Pipeline] echo [2025-11-06T01:13:57.531Z] Exception: hudson.AbortException: Failed to run ssh-agent -k [Pipeline] timeout [2025-11-06T01:13:57.544Z] Timeout set to expire in 5 min 0 sec [Pipeline] { [Pipeline] echo [2025-11-06T01:13:57.572Z] Test_openjdk21_hs_extended.openjdk_aarch64_linux_testList_7 #37 result is FAILURE. Checking console log for specific errors... [Pipeline] } [Pipeline] // timeout [Pipeline] } [Pipeline] // node [Pipeline] } [Pipeline] // stage [Pipeline] } [Pipeline] // timestamps [Pipeline] End of Pipeline Finished: FAILURE