Node ID



Columns











Log Level






Log Marker










Class











































node0 0.000ns 2025-10-30 11:45:26.190 1 INFO STARTUP <main> StaticPlatformBuilder:
////////////////////// // Node is Starting // //////////////////////
node0 128.000ms 2025-10-30 11:45:26.318 2 DEBUG STARTUP <main> StaticPlatformBuilder: main() started {} [com.swirlds.logging.legacy.payload.NodeStartPayload]
node0 301.000ms 2025-10-30 11:45:26.491 3 INFO STARTUP <main> Browser: The following nodes [0] are set to run locally
node0 310.000ms 2025-10-30 11:45:26.500 4 INFO STARTUP <main> PlatformTestingToolMain: Registering PlatformTestingToolState with ConstructableRegistry
node0 346.000ms 2025-10-30 11:45:26.536 5 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 349.000ms 2025-10-30 11:45:26.539 6 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 350.000ms 2025-10-30 11:45:26.540 7 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 350.000ms 2025-10-30 11:45:26.540 8 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 351.000ms 2025-10-30 11:45:26.541 9 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 351.000ms 2025-10-30 11:45:26.541 10 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 352.000ms 2025-10-30 11:45:26.542 11 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node0 353.000ms 2025-10-30 11:45:26.543 12 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 353.000ms 2025-10-30 11:45:26.543 13 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 354.000ms 2025-10-30 11:45:26.544 14 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 354.000ms 2025-10-30 11:45:26.544 15 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 354.000ms 2025-10-30 11:45:26.544 16 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 355.000ms 2025-10-30 11:45:26.545 17 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 355.000ms 2025-10-30 11:45:26.545 18 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node0 356.000ms 2025-10-30 11:45:26.546 19 INFO STARTUP <main> PlatformTestingToolMain: PlatformTestingToolState is registered with ConstructableRegistry: -4571139351850460298
node0 850.000ms 2025-10-30 11:45:27.040 22 DEBUG STARTUP <main> BootstrapUtils: Scanning the classpath for RuntimeConstructable classes
node0 2.116s 2025-10-30 11:45:28.306 23 DEBUG STARTUP <main> BootstrapUtils: Done with registerConstructables, time taken 1264ms
node0 2.177s 2025-10-30 11:45:28.367 24 INFO STARTUP <main> PrometheusEndpoint: PrometheusEndpoint: Starting server listing on port: 9999
node0 2.254s 2025-10-30 11:45:28.444 25 WARN STARTUP <main> CryptoStatic: There are no keys on disk, Adhoc keys will be generated, but this is incompatible with DAB.
node0 2.255s 2025-10-30 11:45:28.445 26 DEBUG STARTUP <main> CryptoStatic: Started generating keys
node0 2.807s 2025-10-30 11:45:28.997 27 DEBUG STARTUP <main> CryptoStatic: Done generating keys
node0 2.891s 2025-10-30 11:45:29.081 30 INFO STARTUP <main> StartupStateUtils: No saved states were found on disk.
node0 2.892s 2025-10-30 11:45:29.082 31 INFO DEMO_INFO <main> ExpectedFCMFamily: Set ExpectedMap initial capacity to be: 4000
node0 2.893s 2025-10-30 11:45:29.083 32 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountList initial capacity to be: 1000
node0 2.894s 2025-10-30 11:45:29.084 33 INFO DEMO_INFO <main> ExpectedFCMFamily: Set accountSelfEntitiesList initial capacity to be: 1000
node0 2.894s 2025-10-30 11:45:29.084 34 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqList initial capacity to be: 1000
node0 2.894s 2025-10-30 11:45:29.084 35 INFO DEMO_INFO <main> ExpectedFCMFamily: Set fcqSelfEntitiesList initial capacity to be: 1000
node0 2.895s 2025-10-30 11:45:29.085 36 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountList initial capacity to be: 1000
node0 2.895s 2025-10-30 11:45:29.085 37 INFO DEMO_INFO <main> ExpectedFCMFamily: Set virtual-merkle-accountSelfEntitiesList initial capacity to be: 1000
node0 3.766s 2025-10-30 11:45:29.956 46 INFO STARTUP <main> BootstrapUtils: Not upgrading software, current software is version SemanticVersion[major=1, minor=0, patch=0, pre=, build=].
node0 3.770s 2025-10-30 11:45:29.960 47 INFO STARTUP <main> AddressBookInitializer: Starting from genesis: using the config address book.
node0 4.910s 2025-10-30 11:45:31.100 48 INFO STARTUP <main> OSHealthChecker:
PASSED - Clock Source Speed Check Report[callsPerSec=26332628] PASSED - Entropy Check Report[success=true, entropySource=Strong Instance, elapsedNanos=271630, randomLong=-19760851091775768, exception=null] PASSED - Entropy Check Report[success=true, entropySource=NativePRNGBlocking:SUN, elapsedNanos=11630, randomLong=-5459450372831732556, exception=null] PASSED - File System Check Report[code=SUCCESS, readNanos=1584500, data=35, exception=null] OS Health Check Report - Complete (took 1025 ms)
node0 4.944s 2025-10-30 11:45:31.134 49 DEBUG STARTUP <main> BootstrapUtils: jvmPauseDetectorThread started
node0 4.953s 2025-10-30 11:45:31.143 50 INFO STARTUP <main> StandardScratchpad: Scratchpad platform.iss contents:
LAST_ISS_ROUND null
node0 4.957s 2025-10-30 11:45:31.147 51 INFO STARTUP <main> PlatformBuilder: Default platform pool parallelism: 8
node0 5.051s 2025-10-30 11:45:31.241 52 INFO STARTUP <main> SwirldsPlatform: Starting with roster history:
RosterHistory[ currentRosterRound: 0 ][ no previous roster set ] Current Roster: { "rosterEntries": [{ "weight": "50000000000", "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": "IoVu3w==", "port": 30124 }, { "ipAddressV4": "CoAANA==", "port": 30124 }] }] }
node0 5.175s 2025-10-30 11:45:31.365 53 INFO STARTUP <main> PlatformTestingToolState: Trigger and PreviousSoftwareVersion state received in init function {"trigger":"GENESIS","previousSoftwareVersion":"null"} [com.swirlds.logging.legacy.payload.SoftwareVersionPayload]
node0 5.176s 2025-10-30 11:45:31.366 54 INFO STARTUP <main> PlatformTestingToolState: Set QuorumResult from genesisInit()
node0 5.194s 2025-10-30 11:45:31.384 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: 765b6ad673383354ac50f49943ab4f36e5c0945edf5ae39eff9559c02e04bd5cef180d0e4cf38e3f2ac50fad944b22c9 (root) PlatformTestingToolState / slice-food-grow-hedgehog 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 method-topple-elite-gate 1 SingletonNode RosterService.ROSTER_STATE /1 pumpkin-army-write-idle 2 VirtualMap RosterService.ROSTERS /2 source-shed-economy-cheese 3 PayloadCfgSimple /3 potato-pill-swear-author 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 journey-bus-million-shy
node0 5.397s 2025-10-30 11:45:31.587 57 INFO EVENT_STREAM <main> DefaultConsensusEventStream: EventStreamManager::updateRunningHash: 38b060a751ac96384cd9327eb1b1e36a21fdb71114be07434c0cc7bf63f6e1da274edebfe76f65fbd51ad2f14898b95b
node0 5.402s 2025-10-30 11:45:31.592 58 INFO STARTUP <platformForkJoinThread-2> Shadowgraph: Shadowgraph starting from expiration threshold 1
node0 5.412s 2025-10-30 11:45:31.602 59 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xms32g
node0 5.413s 2025-10-30 11:45:31.603 60 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xmx118g
node0 5.413s 2025-10-30 11:45:31.603 61 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+UnlockExperimentalVMOptions
node0 5.414s 2025-10-30 11:45:31.604 62 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+UseZGC
node0 5.414s 2025-10-30 11:45:31.604 63 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ZAllocationSpikeTolerance=2
node0 5.414s 2025-10-30 11:45:31.604 64 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ConcGCThreads=14
node0 5.414s 2025-10-30 11:45:31.604 65 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:ZMarkStackSpaceLimit=16g
node0 5.415s 2025-10-30 11:45:31.605 66 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:MaxDirectMemorySize=64g
node0 5.415s 2025-10-30 11:45:31.605 67 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:MetaspaceSize=100M
node0 5.415s 2025-10-30 11:45:31.605 68 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -XX:+ZGenerational
node0 5.416s 2025-10-30 11:45:31.606 69 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Xlog:gc*:gc.log
node0 5.416s 2025-10-30 11:45:31.606 70 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/jdk.internal.misc=ALL-UNNAMED
node0 5.416s 2025-10-30 11:45:31.606 71 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: --add-opens=java.base/java.nio=ALL-UNNAMED
node0 5.417s 2025-10-30 11:45:31.607 72 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: JVM arg: -Dio.netty.tryReflectionSetAccessible=true
node0 5.417s 2025-10-30 11:45:31.607 73 INFO STARTUP <<start-node-0>> PlatformTestingToolMain: Parsing JSON FCM-VMerkle-Basic-SingleNode-2.5k-3m.json
node0 5.436s 2025-10-30 11:45:31.626 74 INFO DEMO_INFO <<start-node-0>> PayloadConfig: insertSeq = true
node0 5.436s 2025-10-30 11:45:31.626 75 INFO DEMO_INFO <<start-node-0>> PayloadConfig: appendSig = true
node0 5.437s 2025-10-30 11:45:31.627 76 INFO DEMO_INFO <<start-node-0>> PayloadConfig: variedSize = false
node0 5.437s 2025-10-30 11:45:31.627 77 INFO DEMO_INFO <<start-node-0>> PayloadConfig: payloadByteSize = 100
node0 5.438s 2025-10-30 11:45:31.628 78 INFO DEMO_INFO <<start-node-0>> PayloadConfig: maxByteSize = 100
node0 5.438s 2025-10-30 11:45:31.628 79 INFO DEMO_INFO <<start-node-0>> PayloadConfig: type = TYPE_FCM_VIRTUAL_MIX
node0 5.439s 2025-10-30 11:45:31.629 80 INFO DEMO_INFO <<start-node-0>> PayloadConfig: invalidSigRatio = 0.0
node0 5.441s 2025-10-30 11:45:31.631 81 INFO DEMO_INFO <<start-node-0>> TransactionSubmitter: Goal is TRANS_PER_SECOND_PER_NODE targe 2500.0
node0 5.446s 2025-10-30 11:45:31.636 82 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: State = com.swirlds.demo.platform.PlatformTestingToolState@17c9916a
node0 5.447s 2025-10-30 11:45:31.637 83 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: total accounts = 39000
node0 5.447s 2025-10-30 11:45:31.637 84 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: Creating virtualmap for 39000 accounts.
node0 5.454s 2025-10-30 11:45:31.644 89 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: accounts VM = com.swirlds.virtualmap.VirtualMap@372dcbda, DS = MerkleDbDataSource[initialCapacity=1000000,preferDiskBasedIndexes=false,pathToDiskLocationInternalNodes.size=0,pathToDiskLocationLeafNodes.size=0,hashesRamToDiskThreshold=8388608,hashStoreRam.size=0,hashStoreDisk=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@62900ac5,hasDiskStoreForHashes=true,keyToPath=com.swirlds.merkledb.files.hashmap.HalfDiskHashMap@3471a38a,pathToKeyValue=com.swirlds.merkledb.files.MemoryIndexDiskKeyValueStore@633b11ff,snapshotInProgress=false]
node0 5.467s 2025-10-30 11:45:31.657 90 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: max KV pairs = 0
node0 5.468s 2025-10-30 11:45:31.658 91 INFO DEMO_INFO <<start-node-0>> VirtualMerkleStateInitializer: total SC = 0
node0 5.474s 2025-10-30 11:45:31.664 92 INFO DEMO_INFO <<start-node-0>> FCMTransactionPool: Random seed for FCMTransactionPool is -5576780473459966109
node0 5.475s 2025-10-30 11:45:31.665 93 INFO DEMO_INFO <<start-node-0>> FCMTransactionPool: This test will generate sequential FCM payload:
node0 5.567s 2025-10-30 11:45:31.757 94 INFO STARTUP <<start-node-0>> SwirldsPlatform: Starting platform 0
node0 5.570s 2025-10-30 11:45:31.760 95 INFO STARTUP <<platform: recycle-bin-cleanup>> RecycleBinImpl: Deleted 0 files from the recycle bin.
node0 5.574s 2025-10-30 11:45:31.764 96 INFO STARTUP <<start-node-0>> CycleFinder: No cyclical back pressure detected in wiring model.
node0 5.575s 2025-10-30 11:45:31.765 97 INFO STARTUP <<start-node-0>> DirectSchedulerChecks: No illegal direct scheduler use detected in the wiring model.
node0 5.576s 2025-10-30 11:45:31.766 98 INFO STARTUP <<start-node-0>> InputWireChecks: All input wires have been bound.
node0 5.578s 2025-10-30 11:45:31.768 99 WARN STARTUP <<start-node-0>> PcesFileTracker: No preconsensus event files available
node0 5.578s 2025-10-30 11:45:31.768 100 INFO STARTUP <<start-node-0>> SwirldsPlatform: replaying preconsensus event stream starting at 0
node0 5.581s 2025-10-30 11:45:31.771 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.
node0 5.582s 2025-10-30 11:45:31.772 102 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Node 0 starts transactions ........
node0 5.585s 2025-10-30 11:45:31.775 103 INFO PLATFORM_STATUS <platformForkJoinThread-4> StatusStateMachine: Platform spent 327.0 ms in STARTING_UP. Now in REPLAYING_EVENTS
node0 5.586s 2025-10-30 11:45:31.776 104 INFO STARTUP <platformForkJoinThread-4> PlatformTestingToolMain: Platform Status Change REPLAYING_EVENTS
node0 5.590s 2025-10-30 11:45:31.780 105 INFO PLATFORM_STATUS <platformForkJoinThread-4> StatusStateMachine: Platform spent 4.0 ms in REPLAYING_EVENTS. Now in OBSERVING
node0 5.590s 2025-10-30 11:45:31.780 106 INFO STARTUP <platformForkJoinThread-4> PlatformTestingToolMain: Platform Status Change OBSERVING
node0 8.425s 2025-10-30 11:45:34.615 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 8.428s 2025-10-30 11:45:34.618 108 DEBUG STARTUP <<platform-core: MetricsThread #0>> LegacyCsvWriter: CsvWriter: Using the existing metrics folder [ folder = '/opt/hgcapp/services-hedera/HapiApp2.0/data/stats' ]
node0 15.677s 2025-10-30 11:45:41.867 109 INFO PLATFORM_STATUS <platformForkJoinThread-6> StatusStateMachine: Platform spent 10.1 s in OBSERVING. Now in CHECKING
node0 15.678s 2025-10-30 11:45:41.868 110 INFO STARTUP <platformForkJoinThread-6> PlatformTestingToolMain: Platform Status Change CHECKING
node0 15.846s 2025-10-30 11:45:42.036 111 INFO PLATFORM_STATUS <platformForkJoinThread-2> StatusStateMachine: Platform spent 167.0 ms in CHECKING. Now in ACTIVE
node0 15.846s 2025-10-30 11:45:42.036 112 INFO STARTUP <platformForkJoinThread-2> PlatformTestingToolMain: Platform Status Change ACTIVE
node0 15.856s 2025-10-30 11:45:42.046 113 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: resetting transaction counters
node0 15.892s 2025-10-30 11:45:42.082 114 TRACE STARTUP <<app: appMain 0>> PttTransactionPool: Signed Message { signatureType = 'ED25519', publicKey = '0x4A3AD9215BA04E54C22BEF6FC6F885CEA36700A68168C729D6BE2660FE00A493', privateKey ='0x4A3AD9215BA04E54C22BEF6FC6F885CEA36700A68168C729D6BE2660FE00A493', signature = '0x0899D89A4C07F1156695B9078A9C1355C83AE6B2FC96EB53CC64FE46364C60A6FF7E9BFF8A56C5349B005A5165B2D010877A573CD7F559B3E6F4812CD6798904',message = '0x12660A0A40B5D8EE9483F6B9D20D325600000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000000004001' }
node0 15.962s 2025-10-30 11:45:42.152 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
node0 16.039s 2025-10-30 11:45:42.229 132 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 16.041s 2025-10-30 11:45:42.231 133 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 16.367s 2025-10-30 11:45:42.557 193 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
node0 16.371s 2025-10-30 11:45:42.561 194 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 3 Timestamp: 2025-10-30T11:45:42.016558071Z Next consensus number: 3 Legacy running event hash: 916b9d9972c04b098842f58db923877f5d2fb528655024fc85cd28118075c68c6343ec148193c854daa528f27cbf8192 Legacy running event mnemonic: sport-erupt-fix-gentle Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: 2044907021 Root hash: c53a3aa6a95a316f8338e30e7cc22715a3f17d657b560eaf192c1cfedc213b15e17e90bb4c445583a12514eeb9e6f553 (root) PlatformTestingToolState / flee-feel-state-combine 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 zoo-allow-luxury-bar 1 SingletonNode RosterService.ROSTER_STATE /1 pumpkin-army-write-idle 2 VirtualMap RosterService.ROSTERS /2 source-shed-economy-cheese 3 PayloadCfgSimple /3 potato-pill-swear-author 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 virus-bird-ancient-indicate 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 journey-bus-million-shy
node0 16.414s 2025-10-30 11:45:42.604 199 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus file on disk.
File: data/saved/preconsensus-events/0/2025/10/30/2025-10-30T11+45+41.901054332Z_seq0_minr1_maxr501_orgn0.pces
node0 16.415s 2025-10-30 11:45:42.605 200 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/10/30/2025-10-30T11+45+41.901054332Z_seq0_minr1_maxr501_orgn0.pces
node0 16.416s 2025-10-30 11:45:42.606 201 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node0 16.417s 2025-10-30 11:45:42.607 202 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node0 16.421s 2025-10-30 11:45:42.611 203 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 23.861s 2025-10-30 11:45:50.051 1130 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 23.979s 2025-10-30 11:45:50.169 1151 INFO DEMO_INFO <<app: appMain 0>> FCMTransactionPool: Generated enough FCM transaction for type TYPE_FCM_CREATE
node0 27.890s 2025-10-30 11:45:54.080 1610 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_DELETE transactions
node0 31.915s 2025-10-30 11:45:58.105 2091 INFO DEMO_INFO <<app: appMain 0>> FCMTransactionPool: Generated enough FCM transaction for type TYPE_FCM_UPDATE
node0 31.922s 2025-10-30 11:45:58.112 2092 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 35.902s 2025-10-30 11:46:02.092 2577 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 39.820s 2025-10-30 11:46:06.010 3066 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_DELETE transactions
node0 39.984s 2025-10-30 11:46:06.174 3107 INFO DEMO_INFO <<app: appMain 0>> FCMTransactionPool: Generated enough FCM transaction for type TYPE_FCM_TRANSFER
node0 43.813s 2025-10-30 11:46:10.003 3568 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 44.801s 2025-10-30 11:46:10.991 3681 INFO DEMO_INFO <<app: appMain 0>> FCMTransactionPool: Generated enough FCM transaction for type TYPE_FCM_DELETE
node0 44.803s 2025-10-30 11:46:10.993 3682 INFO DEMO_INFO <<app: appMain 0>> FCMTransactionPool: Generated enough FCM test for sequential mode, stop generating 4 >= 4
node0 46.318s 2025-10-30 11:46:12.508 3849 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 48.325s 2025-10-30 11:46:14.515 4090 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_DELETE transactions
node0 50.334s 2025-10-30 11:46:16.524 4331 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 52.337s 2025-10-30 11:46:18.527 4576 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 53.909s 2025-10-30 11:46:20.099 4763 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_DELETE transactions
node0 55.934s 2025-10-30 11:46:22.124 5004 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 57.512s 2025-10-30 11:46:23.702 5191 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 59.525s 2025-10-30 11:46:25.715 5436 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_DELETE transactions
node0 1m 1.118s 2025-10-30 11:46:27.308 5623 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_UPDATE transactions
node0 1m 5.139s 2025-10-30 11:46:31.329 6106 INFO DEMO_INFO <<app: appMain 0>> SequentialTransactionRequestSupplier: Finished generating TYPE_VIRTUAL_MERKLE_CREATE transactions
node0 1m 5.143s 2025-10-30 11:46:31.333 6107 INFO DEMO_INFO <<app: appMain 0>> PttTransactionPool: Generated enough virtual merkle test for sequential mode
node0 1m 5.143s 2025-10-30 11:46:31.333 6108 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Stop generating transactions
node0 1m 5.146s 2025-10-30 11:46:31.336 6109 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: node 0 sent ENTER_VALIDATION Message
node0 1m 5.146s 2025-10-30 11:46:31.336 6110 INFO DEMO_INFO <<app: appMain 0>> PlatformTestingToolMain: Node 0 finished generating all transactions.
node0 1m 5.276s 2025-10-30 11:46:31.466 6143 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = ENTER_VALIDATION, consensusTimestamp = 2025-10-30T11:46:31.336775401Z ]
node0 1m 5.277s 2025-10-30 11:46:31.467 6144 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-10-30T11:46:31.336775401Z,type=ENTER_VALIDATION]
node0 1m 5.278s 2025-10-30 11:46:31.468 6145 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 0, type = ENTER_VALIDATION, consensusTime = 2025-10-30T11:46:31.336775401Z ]
node0 1m 5.283s 2025-10-30 11:46:31.473 6150 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Achieved Quorum on ENTER_VALIDATION transaction [ expectedMapFile = Node0000_ExpectedMap_1761824791336_336775401.json, consensusTime = 2025-10-30T11:46:31.336775401Z ]
node0 1m 5.359s 2025-10-30 11:46:31.549 6151 INFO SAVE_EXPECTED_MAP <<PTT: enter-validator 0>> SaveExpectedMapHandler: Serializing ExpectedMap Node0000_ExpectedMap_1761824791336_336775401.json.gz
node0 1m 6.057s 2025-10-30 11:46:32.247 6224 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Successfully wrote expected map to file [ expectedMapFile = Node0000_ExpectedMap_1761824791336_336775401.json, consensusTime = 2025-10-30T11:46:31.336775401Z ]
node0 1m 6.057s 2025-10-30 11:46:32.247 6225 INFO DEMO_QUORUM <<PTT: enter-validator 0>> PlatformTestingToolMain: Sent EXIT_VALIDATION transaction [ consensusTime = 2025-10-30T11:46:31.336775401Z ]
node0 1m 6.234s 2025-10-30 11:46:32.424 6270 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolState: Handling Control Transaction [ originatingNodeId = 0, type = EXIT_VALIDATION, consensusTimestamp = 2025-10-30T11:46:32.297140291Z ]
node0 1m 6.235s 2025-10-30 11:46:32.425 6271 INFO DEMO_INFO <<scheduler TransactionHandler>> QuorumTriggeredAction: Node 0 apply state ControlAction[timestamp=2025-10-30T11:46:32.297140291Z,type=EXIT_VALIDATION]
node0 1m 6.235s 2025-10-30 11:46:32.425 6272 INFO DEMO_INFO <<scheduler TransactionHandler>> PlatformTestingToolMain: Handling Quorum Transition [ triggeringNodeId = 0, type = EXIT_VALIDATION, consensusTime = 2025-10-30T11:46:32.297140291Z ]
node0 1m 6.237s 2025-10-30 11:46:32.427 6273 INFO DEMO_QUORUM <<PTT: exit-validator 0>> PlatformTestingToolMain: Achieved Quorum on EXIT_VALIDATION transaction [ consensusTime = 2025-10-30T11:46:32.297140291Z ]
node0 1m 6.239s 2025-10-30 11:46:32.429 6274 INFO DEMO_INFO <<PTT: exit-validator 0>> TransactionSubmitter: Sending Freeze Transaction...
node0 1m 6.239s 2025-10-30 11:46:32.429 6275 INFO DEMO_INFO <<PTT: exit-validator 0>> TransactionSubmitter: Finished Sending Freeze Transaction.
node0 1m 6.239s 2025-10-30 11:46:32.429 6276 INFO DEMO_QUORUM <<PTT: exit-validator 0>> PlatformTestingToolMain: Waiting for final state to save before terminating
node0 1m 6.421s 2025-10-30 11:46:32.611 6301 DEBUG FREEZE <<scheduler TransactionHandler>> FreezeTransactionHandler: Handling FreezeTransaction: startTimeEpochSecond: 1761824852
node0 2m 5.993s 2025-10-30 11:47:32.183 13308 INFO STARTUP <<scheduler TransactionHandler>> DefaultTransactionHandler: Submitting freeze period entered action for consensus round: 1837 consensusTimeStamp: 2025-10-30T11:47:32.056847693Z
node0 2m 5.994s 2025-10-30 11:47:32.184 13309 INFO EVENT_STREAM <<scheduler ConsensusEngine>> DefaultConsensusEventStream: ConsensusTimestamp of the last Event to be written into file before restarting: 2025-10-30T11:47:32.056847693Z
node0 2m 5.995s 2025-10-30 11:47:32.185 13310 INFO PLATFORM_STATUS <platformForkJoinThread-7> StatusStateMachine: Platform spent 1.8 m in ACTIVE. Now in FREEZING
node0 2m 5.996s 2025-10-30 11:47:32.186 13311 TRACE DEMO_INFO <platformForkJoinThread-7> PlatformTestingToolMain: ENTERING FREEZING!
node0 2m 5.996s 2025-10-30 11:47:32.186 13314 INFO STATE_TO_DISK <<scheduler TransactionHandler>> DefaultSavedStateController: Signed state from round 1837 created, will eventually be written to disk, for reason: FREEZE_STATE
node0 2m 5.996s 2025-10-30 11:47:32.186 13315 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=123000], FCM Transactions: 36000
node0 2m 5.997s 2025-10-30 11:47:32.187 13316 INFO STARTUP <platformForkJoinThread-7> PlatformTestingToolMain: Platform Status Change FREEZING
node0 2m 5.999s 2025-10-30 11:47:32.189 13318 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> DefaultStateSnapshotManager: Freeze state written to disk for round 1837 was not fully signed. This is expected.
Collected signatures representing 0/50000000000 (0.0%) weight.
node0 2m 5.999s 2025-10-30 11:47:32.189 13319 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Started writing round 1837 state to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/1837
node0 2m 5.999s 2025-10-30 11:47:32.189 13320 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 1837
node0 2m 6.024s 2025-10-30 11:47:32.214 13338 INFO FREEZE <<scheduler ConsensusEngine>> TimestampStreamFileWriter: TimestampStreamFileWriter finished writing the last object, is stopped
node0 2m 6.657s 2025-10-30 11:47:32.847 13412 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 1837
node0 2m 6.660s 2025-10-30 11:47:32.850 13413 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Information for state written to disk:
Round: 1837 Timestamp: 2025-10-30T11:47:32.056847693Z Next consensus number: 1837 Legacy running event hash: a22dfa590c89f32eae59130ca6963b7cebb37a62054570e2650d13c44585aa40dc2c93da93079568362a0e13bacc6793 Legacy running event mnemonic: risk-reject-muffin-olympic Rounds non-ancient: 26 Creation version: SemanticVersion[major=1, minor=0, patch=0, pre=, build=] Minimum judge hash code: -625384221 Root hash: 2b5245104c441664d02bb1c42ea9805a8fd9332fc58fa0367aa75fabe458c865b5bbaf2c95de7097e2369ce386de6ba8 (root) PlatformTestingToolState / heart-pear-mass-smart 0 SingletonNode PlatformStateService.PLATFORM_STATE /0 garbage-able-evil-race 1 SingletonNode RosterService.ROSTER_STATE /1 pumpkin-army-write-idle 2 VirtualMap RosterService.ROSTERS /2 source-shed-economy-cheese 3 PayloadCfgSimple /3 potato-pill-swear-author 4 NextSeqConsList /4 sniff-wear-know-arrow 5 FCMFamily /5 disagree-snow-marble-life 0 MerkleMap /5/0 cargo-claw-subject-ridge 1 MerkleMap /5/1 fall-topple-alarm-witness 6 TransactionCounterList /6 road-throw-shy-soda 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 mix-call-turn-foster 10 null /10 bid-belt-culture-decorate 11 null /11 bid-belt-culture-decorate 12 QuorumResult /12 journey-bus-million-shy
node0 2m 6.669s 2025-10-30 11:47:32.859 13414 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 5 preconsensus files on disk.
First file: data/saved/preconsensus-events/0/2025/10/30/2025-10-30T11+46+01.762277355Z_seq1_minr302_maxr656_orgn0.pces Last file: data/saved/preconsensus-events/0/2025/10/30/2025-10-30T11+46+21.382350450Z_seq2_minr629_maxr1053_orgn0.pces
node0 2m 6.670s 2025-10-30 11:47:32.860 13415 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Found 1 preconsensus event file meeting specified criteria to copy.
Lower bound: 1810 File: data/saved/preconsensus-events/0/2025/10/30/2025-10-30T11+47+11.541065642Z_seq4_minr1465_maxr1961_orgn0.pces
node0 2m 6.670s 2025-10-30 11:47:32.860 13416 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Copying 1 preconsensus event file(s)
node0 2m 6.670s 2025-10-30 11:47:32.860 13417 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> BestEffortPcesFileCopy: Finished copying 1 preconsensus event file(s)
node0 2m 6.671s 2025-10-30 11:47:32.861 13418 INFO STATE_TO_DISK <<scheduler StateSnapshotManager>> SignedStateFileWriter: Finished writing state for round 1837 to disk. Reason: FREEZE_STATE, directory: /opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/1837 {"round":1837,"freezeState":true,"reason":"FREEZE_STATE","directory":"file:///opt/hgcapp/services-hedera/HapiApp2.0/data/saved/com.swirlds.demo.platform.PlatformTestingToolMain/0/123/1837/"} [com.swirlds.logging.legacy.payload.StateSavedToDiskPayload]
node0 2m 6.673s 2025-10-30 11:47:32.863 13419 INFO DEMO_QUORUM <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Preparing to terminate the JVM [ sleepAfterTestMs = 90000, consensusTime = 2025-10-30T11:47:32.056847693Z ]
node0 2m 6.673s 2025-10-30 11:47:32.863 13420 INFO PLATFORM_STATUS <platformForkJoinThread-2> StatusStateMachine: Platform spent 677.0 ms in FREEZING. Now in FREEZE_COMPLETE
node0 2m 6.673s 2025-10-30 11:47:32.863 13421 INFO STARTUP <platformForkJoinThread-2> PlatformTestingToolMain: Platform Status Change FREEZE_COMPLETE
node0 2m 6.674s 2025-10-30 11:47:32.864 13422 INFO DEMO_INFO <<scheduler StateSnapshotManager>> PlatformTestingToolMain: Test success: Reached quorum on the EXIT_VALIDATION transaction, consensus time = 2025-10-30T11:47:32.056847693Z {} [com.swirlds.logging.legacy.payload.ApplicationFinishedPayload]