Node ID






Columns











Log Level






Log Marker











Class













































node0 0.000ns 2025-11-21 09:44:41.550 1 INFO STARTUP <main> StaticPlatformBuilder:
////////////////////// // Node is Starting // //////////////////////
node0 95.000ms 2025-11-21 09:44:41.645 2 DEBUG STARTUP <main> StaticPlatformBuilder: main() started {} [com.swirlds.logging.legacy.payload.NodeStartPayload]
node0 226.000ms 2025-11-21 09:44:41.776 3 INFO STARTUP <main> Browser: The following nodes [0] are set to run locally
node1 233.000ms 2025-11-21 09:44:41.783 1 INFO STARTUP <main> StaticPlatformBuilder:
////////////////////// // Node is Starting // //////////////////////
node0 235.000ms 2025-11-21 09:44:41.785 4 INFO STARTUP <main> PlatformTestingToolMain: Registering PlatformTestingToolState with ConstructableRegistry
node0 268.000ms 2025-11-21 09:44:41.818 5 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 271.000ms 2025-11-21 09:44:41.821 6 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 272.000ms 2025-11-21 09:44:41.822 7 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 272.000ms 2025-11-21 09:44:41.822 8 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 273.000ms 2025-11-21 09:44:41.823 9 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 273.000ms 2025-11-21 09:44:41.823 10 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 274.000ms 2025-11-21 09:44:41.824 11 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node0 275.000ms 2025-11-21 09:44:41.825 12 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 275.000ms 2025-11-21 09:44:41.825 13 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 276.000ms 2025-11-21 09:44:41.826 14 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 276.000ms 2025-11-21 09:44:41.826 15 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 276.000ms 2025-11-21 09:44:41.826 16 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 277.000ms 2025-11-21 09:44:41.827 17 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 277.000ms 2025-11-21 09:44:41.827 18 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node0 278.000ms 2025-11-21 09:44:41.828 19 INFO STARTUP <main> PlatformTestingToolMain: PlatformTestingToolState is registered with ConstructableRegistry: -4571139351850460298
node1 320.000ms 2025-11-21 09:44:41.870 2 DEBUG STARTUP <main> StaticPlatformBuilder: main() started {} [com.swirlds.logging.legacy.payload.NodeStartPayload]
node1 441.000ms 2025-11-21 09:44:41.991 3 INFO STARTUP <main> Browser: The following nodes [1] are set to run locally
node1 447.000ms 2025-11-21 09:44:41.997 4 INFO STARTUP <main> PlatformTestingToolMain: Registering PlatformTestingToolState with ConstructableRegistry
node1 474.000ms 2025-11-21 09:44:42.024 5 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node1 476.000ms 2025-11-21 09:44:42.026 6 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node1 477.000ms 2025-11-21 09:44:42.027 7 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node1 477.000ms 2025-11-21 09:44:42.027 8 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node1 478.000ms 2025-11-21 09:44:42.028 9 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node1 478.000ms 2025-11-21 09:44:42.028 10 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node1 479.000ms 2025-11-21 09:44:42.029 11 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node1 479.000ms 2025-11-21 09:44:42.029 12 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node1 480.000ms 2025-11-21 09:44:42.030 13 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node1 480.000ms 2025-11-21 09:44:42.030 14 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node1 481.000ms 2025-11-21 09:44:42.031 15 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node1 481.000ms 2025-11-21 09:44:42.031 16 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node1 481.000ms 2025-11-21 09:44:42.031 17 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node1 482.000ms 2025-11-21 09:44:42.032 18 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node1 482.000ms 2025-11-21 09:44:42.032 19 INFO STARTUP <main> PlatformTestingToolMain: PlatformTestingToolState is registered with ConstructableRegistry: -4571139351850460298
node0 688.000ms 2025-11-21 09:44:42.238 22 DEBUG STARTUP <main> BootstrapUtils: Scanning the classpath for RuntimeConstructable classes
node1 883.000ms 2025-11-21 09:44:42.433 22 DEBUG STARTUP <main> BootstrapUtils: Scanning the classpath for RuntimeConstructable classes
node3 1.066s 2025-11-21 09:44:42.616 1 INFO STARTUP <main> StaticPlatformBuilder:
////////////////////// // Node is Starting // //////////////////////
node3 1.167s 2025-11-21 09:44:42.717 2 DEBUG STARTUP <main> StaticPlatformBuilder: main() started {} [com.swirlds.logging.legacy.payload.NodeStartPayload]
node2 1.291s 2025-11-21 09:44:42.841 1 INFO STARTUP <main> StaticPlatformBuilder:
////////////////////// // Node is Starting // //////////////////////
node3 1.301s 2025-11-21 09:44:42.851 3 INFO STARTUP <main> Browser: The following nodes [3] are set to run locally
node3 1.308s 2025-11-21 09:44:42.858 4 INFO STARTUP <main> PlatformTestingToolMain: Registering PlatformTestingToolState with ConstructableRegistry
node3 1.337s 2025-11-21 09:44:42.887 5 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node3 1.338s 2025-11-21 09:44:42.888 6 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node3 1.339s 2025-11-21 09:44:42.889 7 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node3 1.340s 2025-11-21 09:44:42.890 8 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node3 1.340s 2025-11-21 09:44:42.890 9 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node3 1.341s 2025-11-21 09:44:42.891 10 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node3 1.341s 2025-11-21 09:44:42.891 11 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node3 1.342s 2025-11-21 09:44:42.892 12 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node3 1.343s 2025-11-21 09:44:42.893 13 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node3 1.343s 2025-11-21 09:44:42.893 14 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node3 1.343s 2025-11-21 09:44:42.893 15 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node3 1.344s 2025-11-21 09:44:42.894 16 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node3 1.344s 2025-11-21 09:44:42.894 17 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node3 1.344s 2025-11-21 09:44:42.894 18 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node3 1.345s 2025-11-21 09:44:42.895 19 INFO STARTUP <main> PlatformTestingToolMain: PlatformTestingToolState is registered with ConstructableRegistry: -4571139351850460298
node2 1.390s 2025-11-21 09:44:42.940 2 DEBUG STARTUP <main> StaticPlatformBuilder: main() started {} [com.swirlds.logging.legacy.payload.NodeStartPayload]
node2 1.533s 2025-11-21 09:44:43.083 3 INFO STARTUP <main> Browser: The following nodes [2] are set to run locally
node2 1.541s 2025-11-21 09:44:43.091 4 INFO STARTUP <main> PlatformTestingToolMain: Registering PlatformTestingToolState with ConstructableRegistry
node2 1.572s 2025-11-21 09:44:43.122 5 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node2 1.573s 2025-11-21 09:44:43.123 6 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node2 1.575s 2025-11-21 09:44:43.125 7 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node2 1.576s 2025-11-21 09:44:43.126 8 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node2 1.577s 2025-11-21 09:44:43.127 9 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node2 1.577s 2025-11-21 09:44:43.127 10 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node2 1.578s 2025-11-21 09:44:43.128 11 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node2 1.579s 2025-11-21 09:44:43.129 12 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node2 1.579s 2025-11-21 09:44:43.129 13 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node2 1.580s 2025-11-21 09:44:43.130 14 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node2 1.580s 2025-11-21 09:44:43.130 15 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node2 1.580s 2025-11-21 09:44:43.130 16 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node2 1.581s 2025-11-21 09:44:43.131 17 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node2 1.581s 2025-11-21 09:44:43.131 18 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node2 1.582s 2025-11-21 09:44:43.132 19 INFO STARTUP <main> PlatformTestingToolMain: PlatformTestingToolState is registered with ConstructableRegistry: -4571139351850460298
node0 1.663s 2025-11-21 09:44:43.213 23 DEBUG STARTUP <main> BootstrapUtils: Done with registerConstructables, time taken 975ms
node1 1.704s 2025-11-21 09:44:43.254 23 DEBUG STARTUP <main> BootstrapUtils: Done with registerConstructables, time taken 820ms
node0 1.710s 2025-11-21 09:44:43.260 24 INFO STARTUP <main> PrometheusEndpoint: PrometheusEndpoint: Starting server listing on port: 9999
node1 1.756s 2025-11-21 09:44:43.306 24 INFO STARTUP <main> PrometheusEndpoint: PrometheusEndpoint: Starting server listing on port: 9999
node3 1.764s 2025-11-21 09:44:43.314 22 DEBUG STARTUP <main> BootstrapUtils: Scanning the classpath for RuntimeConstructable classes
node0 1.783s 2025-11-21 09:44:43.333 25 WARN STARTUP <main> CryptoStatic: There are no keys on disk, Adhoc keys will be generated, but this is incompatible with DAB.
node0 1.785s 2025-11-21 09:44:43.335 26 DEBUG STARTUP <main> CryptoStatic: Started generating keys
node1 1.818s 2025-11-21 09:44:43.368 25 WARN STARTUP <main> CryptoStatic: There are no keys on disk, Adhoc keys will be generated, but this is incompatible with DAB.
node1 1.818s 2025-11-21 09:44:43.368 26 DEBUG STARTUP <main> CryptoStatic: Started generating keys
node2 2.012s 2025-11-21 09:44:43.562 22 DEBUG STARTUP <main> BootstrapUtils: Scanning the classpath for RuntimeConstructable classes
node3 2.593s 2025-11-21 09:44:44.143 23 DEBUG STARTUP <main> BootstrapUtils: Done with registerConstructables, time taken 828ms
node3 2.650s 2025-11-21 09:44:44.200 24 INFO STARTUP <main> PrometheusEndpoint: PrometheusEndpoint: Starting server listing on port: 9999
node3 2.722s 2025-11-21 09:44:44.272 25 WARN STARTUP <main> CryptoStatic: There are no keys on disk, Adhoc keys will be generated, but this is incompatible with DAB.
node3 2.723s 2025-11-21 09:44:44.273 26 DEBUG STARTUP <main> CryptoStatic: Started generating keys
node2 3.193s 2025-11-21 09:44:44.743 23 DEBUG STARTUP <main> BootstrapUtils: Done with registerConstructables, time taken 1180ms
node2 3.243s 2025-11-21 09:44:44.793 24 INFO STARTUP <main> PrometheusEndpoint: PrometheusEndpoint: Starting server listing on port: 9999
node2 3.304s 2025-11-21 09:44:44.854 25 WARN STARTUP <main> CryptoStatic: There are no keys on disk, Adhoc keys will be generated, but this is incompatible with DAB.
node2 3.305s 2025-11-21 09:44:44.855 26 DEBUG STARTUP <main> CryptoStatic: Started generating keys
node0 3.821s 2025-11-21 09:44:45.371 27 DEBUG STARTUP <main> CryptoStatic: Done generating keys
node1 3.854s 2025-11-21 09:44:45.404 27 DEBUG STARTUP <main> CryptoStatic: Done generating keys
node0 3.912s 2025-11-21 09:44:45.462 30 INFO STARTUP <main> StartupStateUtils: No saved states were found on disk.
node0 3.913s 2025-11-21 09:44:45.463 31 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 3.914s 2025-11-21 09:44:45.464 32 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 3.914s 2025-11-21 09:44:45.464 33 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 3.915s 2025-11-21 09:44:45.465 34 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 3.915s 2025-11-21 09:44:45.465 35 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 3.915s 2025-11-21 09:44:45.465 36 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 3.916s 2025-11-21 09:44:45.466 37 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node1 3.931s 2025-11-21 09:44:45.481 30 INFO STARTUP <main> StartupStateUtils: No saved states were found on disk.
node1 3.932s 2025-11-21 09:44:45.482 31 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node1 3.933s 2025-11-21 09:44:45.483 32 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node1 3.933s 2025-11-21 09:44:45.483 33 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node1 3.933s 2025-11-21 09:44:45.483 34 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node1 3.933s 2025-11-21 09:44:45.483 35 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node1 3.934s 2025-11-21 09:44:45.484 36 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node1 3.934s 2025-11-21 09:44:45.484 37 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node3 4.703s 2025-11-21 09:44:46.253 27 DEBUG STARTUP <main> CryptoStatic: Done generating keys
node1 4.710s 2025-11-21 09:44:46.260 46 INFO STARTUP <main> BootstrapUtils: Not upgrading software, current software is version SemanticVersion[major=1, minor=0, patch=0, pre=, build=].
node0 4.714s 2025-11-21 09:44:46.264 46 INFO STARTUP <main> BootstrapUtils: Not upgrading software, current software is version SemanticVersion[major=1, minor=0, patch=0, pre=, build=].
node1 4.715s 2025-11-21 09:44:46.265 47 INFO STARTUP <main> AddressBookInitializer: Starting from genesis: using the config address book.
node0 4.719s 2025-11-21 09:44:46.269 47 INFO STARTUP <main> AddressBookInitializer: Starting from genesis: using the config address book.
node3 4.791s 2025-11-21 09:44:46.341 30 INFO STARTUP <main> StartupStateUtils: No saved states were found on disk.
node3 4.792s 2025-11-21 09:44:46.342 31 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node3 4.793s 2025-11-21 09:44:46.343 32 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node3 4.793s 2025-11-21 09:44:46.343 33 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node3 4.793s 2025-11-21 09:44:46.343 34 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node3 4.794s 2025-11-21 09:44:46.344 35 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node3 4.794s 2025-11-21 09:44:46.344 36 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node3 4.794s 2025-11-21 09:44:46.344 37 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node2 5.281s 2025-11-21 09:44:46.831 27 DEBUG STARTUP <main> CryptoStatic: Done generating keys
node2 5.373s 2025-11-21 09:44:46.923 30 INFO STARTUP <main> StartupStateUtils: No saved states were found on disk.
node2 5.374s 2025-11-21 09:44:46.924 31 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node2 5.374s 2025-11-21 09:44:46.924 32 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node2 5.374s 2025-11-21 09:44:46.924 33 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node2 5.374s 2025-11-21 09:44:46.924 34 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node2 5.375s 2025-11-21 09:44:46.925 35 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node2 5.375s 2025-11-21 09:44:46.925 36 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node2 5.375s 2025-11-21 09:44:46.925 37 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node3 5.619s 2025-11-21 09:44:47.169 46 INFO STARTUP <main> BootstrapUtils: Not upgrading software, current software is version SemanticVersion[major=1, minor=0, patch=0, pre=, build=].
node3 5.625s 2025-11-21 09:44:47.175 47 INFO STARTUP <main> AddressBookInitializer: Starting from genesis: using the config address book.
node1 5.831s 2025-11-21 09:44:47.381 48 INFO STARTUP <main> OSHealthChecker:
PASSED - Clock Source Speed Check Report[callsPerSec=26261279] PASSED - Entropy Check Report[success=true, entropySource=Strong Instance, elapsedNanos=200980, randomLong=-6782753399371370361, exception=null] PASSED - Entropy Check Report[success=true, entropySource=NativePRNGBlocking:SUN, elapsedNanos=11190, randomLong=7055653462749962332, exception=null] PASSED - File System Check Report[code=SUCCESS, readNanos=1112341, data=35, exception=null] OS Health Check Report - Complete (took 1021 ms)
node0 5.833s 2025-11-21 09:44:47.383 48 INFO STARTUP <main> OSHealthChecker:
PASSED - Clock Source Speed Check Report[callsPerSec=26323875] PASSED - Entropy Check Report[success=true, entropySource=Strong Instance, elapsedNanos=352550, randomLong=-541494310772225933, exception=null] PASSED - Entropy Check Report[success=true, entropySource=NativePRNGBlocking:SUN, elapsedNanos=11491, randomLong=7992080916327036468, exception=null] PASSED - File System Check Report[code=SUCCESS, readNanos=1061130, data=35, exception=null] OS Health Check Report - Complete (took 1021 ms)
node1 5.861s 2025-11-21 09:44:47.411 49 DEBUG STARTUP <main> BootstrapUtils: jvmPauseDetectorThread started
node0 5.863s 2025-11-21 09:44:47.413 49 DEBUG STARTUP <main> BootstrapUtils: jvmPauseDetectorThread started
node1 5.869s 2025-11-21 09:44:47.419 50 INFO STARTUP <main> StandardScratchpad: Scratchpad platform.iss contents:
LAST_ISS_ROUND null
node0 5.870s 2025-11-21 09:44:47.420 50 INFO STARTUP <main> StandardScratchpad: Scratchpad platform.iss contents:
LAST_ISS_ROUND null
node1 5.871s 2025-11-21 09:44:47.421 51 INFO STARTUP <main> PlatformBuilder: Default platform pool parallelism: 8
node0 5.872s 2025-11-21 09:44:47.422 51 INFO STARTUP <main> PlatformBuilder: Default platform pool parallelism: 8
node1 5.947s 2025-11-21 09:44:47.497 52 INFO STARTUP <main> SwirldsPlatform: Starting with roster history:
RosterHistory[ currentRosterRound: 0 ][ no previous roster set ] Current Roster: { "rosterEntries": [{ "weight": "2685636917", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAK05TS8KZeb1MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTEwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTEwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDBoP9dI3K1PRLRK7h90D9eNCfgzuHTyJi70yDEs90XJXlE6jmgf1NE2av83VAhQHLxu8Ehc/55M9Ayx9IQc0zJLSS+IrRM9QwqoG8ZvNdRgNw+je3V/8rAK/mHId+cPnnyDplCyskyi5kWCv6kTULIewFH8/KVZwhe0/hB2+N6ujWixURrxjjGLHA6b2gPoGAb/nxiVOn+L0cWcOzcyiYShxagj0FBWV7AxKx65Ynzfe7eF0gOzBUA+IM10OM5KXJejk53Xz5KpEyGe8htO/bXFlpLdm3UzrYiIhY0oKPYKECAC1s+VAZA6i+MV0nDpqDgxHRRXD8O2arauPhEI6iVT9f05AtzElrs7U95HbpQUuP1sxkaQw+bLdMOQHHMVCgMgw2g0eDdVDAMJD7wjZ+Bs6kDc/EJELb0l1uy2GEnOZMiHkK4K1r4IyZ/ed6QpyIRKfBCNyT5IIpMoVpzRYxVXgjgFdudd8iErKyvSXHThU6nu92c+vSd+FLBFHPpb6ECAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdga5NYtV48uDCd4vIsmpGWpKuUHtDVDlCvzHc2ij8DxAR6OFp+hIRNEBXkzg1KS5qP8Wba5ptmGoV4f89HemP+AL3Azde+HjpYRtffdfTdQwmMbw7xJg2lKkEo11gDo5+zPZnVbfb3FsZ+IXKji0QshQBfg+ddTkFG3TJG1ttq3ZDw94RxFQivVnkj1p+Ogel/DuBNRWQobFVe5VrmJqbuwwN8AdrPae1dMrkZatF91On5+cpVLGfk96fYUhDohDt6KKQ6DdhvFk5rhd0vsHGMQq2gAW2+Or6ZVsKkHKx8CPINpJVKAdpE0tItI+loMO02jf9oRI/8cThWP1vNAeWnr0D6m275EZf/4qem/DdJ0FJIVou3P7tsq7eSdueDnj5RmcbW/vOBtvlXpD3SqsVRn6sltZ0sk24p+6ZMzopevCZEMf/nL3OzGvSadisXb39H9DgwkNLlefju1QLgHWf0TGfeNHluDgVDhU8+/1/KUGtr2SnZ5EVO1l59FWHALj", "gossipEndpoint": [{ "ipAddressV4": "I8Hnwg==", "port": 30124 }, { "ipAddressV4": "CoAAVg==", "port": 30124 }] }, { "nodeId": "1", "weight": "15745067016", "gossipCaCertificate": "MIIDpjCCAg6gAwIBAgIIHWg7e2Q/smQwDQYJKoZIhvcNAQEMBQAwEjEQMA4GA1UEAxMHcy1ub2RlMjAgFw0wMDAxMDEwMDAwMDBaGA8yMTAwMDEwMTAwMDAwMFowEjEQMA4GA1UEAxMHcy1ub2RlMjCCAaIwDQYJKoZIhvcNAQEBBQADggGPADCCAYoCggGBAKr5WsBepS3+y/0/yfBjzMWje7zianEz7sszrNWV3cGu2KUlR7v2+9wp/EtX1+BdcGlTTojgFs5nEBN4lM76Cp6JjFH461yN8GSkIkpe8GZnb1w4KEjZj5UYMbq+qOUI6QmwmgLeO8RHAsS6lCP1AyGFalb2ZVJ09DcYDxCRXeFj4BqvNbtD5r5DTCtpVT4ax3eb3pzNSGsjQUG9zhyp/WcsAmwmzKdMl72tk6qF8tlAWXyzwiCujWHS0Kln0C5pyEjeFNsG299toC4pgT8juxijgseTeIFRnNHmGSeSmXpAkEELlwLKR8HOnqeiS5UXNqdbxNemx/EpJSc5rTB6kzLX24dIuRsgyIIFWx73goOzmaHUolN4xmenifoMYlSNNM07WrsvmjRC5OLc/uGhdWqhZGBCH6AJB8Cmw84QLXVdHE6LiueP1oMd7g++N4X880wJkuh0ebfV3i7etUIn0jLlM50AkRucG9kwZDJ/M4LY7FT2F85R1/o2FaB/537ARQIDAQABMA0GCSqGSIb3DQEBDAUAA4IBgQB5lTkqYw0hEW+BJTFsQ8jEHfIDNRJ0kNbVuibfP+u7kzlJy15lCEi+Qw6E3d8hA1QBX3xJMxNBlrtYPrdG26hh/tOwo5Np/OfxQC5jo0Q7n7hu7aLxZRUB/q7AfdDbOun4Za6rJhT3+EsFocyARWp8bYSk3YILBMkP+2VYDRkgQidzKgKtO5yv21Y9sEgziSprc+dQb/tqn5aQZLWavFwCLwnB3t4r4qwLHkkH00Jw51uOvLeM49/t333V5Caa7wmWzMcE+KSWW0QWFRxeJrodSyjPdmDi4D8lKN5WJHSAU5L2yWIODUyWD/cvsAapTv7xXk9ja/Ssb9DpMQnM1xh0hYaESajNeL1QbGuZgPxAwrw981h7kprR2P2iMGRVGA6u4ezxmhW3s7D+yJ3+Yxs/x2J/sw65Z16mRYXRWYWHQmhgaVQjIviiAkVB6CWZo1kHl/eYaVedQzKlrTpbr3JtmwGwhYEOnrkzsC63h8/AG9gRtIAIGWGqTPWbn2pEm8M=", "gossipEndpoint": [{ "ipAddressV4": "IiqREA==", "port": 30125 }, { "ipAddressV4": "CoAAXA==", "port": 30125 }] }, { "nodeId": "2", "weight": "15152326407", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAJg3GRFp5bT9MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTMwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTMwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQCl5ut2dCleDmgEneRYpAKa9Pe2qnXzgF+BEIuTfizG2OcPQi/ltv+6HxSrJXtuWNaiX/G4iP7iBzWj2ysaAYwfYj0ezTSMLRqM9hXzVgLtW0LJEF6a8vUXPsJt4GEJkUKiYCCO1MP1NLd3y/3SVJrFhwJSPqKYm2pQNg84WfPDWSkzSneOIO4Z0uWDXgs+vzSNyChWOxVieFQhLjcELtyj6narmLox+Jdo/SxUzPuktuFB3ebNgUqWPkjljgZpl00BTmbRIVHgHfDVulo2PBpXd0VplIDgdPr5zMKdTrKCuDKey8Mft72RkPKMe9LZVZ/21+rXVEh+olvvUCySsP2RkWPUJJD90c8wKo01rZsjAOXscJKQcBYlam5XXO4ZBRYzEdxuivbkPwsOoQ83swCR3alPvwfbg11Va+zXE6sRbUM9LqkYo/M3Hwg8tSIXu8oah6csputanz867dzWwyVJEPzmiXZ6ncVDQO31QlB7RndWCqKTjOQpnpblUMsrE9MCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAnUA8+kz7L+eSOm/iVvUNYF10PKO2nZtxWWL7R1vwK/2Up765PwqxKb0eSEM4bjgvZq1GuGXs9X/Y7dos42yntXvgeUY+/2JzCnw4J5tzxytZ+IKX6DR67NjDzDzVZQfptjLQrb8E7yzml0uxsqrhNPWl57Bmfe66Kg2lD11jImeeEhExlRggFukoiUWVwRNU21Q1jMUWrg2ZwfP+6fFTgRt0WR+X5zkyYPbvI6/yv7reYGjPDuZTOFhbwG8LUTQxdttDswPjnQ606kMyninL+aNelSdV/UIII7lpr/dTvgQAnrlBaGXvdy6brh3wWEwia0FZFZcKEs6M+jZ3MrFxvlTfUIdI3jRq12L10cCDi2VhORg4JmvlM+Tk6kJeSku30ZLAVo3S7GbTdvkuesOxz3UwnF7yfOA1KYOPvhv1oLxGV5z05glsn1OBKnXMdzsKFbAYYHj81bgBni2WLuIpv3oXlai2uc4y9m8LvWAQ+h/ivyog34Ai3Pvr5ZZOFgjy", "gossipEndpoint": [{ "ipAddressV4": "iHQF1Q==", "port": 30126 }, { "ipAddressV4": "CoAAXQ==", "port": 30126 }] }, { "nodeId": "3", "weight": "16416969660", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAN7hww13zBZEMA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTQwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTQwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDK/bVyv0ZUeJZ4cIOImM+wmqtYjCw4jPAC549WQPPV1vG0lzSpgV+nRKqmWBexhLlKN3bsvrfNCUpKSq8meFyCtdppT1dhUOmEZcoNhLZzqxXb2HYYqRPv82tR+tbh+27WFsBOOqYrYTvr72ECD7qDOuw/Xob6KImaw/b/SIAPecMoYy25fkgYkJSETwd8HUpwssYH/JTLBF8eGjjTTMuu14ARQKeH8BXSs+jjV1+3IItXERS8ryUGDjqc5vC8ZW1kDVQbb91IDxRjqZbFyhuasocCqTAcZuiEgE8Wilwp2g1vbAUnHnvKNfiaEAHoEV6vF4lelaWhOnN2U5tnox/ns6PiDqIbOfs0pmXxjAK0vxc6oZM3TwdRtzo6cSb/AYfQdnmQzkra980kHN12r3f7PK2PzGBuVUPT7fLGA4S3vQDYO4rqcgTc/OLobtqLtdBusOFjZscfIfUW4GVWJUI1j+fwvHacxWLmyZwlQ5Q47UtrtjWpFru7CTn5S477lqMCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdW6AWDhT0eOJw+0O6MYngmCgkXfFsgBC/B1plaE596hHo58FHxzCNiLFdvfRj37rxujvqsDAkADWUmOzLzLHYMXu302HzDqAMNY6FZJc32y4ZDsIQpaUOAuiNHAHwFXuPRInVpCqztfJMgw4RhOhcCTEsoIJsqoIN1t4M0pEVAv6x3nJwFKZqSNOZrQ7sOW32FjwWS3kHwRsCTtqdk5n2KxU6wr/fggV3QsSPRMYro8sUfwu93mqggtswwWqfeKlsz5WiaR9aqLnb8z1R6HLvA0bcoPWzjgn8RdP+9we4z06iZ5vdBuNpwBjrCKUELWISyAoekLGGxyS8pPqYiSBRNUoaPITSuUjcCBbJ9EFvm72QgCBesbwF71KPabTPbMPhLmf+uAi+zmeu8ZeVvT6DrX9OHSkIvIEQFry9BrqOT3ce6KBHSO1HpXIetj5Wcd3WHXtz9ulBL9ikWC8eh7/+we51ucmLvFzNKznElhT2Dp+czXUVNEUjp3u/66pyRA4", "gossipEndpoint": [{ "ipAddressV4": "I9+TMQ==", "port": 30127 }, { "ipAddressV4": "CoAATg==", "port": 30127 }] }] }
node0 5.949s 2025-11-21 09:44:47.499 52 INFO STARTUP <main> SwirldsPlatform: Starting with roster history:
RosterHistory[ currentRosterRound: 0 ][ no previous roster set ] Current Roster: { "rosterEntries": [{ "weight": "2685636917", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAK05TS8KZeb1MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTEwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTEwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDBoP9dI3K1PRLRK7h90D9eNCfgzuHTyJi70yDEs90XJXlE6jmgf1NE2av83VAhQHLxu8Ehc/55M9Ayx9IQc0zJLSS+IrRM9QwqoG8ZvNdRgNw+je3V/8rAK/mHId+cPnnyDplCyskyi5kWCv6kTULIewFH8/KVZwhe0/hB2+N6ujWixURrxjjGLHA6b2gPoGAb/nxiVOn+L0cWcOzcyiYShxagj0FBWV7AxKx65Ynzfe7eF0gOzBUA+IM10OM5KXJejk53Xz5KpEyGe8htO/bXFlpLdm3UzrYiIhY0oKPYKECAC1s+VAZA6i+MV0nDpqDgxHRRXD8O2arauPhEI6iVT9f05AtzElrs7U95HbpQUuP1sxkaQw+bLdMOQHHMVCgMgw2g0eDdVDAMJD7wjZ+Bs6kDc/EJELb0l1uy2GEnOZMiHkK4K1r4IyZ/ed6QpyIRKfBCNyT5IIpMoVpzRYxVXgjgFdudd8iErKyvSXHThU6nu92c+vSd+FLBFHPpb6ECAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdga5NYtV48uDCd4vIsmpGWpKuUHtDVDlCvzHc2ij8DxAR6OFp+hIRNEBXkzg1KS5qP8Wba5ptmGoV4f89HemP+AL3Azde+HjpYRtffdfTdQwmMbw7xJg2lKkEo11gDo5+zPZnVbfb3FsZ+IXKji0QshQBfg+ddTkFG3TJG1ttq3ZDw94RxFQivVnkj1p+Ogel/DuBNRWQobFVe5VrmJqbuwwN8AdrPae1dMrkZatF91On5+cpVLGfk96fYUhDohDt6KKQ6DdhvFk5rhd0vsHGMQq2gAW2+Or6ZVsKkHKx8CPINpJVKAdpE0tItI+loMO02jf9oRI/8cThWP1vNAeWnr0D6m275EZf/4qem/DdJ0FJIVou3P7tsq7eSdueDnj5RmcbW/vOBtvlXpD3SqsVRn6sltZ0sk24p+6ZMzopevCZEMf/nL3OzGvSadisXb39H9DgwkNLlefju1QLgHWf0TGfeNHluDgVDhU8+/1/KUGtr2SnZ5EVO1l59FWHALj", "gossipEndpoint": [{ "ipAddressV4": "I8Hnwg==", "port": 30124 }, { "ipAddressV4": "CoAAVg==", "port": 30124 }] }, { "nodeId": "1", "weight": "15745067016", "gossipCaCertificate": "MIIDpjCCAg6gAwIBAgIIHWg7e2Q/smQwDQYJKoZIhvcNAQEMBQAwEjEQMA4GA1UEAxMHcy1ub2RlMjAgFw0wMDAxMDEwMDAwMDBaGA8yMTAwMDEwMTAwMDAwMFowEjEQMA4GA1UEAxMHcy1ub2RlMjCCAaIwDQYJKoZIhvcNAQEBBQADggGPADCCAYoCggGBAKr5WsBepS3+y/0/yfBjzMWje7zianEz7sszrNWV3cGu2KUlR7v2+9wp/EtX1+BdcGlTTojgFs5nEBN4lM76Cp6JjFH461yN8GSkIkpe8GZnb1w4KEjZj5UYMbq+qOUI6QmwmgLeO8RHAsS6lCP1AyGFalb2ZVJ09DcYDxCRXeFj4BqvNbtD5r5DTCtpVT4ax3eb3pzNSGsjQUG9zhyp/WcsAmwmzKdMl72tk6qF8tlAWXyzwiCujWHS0Kln0C5pyEjeFNsG299toC4pgT8juxijgseTeIFRnNHmGSeSmXpAkEELlwLKR8HOnqeiS5UXNqdbxNemx/EpJSc5rTB6kzLX24dIuRsgyIIFWx73goOzmaHUolN4xmenifoMYlSNNM07WrsvmjRC5OLc/uGhdWqhZGBCH6AJB8Cmw84QLXVdHE6LiueP1oMd7g++N4X880wJkuh0ebfV3i7etUIn0jLlM50AkRucG9kwZDJ/M4LY7FT2F85R1/o2FaB/537ARQIDAQABMA0GCSqGSIb3DQEBDAUAA4IBgQB5lTkqYw0hEW+BJTFsQ8jEHfIDNRJ0kNbVuibfP+u7kzlJy15lCEi+Qw6E3d8hA1QBX3xJMxNBlrtYPrdG26hh/tOwo5Np/OfxQC5jo0Q7n7hu7aLxZRUB/q7AfdDbOun4Za6rJhT3+EsFocyARWp8bYSk3YILBMkP+2VYDRkgQidzKgKtO5yv21Y9sEgziSprc+dQb/tqn5aQZLWavFwCLwnB3t4r4qwLHkkH00Jw51uOvLeM49/t333V5Caa7wmWzMcE+KSWW0QWFRxeJrodSyjPdmDi4D8lKN5WJHSAU5L2yWIODUyWD/cvsAapTv7xXk9ja/Ssb9DpMQnM1xh0hYaESajNeL1QbGuZgPxAwrw981h7kprR2P2iMGRVGA6u4ezxmhW3s7D+yJ3+Yxs/x2J/sw65Z16mRYXRWYWHQmhgaVQjIviiAkVB6CWZo1kHl/eYaVedQzKlrTpbr3JtmwGwhYEOnrkzsC63h8/AG9gRtIAIGWGqTPWbn2pEm8M=", "gossipEndpoint": [{ "ipAddressV4": "IiqREA==", "port": 30125 }, { "ipAddressV4": "CoAAXA==", "port": 30125 }] }, { "nodeId": "2", "weight": "15152326407", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAJg3GRFp5bT9MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTMwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTMwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQCl5ut2dCleDmgEneRYpAKa9Pe2qnXzgF+BEIuTfizG2OcPQi/ltv+6HxSrJXtuWNaiX/G4iP7iBzWj2ysaAYwfYj0ezTSMLRqM9hXzVgLtW0LJEF6a8vUXPsJt4GEJkUKiYCCO1MP1NLd3y/3SVJrFhwJSPqKYm2pQNg84WfPDWSkzSneOIO4Z0uWDXgs+vzSNyChWOxVieFQhLjcELtyj6narmLox+Jdo/SxUzPuktuFB3ebNgUqWPkjljgZpl00BTmbRIVHgHfDVulo2PBpXd0VplIDgdPr5zMKdTrKCuDKey8Mft72RkPKMe9LZVZ/21+rXVEh+olvvUCySsP2RkWPUJJD90c8wKo01rZsjAOXscJKQcBYlam5XXO4ZBRYzEdxuivbkPwsOoQ83swCR3alPvwfbg11Va+zXE6sRbUM9LqkYo/M3Hwg8tSIXu8oah6csputanz867dzWwyVJEPzmiXZ6ncVDQO31QlB7RndWCqKTjOQpnpblUMsrE9MCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAnUA8+kz7L+eSOm/iVvUNYF10PKO2nZtxWWL7R1vwK/2Up765PwqxKb0eSEM4bjgvZq1GuGXs9X/Y7dos42yntXvgeUY+/2JzCnw4J5tzxytZ+IKX6DR67NjDzDzVZQfptjLQrb8E7yzml0uxsqrhNPWl57Bmfe66Kg2lD11jImeeEhExlRggFukoiUWVwRNU21Q1jMUWrg2ZwfP+6fFTgRt0WR+X5zkyYPbvI6/yv7reYGjPDuZTOFhbwG8LUTQxdttDswPjnQ606kMyninL+aNelSdV/UIII7lpr/dTvgQAnrlBaGXvdy6brh3wWEwia0FZFZcKEs6M+jZ3MrFxvlTfUIdI3jRq12L10cCDi2VhORg4JmvlM+Tk6kJeSku30ZLAVo3S7GbTdvkuesOxz3UwnF7yfOA1KYOPvhv1oLxGV5z05glsn1OBKnXMdzsKFbAYYHj81bgBni2WLuIpv3oXlai2uc4y9m8LvWAQ+h/ivyog34Ai3Pvr5ZZOFgjy", "gossipEndpoint": [{ "ipAddressV4": "iHQF1Q==", "port": 30126 }, { "ipAddressV4": "CoAAXQ==", "port": 30126 }] }, { "nodeId": "3", "weight": "16416969660", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAN7hww13zBZEMA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTQwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTQwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDK/bVyv0ZUeJZ4cIOImM+wmqtYjCw4jPAC549WQPPV1vG0lzSpgV+nRKqmWBexhLlKN3bsvrfNCUpKSq8meFyCtdppT1dhUOmEZcoNhLZzqxXb2HYYqRPv82tR+tbh+27WFsBOOqYrYTvr72ECD7qDOuw/Xob6KImaw/b/SIAPecMoYy25fkgYkJSETwd8HUpwssYH/JTLBF8eGjjTTMuu14ARQKeH8BXSs+jjV1+3IItXERS8ryUGDjqc5vC8ZW1kDVQbb91IDxRjqZbFyhuasocCqTAcZuiEgE8Wilwp2g1vbAUnHnvKNfiaEAHoEV6vF4lelaWhOnN2U5tnox/ns6PiDqIbOfs0pmXxjAK0vxc6oZM3TwdRtzo6cSb/AYfQdnmQzkra980kHN12r3f7PK2PzGBuVUPT7fLGA4S3vQDYO4rqcgTc/OLobtqLtdBusOFjZscfIfUW4GVWJUI1j+fwvHacxWLmyZwlQ5Q47UtrtjWpFru7CTn5S477lqMCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdW6AWDhT0eOJw+0O6MYngmCgkXfFsgBC/B1plaE596hHo58FHxzCNiLFdvfRj37rxujvqsDAkADWUmOzLzLHYMXu302HzDqAMNY6FZJc32y4ZDsIQpaUOAuiNHAHwFXuPRInVpCqztfJMgw4RhOhcCTEsoIJsqoIN1t4M0pEVAv6x3nJwFKZqSNOZrQ7sOW32FjwWS3kHwRsCTtqdk5n2KxU6wr/fggV3QsSPRMYro8sUfwu93mqggtswwWqfeKlsz5WiaR9aqLnb8z1R6HLvA0bcoPWzjgn8RdP+9we4z06iZ5vdBuNpwBjrCKUELWISyAoekLGGxyS8pPqYiSBRNUoaPITSuUjcCBbJ9EFvm72QgCBesbwF71KPabTPbMPhLmf+uAi+zmeu8ZeVvT6DrX9OHSkIvIEQFry9BrqOT3ce6KBHSO1HpXIetj5Wcd3WHXtz9ulBL9ikWC8eh7/+we51ucmLvFzNKznElhT2Dp+czXUVNEUjp3u/66pyRA4", "gossipEndpoint": [{ "ipAddressV4": "I9+TMQ==", "port": 30127 }, { "ipAddressV4": "CoAATg==", "port": 30127 }] }] }
node0 6.044s 2025-11-21 09:44:47.594 53 INFO STARTUP <main> PlatformTestingToolState: Trigger and PreviousSoftwareVersion state received in init function {"trigger":"GENESIS","previousSoftwareVersion":"null"} [com.swirlds.logging.legacy.payload.SoftwareVersionPayload]
node0 6.045s 2025-11-21 09:44:47.595 54 INFO STARTUP <main> PlatformTestingToolState: Set QuorumResult from genesisInit()
node1 6.048s 2025-11-21 09:44:47.598 53 INFO STARTUP <main> PlatformTestingToolState: Trigger and PreviousSoftwareVersion state received in init function {"trigger":"GENESIS","previousSoftwareVersion":"null"} [com.swirlds.logging.legacy.payload.SoftwareVersionPayload]
node1 6.049s 2025-11-21 09:44:47.599 54 INFO STARTUP <main> PlatformTestingToolState: Set QuorumResult from genesisInit()
node0 6.060s 2025-11-21 09:44:47.610 55 INFO STARTUP <main> StateInitializer: The platform is using the following initial state:
Round: 0 Timestamp: 1970-01-01T00:00:00Z Next consensus number: 0 Legacy running event hash: null Legacy running event mnemonic: null Rounds non-ancient: 0 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 1 Root hash: 12d9fdd9ebcea76c43761bf5d0089e6a01ec5f4e68b9fbc8693d00d0129f5bd8cdeac8b384d766471efe793af34a3ca4 (root) PlatformTestingToolState / forest-eager-main-barely 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 method-topple-elite-gate 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 null /4 bid-belt-culture-decorate 5 null /5 bid-belt-culture-decorate 6 null /6 bid-belt-culture-decorate 7 IssLeaf /7 biology-capable-expose-purpose 8 null /8 bid-belt-culture-decorate 9 null /9 bid-belt-culture-decorate 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node1 6.064s 2025-11-21 09:44:47.614 55 INFO STARTUP <main> StateInitializer: The platform is using the following initial state:
Round: 0 Timestamp: 1970-01-01T00:00:00Z Next consensus number: 0 Legacy running event hash: null Legacy running event mnemonic: null Rounds non-ancient: 0 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 1 Root hash: 12d9fdd9ebcea76c43761bf5d0089e6a01ec5f4e68b9fbc8693d00d0129f5bd8cdeac8b384d766471efe793af34a3ca4 (root) PlatformTestingToolState / forest-eager-main-barely 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 method-topple-elite-gate 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 null /4 bid-belt-culture-decorate 5 null /5 bid-belt-culture-decorate 6 null /6 bid-belt-culture-decorate 7 IssLeaf /7 biology-capable-expose-purpose 8 null /8 bid-belt-culture-decorate 9 null /9 bid-belt-culture-decorate 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node2 6.234s 2025-11-21 09:44:47.784 46 INFO STARTUP <main> BootstrapUtils: Not upgrading software, current software is version SemanticVersion[major=1, minor=0, patch=0, pre=, build=].
node2 6.241s 2025-11-21 09:44:47.791 47 INFO STARTUP <main> AddressBookInitializer: Starting from genesis: using the config address book.
node1 6.269s 2025-11-21 09:44:47.819 57 INFO EVENT_STREAM <main> DefaultConsensusEventStream: EventStreamManager::updateRunningHash: 38b060a751ac96384cd9327eb1b1e36a21fdb71114be07434c0cc7bf63f6e1da274edebfe76f65fbd51ad2f14898b95b
node1 6.273s 2025-11-21 09:44:47.823 58 INFO STARTUP <platformForkJoinThread-2> Shadowgraph: Shadowgraph starting from expiration threshold 1
node0 6.275s 2025-11-21 09:44:47.825 57 INFO EVENT_STREAM <main> DefaultConsensusEventStream: EventStreamManager::updateRunningHash: 38b060a751ac96384cd9327eb1b1e36a21fdb71114be07434c0cc7bf63f6e1da274edebfe76f65fbd51ad2f14898b95b
node0 6.279s 2025-11-21 09:44:47.829 58 INFO STARTUP <platformForkJoinThread-2> Shadowgraph: Shadowgraph starting from expiration threshold 1
node1 6.282s 2025-11-21 09:44:47.832 59 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -Xms32g
node1 6.283s 2025-11-21 09:44:47.833 60 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -Xmx118g
node1 6.283s 2025-11-21 09:44:47.833 61 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:+UnlockExperimentalVMOptions
node1 6.283s 2025-11-21 09:44:47.833 62 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:+UseZGC
node1 6.284s 2025-11-21 09:44:47.834 63 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:ZAllocationSpikeTolerance=2
node1 6.284s 2025-11-21 09:44:47.834 64 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:ConcGCThreads=14
node1 6.284s 2025-11-21 09:44:47.834 65 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:ZMarkStackSpaceLimit=16g
node1 6.285s 2025-11-21 09:44:47.835 66 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:MaxDirectMemorySize=64g
node1 6.285s 2025-11-21 09:44:47.835 67 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:MetaspaceSize=100M
node1 6.285s 2025-11-21 09:44:47.835 68 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -XX:+ZGenerational
node1 6.285s 2025-11-21 09:44:47.835 69 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -Xlog:gc*:gc.log
node1 6.286s 2025-11-21 09:44:47.836 70 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/jdk.internal.misc=ALL-UNNAMED
node1 6.286s 2025-11-21 09:44:47.836 71 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/java.nio=ALL-UNNAMED
node1 6.287s 2025-11-21 09:44:47.837 72 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: JVM arg: -Dio.netty.tryReflectionSetAccessible=true
node1 6.287s 2025-11-21 09:44:47.837 73 INFO STARTUP <<start-node-1>> PlatformTestingToolMain: Parsing JSON VMerkle-Hotspot-1k-15m.json
node0 6.288s 2025-11-21 09:44:47.838 59 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xms32g
node0 6.289s 2025-11-21 09:44:47.839 60 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xmx118g
node0 6.289s 2025-11-21 09:44:47.839 61 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+UnlockExperimentalVMOptions
node0 6.290s 2025-11-21 09:44:47.840 62 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+UseZGC
node0 6.290s 2025-11-21 09:44:47.840 63 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ZAllocationSpikeTolerance=2
node0 6.290s 2025-11-21 09:44:47.840 64 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ConcGCThreads=14
node0 6.291s 2025-11-21 09:44:47.841 65 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ZMarkStackSpaceLimit=16g
node0 6.291s 2025-11-21 09:44:47.841 66 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:MaxDirectMemorySize=64g
node0 6.291s 2025-11-21 09:44:47.841 67 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:MetaspaceSize=100M
node0 6.291s 2025-11-21 09:44:47.841 68 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+ZGenerational
node0 6.292s 2025-11-21 09:44:47.842 69 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xlog:gc*:gc.log
node0 6.292s 2025-11-21 09:44:47.842 70 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/jdk.internal.misc=ALL-UNNAMED
node0 6.292s 2025-11-21 09:44:47.842 71 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/java.nio=ALL-UNNAMED
node0 6.293s 2025-11-21 09:44:47.843 72 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Dio.netty.tryReflectionSetAccessible=true
node0 6.293s 2025-11-21 09:44:47.843 73 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: Parsing JSON VMerkle-Hotspot-1k-15m.json
node1 6.303s 2025-11-21 09:44:47.853 74 INFO DEMO_INFO <<start-node-1>> PayloadConfig: insertSeq = true
node1 6.304s 2025-11-21 09:44:47.854 75 INFO DEMO_INFO <<start-node-1>> PayloadConfig: appendSig = true
node1 6.304s 2025-11-21 09:44:47.854 76 INFO DEMO_INFO <<start-node-1>> PayloadConfig: variedSize = false
node1 6.305s 2025-11-21 09:44:47.855 77 INFO DEMO_INFO <<start-node-1>> PayloadConfig: payloadByteSize = 100
node1 6.305s 2025-11-21 09:44:47.855 78 INFO DEMO_INFO <<start-node-1>> PayloadConfig: maxByteSize = 100
node1 6.306s 2025-11-21 09:44:47.856 79 INFO DEMO_INFO <<start-node-1>> PayloadConfig: type = TYPE_VIRTUAL_MERKLE_TEST
node1 6.306s 2025-11-21 09:44:47.856 80 INFO DEMO_INFO <<start-node-1>> PayloadConfig: invalidSigRatio = 0.0
node1 6.307s 2025-11-21 09:44:47.857 81 INFO DEMO_INFO <<start-node-1>> TransactionSubmitter: Goal is TRANS_PER_SECOND_PER_NODE targe 1000.0
node0 6.309s 2025-11-21 09:44:47.859 74 INFO DEMO_INFO <<start-node-0>> PayloadConfig: insertSeq = true
node0 6.310s 2025-11-21 09:44:47.860 75 INFO DEMO_INFO <<start-node-0>> PayloadConfig: appendSig = true
node0 6.310s 2025-11-21 09:44:47.860 76 INFO DEMO_INFO <<start-node-0>> PayloadConfig: variedSize = false
node0 6.310s 2025-11-21 09:44:47.860 77 INFO DEMO_INFO <<start-node-0>> PayloadConfig: payloadByteSize = 100
node0 6.311s 2025-11-21 09:44:47.861 78 INFO DEMO_INFO <<start-node-0>> PayloadConfig: maxByteSize = 100
node0 6.311s 2025-11-21 09:44:47.861 79 INFO DEMO_INFO <<start-node-0>> PayloadConfig: type = TYPE_VIRTUAL_MERKLE_TEST
node0 6.312s 2025-11-21 09:44:47.862 80 INFO DEMO_INFO <<start-node-0>> PayloadConfig: invalidSigRatio = 0.0
node0 6.313s 2025-11-21 09:44:47.863 81 INFO DEMO_INFO <<start-node-0>> TransactionSubmitter: Goal is TRANS_PER_SECOND_PER_NODE targe 1000.0
node1 6.313s 2025-11-21 09:44:47.863 82 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: State = com.swirlds.demo.platform.PlatformTestingToolState@1e5762c5
node1 6.314s 2025-11-21 09:44:47.864 83 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: total accounts = 80000
node1 6.314s 2025-11-21 09:44:47.864 84 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: Creating virtualmap for 80000 accounts.
node0 6.318s 2025-11-21 09:44:47.868 82 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: State = com.swirlds.demo.platform.PlatformTestingToolState@4c2fc8aa
node0 6.320s 2025-11-21 09:44:47.870 83 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: total accounts = 80000
node0 6.320s 2025-11-21 09:44:47.870 84 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: Creating virtualmap for 80000 accounts.
node1 6.321s 2025-11-21 09:44:47.871 89 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: accounts VM = com.swirlds.virtualmap.VirtualMap@4e76bb7e, DS = MerkleDbDataSource[initialCapacity=1000000,preferDiskBasedIndexes=false,pathToDiskLocationInternalNodes.size=0,pathToDiskLocationLeafNodes.size=0,hashesRamToDiskThreshold=8388608,hashStoreRam.size=0,hashStoreDisk=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@60f666ff,hasDiskStoreForHashes=true,keyToPath=com.swirlds.merkledb.files.hashmap.HalfDiskHashMap@1b703417,pathToKeyValue=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@4fbe21b3,snapshotInProgress=false]
node0 6.327s 2025-11-21 09:44:47.877 89 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: accounts VM = com.swirlds.virtualmap.VirtualMap@6092b203, DS = MerkleDbDataSource[initialCapacity=1000000,preferDiskBasedIndexes=false,pathToDiskLocationInternalNodes.size=0,pathToDiskLocationLeafNodes.size=0,hashesRamToDiskThreshold=8388608,hashStoreRam.size=0,hashStoreDisk=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@3b046cd4,hasDiskStoreForHashes=true,keyToPath=com.swirlds.merkledb.files.hashmap.HalfDiskHashMap@4b4ef1d2,pathToKeyValue=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@4bd58c39,snapshotInProgress=false]
node1 6.330s 2025-11-21 09:44:47.880 90 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: max KV pairs = 0
node1 6.330s 2025-11-21 09:44:47.880 91 INFO DEMO_INFO <<start-node-1>> VirtualMerkleStateInitializer: total SC = 0
node0 6.335s 2025-11-21 09:44:47.885 90 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: max KV pairs = 0
node1 6.335s 2025-11-21 09:44:47.885 92 INFO DEMO_INFO <<start-node-1>> FCMTransactionPool: Random seed for FCMTransactionPool is -4009296773905290188
node1 6.335s 2025-11-21 09:44:47.885 93 INFO DEMO_INFO <<start-node-1>> FCMTransactionPool: This test will generate sequential FCM payload:
node0 6.336s 2025-11-21 09:44:47.886 91 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: total SC = 0
node0 6.340s 2025-11-21 09:44:47.890 92 INFO DEMO_INFO <<start-node-0>> FCMTransactionPool: Random seed for FCMTransactionPool is -1310193330690447372
node0 6.341s 2025-11-21 09:44:47.891 93 INFO DEMO_INFO <<start-node-0>> FCMTransactionPool: This test will generate sequential FCM payload:
node1 6.415s 2025-11-21 09:44:47.965 94 INFO STARTUP <<start-node-1>> SwirldsPlatform: Starting platform 1
node1 6.417s 2025-11-21 09:44:47.967 95 INFO STARTUP <<platform: recycle-bin-cleanup>> RecycleBinImpl: Deleted 0 files from the recycle bin.
node0 6.418s 2025-11-21 09:44:47.968 94 INFO STARTUP <<start-node-0>> SwirldsPlatform: Starting platform 0
node0 6.420s 2025-11-21 09:44:47.970 95 INFO STARTUP <<platform: recycle-bin-cleanup>> RecycleBinImpl: Deleted 0 files from the recycle bin.
node1 6.420s 2025-11-21 09:44:47.970 96 INFO STARTUP <<start-node-1>> CycleFinder: No cyclical back pressure detected in wiring model.
node1 6.421s 2025-11-21 09:44:47.971 97 INFO STARTUP <<start-node-1>> DirectSchedulerChecks: No illegal direct scheduler use detected in the wiring model.
node1 6.422s 2025-11-21 09:44:47.972 98 INFO STARTUP <<start-node-1>> InputWireChecks: All input wires have been bound.
node0 6.423s 2025-11-21 09:44:47.973 96 INFO STARTUP <<start-node-0>> CycleFinder: No cyclical back pressure detected in wiring model.
node1 6.423s 2025-11-21 09:44:47.973 99 WARN STARTUP <<start-node-1>> PcesFileTracker: No preconsensus event files available
node1 6.423s 2025-11-21 09:44:47.973 100 INFO STARTUP <<start-node-1>> SwirldsPlatform: replaying preconsensus event stream starting at 0
node0 6.424s 2025-11-21 09:44:47.974 97 INFO STARTUP <<start-node-0>> DirectSchedulerChecks: No illegal direct scheduler use detected in the wiring model.
node0 6.424s 2025-11-21 09:44:47.974 98 INFO STARTUP <<start-node-0>> InputWireChecks: All input wires have been bound.
node1 6.425s 2025-11-21 09:44:47.975 101 INFO STARTUP <<start-node-1>> PcesReplayer: Replayed 0 preconsensus events with max birth round -1. These events contained 0 transactions. 0 rounds reached consensus spanning 0.0 nanoseconds of consensus time. The latest round to reach consensus is round 0. Replay took 0.0 nanoseconds.
node0 6.426s 2025-11-21 09:44:47.976 99 WARN STARTUP <<start-node-0>> PcesFileTracker: No preconsensus event files available
node0 6.426s 2025-11-21 09:44:47.976 100 INFO STARTUP <<start-node-0>> SwirldsPlatform: replaying preconsensus event stream starting at 0
node1 6.426s 2025-11-21 09:44:47.976 102 INFO DEMO_INFO <<app: appMain 1>> PlatformTestingToolMain: Node 1 starts transactions ........
node0 6.427s 2025-11-21 09:44:47.977 101 INFO STARTUP <<start-node-0>> PcesReplayer: Replayed 0 preconsensus events with max birth round -1. These events contained 0 transactions. 0 rounds reached consensus spanning 0.0 nanoseconds of consensus time. The latest round to reach consensus is round 0. Replay took 0.0 nanoseconds.
node1 6.427s 2025-11-21 09:44:47.977 103 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 309.0 ms in STARTING_UP. Now in REPLAYING_EVENTS
node0 6.428s 2025-11-21 09:44:47.978 102 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Node 0 starts transactions ........
node1 6.428s 2025-11-21 09:44:47.978 104 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change REPLAYING_EVENTS
node0 6.430s 2025-11-21 09:44:47.980 103 INFO PLATFORM_STATUS <platformForkJoinThread-7> StatusStateMachine: Platform spent 316.0 ms in STARTING_UP. Now in REPLAYING_EVENTS
node0 6.431s 2025-11-21 09:44:47.981 104 INFO STARTUP <platformForkJoinThread-7> PlatformTestingToolMain: Platform Status Change REPLAYING_EVENTS
node1 6.432s 2025-11-21 09:44:47.982 105 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 4.0 ms in REPLAYING_EVENTS. Now in OBSERVING
node1 6.432s 2025-11-21 09:44:47.982 106 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change OBSERVING
node0 6.435s 2025-11-21 09:44:47.985 105 INFO PLATFORM_STATUS <platformForkJoinThread-7> StatusStateMachine: Platform spent 4.0 ms in REPLAYING_EVENTS. Now in OBSERVING
node0 6.435s 2025-11-21 09:44:47.985 106 INFO STARTUP <platformForkJoinThread-7> PlatformTestingToolMain: Platform Status Change OBSERVING
node3 6.749s 2025-11-21 09:44:48.299 48 INFO STARTUP <main> OSHealthChecker:
PASSED - Clock Source Speed Check Report[callsPerSec=26263244] PASSED - Entropy Check Report[success=true, entropySource=Strong Instance, elapsedNanos=329900, randomLong=1719355285945002107, exception=null] PASSED - Entropy Check Report[success=true, entropySource=NativePRNGBlocking:SUN, elapsedNanos=74180, randomLong=-6540029272615456276, exception=null] PASSED - File System Check Report[code=SUCCESS, readNanos=1258971, data=35, exception=null] OS Health Check Report - Complete (took 1022 ms)
node3 6.782s 2025-11-21 09:44:48.332 49 DEBUG STARTUP <main> BootstrapUtils: jvmPauseDetectorThread started
node3 6.791s 2025-11-21 09:44:48.341 50 INFO STARTUP <main> StandardScratchpad: Scratchpad platform.iss contents:
LAST_ISS_ROUND null
node3 6.794s 2025-11-21 09:44:48.344 51 INFO STARTUP <main> PlatformBuilder: Default platform pool parallelism: 8
node3 6.878s 2025-11-21 09:44:48.428 52 INFO STARTUP <main> SwirldsPlatform: Starting with roster history:
RosterHistory[ currentRosterRound: 0 ][ no previous roster set ] Current Roster: { "rosterEntries": [{ "weight": "2685636917", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAK05TS8KZeb1MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTEwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTEwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDBoP9dI3K1PRLRK7h90D9eNCfgzuHTyJi70yDEs90XJXlE6jmgf1NE2av83VAhQHLxu8Ehc/55M9Ayx9IQc0zJLSS+IrRM9QwqoG8ZvNdRgNw+je3V/8rAK/mHId+cPnnyDplCyskyi5kWCv6kTULIewFH8/KVZwhe0/hB2+N6ujWixURrxjjGLHA6b2gPoGAb/nxiVOn+L0cWcOzcyiYShxagj0FBWV7AxKx65Ynzfe7eF0gOzBUA+IM10OM5KXJejk53Xz5KpEyGe8htO/bXFlpLdm3UzrYiIhY0oKPYKECAC1s+VAZA6i+MV0nDpqDgxHRRXD8O2arauPhEI6iVT9f05AtzElrs7U95HbpQUuP1sxkaQw+bLdMOQHHMVCgMgw2g0eDdVDAMJD7wjZ+Bs6kDc/EJELb0l1uy2GEnOZMiHkK4K1r4IyZ/ed6QpyIRKfBCNyT5IIpMoVpzRYxVXgjgFdudd8iErKyvSXHThU6nu92c+vSd+FLBFHPpb6ECAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdga5NYtV48uDCd4vIsmpGWpKuUHtDVDlCvzHc2ij8DxAR6OFp+hIRNEBXkzg1KS5qP8Wba5ptmGoV4f89HemP+AL3Azde+HjpYRtffdfTdQwmMbw7xJg2lKkEo11gDo5+zPZnVbfb3FsZ+IXKji0QshQBfg+ddTkFG3TJG1ttq3ZDw94RxFQivVnkj1p+Ogel/DuBNRWQobFVe5VrmJqbuwwN8AdrPae1dMrkZatF91On5+cpVLGfk96fYUhDohDt6KKQ6DdhvFk5rhd0vsHGMQq2gAW2+Or6ZVsKkHKx8CPINpJVKAdpE0tItI+loMO02jf9oRI/8cThWP1vNAeWnr0D6m275EZf/4qem/DdJ0FJIVou3P7tsq7eSdueDnj5RmcbW/vOBtvlXpD3SqsVRn6sltZ0sk24p+6ZMzopevCZEMf/nL3OzGvSadisXb39H9DgwkNLlefju1QLgHWf0TGfeNHluDgVDhU8+/1/KUGtr2SnZ5EVO1l59FWHALj", "gossipEndpoint": [{ "ipAddressV4": "I8Hnwg==", "port": 30124 }, { "ipAddressV4": "CoAAVg==", "port": 30124 }] }, { "nodeId": "1", "weight": "15745067016", "gossipCaCertificate": "MIIDpjCCAg6gAwIBAgIIHWg7e2Q/smQwDQYJKoZIhvcNAQEMBQAwEjEQMA4GA1UEAxMHcy1ub2RlMjAgFw0wMDAxMDEwMDAwMDBaGA8yMTAwMDEwMTAwMDAwMFowEjEQMA4GA1UEAxMHcy1ub2RlMjCCAaIwDQYJKoZIhvcNAQEBBQADggGPADCCAYoCggGBAKr5WsBepS3+y/0/yfBjzMWje7zianEz7sszrNWV3cGu2KUlR7v2+9wp/EtX1+BdcGlTTojgFs5nEBN4lM76Cp6JjFH461yN8GSkIkpe8GZnb1w4KEjZj5UYMbq+qOUI6QmwmgLeO8RHAsS6lCP1AyGFalb2ZVJ09DcYDxCRXeFj4BqvNbtD5r5DTCtpVT4ax3eb3pzNSGsjQUG9zhyp/WcsAmwmzKdMl72tk6qF8tlAWXyzwiCujWHS0Kln0C5pyEjeFNsG299toC4pgT8juxijgseTeIFRnNHmGSeSmXpAkEELlwLKR8HOnqeiS5UXNqdbxNemx/EpJSc5rTB6kzLX24dIuRsgyIIFWx73goOzmaHUolN4xmenifoMYlSNNM07WrsvmjRC5OLc/uGhdWqhZGBCH6AJB8Cmw84QLXVdHE6LiueP1oMd7g++N4X880wJkuh0ebfV3i7etUIn0jLlM50AkRucG9kwZDJ/M4LY7FT2F85R1/o2FaB/537ARQIDAQABMA0GCSqGSIb3DQEBDAUAA4IBgQB5lTkqYw0hEW+BJTFsQ8jEHfIDNRJ0kNbVuibfP+u7kzlJy15lCEi+Qw6E3d8hA1QBX3xJMxNBlrtYPrdG26hh/tOwo5Np/OfxQC5jo0Q7n7hu7aLxZRUB/q7AfdDbOun4Za6rJhT3+EsFocyARWp8bYSk3YILBMkP+2VYDRkgQidzKgKtO5yv21Y9sEgziSprc+dQb/tqn5aQZLWavFwCLwnB3t4r4qwLHkkH00Jw51uOvLeM49/t333V5Caa7wmWzMcE+KSWW0QWFRxeJrodSyjPdmDi4D8lKN5WJHSAU5L2yWIODUyWD/cvsAapTv7xXk9ja/Ssb9DpMQnM1xh0hYaESajNeL1QbGuZgPxAwrw981h7kprR2P2iMGRVGA6u4ezxmhW3s7D+yJ3+Yxs/x2J/sw65Z16mRYXRWYWHQmhgaVQjIviiAkVB6CWZo1kHl/eYaVedQzKlrTpbr3JtmwGwhYEOnrkzsC63h8/AG9gRtIAIGWGqTPWbn2pEm8M=", "gossipEndpoint": [{ "ipAddressV4": "IiqREA==", "port": 30125 }, { "ipAddressV4": "CoAAXA==", "port": 30125 }] }, { "nodeId": "2", "weight": "15152326407", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAJg3GRFp5bT9MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTMwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTMwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQCl5ut2dCleDmgEneRYpAKa9Pe2qnXzgF+BEIuTfizG2OcPQi/ltv+6HxSrJXtuWNaiX/G4iP7iBzWj2ysaAYwfYj0ezTSMLRqM9hXzVgLtW0LJEF6a8vUXPsJt4GEJkUKiYCCO1MP1NLd3y/3SVJrFhwJSPqKYm2pQNg84WfPDWSkzSneOIO4Z0uWDXgs+vzSNyChWOxVieFQhLjcELtyj6narmLox+Jdo/SxUzPuktuFB3ebNgUqWPkjljgZpl00BTmbRIVHgHfDVulo2PBpXd0VplIDgdPr5zMKdTrKCuDKey8Mft72RkPKMe9LZVZ/21+rXVEh+olvvUCySsP2RkWPUJJD90c8wKo01rZsjAOXscJKQcBYlam5XXO4ZBRYzEdxuivbkPwsOoQ83swCR3alPvwfbg11Va+zXE6sRbUM9LqkYo/M3Hwg8tSIXu8oah6csputanz867dzWwyVJEPzmiXZ6ncVDQO31QlB7RndWCqKTjOQpnpblUMsrE9MCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAnUA8+kz7L+eSOm/iVvUNYF10PKO2nZtxWWL7R1vwK/2Up765PwqxKb0eSEM4bjgvZq1GuGXs9X/Y7dos42yntXvgeUY+/2JzCnw4J5tzxytZ+IKX6DR67NjDzDzVZQfptjLQrb8E7yzml0uxsqrhNPWl57Bmfe66Kg2lD11jImeeEhExlRggFukoiUWVwRNU21Q1jMUWrg2ZwfP+6fFTgRt0WR+X5zkyYPbvI6/yv7reYGjPDuZTOFhbwG8LUTQxdttDswPjnQ606kMyninL+aNelSdV/UIII7lpr/dTvgQAnrlBaGXvdy6brh3wWEwia0FZFZcKEs6M+jZ3MrFxvlTfUIdI3jRq12L10cCDi2VhORg4JmvlM+Tk6kJeSku30ZLAVo3S7GbTdvkuesOxz3UwnF7yfOA1KYOPvhv1oLxGV5z05glsn1OBKnXMdzsKFbAYYHj81bgBni2WLuIpv3oXlai2uc4y9m8LvWAQ+h/ivyog34Ai3Pvr5ZZOFgjy", "gossipEndpoint": [{ "ipAddressV4": "iHQF1Q==", "port": 30126 }, { "ipAddressV4": "CoAAXQ==", "port": 30126 }] }, { "nodeId": "3", "weight": "16416969660", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAN7hww13zBZEMA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTQwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTQwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDK/bVyv0ZUeJZ4cIOImM+wmqtYjCw4jPAC549WQPPV1vG0lzSpgV+nRKqmWBexhLlKN3bsvrfNCUpKSq8meFyCtdppT1dhUOmEZcoNhLZzqxXb2HYYqRPv82tR+tbh+27WFsBOOqYrYTvr72ECD7qDOuw/Xob6KImaw/b/SIAPecMoYy25fkgYkJSETwd8HUpwssYH/JTLBF8eGjjTTMuu14ARQKeH8BXSs+jjV1+3IItXERS8ryUGDjqc5vC8ZW1kDVQbb91IDxRjqZbFyhuasocCqTAcZuiEgE8Wilwp2g1vbAUnHnvKNfiaEAHoEV6vF4lelaWhOnN2U5tnox/ns6PiDqIbOfs0pmXxjAK0vxc6oZM3TwdRtzo6cSb/AYfQdnmQzkra980kHN12r3f7PK2PzGBuVUPT7fLGA4S3vQDYO4rqcgTc/OLobtqLtdBusOFjZscfIfUW4GVWJUI1j+fwvHacxWLmyZwlQ5Q47UtrtjWpFru7CTn5S477lqMCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdW6AWDhT0eOJw+0O6MYngmCgkXfFsgBC/B1plaE596hHo58FHxzCNiLFdvfRj37rxujvqsDAkADWUmOzLzLHYMXu302HzDqAMNY6FZJc32y4ZDsIQpaUOAuiNHAHwFXuPRInVpCqztfJMgw4RhOhcCTEsoIJsqoIN1t4M0pEVAv6x3nJwFKZqSNOZrQ7sOW32FjwWS3kHwRsCTtqdk5n2KxU6wr/fggV3QsSPRMYro8sUfwu93mqggtswwWqfeKlsz5WiaR9aqLnb8z1R6HLvA0bcoPWzjgn8RdP+9we4z06iZ5vdBuNpwBjrCKUELWISyAoekLGGxyS8pPqYiSBRNUoaPITSuUjcCBbJ9EFvm72QgCBesbwF71KPabTPbMPhLmf+uAi+zmeu8ZeVvT6DrX9OHSkIvIEQFry9BrqOT3ce6KBHSO1HpXIetj5Wcd3WHXtz9ulBL9ikWC8eh7/+we51ucmLvFzNKznElhT2Dp+czXUVNEUjp3u/66pyRA4", "gossipEndpoint": [{ "ipAddressV4": "I9+TMQ==", "port": 30127 }, { "ipAddressV4": "CoAATg==", "port": 30127 }] }] }
node3 6.991s 2025-11-21 09:44:48.541 53 INFO STARTUP <main> PlatformTestingToolState: Trigger and PreviousSoftwareVersion state received in init function {"trigger":"GENESIS","previousSoftwareVersion":"null"} [com.swirlds.logging.legacy.payload.SoftwareVersionPayload]
node3 6.991s 2025-11-21 09:44:48.541 54 INFO STARTUP <main> PlatformTestingToolState: Set QuorumResult from genesisInit()
node3 7.010s 2025-11-21 09:44:48.560 55 INFO STARTUP <main> StateInitializer: The platform is using the following initial state:
Round: 0 Timestamp: 1970-01-01T00:00:00Z Next consensus number: 0 Legacy running event hash: null Legacy running event mnemonic: null Rounds non-ancient: 0 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 1 Root hash: 12d9fdd9ebcea76c43761bf5d0089e6a01ec5f4e68b9fbc8693d00d0129f5bd8cdeac8b384d766471efe793af34a3ca4 (root) PlatformTestingToolState / forest-eager-main-barely 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 method-topple-elite-gate 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 null /4 bid-belt-culture-decorate 5 null /5 bid-belt-culture-decorate 6 null /6 bid-belt-culture-decorate 7 IssLeaf /7 biology-capable-expose-purpose 8 null /8 bid-belt-culture-decorate 9 null /9 bid-belt-culture-decorate 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node3 7.210s 2025-11-21 09:44:48.760 57 INFO EVENT_STREAM <main> DefaultConsensusEventStream: EventStreamManager::updateRunningHash: 38b060a751ac96384cd9327eb1b1e36a21fdb71114be07434c0cc7bf63f6e1da274edebfe76f65fbd51ad2f14898b95b
node3 7.215s 2025-11-21 09:44:48.765 58 INFO STARTUP <platformForkJoinThread-2> Shadowgraph: Shadowgraph starting from expiration threshold 1
node3 7.224s 2025-11-21 09:44:48.774 59 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -Xms32g
node3 7.225s 2025-11-21 09:44:48.775 60 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -Xmx118g
node3 7.225s 2025-11-21 09:44:48.775 61 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:+UnlockExperimentalVMOptions
node3 7.226s 2025-11-21 09:44:48.776 62 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:+UseZGC
node3 7.226s 2025-11-21 09:44:48.776 63 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:ZAllocationSpikeTolerance=2
node3 7.227s 2025-11-21 09:44:48.777 64 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:ConcGCThreads=14
node3 7.227s 2025-11-21 09:44:48.777 65 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:ZMarkStackSpaceLimit=16g
node3 7.228s 2025-11-21 09:44:48.778 66 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:MaxDirectMemorySize=64g
node3 7.228s 2025-11-21 09:44:48.778 67 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:MetaspaceSize=100M
node3 7.228s 2025-11-21 09:44:48.778 68 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -XX:+ZGenerational
node3 7.229s 2025-11-21 09:44:48.779 69 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -Xlog:gc*:gc.log
node3 7.229s 2025-11-21 09:44:48.779 70 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/jdk.internal.misc=ALL-UNNAMED
node3 7.229s 2025-11-21 09:44:48.779 71 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/java.nio=ALL-UNNAMED
node3 7.230s 2025-11-21 09:44:48.780 72 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: JVM arg: -Dio.netty.tryReflectionSetAccessible=true
node3 7.230s 2025-11-21 09:44:48.780 73 INFO STARTUP <<start-node-3>> PlatformTestingToolMain: Parsing JSON VMerkle-Hotspot-1k-15m.json
node3 7.253s 2025-11-21 09:44:48.803 74 INFO DEMO_INFO <<start-node-3>> PayloadConfig: insertSeq = true
node3 7.254s 2025-11-21 09:44:48.804 75 INFO DEMO_INFO <<start-node-3>> PayloadConfig: appendSig = true
node3 7.254s 2025-11-21 09:44:48.804 76 INFO DEMO_INFO <<start-node-3>> PayloadConfig: variedSize = false
node3 7.255s 2025-11-21 09:44:48.805 77 INFO DEMO_INFO <<start-node-3>> PayloadConfig: payloadByteSize = 100
node3 7.256s 2025-11-21 09:44:48.806 78 INFO DEMO_INFO <<start-node-3>> PayloadConfig: maxByteSize = 100
node3 7.256s 2025-11-21 09:44:48.806 79 INFO DEMO_INFO <<start-node-3>> PayloadConfig: type = TYPE_VIRTUAL_MERKLE_TEST
node3 7.257s 2025-11-21 09:44:48.807 80 INFO DEMO_INFO <<start-node-3>> PayloadConfig: invalidSigRatio = 0.0
node3 7.258s 2025-11-21 09:44:48.808 81 INFO DEMO_INFO <<start-node-3>> TransactionSubmitter: Goal is TRANS_PER_SECOND_PER_NODE targe 1000.0
node3 7.266s 2025-11-21 09:44:48.816 82 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: State = com.swirlds.demo.platform.PlatformTestingToolState@5a189e3
node3 7.267s 2025-11-21 09:44:48.817 83 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: total accounts = 80000
node3 7.268s 2025-11-21 09:44:48.818 84 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: Creating virtualmap for 80000 accounts.
node3 7.275s 2025-11-21 09:44:48.825 89 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: accounts VM = com.swirlds.virtualmap.VirtualMap@7b295432, DS = MerkleDbDataSource[initialCapacity=1000000,preferDiskBasedIndexes=false,pathToDiskLocationInternalNodes.size=0,pathToDiskLocationLeafNodes.size=0,hashesRamToDiskThreshold=8388608,hashStoreRam.size=0,hashStoreDisk=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@3e898ed7,hasDiskStoreForHashes=true,keyToPath=com.swirlds.merkledb.files.hashmap.HalfDiskHashMap@62b5c4d2,pathToKeyValue=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@5c7b45b9,snapshotInProgress=false]
node3 7.284s 2025-11-21 09:44:48.834 90 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: max KV pairs = 0
node3 7.284s 2025-11-21 09:44:48.834 91 INFO DEMO_INFO <<start-node-3>> VirtualMerkleStateInitializer: total SC = 0
node3 7.289s 2025-11-21 09:44:48.839 92 INFO DEMO_INFO <<start-node-3>> FCMTransactionPool: Random seed for FCMTransactionPool is -6378578035079409265
node3 7.290s 2025-11-21 09:44:48.840 93 INFO DEMO_INFO <<start-node-3>> FCMTransactionPool: This test will generate sequential FCM payload:
node3 7.374s 2025-11-21 09:44:48.924 94 INFO STARTUP <<start-node-3>> SwirldsPlatform: Starting platform 3
node3 7.375s 2025-11-21 09:44:48.925 95 INFO STARTUP <<platform: recycle-bin-cleanup>> RecycleBinImpl: Deleted 0 files from the recycle bin.
node3 7.380s 2025-11-21 09:44:48.930 96 INFO STARTUP <<start-node-3>> CycleFinder: No cyclical back pressure detected in wiring model.
node3 7.381s 2025-11-21 09:44:48.931 97 INFO STARTUP <<start-node-3>> DirectSchedulerChecks: No illegal direct scheduler use detected in the wiring model.
node3 7.381s 2025-11-21 09:44:48.931 98 INFO STARTUP <<start-node-3>> InputWireChecks: All input wires have been bound.
node3 7.383s 2025-11-21 09:44:48.933 99 WARN STARTUP <<start-node-3>> PcesFileTracker: No preconsensus event files available
node3 7.383s 2025-11-21 09:44:48.933 100 INFO STARTUP <<start-node-3>> SwirldsPlatform: replaying preconsensus event stream starting at 0
node2 7.384s 2025-11-21 09:44:48.934 48 INFO STARTUP <main> OSHealthChecker:
PASSED - Clock Source Speed Check Report[callsPerSec=26170801] PASSED - Entropy Check Report[success=true, entropySource=Strong Instance, elapsedNanos=314120, randomLong=-4721035306411209844, exception=null] PASSED - Entropy Check Report[success=true, entropySource=NativePRNGBlocking:SUN, elapsedNanos=77050, randomLong=-4227521238151697685, exception=null] PASSED - File System Check Report[code=SUCCESS, readNanos=1491960, data=35, exception=null] OS Health Check Report - Complete (took 1023 ms)
node3 7.386s 2025-11-21 09:44:48.936 101 INFO STARTUP <<start-node-3>> PcesReplayer: Replayed 0 preconsensus events with max birth round -1. These events contained 0 transactions. 0 rounds reached consensus spanning 0.0 nanoseconds of consensus time. The latest round to reach consensus is round 0. Replay took 0.0 nanoseconds.
node3 7.387s 2025-11-21 09:44:48.937 102 INFO DEMO_INFO <<app: appMain 3>> PlatformTestingToolMain: Node 3 starts transactions ........
node3 7.390s 2025-11-21 09:44:48.940 103 INFO PLATFORM_STATUS <platformForkJoinThread-2> StatusStateMachine: Platform spent 320.0 ms in STARTING_UP. Now in REPLAYING_EVENTS
node3 7.390s 2025-11-21 09:44:48.940 104 INFO STARTUP <platformForkJoinThread-2> PlatformTestingToolMain: Platform Status Change REPLAYING_EVENTS
node3 7.395s 2025-11-21 09:44:48.945 105 INFO PLATFORM_STATUS <platformForkJoinThread-2> StatusStateMachine: Platform spent 4.0 ms in REPLAYING_EVENTS. Now in OBSERVING
node3 7.396s 2025-11-21 09:44:48.946 106 INFO STARTUP <platformForkJoinThread-2> PlatformTestingToolMain: Platform Status Change OBSERVING
node2 7.415s 2025-11-21 09:44:48.965 49 DEBUG STARTUP <main> BootstrapUtils: jvmPauseDetectorThread started
node2 7.423s 2025-11-21 09:44:48.973 50 INFO STARTUP <main> StandardScratchpad: Scratchpad platform.iss contents:
LAST_ISS_ROUND null
node2 7.426s 2025-11-21 09:44:48.976 51 INFO STARTUP <main> PlatformBuilder: Default platform pool parallelism: 8
node2 7.512s 2025-11-21 09:44:49.062 52 INFO STARTUP <main> SwirldsPlatform: Starting with roster history:
RosterHistory[ currentRosterRound: 0 ][ no previous roster set ] Current Roster: { "rosterEntries": [{ "weight": "2685636917", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAK05TS8KZeb1MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTEwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTEwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDBoP9dI3K1PRLRK7h90D9eNCfgzuHTyJi70yDEs90XJXlE6jmgf1NE2av83VAhQHLxu8Ehc/55M9Ayx9IQc0zJLSS+IrRM9QwqoG8ZvNdRgNw+je3V/8rAK/mHId+cPnnyDplCyskyi5kWCv6kTULIewFH8/KVZwhe0/hB2+N6ujWixURrxjjGLHA6b2gPoGAb/nxiVOn+L0cWcOzcyiYShxagj0FBWV7AxKx65Ynzfe7eF0gOzBUA+IM10OM5KXJejk53Xz5KpEyGe8htO/bXFlpLdm3UzrYiIhY0oKPYKECAC1s+VAZA6i+MV0nDpqDgxHRRXD8O2arauPhEI6iVT9f05AtzElrs7U95HbpQUuP1sxkaQw+bLdMOQHHMVCgMgw2g0eDdVDAMJD7wjZ+Bs6kDc/EJELb0l1uy2GEnOZMiHkK4K1r4IyZ/ed6QpyIRKfBCNyT5IIpMoVpzRYxVXgjgFdudd8iErKyvSXHThU6nu92c+vSd+FLBFHPpb6ECAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdga5NYtV48uDCd4vIsmpGWpKuUHtDVDlCvzHc2ij8DxAR6OFp+hIRNEBXkzg1KS5qP8Wba5ptmGoV4f89HemP+AL3Azde+HjpYRtffdfTdQwmMbw7xJg2lKkEo11gDo5+zPZnVbfb3FsZ+IXKji0QshQBfg+ddTkFG3TJG1ttq3ZDw94RxFQivVnkj1p+Ogel/DuBNRWQobFVe5VrmJqbuwwN8AdrPae1dMrkZatF91On5+cpVLGfk96fYUhDohDt6KKQ6DdhvFk5rhd0vsHGMQq2gAW2+Or6ZVsKkHKx8CPINpJVKAdpE0tItI+loMO02jf9oRI/8cThWP1vNAeWnr0D6m275EZf/4qem/DdJ0FJIVou3P7tsq7eSdueDnj5RmcbW/vOBtvlXpD3SqsVRn6sltZ0sk24p+6ZMzopevCZEMf/nL3OzGvSadisXb39H9DgwkNLlefju1QLgHWf0TGfeNHluDgVDhU8+/1/KUGtr2SnZ5EVO1l59FWHALj", "gossipEndpoint": [{ "ipAddressV4": "I8Hnwg==", "port": 30124 }, { "ipAddressV4": "CoAAVg==", "port": 30124 }] }, { "nodeId": "1", "weight": "15745067016", "gossipCaCertificate": "MIIDpjCCAg6gAwIBAgIIHWg7e2Q/smQwDQYJKoZIhvcNAQEMBQAwEjEQMA4GA1UEAxMHcy1ub2RlMjAgFw0wMDAxMDEwMDAwMDBaGA8yMTAwMDEwMTAwMDAwMFowEjEQMA4GA1UEAxMHcy1ub2RlMjCCAaIwDQYJKoZIhvcNAQEBBQADggGPADCCAYoCggGBAKr5WsBepS3+y/0/yfBjzMWje7zianEz7sszrNWV3cGu2KUlR7v2+9wp/EtX1+BdcGlTTojgFs5nEBN4lM76Cp6JjFH461yN8GSkIkpe8GZnb1w4KEjZj5UYMbq+qOUI6QmwmgLeO8RHAsS6lCP1AyGFalb2ZVJ09DcYDxCRXeFj4BqvNbtD5r5DTCtpVT4ax3eb3pzNSGsjQUG9zhyp/WcsAmwmzKdMl72tk6qF8tlAWXyzwiCujWHS0Kln0C5pyEjeFNsG299toC4pgT8juxijgseTeIFRnNHmGSeSmXpAkEELlwLKR8HOnqeiS5UXNqdbxNemx/EpJSc5rTB6kzLX24dIuRsgyIIFWx73goOzmaHUolN4xmenifoMYlSNNM07WrsvmjRC5OLc/uGhdWqhZGBCH6AJB8Cmw84QLXVdHE6LiueP1oMd7g++N4X880wJkuh0ebfV3i7etUIn0jLlM50AkRucG9kwZDJ/M4LY7FT2F85R1/o2FaB/537ARQIDAQABMA0GCSqGSIb3DQEBDAUAA4IBgQB5lTkqYw0hEW+BJTFsQ8jEHfIDNRJ0kNbVuibfP+u7kzlJy15lCEi+Qw6E3d8hA1QBX3xJMxNBlrtYPrdG26hh/tOwo5Np/OfxQC5jo0Q7n7hu7aLxZRUB/q7AfdDbOun4Za6rJhT3+EsFocyARWp8bYSk3YILBMkP+2VYDRkgQidzKgKtO5yv21Y9sEgziSprc+dQb/tqn5aQZLWavFwCLwnB3t4r4qwLHkkH00Jw51uOvLeM49/t333V5Caa7wmWzMcE+KSWW0QWFRxeJrodSyjPdmDi4D8lKN5WJHSAU5L2yWIODUyWD/cvsAapTv7xXk9ja/Ssb9DpMQnM1xh0hYaESajNeL1QbGuZgPxAwrw981h7kprR2P2iMGRVGA6u4ezxmhW3s7D+yJ3+Yxs/x2J/sw65Z16mRYXRWYWHQmhgaVQjIviiAkVB6CWZo1kHl/eYaVedQzKlrTpbr3JtmwGwhYEOnrkzsC63h8/AG9gRtIAIGWGqTPWbn2pEm8M=", "gossipEndpoint": [{ "ipAddressV4": "IiqREA==", "port": 30125 }, { "ipAddressV4": "CoAAXA==", "port": 30125 }] }, { "nodeId": "2", "weight": "15152326407", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAJg3GRFp5bT9MA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTMwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTMwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQCl5ut2dCleDmgEneRYpAKa9Pe2qnXzgF+BEIuTfizG2OcPQi/ltv+6HxSrJXtuWNaiX/G4iP7iBzWj2ysaAYwfYj0ezTSMLRqM9hXzVgLtW0LJEF6a8vUXPsJt4GEJkUKiYCCO1MP1NLd3y/3SVJrFhwJSPqKYm2pQNg84WfPDWSkzSneOIO4Z0uWDXgs+vzSNyChWOxVieFQhLjcELtyj6narmLox+Jdo/SxUzPuktuFB3ebNgUqWPkjljgZpl00BTmbRIVHgHfDVulo2PBpXd0VplIDgdPr5zMKdTrKCuDKey8Mft72RkPKMe9LZVZ/21+rXVEh+olvvUCySsP2RkWPUJJD90c8wKo01rZsjAOXscJKQcBYlam5XXO4ZBRYzEdxuivbkPwsOoQ83swCR3alPvwfbg11Va+zXE6sRbUM9LqkYo/M3Hwg8tSIXu8oah6csputanz867dzWwyVJEPzmiXZ6ncVDQO31QlB7RndWCqKTjOQpnpblUMsrE9MCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAnUA8+kz7L+eSOm/iVvUNYF10PKO2nZtxWWL7R1vwK/2Up765PwqxKb0eSEM4bjgvZq1GuGXs9X/Y7dos42yntXvgeUY+/2JzCnw4J5tzxytZ+IKX6DR67NjDzDzVZQfptjLQrb8E7yzml0uxsqrhNPWl57Bmfe66Kg2lD11jImeeEhExlRggFukoiUWVwRNU21Q1jMUWrg2ZwfP+6fFTgRt0WR+X5zkyYPbvI6/yv7reYGjPDuZTOFhbwG8LUTQxdttDswPjnQ606kMyninL+aNelSdV/UIII7lpr/dTvgQAnrlBaGXvdy6brh3wWEwia0FZFZcKEs6M+jZ3MrFxvlTfUIdI3jRq12L10cCDi2VhORg4JmvlM+Tk6kJeSku30ZLAVo3S7GbTdvkuesOxz3UwnF7yfOA1KYOPvhv1oLxGV5z05glsn1OBKnXMdzsKFbAYYHj81bgBni2WLuIpv3oXlai2uc4y9m8LvWAQ+h/ivyog34Ai3Pvr5ZZOFgjy", "gossipEndpoint": [{ "ipAddressV4": "iHQF1Q==", "port": 30126 }, { "ipAddressV4": "CoAAXQ==", "port": 30126 }] }, { "nodeId": "3", "weight": "16416969660", "gossipCaCertificate": "MIIDpzCCAg+gAwIBAgIJAN7hww13zBZEMA0GCSqGSIb3DQEBDAUAMBIxEDAOBgNVBAMTB3Mtbm9kZTQwIBcNMDAwMTAxMDAwMDAwWhgPMjEwMDAxMDEwMDAwMDBaMBIxEDAOBgNVBAMTB3Mtbm9kZTQwggGiMA0GCSqGSIb3DQEBAQUAA4IBjwAwggGKAoIBgQDK/bVyv0ZUeJZ4cIOImM+wmqtYjCw4jPAC549WQPPV1vG0lzSpgV+nRKqmWBexhLlKN3bsvrfNCUpKSq8meFyCtdppT1dhUOmEZcoNhLZzqxXb2HYYqRPv82tR+tbh+27WFsBOOqYrYTvr72ECD7qDOuw/Xob6KImaw/b/SIAPecMoYy25fkgYkJSETwd8HUpwssYH/JTLBF8eGjjTTMuu14ARQKeH8BXSs+jjV1+3IItXERS8ryUGDjqc5vC8ZW1kDVQbb91IDxRjqZbFyhuasocCqTAcZuiEgE8Wilwp2g1vbAUnHnvKNfiaEAHoEV6vF4lelaWhOnN2U5tnox/ns6PiDqIbOfs0pmXxjAK0vxc6oZM3TwdRtzo6cSb/AYfQdnmQzkra980kHN12r3f7PK2PzGBuVUPT7fLGA4S3vQDYO4rqcgTc/OLobtqLtdBusOFjZscfIfUW4GVWJUI1j+fwvHacxWLmyZwlQ5Q47UtrtjWpFru7CTn5S477lqMCAwEAATANBgkqhkiG9w0BAQwFAAOCAYEAdW6AWDhT0eOJw+0O6MYngmCgkXfFsgBC/B1plaE596hHo58FHxzCNiLFdvfRj37rxujvqsDAkADWUmOzLzLHYMXu302HzDqAMNY6FZJc32y4ZDsIQpaUOAuiNHAHwFXuPRInVpCqztfJMgw4RhOhcCTEsoIJsqoIN1t4M0pEVAv6x3nJwFKZqSNOZrQ7sOW32FjwWS3kHwRsCTtqdk5n2KxU6wr/fggV3QsSPRMYro8sUfwu93mqggtswwWqfeKlsz5WiaR9aqLnb8z1R6HLvA0bcoPWzjgn8RdP+9we4z06iZ5vdBuNpwBjrCKUELWISyAoekLGGxyS8pPqYiSBRNUoaPITSuUjcCBbJ9EFvm72QgCBesbwF71KPabTPbMPhLmf+uAi+zmeu8ZeVvT6DrX9OHSkIvIEQFry9BrqOT3ce6KBHSO1HpXIetj5Wcd3WHXtz9ulBL9ikWC8eh7/+we51ucmLvFzNKznElhT2Dp+czXUVNEUjp3u/66pyRA4", "gossipEndpoint": [{ "ipAddressV4": "I9+TMQ==", "port": 30127 }, { "ipAddressV4": "CoAATg==", "port": 30127 }] }] }
node2 7.614s 2025-11-21 09:44:49.164 53 INFO STARTUP <main> PlatformTestingToolState: Trigger and PreviousSoftwareVersion state received in init function {"trigger":"GENESIS","previousSoftwareVersion":"null"} [com.swirlds.logging.legacy.payload.SoftwareVersionPayload]
node2 7.615s 2025-11-21 09:44:49.165 54 INFO STARTUP <main> PlatformTestingToolState: Set QuorumResult from genesisInit()
node2 7.632s 2025-11-21 09:44:49.182 55 INFO STARTUP <main> StateInitializer: The platform is using the following initial state:
Round: 0 Timestamp: 1970-01-01T00:00:00Z Next consensus number: 0 Legacy running event hash: null Legacy running event mnemonic: null Rounds non-ancient: 0 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 1 Root hash: 12d9fdd9ebcea76c43761bf5d0089e6a01ec5f4e68b9fbc8693d00d0129f5bd8cdeac8b384d766471efe793af34a3ca4 (root) PlatformTestingToolState / forest-eager-main-barely 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 method-topple-elite-gate 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 null /4 bid-belt-culture-decorate 5 null /5 bid-belt-culture-decorate 6 null /6 bid-belt-culture-decorate 7 IssLeaf /7 biology-capable-expose-purpose 8 null /8 bid-belt-culture-decorate 9 null /9 bid-belt-culture-decorate 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node2 7.853s 2025-11-21 09:44:49.403 57 INFO EVENT_STREAM <main> DefaultConsensusEventStream: EventStreamManager::updateRunningHash: 38b060a751ac96384cd9327eb1b1e36a21fdb71114be07434c0cc7bf63f6e1da274edebfe76f65fbd51ad2f14898b95b
node2 7.858s 2025-11-21 09:44:49.408 58 INFO STARTUP <platformForkJoinThread-2> Shadowgraph: Shadowgraph starting from expiration threshold 1
node2 7.866s 2025-11-21 09:44:49.416 59 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -Xms32g
node2 7.867s 2025-11-21 09:44:49.417 60 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -Xmx118g
node2 7.867s 2025-11-21 09:44:49.417 61 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:+UnlockExperimentalVMOptions
node2 7.868s 2025-11-21 09:44:49.418 62 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:+UseZGC
node2 7.868s 2025-11-21 09:44:49.418 63 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:ZAllocationSpikeTolerance=2
node2 7.868s 2025-11-21 09:44:49.418 64 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:ConcGCThreads=14
node2 7.869s 2025-11-21 09:44:49.419 65 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:ZMarkStackSpaceLimit=16g
node2 7.869s 2025-11-21 09:44:49.419 66 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:MaxDirectMemorySize=64g
node2 7.869s 2025-11-21 09:44:49.419 67 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:MetaspaceSize=100M
node2 7.869s 2025-11-21 09:44:49.419 68 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -XX:+ZGenerational
node2 7.870s 2025-11-21 09:44:49.420 69 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -Xlog:gc*:gc.log
node2 7.870s 2025-11-21 09:44:49.420 70 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/jdk.internal.misc=ALL-UNNAMED
node2 7.870s 2025-11-21 09:44:49.420 71 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/java.nio=ALL-UNNAMED
node2 7.871s 2025-11-21 09:44:49.421 72 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: JVM arg: -Dio.netty.tryReflectionSetAccessible=true
node2 7.871s 2025-11-21 09:44:49.421 73 INFO STARTUP <<start-node-2>> PlatformTestingToolMain: Parsing JSON VMerkle-Hotspot-1k-15m.json
node2 7.886s 2025-11-21 09:44:49.436 74 INFO DEMO_INFO <<start-node-2>> PayloadConfig: insertSeq = true
node2 7.887s 2025-11-21 09:44:49.437 75 INFO DEMO_INFO <<start-node-2>> PayloadConfig: appendSig = true
node2 7.887s 2025-11-21 09:44:49.437 76 INFO DEMO_INFO <<start-node-2>> PayloadConfig: variedSize = false
node2 7.887s 2025-11-21 09:44:49.437 77 INFO DEMO_INFO <<start-node-2>> PayloadConfig: payloadByteSize = 100
node2 7.889s 2025-11-21 09:44:49.439 78 INFO DEMO_INFO <<start-node-2>> PayloadConfig: maxByteSize = 100
node2 7.889s 2025-11-21 09:44:49.439 79 INFO DEMO_INFO <<start-node-2>> PayloadConfig: type = TYPE_VIRTUAL_MERKLE_TEST
node2 7.890s 2025-11-21 09:44:49.440 80 INFO DEMO_INFO <<start-node-2>> PayloadConfig: invalidSigRatio = 0.0
node2 7.891s 2025-11-21 09:44:49.441 81 INFO DEMO_INFO <<start-node-2>> TransactionSubmitter: Goal is TRANS_PER_SECOND_PER_NODE targe 1000.0
node2 7.897s 2025-11-21 09:44:49.447 82 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: State = com.swirlds.demo.platform.PlatformTestingToolState@8bb0a25
node2 7.898s 2025-11-21 09:44:49.448 83 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: total accounts = 80000
node2 7.898s 2025-11-21 09:44:49.448 84 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: Creating virtualmap for 80000 accounts.
node2 7.906s 2025-11-21 09:44:49.456 89 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: accounts VM = com.swirlds.virtualmap.VirtualMap@1a11f984, DS = MerkleDbDataSource[initialCapacity=1000000,preferDiskBasedIndexes=false,pathToDiskLocationInternalNodes.size=0,pathToDiskLocationLeafNodes.size=0,hashesRamToDiskThreshold=8388608,hashStoreRam.size=0,hashStoreDisk=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@11b14616,hasDiskStoreForHashes=true,keyToPath=com.swirlds.merkledb.files.hashmap.HalfDiskHashMap@3dabfa3a,pathToKeyValue=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@76b80af5,snapshotInProgress=false]
node2 7.914s 2025-11-21 09:44:49.464 90 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: max KV pairs = 0
node2 7.915s 2025-11-21 09:44:49.465 91 INFO DEMO_INFO <<start-node-2>> VirtualMerkleStateInitializer: total SC = 0
node2 7.919s 2025-11-21 09:44:49.469 92 INFO DEMO_INFO <<start-node-2>> FCMTransactionPool: Random seed for FCMTransactionPool is 1806627781791101431
node2 7.920s 2025-11-21 09:44:49.470 93 INFO DEMO_INFO <<start-node-2>> FCMTransactionPool: This test will generate sequential FCM payload:
node2 8.005s 2025-11-21 09:44:49.555 94 INFO STARTUP <<start-node-2>> SwirldsPlatform: Starting platform 2
node2 8.007s 2025-11-21 09:44:49.557 95 INFO STARTUP <<platform: recycle-bin-cleanup>> RecycleBinImpl: Deleted 0 files from the recycle bin.
node2 8.011s 2025-11-21 09:44:49.561 96 INFO STARTUP <<start-node-2>> CycleFinder: No cyclical back pressure detected in wiring model.
node2 8.012s 2025-11-21 09:44:49.562 97 INFO STARTUP <<start-node-2>> DirectSchedulerChecks: No illegal direct scheduler use detected in the wiring model.
node2 8.013s 2025-11-21 09:44:49.563 98 INFO STARTUP <<start-node-2>> InputWireChecks: All input wires have been bound.
node2 8.014s 2025-11-21 09:44:49.564 99 WARN STARTUP <<start-node-2>> PcesFileTracker: No preconsensus event files available
node2 8.015s 2025-11-21 09:44:49.565 100 INFO STARTUP <<start-node-2>> SwirldsPlatform: replaying preconsensus event stream starting at 0
node2 8.016s 2025-11-21 09:44:49.566 101 INFO STARTUP <<start-node-2>> PcesReplayer: Replayed 0 preconsensus events with max birth round -1. These events contained 0 transactions. 0 rounds reached consensus spanning 0.0 nanoseconds of consensus time. The latest round to reach consensus is round 0. Replay took 0.0 nanoseconds.
node2 8.017s 2025-11-21 09:44:49.567 102 INFO DEMO_INFO <<app: appMain 2>> PlatformTestingToolMain: Node 2 starts transactions ........
node2 8.019s 2025-11-21 09:44:49.569 103 INFO PLATFORM_STATUS <platformForkJoinThread-3> StatusStateMachine: Platform spent 327.0 ms in STARTING_UP. Now in REPLAYING_EVENTS
node2 8.020s 2025-11-21 09:44:49.570 104 INFO STARTUP <platformForkJoinThread-3> PlatformTestingToolMain: Platform Status Change REPLAYING_EVENTS
node2 8.025s 2025-11-21 09:44:49.575 105 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 4.0 ms in REPLAYING_EVENTS. Now in OBSERVING
node2 8.025s 2025-11-21 09:44:49.575 106 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change OBSERVING
node1 9.290s 2025-11-21 09:44:50.840 107 INFO STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Initializing statistics output in CSV format [ csvOutputFolder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats', csvFileName = 'PlatformTesting1.csv' ]
node1 9.292s 2025-11-21 09:44:50.842 108 DEBUG STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Using the existing metrics folder [ folder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats' ]
node0 9.299s 2025-11-21 09:44:50.849 107 INFO STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Initializing statistics output in CSV format [ csvOutputFolder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats', csvFileName = 'PlatformTesting0.csv' ]
node0 9.302s 2025-11-21 09:44:50.852 108 DEBUG STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Using the existing metrics folder [ folder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats' ]
node3 10.233s 2025-11-21 09:44:51.783 107 INFO STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Initializing statistics output in CSV format [ csvOutputFolder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats', csvFileName = 'PlatformTesting3.csv' ]
node3 10.235s 2025-11-21 09:44:51.785 108 DEBUG STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Using the existing metrics folder [ folder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats' ]
node2 10.874s 2025-11-21 09:44:52.424 107 INFO STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Initializing statistics output in CSV format [ csvOutputFolder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats', csvFileName = 'PlatformTesting2.csv' ]
node2 10.876s 2025-11-21 09:44:52.426 108 DEBUG STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Using the existing metrics folder [ folder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats' ]
node1 16.524s 2025-11-21 09:44:58.074 109 INFO PLATFORM_STATUS <platformForkJoinThread-7> StatusStateMachine: Platform spent 10.1 s in OBSERVING. Now in CHECKING
node1 16.525s 2025-11-21 09:44:58.075 110 INFO STARTUP <platformForkJoinThread-7> PlatformTestingToolMain: Platform Status Change CHECKING
node0 16.526s 2025-11-21 09:44:58.076 109 INFO PLATFORM_STATUS <platformForkJoinThread-1> StatusStateMachine: Platform spent 10.1 s in OBSERVING. Now in CHECKING
node0 16.527s 2025-11-21 09:44:58.077 110 INFO STARTUP <platformForkJoinThread-1> PlatformTestingToolMain: Platform Status Change CHECKING
node3 17.483s 2025-11-21 09:44:59.033 109 INFO PLATFORM_STATUS <platformForkJoinThread-3> StatusStateMachine: Platform spent 10.1 s in OBSERVING. Now in CHECKING
node3 17.484s 2025-11-21 09:44:59.034 110 INFO STARTUP <platformForkJoinThread-3> PlatformTestingToolMain: Platform Status Change CHECKING
node2 18.115s 2025-11-21 09:44:59.665 109 INFO PLATFORM_STATUS <platformForkJoinThread-8> StatusStateMachine: Platform spent 10.1 s in OBSERVING. Now in CHECKING
node2 18.117s 2025-11-21 09:44:59.667 110 INFO STARTUP <platformForkJoinThread-8> PlatformTestingToolMain: Platform Status Change CHECKING
node3 18.588s 2025-11-21 09:45:00.138 111 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Ignoring empty consensus round 1
node1 18.657s 2025-11-21 09:45:00.207 111 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Ignoring empty consensus round 1
node0 18.659s 2025-11-21 09:45:00.209 111 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Ignoring empty consensus round 1
node2 18.740s 2025-11-21 09:45:00.290 111 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Ignoring empty consensus round 1
node0 19.276s 2025-11-21 09:45:00.826 112 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 2.7 s in CHECKING. Now in ACTIVE
node0 19.276s 2025-11-21 09:45:00.826 113 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change ACTIVE
node0 19.287s 2025-11-21 09:45:00.837 114 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: resetting transaction counters
node0 19.342s 2025-11-21 09:45:00.892 115 TRACE STARTUP <<app: appMain 0>> PttTransactionPool: Signed Message { signatureType = 'ED25519', publicKey = '0x1B1B95CFAAFF739F5080A1E57D5DFECAA18619B5BA78531F32092B4B6778B97E', privateKey ='0x1B1B95CFAAFF739F5080A1E57D5DFECAA18619B5BA78531F32092B4B6778B97E', signature = '0x9499EA6235CEBFC04F1E1838118E611D90FBA826D98108A716E737AA3E5C3977C0A578C7AB5B12F1813F2F17A28B092B8156BEDC367740F884E0EE4677FEA600',message = '0x12660A0A4090F6C38BD3F6B2B861325800000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000' }
node3 19.356s 2025-11-21 09:45:00.906 112 INFO PLATFORM_STATUS <platformForkJoinThread-1> StatusStateMachine: Platform spent 1.9 s in CHECKING. Now in ACTIVE
node3 19.357s 2025-11-21 09:45:00.907 113 INFO STARTUP <platformForkJoinThread-1> PlatformTestingToolMain: Platform Status Change ACTIVE
node1 19.366s 2025-11-21 09:45:00.916 112 INFO PLATFORM_STATUS <platformForkJoinThread-3> StatusStateMachine: Platform spent 2.8 s in CHECKING. Now in ACTIVE
node1 19.366s 2025-11-21 09:45:00.916 113 INFO STARTUP <platformForkJoinThread-3> PlatformTestingToolMain: Platform Status Change ACTIVE
node3 19.370s 2025-11-21 09:45:00.920 114 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: resetting transaction counters
node1 19.377s 2025-11-21 09:45:00.927 114 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: resetting transaction counters
node2 19.388s 2025-11-21 09:45:00.938 112 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: resetting transaction counters
node3 19.403s 2025-11-21 09:45:00.953 115 TRACE STARTUP <<app: appMain 3>> PttTransactionPool: Signed Message { signatureType = 'ED25519', publicKey = '0x3DAA0E67EA56070259B7979287ADB95111CB9719328C95B6B2865E7E4CF33C7D', privateKey ='0x3DAA0E67EA56070259B7979287ADB95111CB9719328C95B6B2865E7E4CF33C7D', signature = '0xA2CCFB9DEF0249E281C2E55B1A418AC9E6FEACF9C9A190DDB3080121B00211CFE536C3611775FD61C33CD2A749BB140D292D58694D4E0DCB1C996F1917B05C07',message = '0x12660A1E080310031880D30E2080D30E2880D30E3080D30E4083F5C882E2D3D3B83732420000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000003803' }
node1 19.443s 2025-11-21 09:45:00.993 115 TRACE STARTUP <<app: appMain 1>> PttTransactionPool: Signed Message { signatureType = 'ED25519', publicKey = '0xFC3A40DD023F1E2A6F50D222B5F5641D84E1EA695D3B81D7340A14843AA95C52', privateKey ='0xFC3A40DD023F1E2A6F50D222B5F5641D84E1EA695D3B81D7340A14843AA95C52', signature = '0x1E5C4ED69F4FA6DF4930CA9875CA27765E074F5CB393D077B256DF30BE48B995FE2F775A16BF59FFA262C38F3AFB41F8D6A71F915C42CF9574F14DF861C2A701',message = '0x12660A1E080110011880F1042080F1042880F1043080F10440AC89E5F4C1DF88952C32420000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000003801' }
node2 20.464s 2025-11-21 09:45:02.014 113 INFO PLATFORM_STATUS <platformForkJoinThread-4> StatusStateMachine: Platform spent 2.3 s in CHECKING. Now in ACTIVE
node2 20.465s 2025-11-21 09:45:02.015 114 INFO STARTUP <platformForkJoinThread-4> PlatformTestingToolMain: Platform Status Change ACTIVE
node2 20.468s 2025-11-21 09:45:02.018 117 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 3 created, will eventually be written to disk, for reason: FIRST_ROUND_AFTER_GENESIS
node2 20.495s 2025-11-21 09:45:02.045 132 TRACE STARTUP <<app: appMain 2>> PttTransactionPool: Signed Message { signatureType = 'ED25519', publicKey = '0x93C7BED0E40B3BA14484ACD89726C85F7AB61F61491874B6059443D6E215EAC4', privateKey ='0x93C7BED0E40B3BA14484ACD89726C85F7AB61F61491874B6059443D6E215EAC4', signature = '0x7647A74B8543A41871945090D2B6E0288156C1D958EA9CC39F1491EE1A8E52ED2FE39F346372C592AB3AFB1223EB18D964D535AA4F7ECF440070F65A06EAEB03',message = '0x12660A1E080210021880E2092080E2092880E2093080E20940A8F69FB2A5C6B2D82432420000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000003802' }
node1 20.537s 2025-11-21 09:45:02.087 118 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 3 created, will eventually be written to disk, for reason: FIRST_ROUND_AFTER_GENESIS
node3 20.568s 2025-11-21 09:45:02.118 118 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 3 created, will eventually be written to disk, for reason: FIRST_ROUND_AFTER_GENESIS
node0 20.579s 2025-11-21 09:45:02.129 118 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 3 created, will eventually be written to disk, for reason: FIRST_ROUND_AFTER_GENESIS
node3 21.269s 2025-11-21 09:45:02.819 133 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 3 state to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/3
node3 21.271s 2025-11-21 09:45:02.821 134 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node2 21.278s 2025-11-21 09:45:02.828 133 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 3 state to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/3
node2 21.280s 2025-11-21 09:45:02.830 134 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node0 21.329s 2025-11-21 09:45:02.879 133 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 3 state to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/3
node0 21.331s 2025-11-21 09:45:02.881 134 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node1 21.334s 2025-11-21 09:45:02.884 133 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 3 state to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/3
node1 21.336s 2025-11-21 09:45:02.886 134 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node3 21.543s 2025-11-21 09:45:03.093 188 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node3 21.547s 2025-11-21 09:45:03.097 189 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 3 Timestamp: 2025-11-21T09:45:00.194644578Z Next consensus number: 15 Legacy running event hash: 00429b139fa24fdd090bcd30af8a948d6c4ccd06a52bae06d622202ff2d905eb9ebef3af5fc6f207650cd446681303b1 Legacy running event mnemonic: analyst-oval-armed-wing Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 2044907021 Root hash: 1a66ce7cec1797aa722046dbd51d3a50705528145fad15e0b630474272288e5f345874f9ce86dc21b307466088e6c672 (root) PlatformTestingToolState / error-correct-large-approve 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 increase-better-depart-glad 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 talk-valve-shift-secret 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 absent-boy-buddy-wear 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node2 21.568s 2025-11-21 09:45:03.118 188 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node2 21.571s 2025-11-21 09:45:03.121 189 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 3 Timestamp: 2025-11-21T09:45:00.194644578Z Next consensus number: 15 Legacy running event hash: 00429b139fa24fdd090bcd30af8a948d6c4ccd06a52bae06d622202ff2d905eb9ebef3af5fc6f207650cd446681303b1 Legacy running event mnemonic: analyst-oval-armed-wing Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 2044907021 Root hash: 1a66ce7cec1797aa722046dbd51d3a50705528145fad15e0b630474272288e5f345874f9ce86dc21b307466088e6c672 (root) PlatformTestingToolState / error-correct-large-approve 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 increase-better-depart-glad 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 talk-valve-shift-secret 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 absent-boy-buddy-wear 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node3 21.583s 2025-11-21 09:45:03.133 190 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus file on disk.
File: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+44+58.291805348Z_seq0_minr1_maxr501_orgn0.pces
node3 21.584s 2025-11-21 09:45:03.134 191 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus event file meeting specified criteria to copy.
Lower bound: 1 File: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+44+58.291805348Z_seq0_minr1_maxr501_orgn0.pces
node3 21.584s 2025-11-21 09:45:03.134 192 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node3 21.586s 2025-11-21 09:45:03.136 193 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node3 21.589s 2025-11-21 09:45:03.139 194 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 3 to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/3 {"round":3,"freezeState":false,"reason":"FIRST_ROUND_AFTER_GENESIS","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/3/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node1 21.605s 2025-11-21 09:45:03.155 188 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node1 21.608s 2025-11-21 09:45:03.158 189 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 3 Timestamp: 2025-11-21T09:45:00.194644578Z Next consensus number: 15 Legacy running event hash: 00429b139fa24fdd090bcd30af8a948d6c4ccd06a52bae06d622202ff2d905eb9ebef3af5fc6f207650cd446681303b1 Legacy running event mnemonic: analyst-oval-armed-wing Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 2044907021 Root hash: 1a66ce7cec1797aa722046dbd51d3a50705528145fad15e0b630474272288e5f345874f9ce86dc21b307466088e6c672 (root) PlatformTestingToolState / error-correct-large-approve 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 increase-better-depart-glad 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 talk-valve-shift-secret 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 absent-boy-buddy-wear 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node0 21.610s 2025-11-21 09:45:03.160 188 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/2 for round 3
node2 21.610s 2025-11-21 09:45:03.160 190 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus file on disk.
File: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+44+58.585574697Z_seq0_minr1_maxr501_orgn0.pces
node2 21.610s 2025-11-21 09:45:03.160 191 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus event file meeting specified criteria to copy.
Lower bound: 1 File: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+44+58.585574697Z_seq0_minr1_maxr501_orgn0.pces
node2 21.610s 2025-11-21 09:45:03.160 192 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node0 21.613s 2025-11-21 09:45:03.163 189 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 3 Timestamp: 2025-11-21T09:45:00.194644578Z Next consensus number: 15 Legacy running event hash: 00429b139fa24fdd090bcd30af8a948d6c4ccd06a52bae06d622202ff2d905eb9ebef3af5fc6f207650cd446681303b1 Legacy running event mnemonic: analyst-oval-armed-wing Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 2044907021 Root hash: 1a66ce7cec1797aa722046dbd51d3a50705528145fad15e0b630474272288e5f345874f9ce86dc21b307466088e6c672 (root) PlatformTestingToolState / error-correct-large-approve 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 increase-better-depart-glad 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 talk-valve-shift-secret 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 absent-boy-buddy-wear 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node2 21.613s 2025-11-21 09:45:03.163 193 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node2 21.617s 2025-11-21 09:45:03.167 194 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 3 to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/3 {"round":3,"freezeState":false,"reason":"FIRST_ROUND_AFTER_GENESIS","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/3/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node1 21.640s 2025-11-21 09:45:03.190 190 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus file on disk.
File: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+44+58.103439515Z_seq0_minr1_maxr501_orgn0.pces
node1 21.640s 2025-11-21 09:45:03.190 191 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus event file meeting specified criteria to copy.
Lower bound: 1 File: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+44+58.103439515Z_seq0_minr1_maxr501_orgn0.pces
node1 21.640s 2025-11-21 09:45:03.190 192 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node1 21.642s 2025-11-21 09:45:03.192 193 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node1 21.645s 2025-11-21 09:45:03.195 194 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 3 to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/3 {"round":3,"freezeState":false,"reason":"FIRST_ROUND_AFTER_GENESIS","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/3/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node0 21.647s 2025-11-21 09:45:03.197 190 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus file on disk.
File: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+44+58.107777441Z_seq0_minr1_maxr501_orgn0.pces
node0 21.647s 2025-11-21 09:45:03.197 191 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus event file meeting specified criteria to copy.
Lower bound: 1 File: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+44+58.107777441Z_seq0_minr1_maxr501_orgn0.pces
node0 21.648s 2025-11-21 09:45:03.198 192 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node0 21.650s 2025-11-21 09:45:03.200 193 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node0 21.653s 2025-11-21 09:45:03.203 194 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 3 to disk. Reason: FIRST_ROUND_AFTER_GENESIS, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/3 {"round":3,"freezeState":false,"reason":"FIRST_ROUND_AFTER_GENESIS","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/3/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node0 1m 39.343s 2025-11-21 09:46:20.893 1095 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node3 1m 39.412s 2025-11-21 09:46:20.962 1095 INFO DEMO_INFO <<app: appMain 3>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node1 1m 39.452s 2025-11-21 09:46:21.002 1095 INFO DEMO_INFO <<app: appMain 1>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node2 1m 40.493s 2025-11-21 09:46:22.043 1115 INFO DEMO_INFO <<app: appMain 2>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 6m 59.369s 2025-11-21 09:51:40.919 4468 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 6m 59.372s 2025-11-21 09:51:40.922 4469 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Stop generating transactions
node0 6m 59.375s 2025-11-21 09:51:40.925 4470 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: node 0 sent ENTER_VALIDATION Message
node0 6m 59.375s 2025-11-21 09:51:40.925 4471 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Node 0 finished generating all transactions.
node3 6m 59.441s 2025-11-21 09:51:40.991 4464 INFO DEMO_INFO <<app: appMain 3>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node3 6m 59.444s 2025-11-21 09:51:40.994 4465 INFO DEMO_INFO <<app: appMain 3>> PlatformTestingToolMain: Stop generating transactions
node3 6m 59.448s 2025-11-21 09:51:40.998 4466 INFO DEMO_INFO <<app: appMain 3>> PlatformTestingToolMain: node 3 sent ENTER_VALIDATION Message
node3 6m 59.448s 2025-11-21 09:51:40.998 4467 INFO DEMO_INFO <<app: appMain 3>> PlatformTestingToolMain: Node 3 finished generating all transactions.
node1 6m 59.454s 2025-11-21 09:51:41.004 4464 INFO DEMO_INFO <<app: appMain 1>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node1 6m 59.458s 2025-11-21 09:51:41.008 4465 INFO DEMO_INFO <<app: appMain 1>> PlatformTestingToolMain: Stop generating transactions
node1 6m 59.461s 2025-11-21 09:51:41.011 4466 INFO DEMO_INFO <<app: appMain 1>> PlatformTestingToolMain: node 1 sent ENTER_VALIDATION Message
node1 6m 59.461s 2025-11-21 09:51:41.011 4467 INFO DEMO_INFO <<app: appMain 1>> PlatformTestingToolMain: Node 1 finished generating all transactions.
node2 7.009m 2025-11-21 09:51:42.079 4488 INFO DEMO_INFO <<app: appMain 2>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node2 7.009m 2025-11-21 09:51:42.081 4489 INFO DEMO_INFO <<app: appMain 2>> PlatformTestingToolMain: Stop generating transactions
node2 7.009m 2025-11-21 09:51:42.082 4490 INFO DEMO_INFO <<app: appMain 2>> PlatformTestingToolMain: node 2 sent ENTER_VALIDATION Message
node2 7.009m 2025-11-21 09:51:42.082 4491 INFO DEMO_INFO <<app: appMain 2>> PlatformTestingToolMain: Node 2 finished generating all transactions.
node3 7.016m 2025-11-21 09:51:42.537 4488 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.223022Z ]
node3 7.016m 2025-11-21 09:51:42.537 4489 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:41.223022Z,type=ENTER_VALIDATION]
node1 7m 1.107s 2025-11-21 09:51:42.657 4488 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.223022Z ]
node1 7m 1.108s 2025-11-21 09:51:42.658 4489 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:41.223022Z,type=ENTER_VALIDATION]
node2 7m 1.129s 2025-11-21 09:51:42.679 4492 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.223022Z ]
node2 7m 1.130s 2025-11-21 09:51:42.680 4493 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:41.223022Z,type=ENTER_VALIDATION]
node0 7m 1.168s 2025-11-21 09:51:42.718 4492 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.223022Z ]
node0 7m 1.168s 2025-11-21 09:51:42.718 4493 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:41.223022Z,type=ENTER_VALIDATION]
node0 7m 1.613s 2025-11-21 09:51:43.163 4494 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453117948Z ]
node0 7m 1.614s 2025-11-21 09:51:43.164 4495 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:41.453117948Z,type=ENTER_VALIDATION]
node0 7m 1.614s 2025-11-21 09:51:43.164 4496 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453263Z ]
node0 7m 1.615s 2025-11-21 09:51:43.165 4497 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:41.453263Z,type=ENTER_VALIDATION]
node2 7m 1.753s 2025-11-21 09:51:43.303 4494 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453117948Z ]
node2 7m 1.754s 2025-11-21 09:51:43.304 4495 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:41.453117948Z,type=ENTER_VALIDATION]
node2 7m 1.755s 2025-11-21 09:51:43.305 4496 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453263Z ]
node2 7m 1.755s 2025-11-21 09:51:43.305 4497 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:41.453263Z,type=ENTER_VALIDATION]
node3 7m 1.832s 2025-11-21 09:51:43.382 4490 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453117948Z ]
node3 7m 1.832s 2025-11-21 09:51:43.382 4491 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:41.453117948Z,type=ENTER_VALIDATION]
node3 7m 1.833s 2025-11-21 09:51:43.383 4492 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453263Z ]
node3 7m 1.833s 2025-11-21 09:51:43.383 4493 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:41.453263Z,type=ENTER_VALIDATION]
node1 7m 1.948s 2025-11-21 09:51:43.498 4490 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453117948Z ]
node1 7m 1.949s 2025-11-21 09:51:43.499 4491 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:41.453117948Z,type=ENTER_VALIDATION]
node1 7m 1.949s 2025-11-21 09:51:43.499 4492 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:41.453263Z ]
node1 7m 1.950s 2025-11-21 09:51:43.500 4493 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:41.453263Z,type=ENTER_VALIDATION]
node0 7m 2.433s 2025-11-21 09:51:43.983 4518 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:42.513137Z ]
node0 7m 2.433s 2025-11-21 09:51:43.983 4519 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:42.513137Z,type=ENTER_VALIDATION]
node0 7m 2.434s 2025-11-21 09:51:43.984 4520 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = ENTER_VALIDATION, consensusTime = 2025-11-21T09:51:42.513137Z ]
node0 7m 2.438s 2025-11-21 09:51:43.988 4521 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Achieved Quorum on ENTER_VALIDATION transaction [ expectedMapFile = Node0000_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node0 7m 2.439s 2025-11-21 09:51:43.989 4522 INFO DEMO_INFO <<PTT: enter-validator 0>> VirtualMerkleTransactionHandler: There was no mismatch between the expected map and state.
node0 7m 2.440s 2025-11-21 09:51:43.990 4523 INFO SAVE_EXPECTED_MAP <<PTT: enter-validator 0>> SaveExpectedMapHandler: Serializing ExpectedMap Node0000_ExpectedMap_1763718702513_513137000.json.gz
node0 7m 2.444s 2025-11-21 09:51:43.994 4524 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Successfully wrote expected map to file [ expectedMapFile = Node0000_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node0 7m 2.444s 2025-11-21 09:51:43.994 4525 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Sent EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:42.513137Z ]
node3 7m 2.451s 2025-11-21 09:51:44.001 4514 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:42.513137Z ]
node3 7m 2.451s 2025-11-21 09:51:44.001 4515 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:42.513137Z,type=ENTER_VALIDATION]
node3 7m 2.452s 2025-11-21 09:51:44.002 4516 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = ENTER_VALIDATION, consensusTime = 2025-11-21T09:51:42.513137Z ]
node3 7m 2.457s 2025-11-21 09:51:44.007 4517 INFO DEMO_QUORUM <<PTT: enter-validator 3>> PlatformTestingToolMain: Achieved Quorum on ENTER_VALIDATION transaction [ expectedMapFile = Node0003_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node3 7m 2.458s 2025-11-21 09:51:44.008 4518 INFO DEMO_INFO <<PTT: enter-validator 3>> VirtualMerkleTransactionHandler: There was no mismatch between the expected map and state.
node3 7m 2.458s 2025-11-21 09:51:44.008 4519 INFO SAVE_EXPECTED_MAP <<PTT: enter-validator 3>> SaveExpectedMapHandler: Serializing ExpectedMap Node0003_ExpectedMap_1763718702513_513137000.json.gz
node3 7m 2.463s 2025-11-21 09:51:44.013 4520 INFO DEMO_QUORUM <<PTT: enter-validator 3>> PlatformTestingToolMain: Successfully wrote expected map to file [ expectedMapFile = Node0003_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node3 7m 2.463s 2025-11-21 09:51:44.013 4521 INFO DEMO_QUORUM <<PTT: enter-validator 3>> PlatformTestingToolMain: Sent EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:42.513137Z ]
node1 7m 2.511s 2025-11-21 09:51:44.061 4514 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:42.513137Z ]
node1 7m 2.511s 2025-11-21 09:51:44.061 4515 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:42.513137Z,type=ENTER_VALIDATION]
node1 7m 2.512s 2025-11-21 09:51:44.062 4516 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = ENTER_VALIDATION, consensusTime = 2025-11-21T09:51:42.513137Z ]
node1 7m 2.516s 2025-11-21 09:51:44.066 4517 INFO DEMO_QUORUM <<PTT: enter-validator 1>> PlatformTestingToolMain: Achieved Quorum on ENTER_VALIDATION transaction [ expectedMapFile = Node0001_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node1 7m 2.518s 2025-11-21 09:51:44.068 4518 INFO DEMO_INFO <<PTT: enter-validator 1>> VirtualMerkleTransactionHandler: There was no mismatch between the expected map and state.
node1 7m 2.518s 2025-11-21 09:51:44.068 4519 INFO SAVE_EXPECTED_MAP <<PTT: enter-validator 1>> SaveExpectedMapHandler: Serializing ExpectedMap Node0001_ExpectedMap_1763718702513_513137000.json.gz
node1 7m 2.523s 2025-11-21 09:51:44.073 4520 INFO DEMO_QUORUM <<PTT: enter-validator 1>> PlatformTestingToolMain: Successfully wrote expected map to file [ expectedMapFile = Node0001_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node1 7m 2.523s 2025-11-21 09:51:44.073 4521 INFO DEMO_QUORUM <<PTT: enter-validator 1>> PlatformTestingToolMain: Sent EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:42.513137Z ]
node2 7m 2.524s 2025-11-21 09:51:44.074 4518 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = ENTER_VALIDATION, consensusTimestamp = 2025-11-21T09:51:42.513137Z ]
node2 7m 2.525s 2025-11-21 09:51:44.075 4519 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:42.513137Z,type=ENTER_VALIDATION]
node2 7m 2.526s 2025-11-21 09:51:44.076 4520 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = ENTER_VALIDATION, consensusTime = 2025-11-21T09:51:42.513137Z ]
node2 7m 2.530s 2025-11-21 09:51:44.080 4521 INFO DEMO_QUORUM <<PTT: enter-validator 2>> PlatformTestingToolMain: Achieved Quorum on ENTER_VALIDATION transaction [ expectedMapFile = Node0002_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node2 7m 2.531s 2025-11-21 09:51:44.081 4522 INFO DEMO_INFO <<PTT: enter-validator 2>> VirtualMerkleTransactionHandler: There was no mismatch between the expected map and state.
node2 7m 2.532s 2025-11-21 09:51:44.082 4523 INFO SAVE_EXPECTED_MAP <<PTT: enter-validator 2>> SaveExpectedMapHandler: Serializing ExpectedMap Node0002_ExpectedMap_1763718702513_513137000.json.gz
node2 7m 2.536s 2025-11-21 09:51:44.086 4524 INFO DEMO_QUORUM <<PTT: enter-validator 2>> PlatformTestingToolMain: Successfully wrote expected map to file [ expectedMapFile = Node0002_ExpectedMap_1763718702513_513137000.json, consensusTime = 2025-11-21T09:51:42.513137Z ]
node2 7m 2.537s 2025-11-21 09:51:44.087 4525 INFO DEMO_QUORUM <<PTT: enter-validator 2>> PlatformTestingToolMain: Sent EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:42.513137Z ]
node1 7m 4.358s 2025-11-21 09:51:45.908 4526 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.422477Z ]
node3 7m 4.358s 2025-11-21 09:51:45.908 4526 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.422477Z ]
node1 7m 4.361s 2025-11-21 09:51:45.911 4527 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:44.422477Z,type=EXIT_VALIDATION]
node1 7m 4.361s 2025-11-21 09:51:45.911 4528 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.612608820Z ]
node1 7m 4.361s 2025-11-21 09:51:45.911 4529 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:44.612608820Z,type=EXIT_VALIDATION]
node3 7m 4.361s 2025-11-21 09:51:45.911 4527 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:44.422477Z,type=EXIT_VALIDATION]
node3 7m 4.361s 2025-11-21 09:51:45.911 4528 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.612608820Z ]
node3 7m 4.361s 2025-11-21 09:51:45.911 4529 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:44.612608820Z,type=EXIT_VALIDATION]
node0 7m 4.470s 2025-11-21 09:51:46.020 4546 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.422477Z ]
node0 7m 4.473s 2025-11-21 09:51:46.023 4547 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:44.422477Z,type=EXIT_VALIDATION]
node0 7m 4.473s 2025-11-21 09:51:46.023 4548 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.612608820Z ]
node0 7m 4.474s 2025-11-21 09:51:46.024 4549 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:44.612608820Z,type=EXIT_VALIDATION]
node2 7m 4.510s 2025-11-21 09:51:46.060 4530 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 1, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.422477Z ]
node2 7m 4.515s 2025-11-21 09:51:46.065 4531 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 1 apply state ControlAction[timestamp=2025-11-21T09:51:44.422477Z,type=EXIT_VALIDATION]
node2 7m 4.515s 2025-11-21 09:51:46.065 4532 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.612608820Z ]
node2 7m 4.516s 2025-11-21 09:51:46.066 4533 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-11-21T09:51:44.612608820Z,type=EXIT_VALIDATION]
node1 7m 4.958s 2025-11-21 09:51:46.508 4546 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782976Z ]
node1 7m 4.959s 2025-11-21 09:51:46.509 4547 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:44.782976Z,type=EXIT_VALIDATION]
node1 7m 4.959s 2025-11-21 09:51:46.509 4548 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782978Z ]
node1 7m 4.959s 2025-11-21 09:51:46.509 4549 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:44.782978Z,type=EXIT_VALIDATION]
node1 7m 4.959s 2025-11-21 09:51:46.509 4550 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = EXIT_VALIDATION, consensusTime = 2025-11-21T09:51:44.782978Z ]
node1 7m 4.960s 2025-11-21 09:51:46.510 4551 INFO DEMO_QUORUM <<PTT: exit-validator 1>> PlatformTestingToolMain: Achieved Quorum on EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:44.782978Z ]
node1 7m 4.960s 2025-11-21 09:51:46.510 4552 INFO DEMO_QUORUM <<PTT: exit-validator 1>> PlatformTestingToolMain: Waiting for final state to save before terminating
node0 7m 5.000s 2025-11-21 09:51:46.550 4550 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782976Z ]
node0 7m 5.001s 2025-11-21 09:51:46.551 4551 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:44.782976Z,type=EXIT_VALIDATION]
node0 7m 5.001s 2025-11-21 09:51:46.551 4552 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782978Z ]
node0 7m 5.001s 2025-11-21 09:51:46.551 4553 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:44.782978Z,type=EXIT_VALIDATION]
node0 7m 5.001s 2025-11-21 09:51:46.551 4554 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = EXIT_VALIDATION, consensusTime = 2025-11-21T09:51:44.782978Z ]
node0 7m 5.002s 2025-11-21 09:51:46.552 4555 INFO DEMO_QUORUM <<PTT: exit-validator 0>> PlatformTestingToolMain: Achieved Quorum on EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:44.782978Z ]
node0 7m 5.004s 2025-11-21 09:51:46.554 4556 INFO DEMO_INFO <<PTT: exit-validator 0>> TransactionSubmitter: Sending Freeze Transaction...
node0 7m 5.004s 2025-11-21 09:51:46.554 4557 INFO DEMO_INFO <<PTT: exit-validator 0>> TransactionSubmitter: Finished Sending Freeze Transaction.
node0 7m 5.004s 2025-11-21 09:51:46.554 4558 INFO DEMO_QUORUM <<PTT: exit-validator 0>> PlatformTestingToolMain: Waiting for final state to save before terminating
node2 7m 5.121s 2025-11-21 09:51:46.671 4550 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782976Z ]
node2 7m 5.121s 2025-11-21 09:51:46.671 4551 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:44.782976Z,type=EXIT_VALIDATION]
node2 7m 5.122s 2025-11-21 09:51:46.672 4552 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782978Z ]
node2 7m 5.122s 2025-11-21 09:51:46.672 4553 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:44.782978Z,type=EXIT_VALIDATION]
node2 7m 5.122s 2025-11-21 09:51:46.672 4554 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = EXIT_VALIDATION, consensusTime = 2025-11-21T09:51:44.782978Z ]
node2 7m 5.123s 2025-11-21 09:51:46.673 4555 INFO DEMO_QUORUM <<PTT: exit-validator 2>> PlatformTestingToolMain: Achieved Quorum on EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:44.782978Z ]
node2 7m 5.123s 2025-11-21 09:51:46.673 4556 INFO DEMO_QUORUM <<PTT: exit-validator 2>> PlatformTestingToolMain: Waiting for final state to save before terminating
node3 7m 5.196s 2025-11-21 09:51:46.746 4546 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 3, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782976Z ]
node3 7m 5.196s 2025-11-21 09:51:46.746 4547 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 3 apply state ControlAction[timestamp=2025-11-21T09:51:44.782976Z,type=EXIT_VALIDATION]
node3 7m 5.196s 2025-11-21 09:51:46.746 4548 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 2, type = EXIT_VALIDATION, consensusTimestamp = 2025-11-21T09:51:44.782978Z ]
node3 7m 5.197s 2025-11-21 09:51:46.747 4549 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 2 apply state ControlAction[timestamp=2025-11-21T09:51:44.782978Z,type=EXIT_VALIDATION]
node3 7m 5.197s 2025-11-21 09:51:46.747 4550 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 2, type = EXIT_VALIDATION, consensusTime = 2025-11-21T09:51:44.782978Z ]
node3 7m 5.197s 2025-11-21 09:51:46.747 4551 INFO DEMO_QUORUM <<PTT: exit-validator 3>> PlatformTestingToolMain: Achieved Quorum on EXIT_VALIDATION transaction [ consensusTime = 2025-11-21T09:51:44.782978Z ]
node3 7m 5.198s 2025-11-21 09:51:46.748 4552 INFO DEMO_QUORUM <<PTT: exit-validator 3>> PlatformTestingToolMain: Waiting for final state to save before terminating
node2 7m 7.071s 2025-11-21 09:51:48.621 4577 DEBUG FREEZE <<scheduler TransactionHandler>> FreezeTransactionHandler: Handling FreezeTransaction: startTimeEpochSecond: 1763718766
node3 7m 7.187s 2025-11-21 09:51:48.737 4573 DEBUG FREEZE <<scheduler TransactionHandler>> FreezeTransactionHandler: Handling FreezeTransaction: startTimeEpochSecond: 1763718766
5134 INFO EVENT_STREAM <<scheduler ConsensusEngine>> DefaultConsensusEventStream: ConsensusTimestamp of the last Event to be written into file before restarting: 2025-11-21T09:52:46.153432803Z
node1 7m 7.258s 2025-11-21 09:51:48.808 4573 DEBUG FREEZE <<scheduler TransactionHandler>> FreezeTransactionHandler: Handling FreezeTransaction: startTimeEpochSecond: 1763718766
5134 INFO EVENT_STREAM <<scheduler ConsensusEngine>> DefaultConsensusEventStream: ConsensusTimestamp of the last Event to be written into file before restarting: 2025-11-21T09:52:46.153432803Z
node0 7m 7.308s 2025-11-21 09:51:48.858 4579 DEBUG FREEZE <<scheduler TransactionHandler>> FreezeTransactionHandler: Handling FreezeTransaction: startTimeEpochSecond: 1763718766
node1 8m 5.969s 2025-11-21 09:52:47.519 5135 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Submitting freeze period entered action for consensus round: 740 consensusTimeStamp: 2025-11-21T09:52:46.153432803Z
node1 8m 5.970s 2025-11-21 09:52:47.520 5138 INFO PLATFORM_STATUS <platformForkJoinThread-1> StatusStateMachine: Platform spent 7.8 m in ACTIVE. Now in FREEZING
node1 8m 5.970s 2025-11-21 09:52:47.520 5139 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 740 created, will eventually be written to disk, for reason: FREEZE_STATE
node1 8m 5.970s 2025-11-21 09:52:47.520 5140 TRACE DEMO_INFO <platformForkJoinThread-1> PlatformTestingToolMain: ENTERING FREEZING!
node1 8m 5.971s 2025-11-21 09:52:47.521 5142 TRACE DEMO_INFO <platformForkJoinThread-1> PlatformTestingToolMain: total submitted transactions: DefaultCounter[category=Debug:info,name=tranSub,description=number of transactions submitted to platform,unit=,format=%d,dataType=INT,value=400000], FCM Transactions: 0
node1 8m 5.971s 2025-11-21 09:52:47.521 5144 INFO STARTUP <platformForkJoinThread-1> PlatformTestingToolMain: Platform Status Change FREEZING
node1 8m 5.972s 2025-11-21 09:52:47.522 5145 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> DefaultStateSnapshotManager: Freeze state written to disk for round 740 was not fully signed. This is expected.
Collected signatures representing 0/50000000000 (0.0%) weight.
node1 8m 5.972s 2025-11-21 09:52:47.522 5146 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 740 state to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/740
node1 8m 5.973s 2025-11-21 09:52:47.523 5147 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node1 8m 5.999s 2025-11-21 09:52:47.549 5163 INFO FREEZE <<scheduler ConsensusEngine>> TimestampStreamFileWriter: TimestampStreamFileWriter finished writing the last object, is stopped
node2 8m 6.208s 2025-11-21 09:52:47.758 5138 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Submitting freeze period entered action for consensus round: 740 consensusTimeStamp: 2025-11-21T09:52:46.153432803Z
node2 8m 6.209s 2025-11-21 09:52:47.759 5139 INFO EVENT_STREAM <<scheduler ConsensusEngine>> DefaultConsensusEventStream: ConsensusTimestamp of the last Event to be written into file before restarting: 2025-11-21T09:52:46.153432803Z
node2 8m 6.210s 2025-11-21 09:52:47.760 5140 INFO PLATFORM_STATUS <platformForkJoinThread-4> StatusStateMachine: Platform spent 7.8 m in ACTIVE. Now in FREEZING
node2 8m 6.211s 2025-11-21 09:52:47.761 5142 TRACE DEMO_INFO <platformForkJoinThread-4> PlatformTestingToolMain: ENTERING FREEZING!
node2 8m 6.211s 2025-11-21 09:52:47.761 5144 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 740 created, will eventually be written to disk, for reason: FREEZE_STATE
node2 8m 6.211s 2025-11-21 09:52:47.761 5145 TRACE DEMO_INFO <platformForkJoinThread-4> PlatformTestingToolMain: total submitted transactions: DefaultCounter[category=Debug:info,name=tranSub,description=number of transactions submitted to platform,unit=,format=%d,dataType=INT,value=400000], FCM Transactions: 0
node2 8m 6.212s 2025-11-21 09:52:47.762 5146 INFO STARTUP <platformForkJoinThread-4> PlatformTestingToolMain: Platform Status Change FREEZING
node2 8m 6.213s 2025-11-21 09:52:47.763 5149 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> DefaultStateSnapshotManager: Freeze state written to disk for round 740 was not fully signed. This is expected.
Collected signatures representing 0/50000000000 (0.0%) weight.
node2 8m 6.214s 2025-11-21 09:52:47.764 5150 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 740 state to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/740
node2 8m 6.214s 2025-11-21 09:52:47.764 5151 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node2 8m 6.238s 2025-11-21 09:52:47.788 5167 INFO FREEZE <<scheduler ConsensusEngine>> TimestampStreamFileWriter: TimestampStreamFileWriter finished writing the last object, is stopped
node3 8m 6.299s 2025-11-21 09:52:47.849 5135 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Submitting freeze period entered action for consensus round: 740 consensusTimeStamp: 2025-11-21T09:52:46.153432803Z
node3 8m 6.300s 2025-11-21 09:52:47.850 5136 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 7.8 m in ACTIVE. Now in FREEZING
node3 8m 6.300s 2025-11-21 09:52:47.850 5138 TRACE DEMO_INFO <platformForkJoinThread-5> PlatformTestingToolMain: ENTERING FREEZING!
node3 8m 6.300s 2025-11-21 09:52:47.850 5140 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 740 created, will eventually be written to disk, for reason: FREEZE_STATE
node3 8m 6.300s 2025-11-21 09:52:47.850 5141 TRACE DEMO_INFO <platformForkJoinThread-5> PlatformTestingToolMain: total submitted transactions: DefaultCounter[category=Debug:info,name=tranSub,description=number of transactions submitted to platform,unit=,format=%d,dataType=INT,value=400000], FCM Transactions: 0
node3 8m 6.300s 2025-11-21 09:52:47.850 5142 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change FREEZING
node3 8m 6.302s 2025-11-21 09:52:47.852 5145 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> DefaultStateSnapshotManager: Freeze state written to disk for round 740 was not fully signed. This is expected.
Collected signatures representing 0/50000000000 (0.0%) weight.
node3 8m 6.302s 2025-11-21 09:52:47.852 5146 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 740 state to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/740
node3 8m 6.302s 2025-11-21 09:52:47.852 5147 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node3 8m 6.319s 2025-11-21 09:52:47.869 5163 INFO FREEZE <<scheduler ConsensusEngine>> TimestampStreamFileWriter: TimestampStreamFileWriter finished writing the last object, is stopped
node0 8m 6.371s 2025-11-21 09:52:47.921 5140 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Submitting freeze period entered action for consensus round: 740 consensusTimeStamp: 2025-11-21T09:52:46.153432803Z
node0 8m 6.372s 2025-11-21 09:52:47.922 5141 INFO EVENT_STREAM <<scheduler ConsensusEngine>> DefaultConsensusEventStream: ConsensusTimestamp of the last Event to be written into file before restarting: 2025-11-21T09:52:46.153432803Z
node0 8m 6.372s 2025-11-21 09:52:47.922 5142 INFO PLATFORM_STATUS <platformForkJoinThread-7> StatusStateMachine: Platform spent 7.8 m in ACTIVE. Now in FREEZING
node0 8m 6.373s 2025-11-21 09:52:47.923 5143 TRACE DEMO_INFO <platformForkJoinThread-7> PlatformTestingToolMain: ENTERING FREEZING!
node0 8m 6.373s 2025-11-21 09:52:47.923 5146 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 740 created, will eventually be written to disk, for reason: FREEZE_STATE
node0 8m 6.373s 2025-11-21 09:52:47.923 5147 TRACE DEMO_INFO <platformForkJoinThread-7> PlatformTestingToolMain: total submitted transactions: DefaultCounter[category=Debug:info,name=tranSub,description=number of transactions submitted to platform,unit=,format=%d,dataType=INT,value=400000], FCM Transactions: 0
node0 8m 6.373s 2025-11-21 09:52:47.923 5148 INFO STARTUP <platformForkJoinThread-7> PlatformTestingToolMain: Platform Status Change FREEZING
node0 8m 6.374s 2025-11-21 09:52:47.924 5151 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> DefaultStateSnapshotManager: Freeze state written to disk for round 740 was not fully signed. This is expected.
Collected signatures representing 0/50000000000 (0.0%) weight.
node0 8m 6.375s 2025-11-21 09:52:47.925 5152 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 740 state to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/740
node0 8m 6.375s 2025-11-21 09:52:47.925 5153 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Creating a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node0 8m 6.401s 2025-11-21 09:52:47.951 5171 INFO FREEZE <<scheduler ConsensusEngine>> TimestampStreamFileWriter: TimestampStreamFileWriter finished writing the last object, is stopped
node1 8m 8.658s 2025-11-21 09:52:50.208 5232 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node1 8m 8.660s 2025-11-21 09:52:50.210 5233 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 740 Timestamp: 2025-11-21T09:52:46.153432803Z Next consensus number: 12124 Legacy running event hash: 72222eef9285918529eb1a83b3958c88b48852d9c2b90d2f69f6a948c3a61fa7fbac37e0452182164b0d8c836d9edcef Legacy running event mnemonic: dust-target-quarter-sorry Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 957339436 Root hash: 4c753944b0d0d7cc26d262cbc4a163f66a8b6d5416999f56f99552e332004e93550e872bb4bcbfdca26f32b4c35a3f91 (root) PlatformTestingToolState / modify-chuckle-toward-alley 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 citizen-century-local-scrub 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 verb-arrange-angry-absurd 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 long-again-goddess-gym 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node1 8m 8.670s 2025-11-21 09:52:50.220 5234 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 41 preconsensus files on disk.
First file: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+48+17.676787954Z_seq21_minr304_maxr353_orgn0.pces Last file: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+49+07.090027923Z_seq25_minr386_maxr436_orgn0.pces
node1 8m 8.671s 2025-11-21 09:52:50.221 5235 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 2 preconsensus event files meeting specified criteria to copy.
Lower bound: 713 First file to copy: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+52+13.726119856Z_seq39_minr665_maxr723_orgn0.pces Last file to copy: data/saved/preconsensus-events/1/2025/11/21/2025-11-21T09+52+35.816686328Z_seq40_minr696_maxr757_orgn0.pces
node1 8m 8.671s 2025-11-21 09:52:50.221 5236 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 2 preconsensus event file(s)
node1 8m 8.672s 2025-11-21 09:52:50.222 5237 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 2 preconsensus event file(s)
node1 8m 8.672s 2025-11-21 09:52:50.222 5238 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 740 to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/740 {"round":740,"freezeState":true,"reason":"FREEZE_STATE","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/1/123/740/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node1 8m 8.673s 2025-11-21 09:52:50.223 5239 INFO DEMO_QUORUM <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Preparing to terminate the JVM [ sleepAfterTestMs = 90000, consensusTime = 2025-11-21T09:52:46.153432803Z ]
node1 8m 8.674s 2025-11-21 09:52:50.224 5240 INFO PLATFORM_STATUS <platformForkJoinThread-2> StatusStateMachine: Platform spent 2.7 s in FREEZING. Now in FREEZE_COMPLETE
node1 8m 8.674s 2025-11-21 09:52:50.224 5241 INFO STARTUP <platformForkJoinThread-2> PlatformTestingToolMain: Platform Status Change FREEZE_COMPLETE
node1 8m 8.674s 2025-11-21 09:52:50.224 5242 INFO DEMO_INFO <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Test success: Reached quorum on the EXIT_VALIDATION transaction, consensus time = 2025-11-21T09:52:46.153432803Z {} [com.swirlds.logging.legacy.payload.ApplicationFinishedPayload]
node3 8m 8.914s 2025-11-21 09:52:50.464 5232 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node3 8m 8.916s 2025-11-21 09:52:50.466 5233 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 740 Timestamp: 2025-11-21T09:52:46.153432803Z Next consensus number: 12124 Legacy running event hash: 72222eef9285918529eb1a83b3958c88b48852d9c2b90d2f69f6a948c3a61fa7fbac37e0452182164b0d8c836d9edcef Legacy running event mnemonic: dust-target-quarter-sorry Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 957339436 Root hash: 4c753944b0d0d7cc26d262cbc4a163f66a8b6d5416999f56f99552e332004e93550e872bb4bcbfdca26f32b4c35a3f91 (root) PlatformTestingToolState / modify-chuckle-toward-alley 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 citizen-century-local-scrub 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 verb-arrange-angry-absurd 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 long-again-goddess-gym 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node3 8m 8.927s 2025-11-21 09:52:50.477 5234 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 41 preconsensus files on disk.
First file: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+52+13.986928930Z_seq39_minr664_maxr722_orgn0.pces Last file: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+47+03.930976275Z_seq15_minr183_maxr229_orgn0.pces
node3 8m 8.927s 2025-11-21 09:52:50.477 5235 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 2 preconsensus event files meeting specified criteria to copy.
Lower bound: 713 First file to copy: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+52+13.986928930Z_seq39_minr664_maxr722_orgn0.pces Last file to copy: data/saved/preconsensus-events/3/2025/11/21/2025-11-21T09+52+35.151658316Z_seq40_minr695_maxr756_orgn0.pces
node3 8m 8.927s 2025-11-21 09:52:50.477 5236 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 2 preconsensus event file(s)
node3 8m 8.928s 2025-11-21 09:52:50.478 5237 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 2 preconsensus event file(s)
node3 8m 8.929s 2025-11-21 09:52:50.479 5238 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 740 to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/740 {"round":740,"freezeState":true,"reason":"FREEZE_STATE","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/3/123/740/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node3 8m 8.930s 2025-11-21 09:52:50.480 5239 INFO DEMO_QUORUM <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Preparing to terminate the JVM [ sleepAfterTestMs = 90000, consensusTime = 2025-11-21T09:52:46.153432803Z ]
node3 8m 8.930s 2025-11-21 09:52:50.480 5240 INFO PLATFORM_STATUS <platformForkJoinThread-5> StatusStateMachine: Platform spent 2.6 s in FREEZING. Now in FREEZE_COMPLETE
node3 8m 8.930s 2025-11-21 09:52:50.480 5241 INFO STARTUP <platformForkJoinThread-5> PlatformTestingToolMain: Platform Status Change FREEZE_COMPLETE
node3 8m 8.931s 2025-11-21 09:52:50.481 5242 INFO DEMO_INFO <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Test success: Reached quorum on the EXIT_VALIDATION transaction, consensus time = 2025-11-21T09:52:46.153432803Z {} [com.swirlds.logging.legacy.payload.ApplicationFinishedPayload]
node0 8m 8.959s 2025-11-21 09:52:50.509 5238 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node0 8m 8.961s 2025-11-21 09:52:50.511 5239 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 740 Timestamp: 2025-11-21T09:52:46.153432803Z Next consensus number: 12124 Legacy running event hash: 72222eef9285918529eb1a83b3958c88b48852d9c2b90d2f69f6a948c3a61fa7fbac37e0452182164b0d8c836d9edcef Legacy running event mnemonic: dust-target-quarter-sorry Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 957339436 Root hash: 4c753944b0d0d7cc26d262cbc4a163f66a8b6d5416999f56f99552e332004e93550e872bb4bcbfdca26f32b4c35a3f91 (root) PlatformTestingToolState / modify-chuckle-toward-alley 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 citizen-century-local-scrub 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 verb-arrange-angry-absurd 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 long-again-goddess-gym 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node0 8m 8.971s 2025-11-21 09:52:50.521 5240 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 41 preconsensus files on disk.
First file: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+45+17.349566907Z_seq2_minr1_maxr32_orgn0.pces Last file: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+46+50.136951209Z_seq14_minr161_maxr209_orgn0.pces
node0 8m 8.971s 2025-11-21 09:52:50.521 5241 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 2 preconsensus event files meeting specified criteria to copy.
Lower bound: 713 First file to copy: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+52+12.744814075Z_seq39_minr663_maxr721_orgn0.pces Last file to copy: data/saved/preconsensus-events/0/2025/11/21/2025-11-21T09+52+34.388728464Z_seq40_minr694_maxr755_orgn0.pces
node0 8m 8.971s 2025-11-21 09:52:50.521 5242 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 2 preconsensus event file(s)
node0 8m 8.972s 2025-11-21 09:52:50.522 5243 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 2 preconsensus event file(s)
node0 8m 8.973s 2025-11-21 09:52:50.523 5244 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 740 to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/740 {"round":740,"freezeState":true,"reason":"FREEZE_STATE","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/740/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node0 8m 8.974s 2025-11-21 09:52:50.524 5245 INFO DEMO_QUORUM <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Preparing to terminate the JVM [ sleepAfterTestMs = 90000, consensusTime = 2025-11-21T09:52:46.153432803Z ]
node0 8m 8.974s 2025-11-21 09:52:50.524 5246 INFO PLATFORM_STATUS <platformForkJoinThread-6> StatusStateMachine: Platform spent 2.6 s in FREEZING. Now in FREEZE_COMPLETE
node0 8m 8.974s 2025-11-21 09:52:50.524 5247 INFO STARTUP <platformForkJoinThread-6> PlatformTestingToolMain: Platform Status Change FREEZE_COMPLETE
node0 8m 8.975s 2025-11-21 09:52:50.525 5248 INFO DEMO_INFO <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Test success: Reached quorum on the EXIT_VALIDATION transaction, consensus time = 2025-11-21T09:52:46.153432803Z {} [com.swirlds.logging.legacy.payload.ApplicationFinishedPayload]
node2 8m 8.996s 2025-11-21 09:52:50.546 5236 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> MerkleTreeSnapshotWriter: Successfully created a snapshot on demand in /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/swirlds-tmp/14 for round 740
node2 8m 8.999s 2025-11-21 09:52:50.549 5237 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 740 Timestamp: 2025-11-21T09:52:46.153432803Z Next consensus number: 12124 Legacy running event hash: 72222eef9285918529eb1a83b3958c88b48852d9c2b90d2f69f6a948c3a61fa7fbac37e0452182164b0d8c836d9edcef Legacy running event mnemonic: dust-target-quarter-sorry Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 957339436 Root hash: 4c753944b0d0d7cc26d262cbc4a163f66a8b6d5416999f56f99552e332004e93550e872bb4bcbfdca26f32b4c35a3f91 (root) PlatformTestingToolState / modify-chuckle-toward-alley 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 citizen-century-local-scrub 1 SingletonNode RosterService.ROSTER_STATE /1 involve-wrong-garlic-walk 2 VirtualMap RosterService.ROSTERS /2 aisle-icon-tiger-day 3 PayloadCfgSimple /3 small-crucial-observe-bar 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 coconut-machine-scrap-dish 0 MerkleMap /5/0 fall-topple-alarm-witness 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 verb-arrange-angry-absurd 7 IssLeaf /7 biology-capable-expose-purpose 8 NftLedger /8 chicken-butter-size-happy 0 MerkleMap /8/0 fall-topple-alarm-witness 1 null /8/1 bid-belt-culture-decorate 9 VirtualMap accounts /9 long-again-goddess-gym 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 globe-math-mass-loop
node2 8m 9.011s 2025-11-21 09:52:50.561 5238 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 41 preconsensus files on disk.
First file: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+51+53.725030007Z_seq38_minr636_maxr692_orgn0.pces Last file: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+51+35.171876169Z_seq37_minr609_maxr663_orgn0.pces
node2 8m 9.011s 2025-11-21 09:52:50.561 5239 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 2 preconsensus event files meeting specified criteria to copy.
Lower bound: 713 First file to copy: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+52+13.892653657Z_seq39_minr664_maxr722_orgn0.pces Last file to copy: data/saved/preconsensus-events/2/2025/11/21/2025-11-21T09+52+35.052660631Z_seq40_minr694_maxr755_orgn0.pces
node2 8m 9.011s 2025-11-21 09:52:50.561 5240 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 2 preconsensus event file(s)
node2 8m 9.012s 2025-11-21 09:52:50.562 5241 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 2 preconsensus event file(s)
node2 8m 9.013s 2025-11-21 09:52:50.563 5242 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 740 to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/740 {"round":740,"freezeState":true,"reason":"FREEZE_STATE","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/2/123/740/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node2 8m 9.014s 2025-11-21 09:52:50.564 5243 INFO DEMO_QUORUM <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Preparing to terminate the JVM [ sleepAfterTestMs = 90000, consensusTime = 2025-11-21T09:52:46.153432803Z ]
node2 8m 9.014s 2025-11-21 09:52:50.564 5244 INFO PLATFORM_STATUS <platformForkJoinThread-8> StatusStateMachine: Platform spent 2.8 s in FREEZING. Now in FREEZE_COMPLETE
node2 8m 9.015s 2025-11-21 09:52:50.565 5245 INFO STARTUP <platformForkJoinThread-8> PlatformTestingToolMain: Platform Status Change FREEZE_COMPLETE
node2 8m 9.015s 2025-11-21 09:52:50.565 5246 INFO DEMO_INFO <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Test success: Reached quorum on the EXIT_VALIDATION transaction, consensus time = 2025-11-21T09:52:46.153432803Z {} [com.swirlds.logging.legacy.payload.ApplicationFinishedPayload]
node2 9m 11.818s 2025-11-21 09:53:53.368 5247 WARN SOCKET_EXCEPTIONS <<platform-core: SyncProtocolWith0 2 to 0>> NetworkUtils: Connection broken: 2 <- 0
java.io.IOException: com.swirlds.common.threading.pool.ParallelExecutionException: Time thrown: 2025-11-21T09:53:53.365811035Z at com.swirlds.platform.gossip.sync.protocol.SyncPeerProtocol.runProtocol(SyncPeerProtocol.java:258) at com.swirlds.platform.network.communication.states.ProtocolNegotiated.transition(ProtocolNegotiated.java:47) at com.swirlds.platform.network.communication.Negotiator.execute(Negotiator.java:79) at com.swirlds.platform.network.communication.ProtocolNegotiatorThread.run(ProtocolNegotiatorThread.java:70) at com.swirlds.common.threading.framework.internal.StoppableThreadImpl.doWork(StoppableThreadImpl.java:599) at com.swirlds.common.threading.framework.internal.StoppableThreadImpl.run(StoppableThreadImpl.java:200) at com.swirlds.common.threading.framework.internal.AbstractThreadConfiguration.lambda$wrapRunnableWithSnapshot$3(AbstractThreadConfiguration.java:654) at java.base/java.lang.Thread.run(Thread.java:1583) Caused by: com.swirlds.common.threading.pool.ParallelExecutionException: Time thrown: 2025-11-21T09:53:53.365811035Z at com.swirlds.common.threading.pool.CachedPoolParallelExecutor.doParallelWithHandler(CachedPoolParallelExecutor.java:148) at com.swirlds.platform.gossip.shadowgraph.ShadowgraphSynchronizer.readWriteParallel(ShadowgraphSynchronizer.java:304) at com.swirlds.platform.gossip.shadowgraph.ShadowgraphSynchronizer.reserveSynchronize(ShadowgraphSynchronizer.java:148) at com.swirlds.platform.gossip.shadowgraph.ShadowgraphSynchronizer.synchronize(ShadowgraphSynchronizer.java:113) at com.swirlds.platform.gossip.sync.protocol.SyncPeerProtocol.runProtocol(SyncPeerProtocol.java:254) ... 7 more Caused by: java.net.SocketException: Connection reset at java.base/sun.nio.ch.NioSocketImpl.implRead(NioSocketImpl.java:318) at java.base/sun.nio.ch.NioSocketImpl.read(NioSocketImpl.java:346) at java.base/sun.nio.ch.NioSocketImpl$1.read(NioSocketImpl.java:796) at java.base/java.net.Socket$SocketInputStream.read(Socket.java:1099) at java.base/sun.security.ssl.SSLSocketInputRecord.read(SSLSocketInputRecord.java:489) at java.base/sun.security.ssl.SSLSocketInputRecord.readHeader(SSLSocketInputRecord.java:483) at java.base/sun.security.ssl.SSLSocketInputRecord.bytesInCompletePacket(SSLSocketInputRecord.java:70) at java.base/sun.security.ssl.SSLSocketImpl.readApplicationRecord(SSLSocketImpl.java:1461) at java.base/sun.security.ssl.SSLSocketImpl$AppInputStream.read(SSLSocketImpl.java:1066) at com.swirlds.common.io.extendable.extensions.AbstractStreamExtension.read(AbstractStreamExtension.java:73) at com.swirlds.common.io.extendable.ExtendableInputStream.read(ExtendableInputStream.java:63) at java.base/java.io.BufferedInputStream.fill(BufferedInputStream.java:291) at java.base/java.io.BufferedInputStream.read1(BufferedInputStream.java:347) at java.base/java.io.BufferedInputStream.implRead(BufferedInputStream.java:420) at java.base/java.io.BufferedInputStream.read(BufferedInputStream.java:399) at java.base/java.io.DataInputStream.readFully(DataInputStream.java:208) at java.base/java.io.DataInputStream.readLong(DataInputStream.java:407) at org.hiero.base.io.streams.AugmentedDataInputStream.readLong(AugmentedDataInputStream.java:186) at com.swirlds.platform.gossip.shadowgraph.SyncUtils.deserializeEventWindow(SyncUtils.java:640) at com.swirlds.platform.gossip.shadowgraph.SyncUtils.lambda$readTheirTipsAndEventWindow$3(SyncUtils.java:104) at com.swirlds.common.threading.pool.CachedPoolParallelExecutor.doParallelWithHandler(CachedPoolParallelExecutor.java:146) ... 11 more