[2025-10-23T10:08:01.215Z] Running test jdk_custom_0 ... [2025-10-23T10:08:01.215Z] =============================================== [2025-10-23T10:08:01.215Z] jdk_custom_0 Start Time: Thu Oct 23 03:08:00 2025 Epoch Time (ms): 1761214080852 [2025-10-23T10:08:01.215Z] variation: NoOptions [2025-10-23T10:08:01.215Z] JVM_OPTIONS: [2025-10-23T10:08:01.215Z] { \ [2025-10-23T10:08:01.215Z] echo ""; echo "TEST SETUP:"; \ [2025-10-23T10:08:01.215Z] echo "Nothing to be done for setup."; \ [2025-10-23T10:08:01.215Z] mkdir -p "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0"; \ [2025-10-23T10:08:01.215Z] cd "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0"; \ [2025-10-23T10:08:01.215Z] echo ""; echo "TESTING:"; \ [2025-10-23T10:08:01.215Z] "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/..//bin/java" -Xmx512m -jar "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../../jvmtest/openjdk/jtreg/lib/jtreg.jar" \ [2025-10-23T10:08:01.215Z] -agentvm -a -ea -esa -v:fail,error,time,nopass -retain:fail,error,*.dmp,javacore.*,heapdump.*,*.trc -ignore:quiet -timeoutFactor:8 -xml:verify -concurrency:2 -nativepath:"/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/openjdk-test-image/jdk/jtreg/native" -vmoptions:"-Xmx512m " \ [2025-10-23T10:08:01.215Z] \ [2025-10-23T10:08:01.215Z] -w ""/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0"/work" \ [2025-10-23T10:08:01.215Z] -r ""/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0"/report" \ [2025-10-23T10:08:01.215Z] -jdk:"/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/../" \ [2025-10-23T10:08:01.215Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin/Starvation.java; \ [2025-10-23T10:08:01.215Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "jdk_custom_0""_PASSED"; echo "-----------------------------------"; cd /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/..; else echo "-----------------------------------"; echo "jdk_custom_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-10-23T10:08:01.215Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-10-23T10:08:01.215Z] echo "Nothing to be done for teardown."; \ [2025-10-23T10:08:01.215Z] } 2>&1 | tee -a "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/TestTargetResult"; [2025-10-23T10:08:01.215Z] [2025-10-23T10:08:01.215Z] TEST SETUP: [2025-10-23T10:08:01.215Z] Nothing to be done for setup. [2025-10-23T10:08:01.215Z] [2025-10-23T10:08:01.215Z] TESTING: [2025-10-23T10:08:04.913Z] Directory "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0/work" not found: creating [2025-10-23T10:08:04.913Z] Directory "/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/../TKG/output_17612140698742/jdk_custom_0/report" not found: creating [2025-10-23T10:09:07.457Z] XML output with verification to /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work [2025-10-23T10:25:34.013Z] -------------------------------------------------- [2025-10-23T10:25:34.013Z] TEST: java/util/concurrent/forkjoin/Starvation.java [2025-10-23T10:25:34.013Z] TEST JDK: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/.. [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] ACTION: build -- Passed. Build successful [2025-10-23T10:25:34.013Z] REASON: Named class compiled on demand [2025-10-23T10:25:34.013Z] TIME: 11.169 seconds [2025-10-23T10:25:34.013Z] messages: [2025-10-23T10:25:34.013Z] command: build Starvation [2025-10-23T10:25:34.013Z] reason: Named class compiled on demand [2025-10-23T10:25:34.013Z] started: Thu Oct 23 03:09:08 PDT 2025 [2025-10-23T10:25:34.013Z] Test directory: [2025-10-23T10:25:34.013Z] compile: Starvation [2025-10-23T10:25:34.013Z] finished: Thu Oct 23 03:09:19 PDT 2025 [2025-10-23T10:25:34.013Z] elapsed time (seconds): 11.169 [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] ACTION: compile -- Passed. Compilation successful [2025-10-23T10:25:34.013Z] REASON: .class file out of date or does not exist [2025-10-23T10:25:34.013Z] TIME: 10.899 seconds [2025-10-23T10:25:34.013Z] messages: [2025-10-23T10:25:34.013Z] command: compile /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin/Starvation.java [2025-10-23T10:25:34.013Z] reason: .class file out of date or does not exist [2025-10-23T10:25:34.013Z] started: Thu Oct 23 03:09:08 PDT 2025 [2025-10-23T10:25:34.013Z] Mode: agentvm [2025-10-23T10:25:34.013Z] Agent id: 1 [2025-10-23T10:25:34.013Z] Process id: 55831 [2025-10-23T10:25:34.013Z] finished: Thu Oct 23 03:09:19 PDT 2025 [2025-10-23T10:25:34.013Z] elapsed time (seconds): 10.899 [2025-10-23T10:25:34.013Z] configuration: [2025-10-23T10:25:34.013Z] Boot Layer (javac runtime environment) [2025-10-23T10:25:34.013Z] class path: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/javatest.jar [2025-10-23T10:25:34.013Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/jtreg.jar [2025-10-23T10:25:34.013Z] patch: java.base /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/patches/java.base [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] javac compilation environment [2025-10-23T10:25:34.013Z] source path: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin [2025-10-23T10:25:34.013Z] class path: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin [2025-10-23T10:25:34.013Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] rerun: [2025-10-23T10:25:34.013Z] cd /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/scratch/0 && \ [2025-10-23T10:25:34.013Z] HOME=/Users/admin \ [2025-10-23T10:25:34.013Z] PATH=/bin:/usr/bin:/usr/sbin \ [2025-10-23T10:25:34.013Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/../bin/javac \ [2025-10-23T10:25:34.013Z] -J-ea \ [2025-10-23T10:25:34.013Z] -J-esa \ [2025-10-23T10:25:34.013Z] -J-Xmx512m \ [2025-10-23T10:25:34.013Z] -J-Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-10-23T10:25:34.013Z] -J-Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-10-23T10:25:34.013Z] -J-Dtest.compiler.opts= \ [2025-10-23T10:25:34.013Z] -J-Dtest.java.opts= \ [2025-10-23T10:25:34.013Z] -J-Dtest.jdk=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/.. \ [2025-10-23T10:25:34.013Z] -J-Dcompile.jdk=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/.. \ [2025-10-23T10:25:34.013Z] -J-Dtest.timeout.factor=8.0 \ [2025-10-23T10:25:34.013Z] -J-Dtest.nativepath=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/openjdk-test-image/jdk/jtreg/native \ [2025-10-23T10:25:34.013Z] -J-Dtest.root=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk \ [2025-10-23T10:25:34.013Z] -J-Dtest.name=java/util/concurrent/forkjoin/Starvation.java \ [2025-10-23T10:25:34.013Z] -J-Dtest.verbose=Verbose[p=NONE,f=FULL,e=FULL,t=true,m=false] \ [2025-10-23T10:25:34.013Z] -J-Dtest.file=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin/Starvation.java \ [2025-10-23T10:25:34.013Z] -J-Dtest.src=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.013Z] -J-Dtest.src.path=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.013Z] -J-Dtest.classes=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d \ [2025-10-23T10:25:34.013Z] -J-Dtest.class.path=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d \ [2025-10-23T10:25:34.013Z] -J-Dtest.class.path.prefix=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.013Z] -d /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d \ [2025-10-23T10:25:34.013Z] -sourcepath /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.013Z] -classpath /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin/Starvation.java [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] ACTION: main -- Error. "main" action timed out with a timeout of 960 seconds on agent 2 [2025-10-23T10:25:34.013Z] REASON: Assumed action based on file name: run main Starvation [2025-10-23T10:25:34.013Z] TIME: 967.954 seconds [2025-10-23T10:25:34.013Z] messages: [2025-10-23T10:25:34.013Z] command: main Starvation [2025-10-23T10:25:34.013Z] reason: Assumed action based on file name: run main Starvation [2025-10-23T10:25:34.013Z] started: Thu Oct 23 03:09:19 PDT 2025 [2025-10-23T10:25:34.013Z] Mode: agentvm [2025-10-23T10:25:34.013Z] Agent id: 2 [2025-10-23T10:25:34.013Z] Process id: 55839 [2025-10-23T10:25:34.013Z] Timeout signalled after 960 seconds [2025-10-23T10:25:34.013Z] Timeout information: [2025-10-23T10:25:34.013Z] Running jstack on process 55839 [2025-10-23T10:25:34.013Z] 2025-10-23 03:25:26 [2025-10-23T10:25:34.013Z] Full thread dump OpenJDK 64-Bit Server VM (25.0.1+8-LTS mixed mode): [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] Threads class SMR info: [2025-10-23T10:25:34.013Z] _java_thread_list=0x00006000008a5f20, length=15, elements={ [2025-10-23T10:25:34.013Z] 0x00007fc4e3808200, 0x00007fc4e2066200, 0x00007fc4e2068c00, 0x00007fc4e2069400, [2025-10-23T10:25:34.013Z] 0x00007fc4e2069c00, 0x00007fc4e206a400, 0x00007fc4e206ac00, 0x00007fc4e20d5e00, [2025-10-23T10:25:34.013Z] 0x00007fc4e381b800, 0x00007fc4e20fec00, 0x00007fc4e3b11800, 0x00007fc4e30bb800, [2025-10-23T10:25:34.013Z] 0x00007fc4e30bc000, 0x00007fc4e30c4600, 0x00007fc4e3b1ca00 [2025-10-23T10:25:34.013Z] } [2025-10-23T10:25:34.013Z] _to_delete_list=0x00006000008a4dc0, length=14, elements={ [2025-10-23T10:25:34.013Z] 0x00007fc4e3808200, 0x00007fc4e2066200, 0x00007fc4e2068c00, 0x00007fc4e2069400, [2025-10-23T10:25:34.013Z] 0x00007fc4e2069c00, 0x00007fc4e206a400, 0x00007fc4e206ac00, 0x00007fc4e20d5e00, [2025-10-23T10:25:34.013Z] 0x00007fc4e381b800, 0x00007fc4e20fec00, 0x00007fc4e3b11800, 0x00007fc4e30bb800, [2025-10-23T10:25:34.013Z] 0x00007fc4e30bc000, 0x00007fc4e30c4600 [2025-10-23T10:25:34.013Z] } [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "main" #3 [8963] prio=5 os_prio=31 cpu=1973.23ms elapsed=966.01s tid=0x00007fc4e3808200 nid=8963 in Object.wait() [0x000070000b1ed000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: WAITING (on object monitor) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait0(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - waiting on <0x00000007ed300000> (a java.lang.Thread) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait(java.base@25.0.1/Object.java:389) [2025-10-23T10:25:34.013Z] at java.lang.Thread.join(java.base@25.0.1/Thread.java:1887) [2025-10-23T10:25:34.013Z] - locked <0x00000007ed300000> (a java.lang.Thread) [2025-10-23T10:25:34.013Z] at java.lang.Thread.join(java.base@25.0.1/Thread.java:1963) [2025-10-23T10:25:34.013Z] at com.sun.javatest.regtest.agent.MainActionHelper.runClass(MainActionHelper.java:219) [2025-10-23T10:25:34.013Z] at com.sun.javatest.regtest.agent.AgentServer.doMain(AgentServer.java:319) [2025-10-23T10:25:34.013Z] at com.sun.javatest.regtest.agent.AgentServer.run(AgentServer.java:244) [2025-10-23T10:25:34.013Z] at com.sun.javatest.regtest.agent.AgentServer.main(AgentServer.java:71) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Reference Handler" #11 [24323] daemon prio=10 os_prio=31 cpu=1.08ms elapsed=965.75s tid=0x00007fc4e2066200 nid=24323 waiting on condition [0x000070000bb8e000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] at java.lang.ref.Reference.waitForReferencePendingList(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] at java.lang.ref.Reference.processPendingReferences(java.base@25.0.1/Reference.java:246) [2025-10-23T10:25:34.013Z] at java.lang.ref.Reference$ReferenceHandler.run(java.base@25.0.1/Reference.java:208) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Finalizer" #12 [24835] daemon prio=8 os_prio=31 cpu=0.42ms elapsed=965.75s tid=0x00007fc4e2068c00 nid=24835 in Object.wait() [0x000070000bc91000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: WAITING (on object monitor) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait0(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - waiting on <0x00000007ed22a6b8> (a java.lang.ref.ReferenceQueue$Lock) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait(java.base@25.0.1/Object.java:389) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait(java.base@25.0.1/Object.java:351) [2025-10-23T10:25:34.013Z] at java.lang.ref.ReferenceQueue.remove0(java.base@25.0.1/ReferenceQueue.java:137) [2025-10-23T10:25:34.013Z] at java.lang.ref.ReferenceQueue.remove(java.base@25.0.1/ReferenceQueue.java:215) [2025-10-23T10:25:34.013Z] - locked <0x00000007ed22a6b8> (a java.lang.ref.ReferenceQueue$Lock) [2025-10-23T10:25:34.013Z] at java.lang.ref.Finalizer$FinalizerThread.run(java.base@25.0.1/Finalizer.java:165) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Signal Dispatcher" #13 [28675] daemon prio=9 os_prio=31 cpu=1.98ms elapsed=965.73s tid=0x00007fc4e2069400 nid=28675 waiting on condition [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Service Thread" #14 [25347] daemon prio=9 os_prio=31 cpu=110.44ms elapsed=965.73s tid=0x00007fc4e2069c00 nid=25347 runnable [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Monitor Deflation Thread" #15 [25603] daemon prio=9 os_prio=31 cpu=705.75ms elapsed=965.73s tid=0x00007fc4e206a400 nid=25603 runnable [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "C2 CompilerThread0" #16 [26115] daemon prio=9 os_prio=31 cpu=1108.72ms elapsed=965.73s tid=0x00007fc4e206ac00 nid=26115 waiting on condition [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] No compile task [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "C1 CompilerThread0" #17 [26627] daemon prio=9 os_prio=31 cpu=728.15ms elapsed=965.73s tid=0x00007fc4e20d5e00 nid=26627 waiting on condition [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] No compile task [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Common-Cleaner" #18 [26883] daemon prio=8 os_prio=31 cpu=2.44ms elapsed=965.40s tid=0x00007fc4e381b800 nid=26883 in Object.wait() [0x000070000c2a3000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: TIMED_WAITING (on object monitor) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait0(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - waiting on <0x00000007ed301f88> (a java.lang.ref.ReferenceQueue$Lock) [2025-10-23T10:25:34.013Z] at java.lang.Object.wait(java.base@25.0.1/Object.java:389) [2025-10-23T10:25:34.013Z] at java.lang.ref.ReferenceQueue.remove0(java.base@25.0.1/ReferenceQueue.java:123) [2025-10-23T10:25:34.013Z] at java.lang.ref.ReferenceQueue.remove(java.base@25.0.1/ReferenceQueue.java:201) [2025-10-23T10:25:34.013Z] - locked <0x00000007ed301f88> (a java.lang.ref.ReferenceQueue$Lock) [2025-10-23T10:25:34.013Z] at jdk.internal.ref.CleanerImpl.run(java.base@25.0.1/CleanerImpl.java:146) [2025-10-23T10:25:34.013Z] at java.lang.Thread.runWith(java.base@25.0.1/Thread.java:1487) [2025-10-23T10:25:34.013Z] at java.lang.Thread.run(java.base@25.0.1/Thread.java:1474) [2025-10-23T10:25:34.013Z] at jdk.internal.misc.InnocuousThread.run(java.base@25.0.1/InnocuousThread.java:148) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "Notification Thread" #19 [27395] daemon prio=9 os_prio=31 cpu=0.17ms elapsed=964.81s tid=0x00007fc4e20fec00 nid=27395 runnable [0x0000000000000000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "pool-1-thread-1" #20 [32771] daemon prio=5 os_prio=31 cpu=11.14ms elapsed=962.90s tid=0x00007fc4e3b11800 nid=32771 waiting on condition [0x000070000c4a9000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: TIMED_WAITING (parking) [2025-10-23T10:25:34.013Z] at jdk.internal.misc.Unsafe.park(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - parking to wait for <0x00000007ed21f878> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject) [2025-10-23T10:25:34.013Z] at java.util.concurrent.locks.LockSupport.parkNanos(java.base@25.0.1/LockSupport.java:271) [2025-10-23T10:25:34.013Z] at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.awaitNanos(java.base@25.0.1/AbstractQueuedSynchronizer.java:1803) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ScheduledThreadPoolExecutor$DelayedWorkQueue.take(java.base@25.0.1/ScheduledThreadPoolExecutor.java:1166) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ScheduledThreadPoolExecutor$DelayedWorkQueue.take(java.base@25.0.1/ScheduledThreadPoolExecutor.java:883) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ThreadPoolExecutor.getTask(java.base@25.0.1/ThreadPoolExecutor.java:1016) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ThreadPoolExecutor.runWorker(java.base@25.0.1/ThreadPoolExecutor.java:1076) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ThreadPoolExecutor$Worker.run(java.base@25.0.1/ThreadPoolExecutor.java:614) [2025-10-23T10:25:34.013Z] at java.lang.Thread.runWith(java.base@25.0.1/Thread.java:1487) [2025-10-23T10:25:34.013Z] at java.lang.Thread.run(java.base@25.0.1/Thread.java:1474) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "AgentVMThread" #21 [33027] prio=5 os_prio=31 cpu=14272.65ms elapsed=962.72s tid=0x00007fc4e30bb800 nid=33027 waiting on condition [0x000070000c5ac000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: WAITING (parking) [2025-10-23T10:25:34.013Z] at jdk.internal.misc.Unsafe.park(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - parking to wait for <0x00000007edd62a98> (a java.util.concurrent.ForkJoinTask$AdaptedInterruptibleCallable) [2025-10-23T10:25:34.013Z] at java.util.concurrent.locks.LockSupport.park(java.base@25.0.1/LockSupport.java:369) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinTask.awaitDone(java.base@25.0.1/ForkJoinTask.java:445) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinTask.awaitDone(java.base@25.0.1/ForkJoinTask.java:500) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinTask.get(java.base@25.0.1/ForkJoinTask.java:1015) [2025-10-23T10:25:34.013Z] at Starvation.main(Starvation.java:50) [2025-10-23T10:25:34.013Z] at java.lang.invoke.LambdaForm$DMH/0x000000079d081400.invokeStatic(java.base@25.0.1/LambdaForm$DMH) [2025-10-23T10:25:34.013Z] at java.lang.invoke.LambdaForm$MH/0x000000079d08c800.invoke(java.base@25.0.1/LambdaForm$MH) [2025-10-23T10:25:34.013Z] at java.lang.invoke.Invokers$Holder.invokeExact_MT(java.base@25.0.1/Invokers$Holder) [2025-10-23T10:25:34.013Z] at jdk.internal.reflect.DirectMethodHandleAccessor.invokeImpl(java.base@25.0.1/DirectMethodHandleAccessor.java:155) [2025-10-23T10:25:34.013Z] at jdk.internal.reflect.DirectMethodHandleAccessor.invoke(java.base@25.0.1/DirectMethodHandleAccessor.java:104) [2025-10-23T10:25:34.013Z] at java.lang.reflect.Method.invoke(java.base@25.0.1/Method.java:565) [2025-10-23T10:25:34.013Z] at com.sun.javatest.regtest.agent.MainActionHelper$AgentVMRunnable.run(MainActionHelper.java:335) [2025-10-23T10:25:34.013Z] at java.lang.Thread.runWith(java.base@25.0.1/Thread.java:1487) [2025-10-23T10:25:34.013Z] at java.lang.Thread.run(java.base@25.0.1/Thread.java:1474) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "ForkJoinPool-1-worker-1" #22 [43011] daemon prio=5 os_prio=31 cpu=298761.93ms elapsed=962.72s tid=0x00007fc4e30bc000 nid=43011 runnable [0x000070000c6af000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: WAITING (parking) [2025-10-23T10:25:34.013Z] at jdk.internal.misc.Unsafe.park(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] - parking to wait for <0x00000007ed22b6d8> (a java.util.concurrent.ForkJoinPool) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinPool.awaitWork(java.base@25.0.1/ForkJoinPool.java:2109) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinPool.deactivate(java.base@25.0.1/ForkJoinPool.java:2063) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinPool.runWorker(java.base@25.0.1/ForkJoinPool.java:2027) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinWorkerThread.run(java.base@25.0.1/ForkJoinWorkerThread.java:187) [2025-10-23T10:25:34.013Z] [2025-10-23T10:25:34.013Z] "ForkJoinPool-1-worker-2" #23 [42499] daemon prio=5 os_prio=31 cpu=297064.72ms elapsed=962.72s tid=0x00007fc4e30c4600 nid=42499 runnable [0x000070000c7b2000] [2025-10-23T10:25:34.013Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.013Z] at jdk.internal.misc.Unsafe.unpark(java.base@25.0.1/Native Method) [2025-10-23T10:25:34.013Z] at java.util.concurrent.locks.LockSupport.unpark(java.base@25.0.1/LockSupport.java:183) [2025-10-23T10:25:34.013Z] at java.util.concurrent.ForkJoinTask.signalWaiters(java.base@25.0.1/ForkJoinTask.java:319) [2025-10-23T10:25:34.014Z] at java.util.concurrent.ForkJoinTask.setDone(java.base@25.0.1/ForkJoinTask.java:331) [2025-10-23T10:25:34.014Z] at java.util.concurrent.ForkJoinTask.doExec(java.base@25.0.1/ForkJoinTask.java:516) [2025-10-23T10:25:34.014Z] at java.util.concurrent.ForkJoinPool$WorkQueue.topLevelExec(java.base@25.0.1/ForkJoinPool.java:1450) [2025-10-23T10:25:34.014Z] at java.util.concurrent.ForkJoinPool.runWorker(java.base@25.0.1/ForkJoinPool.java:2019) [2025-10-23T10:25:34.014Z] at java.util.concurrent.ForkJoinWorkerThread.run(java.base@25.0.1/ForkJoinWorkerThread.java:187) [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "Attach Listener" #26 [41731] daemon prio=9 os_prio=31 cpu=5.51ms elapsed=0.37s tid=0x00007fc4e3b1ca00 nid=41731 waiting on condition [0x0000000000000000] [2025-10-23T10:25:34.014Z] java.lang.Thread.State: RUNNABLE [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "GC Thread#2" os_prio=31 cpu=2.98ms elapsed=128.01s tid=0x00007fc4e306d000 nid=41987 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "GC Thread#1" os_prio=31 cpu=16.83ms elapsed=128.01s tid=0x00007fc4e3070200 nid=23815 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "VM Thread" os_prio=31 cpu=75.27ms elapsed=965.92s tid=0x00007fc4e200f800 nid=18435 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "VM Periodic Task Thread" os_prio=31 cpu=47.74ms elapsed=966.01s tid=0x00007fc4e2807490 nid=17923 waiting on condition [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "G1 Service" os_prio=31 cpu=148.86ms elapsed=966.04s tid=0x00007fc4e3020c00 nid=21507 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "G1 Refine#0" os_prio=31 cpu=0.20ms elapsed=966.05s tid=0x00007fc4e3020600 nid=16899 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "G1 Conc#0" os_prio=31 cpu=0.14ms elapsed=966.08s tid=0x00007fc4e202a600 nid=16387 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "GC Thread#0" os_prio=31 cpu=15.52ms elapsed=966.08s tid=0x00007fc4e200aa00 nid=14595 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] "G1 Main Marker" os_prio=31 cpu=0.17ms elapsed=966.08s tid=0x00007fc4e201a400 nid=14339 runnable [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] JNI global refs: 15, weak refs: 0 [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] --- Timeout information end. [2025-10-23T10:25:34.014Z] finished: Thu Oct 23 03:25:27 PDT 2025 [2025-10-23T10:25:34.014Z] elapsed time (seconds): 967.954 [2025-10-23T10:25:34.014Z] configuration: [2025-10-23T10:25:34.014Z] Boot Layer [2025-10-23T10:25:34.014Z] class path: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/javatest.jar [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/jtreg.jar [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/junit-platform-console-standalone-1.11.0.jar [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/testng-7.3.0.jar [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/guice-5.1.0.jar [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/jcommander-1.82.jar [2025-10-23T10:25:34.014Z] patch: java.base /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/patches/java.base [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] Test Layer [2025-10-23T10:25:34.014Z] class path: /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] rerun: [2025-10-23T10:25:34.014Z] cd /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/scratch/0 && \ [2025-10-23T10:25:34.014Z] HOME=/Users/admin \ [2025-10-23T10:25:34.014Z] PATH=/bin:/usr/bin:/usr/sbin \ [2025-10-23T10:25:34.014Z] /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/../bin/java \ [2025-10-23T10:25:34.014Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-10-23T10:25:34.014Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-10-23T10:25:34.014Z] -Dtest.compiler.opts= \ [2025-10-23T10:25:34.014Z] -Dtest.java.opts= \ [2025-10-23T10:25:34.014Z] -Dtest.jdk=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/.. \ [2025-10-23T10:25:34.014Z] -Dcompile.jdk=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/j2sdk-image/Contents/Home/bin/.. \ [2025-10-23T10:25:34.014Z] -Dtest.timeout.factor=8.0 \ [2025-10-23T10:25:34.014Z] -Dtest.nativepath=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jdkbinary/openjdk-test-image/jdk/jtreg/native \ [2025-10-23T10:25:34.014Z] -Dtest.root=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk \ [2025-10-23T10:25:34.014Z] -Dtest.name=java/util/concurrent/forkjoin/Starvation.java \ [2025-10-23T10:25:34.014Z] -Dtest.verbose=Verbose[p=NONE,f=FULL,e=FULL,t=true,m=false] \ [2025-10-23T10:25:34.014Z] -Dtest.file=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin/Starvation.java \ [2025-10-23T10:25:34.014Z] -Dtest.src=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.014Z] -Dtest.src.path=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.014Z] -Dtest.classes=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d \ [2025-10-23T10:25:34.014Z] -Dtest.class.path=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d \ [2025-10-23T10:25:34.014Z] -Dtest.class.path.prefix=/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin \ [2025-10-23T10:25:34.014Z] -classpath /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work/classes/0/java/util/concurrent/forkjoin/Starvation.d:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/openjdk/openjdk-jdk/test/jdk/java/util/concurrent/forkjoin:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/javatest.jar:/Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/jvmtest/openjdk/jtreg/lib/jtreg.jar \ [2025-10-23T10:25:34.014Z] Starvation [2025-10-23T10:25:34.014Z] [2025-10-23T10:25:34.014Z] TEST RESULT: Error. "main" action timed out with a timeout of 960 seconds on agent 2 [2025-10-23T10:25:34.014Z] -------------------------------------------------- [2025-10-23T10:25:34.014Z] Test results: error: 1 [2025-10-23T10:26:06.337Z] Report written to /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/report/html/report.html [2025-10-23T10:26:06.337Z] Results written to /Users/admin/workspace/workspace/Test_openjdk25_hs_sanity.openjdk_x86-64_mac_rerun/aqa-tests/TKG/output_17612140698742/jdk_custom_0/work [2025-10-23T10:26:06.337Z] Error: Some tests failed or other problems occurred. [2025-10-23T10:26:06.337Z] ----------------------------------- [2025-10-23T10:26:06.337Z] jdk_custom_0_FAILED [2025-10-23T10:26:06.337Z] ----------------------------------- [2025-10-23T10:26:06.337Z] [2025-10-23T10:26:06.337Z] TEST TEARDOWN: [2025-10-23T10:26:06.337Z] Nothing to be done for teardown. [2025-10-23T10:26:06.337Z] jdk_custom_0 Finish Time: Thu Oct 23 03:26:04 2025 Epoch Time (ms): 1761215164074