AutoMod_Impl2_0
[2026-02-11T17:47:05.233Z] Running test AutoMod_Impl2_0 ...
[2026-02-11T17:47:05.233Z] ===============================================
[2026-02-11T17:47:05.628Z] AutoMod_Impl2_0 Start Time: Wed Feb 11 17:47:05 2026 Epoch Time (ms): 1770832025339
[2026-02-11T17:47:05.964Z] variation: Mode150
[2026-02-11T17:47:06.300Z] JVM_OPTIONS: -XX:+UseCompressedOops
[2026-02-11T17:47:06.300Z] { \
[2026-02-11T17:47:06.300Z] echo ""; echo "TEST SETUP:"; \
[2026-02-11T17:47:06.300Z] echo "Nothing to be done for setup."; \
[2026-02-11T17:47:06.300Z] mkdir -p "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\\TKG\\output_17708250051633\\AutoMod_Impl2_0"; \
[2026-02-11T17:47:06.300Z] cd "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\\TKG\\output_17708250051633\\AutoMod_Impl2_0"; \
[2026-02-11T17:47:06.300Z] echo ""; echo "TESTING:"; \
[2026-02-11T17:47:06.300Z] perl C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests///..//jvmtest\\system\\modularity/../\\STF\\stf.core\\scripts\\stf.pl -test-root="C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests///..//jvmtest\\system\\modularity/../\\STF;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests///..//jvmtest\\system\\modularity/../\\aqa-systemtest""" -systemtest-prereqs="c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/../../externalDependency/system_lib\\" -java-args=' -XX:+UseCompressedOops ' -results-root="C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\\TKG\\output_17708250051633\\AutoMod_Impl2_0" -test=AutoModTest -test-args="variant=Impl2"; \
[2026-02-11T17:47:06.300Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "AutoMod_Impl2_0""_PASSED"; echo "-----------------------------------"; cd C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/; rm -f -r "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\\TKG\\output_17708250051633\\AutoMod_Impl2_0"; else echo "-----------------------------------"; echo "AutoMod_Impl2_0""_FAILED"; echo "-----------------------------------"; fi; \
[2026-02-11T17:47:06.300Z] echo ""; echo "TEST TEARDOWN:"; \
[2026-02-11T17:47:06.300Z] echo "Nothing to be done for teardown."; \
[2026-02-11T17:47:06.300Z] } 2>&1 | tee -a "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\\TKG\\output_17708250051633\\TestTargetResult";
[2026-02-11T17:47:06.859Z]
[2026-02-11T17:47:06.859Z] TEST SETUP:
[2026-02-11T17:47:06.859Z] Nothing to be done for setup.
[2026-02-11T17:47:06.859Z]
[2026-02-11T17:47:06.859Z] TESTING:
[2026-02-11T17:47:07.336Z] STF 17:47:06.642 - ========================= S T F =========================
[2026-02-11T17:47:07.336Z] systemtest-prereqs has been processed, and set to: c:/workspace/externalDependency/system_libRetrieving amount of free space on drive containing C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0
[2026-02-11T17:47:07.336Z] There is 161004 Mb free
[2026-02-11T17:47:07.336Z] STF 17:47:06.757 - ================== G E N E R A T I O N ==================
[2026-02-11T17:47:07.336Z] STF 17:47:06.763 - Checking JVM: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image
[2026-02-11T17:47:07.336Z] STF 17:47:06.764 - Starting process to generate scripts: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/java -Dlog4j.skipJansi=true -Djava.system.class.loader=net.adoptopenjdk.stf.runner.StfClassLoader -Dload.agent.path=C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jvmtest/system/STF/stf.core/scripts/../../stf.load/bin/stf.load.jar -classpath c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/../../externalDependency/system_lib\/asm/asm.jar;c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/../../externalDependency/system_lib\/asm/asm-commons.jar;c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/../../externalDependency/system_lib\/log4j/log4j-api.jar;c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/../../externalDependency/system_lib\/log4j/log4j-core.jar;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jvmtest/system/STF/stf.core/scripts/../bin net.adoptopenjdk.stf.runner.StfRunner -properties "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0/20260211-174706-AutoModTest/stf_parameters.properties, , C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0/20260211-174706-AutoModTest"
[2026-02-11T17:47:07.336Z] GEN stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:07.336Z] GEN [0.032s][warning][cds] Archived non-system classes are disabled because the java.system.class.loader property is specified (value = "net.adoptopenjdk.stf.runner.StfClassLoader"). To use archived non-system classes, this property must not be set
[2026-02-11T17:47:09.256Z] GEN 17:47:08.603 - Found test. Project: 'openjdk.test.modularity' class: 'AutoModTest.class' Dir: 'C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin'
[2026-02-11T17:47:09.256Z] GEN 17:47:08.628 - Found test. Project: 'openjdk.test.modularity' class: 'net.adoptopenjdk.test.modularity.AutoModTest'
[2026-02-11T17:47:09.256Z] GEN Classpath directories used by project 'openjdk.test.modularity':
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\displayService
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.helper
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\displayServiceImpl1
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.discreet
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.hello
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.hola
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\displayServiceImpl2
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.hi
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-override
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-override-new
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common\displayServiceImpl3
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common\displayServiceImpl4
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common
[2026-02-11T17:47:09.256Z] GEN C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\tests
[2026-02-11T17:47:09.256Z] GEN C:\\workspace\\workspace\\Test_openjdk21_hs_sanity.system_x86-64_windows\\jvmtest\\system\\aqa-systemtest\\openjdk.test.modularity\\bin
[2026-02-11T17:47:09.256Z] GEN C:\\workspace\\workspace\\Test_openjdk21_hs_sanity.system_x86-64_windows\\jvmtest\\system\\STF\\stf.core\\bin
[2026-02-11T17:47:09.256Z] GEN c:/workspace/externalDependency/system_lib/log4j/log4j-api.jar
[2026-02-11T17:47:09.256Z] GEN c:/workspace/externalDependency/system_lib/log4j/log4j-core.jar
[2026-02-11T17:47:09.256Z] GEN c:/workspace/externalDependency/system_lib/junit/junit.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:08.967 - Using Mode NoOptions. Values = ''
[2026-02-11T17:47:09.736Z] GEN 17:47:09.157 -
[2026-02-11T17:47:09.736Z] GEN 17:47:09.157 - Test command summary:
[2026-02-11T17:47:09.736Z] GEN 17:47:09.158 - Step Stage Command Description
[2026-02-11T17:47:09.736Z] GEN 17:47:09.158 - -----+--------+-----------------+------------
[2026-02-11T17:47:09.736Z] GEN 17:47:09.158 - 1 setUp jar create common.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 2 setUp jar create com.hola.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 3 setUp jar create com.helper.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 4 setUp jar create com.test.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 5 setUp jar create com.hello.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 6 setUp jar create com.discreet.jar
[2026-02-11T17:47:09.736Z] GEN 17:47:09.159 - 7 execute Run java Run TestImpliedReadability for usecase 2
[2026-02-11T17:47:09.736Z] STF 17:47:09.215 -
[2026-02-11T17:47:09.736Z] STF 17:47:09.216 - Script generation completed
[2026-02-11T17:47:09.736Z] STF 17:47:09.216 -
[2026-02-11T17:47:09.736Z] STF 17:47:09.218 -
[2026-02-11T17:47:09.736Z] STF 17:47:09.218 - ======================= S E T U P =======================
[2026-02-11T17:47:09.736Z] STF 17:47:09.218 - Running setup: perl C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0/20260211-174706-AutoModTest/setUp.pl
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 -
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 - +------ Step 1 - create common.jar
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 - | Create project jar
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 - | ProjectSpec: openjdk.test.modularity/bin/common
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 - | ArchiveSpec: ["adoptopenjdk"]
[2026-02-11T17:47:09.736Z] STF 17:47:09.474 - |
[2026-02-11T17:47:09.736Z] STF 17:47:09.475 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/common.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common adoptopenjdk
[2026-02-11T17:47:09.736Z] STF 17:47:09.476 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/1.JAR.stderr
[2026-02-11T17:47:09.736Z] STF 17:47:09.476 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/1.JAR.stdout
[2026-02-11T17:47:09.736Z] STF 17:47:09.533 - Monitoring processes: JAR
[2026-02-11T17:47:10.201Z] JAR stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - Monitoring Report Summary:
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - o Process JAR ended with the expected exit code (0)
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - Created project jar: common.jar
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 -
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - +------ Step 2 - create com.hola.jar
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - | Create project jar
[2026-02-11T17:47:10.669Z] STF 17:47:10.035 - | ProjectSpec: openjdk.test.modularity/bin/common-mods/com.hola
[2026-02-11T17:47:10.669Z] STF 17:47:10.036 - | ArchiveSpec: ["adoptopenjdk"]
[2026-02-11T17:47:10.669Z] STF 17:47:10.036 - |
[2026-02-11T17:47:10.669Z] STF 17:47:10.036 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/com.hola.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.hola adoptopenjdk
[2026-02-11T17:47:10.669Z] STF 17:47:10.036 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/2.JAR.stderr
[2026-02-11T17:47:10.669Z] STF 17:47:10.036 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/2.JAR.stdout
[2026-02-11T17:47:10.669Z] STF 17:47:10.048 - Monitoring processes: JAR
[2026-02-11T17:47:10.669Z] JAR stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:11.144Z] STF 17:47:10.513 - Monitoring Report Summary:
[2026-02-11T17:47:11.144Z] STF 17:47:10.513 - o Process JAR ended with the expected exit code (0)
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - Created project jar: com.hola.jar
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 -
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - +------ Step 3 - create com.helper.jar
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - | Create project jar
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - | ProjectSpec: openjdk.test.modularity/bin/common-mods/com.helper
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - | ArchiveSpec: ["adoptopenjdk"]
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - |
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/com.helper.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.helper adoptopenjdk
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/3.JAR.stderr
[2026-02-11T17:47:11.144Z] STF 17:47:10.514 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/3.JAR.stdout
[2026-02-11T17:47:11.144Z] STF 17:47:10.526 - Monitoring processes: JAR
[2026-02-11T17:47:11.144Z] JAR stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:11.763Z] STF 17:47:10.965 - Monitoring Report Summary:
[2026-02-11T17:47:11.763Z] STF 17:47:10.965 - o Process JAR ended with the expected exit code (0)
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - Created project jar: com.helper.jar
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 -
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - +------ Step 4 - create com.test.jar
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - | Create project jar
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - | ProjectSpec: openjdk.test.modularity/bin/tests/com.test
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - | ArchiveSpec: ["net"]
[2026-02-11T17:47:11.763Z] STF 17:47:10.966 - |
[2026-02-11T17:47:11.763Z] STF 17:47:10.967 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/com.test.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\tests\com.test net
[2026-02-11T17:47:11.763Z] STF 17:47:10.967 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/4.JAR.stderr
[2026-02-11T17:47:11.763Z] STF 17:47:10.967 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/4.JAR.stdout
[2026-02-11T17:47:11.763Z] STF 17:47:10.979 - Monitoring processes: JAR
[2026-02-11T17:47:11.763Z] JAR stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:12.239Z] STF 17:47:11.487 - Monitoring Report Summary:
[2026-02-11T17:47:12.239Z] STF 17:47:11.487 - o Process JAR ended with the expected exit code (0)
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - Created project jar: com.test.jar
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 -
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - +------ Step 5 - create com.hello.jar
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - | Create modular jar
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - | ModuleSpec: openjdk.test.modularity/bin/common-mods/com.hello
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - | ModuleVersion: null
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - | MainClass: null
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - | HashModules: null
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - |
[2026-02-11T17:47:12.239Z] STF 17:47:11.488 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/modules/5.com.hello.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.hello .
[2026-02-11T17:47:12.239Z] STF 17:47:11.489 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/5.CMJ.stderr
[2026-02-11T17:47:12.239Z] STF 17:47:11.489 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/5.CMJ.stdout
[2026-02-11T17:47:12.239Z] STF 17:47:11.508 - Monitoring processes: CMJ
[2026-02-11T17:47:12.240Z] CMJ stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:12.726Z] STF 17:47:12.165 - Monitoring Report Summary:
[2026-02-11T17:47:12.726Z] STF 17:47:12.165 - o Process CMJ ended with the expected exit code (0)
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - Created modular jar: 5.com.hello.jar
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 -
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - +------ Step 6 - create com.discreet.jar
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - | Create modular jar
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - | ModuleSpec: openjdk.test.modularity/bin/common-mods/com.discreet
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - | ModuleVersion: null
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - | MainClass: null
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - | HashModules: null
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - |
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/jar --create --file C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/modules/6.com.discreet.jar -C C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\common-mods\com.discreet .
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/6.CMJ.stderr
[2026-02-11T17:47:12.726Z] STF 17:47:12.166 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/6.CMJ.stdout
[2026-02-11T17:47:12.726Z] STF 17:47:12.178 - Monitoring processes: CMJ
[2026-02-11T17:47:12.726Z] CMJ stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:13.192Z] STF 17:47:12.724 - Monitoring Report Summary:
[2026-02-11T17:47:13.192Z] STF 17:47:12.724 - o Process CMJ ended with the expected exit code (0)
[2026-02-11T17:47:13.192Z] STF 17:47:12.724 - Created modular jar: 6.com.discreet.jar
[2026-02-11T17:47:13.192Z] STF 17:47:12.724 - SETUP stage completed
[2026-02-11T17:47:13.192Z] STF 17:47:12.763 -
[2026-02-11T17:47:13.192Z] STF 17:47:12.763 - ==================== E X E C U T E - ====================
[2026-02-11T17:47:13.192Z] STF 17:47:12.763 - Running execute: perl C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0/20260211-174706-AutoModTest/execute.pl
[2026-02-11T17:47:13.192Z] STF 17:47:13.024 -
[2026-02-11T17:47:13.192Z] STF 17:47:13.024 - Java version
[2026-02-11T17:47:13.192Z] STF 17:47:13.024 - Running: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/java -version
[2026-02-11T17:47:13.671Z] Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:13.671Z] openjdk version "21.0.10" 2026-01-20 LTS
[2026-02-11T17:47:13.671Z] OpenJDK Runtime Environment Temurin-21.0.10+7 (build 21.0.10+7-LTS)
[2026-02-11T17:47:13.671Z] OpenJDK 64-Bit Server VM Temurin-21.0.10+7 (build 21.0.10+7-LTS, mixed mode, sharing)
[2026-02-11T17:47:13.671Z] STF 17:47:13.200 -
[2026-02-11T17:47:13.671Z] STF 17:47:13.200 - +------ Step 7 - Run TestImpliedReadability for usecase 2
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - | Run foreground process
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - | Program: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/java
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - | Mnemonic: T4
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - | Echo: ECHO_ON
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - | Expectation: CLEAN_RUN within 1m
[2026-02-11T17:47:13.671Z] STF 17:47:13.201 - |
[2026-02-11T17:47:13.671Z] STF 17:47:13.202 - Running command: c:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/jdkbinary/j2sdk-image/bin/java --add-reads com.test=ALL-UNNAMED --module-path C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin\tests;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/modules/5.com.hello.jar;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/modules/6.com.discreet.jar;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/com.helper.jar --add-modules=com.test -XX:+UseCompressedOops -classpath c:/workspace/externalDependency/system_lib/junit/junit.jar;c:/workspace/externalDependency/system_lib/junit/hamcrest-core.jar;C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/tmp/com.hola.jar;C:\workspace\workspace\Test_openjdk21_hs_sanity.system_x86-64_windows\jvmtest\system\aqa-systemtest\openjdk.test.modularity\bin org.junit.runner.JUnitCore net.adoptopenjdk.test.modularity.junit.TestImpliedReadability
[2026-02-11T17:47:13.671Z] STF 17:47:13.202 - Redirecting stderr to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/7.T4.stderr
[2026-02-11T17:47:13.671Z] STF 17:47:13.202 - Redirecting stdout to C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/TKG/output_17708250051633/AutoMod_Impl2_0/20260211-174706-AutoModTest/results/7.T4.stdout
[2026-02-11T17:47:13.671Z] STF 17:47:13.251 - Monitoring processes: T4
[2026-02-11T17:47:13.671Z] T4 stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2026-02-11T17:47:14.146Z] T4 JUnit version 4.12
[2026-02-11T17:47:14.146Z] T4 ..
[2026-02-11T17:47:14.146Z] T4 Time: 0.021
[2026-02-11T17:47:14.146Z] T4
[2026-02-11T17:47:14.146Z] T4 OK (2 tests)
[2026-02-11T17:47:14.146Z] T4
[2026-02-11T17:47:14.146Z] STF 17:47:13.810 - Monitoring Report Summary:
[2026-02-11T17:47:14.146Z] STF 17:47:13.810 - o Process T4 ended with the expected exit code (0)
[2026-02-11T17:47:14.146Z] STF 17:47:13.811 - EXECUTE stage completed
[2026-02-11T17:47:14.146Z] STF 17:47:13.854 -
[2026-02-11T17:47:14.146Z] STF 17:47:13.854 - ==================== T E A R D O W N ====================
[2026-02-11T17:47:14.146Z] STF 17:47:13.854 - Running teardown: perl C:/workspace/workspace/Test_openjdk21_hs_sanity.system_x86-64_windows/aqa-tests/\TKG\output_17708250051633\AutoMod_Impl2_0/20260211-174706-AutoModTest/tearDown.pl
[2026-02-11T17:47:14.511Z] STF 17:47:14.162 - TEARDOWN stage completed
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 -
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - ===================== R E S U L T S =====================
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - Stage results:
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - setUp: pass
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - execute: pass
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - teardown: pass
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 -
[2026-02-11T17:47:14.511Z] STF 17:47:14.185 - Overall result: PASSED
[2026-02-11T17:47:14.511Z] -----------------------------------
[2026-02-11T17:47:14.511Z] AutoMod_Impl2_0_PASSED
[2026-02-11T17:47:14.511Z] -----------------------------------
[2026-02-11T17:47:14.511Z]
[2026-02-11T17:47:14.511Z] TEST TEARDOWN:
[2026-02-11T17:47:14.512Z] Nothing to be done for teardown.
[2026-02-11T17:47:14.899Z] AutoMod_Impl2_0 Finish Time: Wed Feb 11 17:47:14 2026 Epoch Time (ms): 1770832034645