Parent Log: http://ci.aztec-labs.com/88af6abc5e7063c3 Command: 34bb2d8006849c58:ONLY_TERM_PARENT=1 BOX=vite BROWSER=webkit run_compose_test vite-webkit box boxes Commit: https://github.com/AztecProtocol/aztec-packages/commit/42440bd429a3b283b3a344db0be4652d818bd261 Env: REF_NAME=gh-readonly-queue/next/pr-15046-2469b5f1633350f6be15733c04242af1cdc98227 CURRENT_VERSION=0.87.6 CI_FULL=1 Date: Mon Jun 16 19:53:06 UTC 2025 System: ARCH=amd64 CPUS=128 MEM=493Gi HOSTNAME=pr-15046_amd64_x1-full Resources: CPU_LIST=0-127 CPUS=2 MEM=8g TIMEOUT=600s History: [?25l[+] Running 4/4 19:53:08 Network vite-webkit_default Created0.1s 19:53:08 Container vite-webkit-ethereum-1 Created1.0s 19:53:08 Container vite-webkit-aztec-1 Created0.5s 19:53:08 Container vite-webkit-box-1 Created0.2s 19:53:08 [?25hAttaching to aztec-1, box-1, ethereum-1 19:53:13 aztec-1 | 19:53:13 aztec-1 | _ 19:53:13 aztec-1 | /\ | | 19:53:13 aztec-1 | / \ ___| |_ ___ ___ 19:53:13 aztec-1 | / /\ \ |_ / __/ _ \/ __| 19:53:13 aztec-1 | / ____ \ / /| || __/ (__ 19:53:13 aztec-1 | /_/___ \_\/___|\__\___|\___| 19:53:13 aztec-1 | 19:53:13 aztec-1 | https://github.com/AztecProtocol 19:53:13 aztec-1 | 19:53:13 aztec-1 | 19:53:13 aztec-1 | Setting up Aztec Sandbox 0.87.6, please stand by... 19:53:13 aztec-1 | Setting up test accounts 19:53:15 aztec-1 | [19:53:14.582] INFO: world-state:database Creating world state data store at directory /tmp/aztec-world-state-QlzPN2/world_state with map sizes {"archiveTreeMapSizeKb":10485760,"nullifierTreeMapSizeKb":10485760,"noteHashTreeMapSizeKb":10485760,"messageTreeMapSizeKb":10485760,"publicDataTreeMapSizeKb":10485760} and 4 threads. 19:53:15 aztec-1 | [19:53:14.862] INFO: sandbox Calling anvil_setBlockTimestampInterval with params: [12] 19:53:15 aztec-1 | [19:53:14.868] WARN: sandbox Set block interval to 12 19:53:15 aztec-1 | [19:53:15.111] INFO: sandbox Waiting for 7 transactions to be mined... 19:53:15 aztec-1 | [19:53:15.137] INFO: sandbox All transactions mined successfully 19:53:15 aztec-1 | [19:53:15.228] INFO: sandbox Waiting for 9 transactions to be mined... 19:53:15 aztec-1 | [19:53:15.246] INFO: sandbox All transactions mined successfully 19:53:15 aztec-1 | [19:53:15.406] INFO: sandbox Waiting for 11 transactions to be mined... 19:53:15 aztec-1 | [19:53:15.432] INFO: sandbox All transactions mined successfully 19:53:15 aztec-1 | [19:53:15.506] INFO: sandbox Waiting for 12 transactions to be mined... 19:53:15 aztec-1 | [19:53:15.532] INFO: sandbox All transactions mined successfully 19:53:15 aztec-1 | [19:53:15.539] INFO: sandbox Waiting for 12 transactions to be mined... 19:53:15 aztec-1 | [19:53:15.561] INFO: sandbox All transactions mined successfully 19:53:15 aztec-1 | [19:53:15.584] INFO: sandbox Aztec L1 contracts initialized {"registryAddress":"0xcf7ed3acca5a467e9e704c703e8d87f634fb0fc9","governanceAddress":"0x5fc8d32690cc91d4c39d9d3abcbd16989f875707","governanceProposerAddress":"0xdc64a140aa3e981100a9beca4e685f962f0cf6c9","rollupAddress":"0x3aa5ebb10dc797cac828524e59a333d0a371443c","inboxAddress":"0x4374eecaad0dcaa149cffc160d5a0552b1d092b0","outboxAddress":"0x44bf2a9217a2970a1bcc7529bf1d40828c594320","feeJuicePortalAddress":"0xa0719ec6accbac2301f88bc71e2f5ddc8c29149b","feeJuiceAddress":"0x5fbdb2315678afecb367f032d93f642f64180aa3","stakingAssetAddress":"0xe7f1725e7734ce288f8367e1bb143e90bb3f0512","rewardDistributorAddress":"0xd8058efe0198ae9dd7d563e1b4938dcbc86a1f81","gseAddress":"0x9fe46736679d2d9a65f0992f2272de9f3c7fa6e0","coinIssuerAddress":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266"} 19:53:15 aztec-1 | [19:53:15.585] INFO: sandbox Handing over to governance 19:53:15 aztec-1 | [19:53:15.599] INFO: aztecjs:utils:watcher Watcher started for rollup at 0x3Aa5ebB10DC797CAC828524e59A333d0A371443c 19:53:15 aztec-1 | [19:53:15.599] INFO: telemetry:client Using NoopTelemetryClient 19:53:15 aztec-1 | [19:53:15.599] INFO: blob-sink:client Creating local blob sink client. 19:53:15 aztec-1 | [19:53:15.604] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:53:15 aztec-1 | [19:53:15.605] WARN: foundation:test-date-provider Time set to 2025-06-16T19:57:56.000Z {"offset":280396,"timeMs":1750103876000} 19:53:15 aztec-1 | [19:53:15.632] INFO: archiver:lmdb Starting data store with maxReaders 16 19:53:16 aztec-1 | [19:53:16.054] INFO: archiver Starting archiver sync to rollup contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c from L1 block 20 to current L1 block 24 with hash 0x32908b2eb7cd14452ae11197a96654bd0e8aef3d5b2b199c8ea06b2fbbed1910 {"blocksSynchedTo":20,"messagesSynchedTo":{"l1BlockHash":"0x8590bb74eca1316026b0c17df6a01ab4a3a9368f05f77b0308219bb205714fbe","l1BlockNumber":20}} 19:53:16 aztec-1 | [19:53:16.082] INFO: archiver Initial archiver sync to L1 block 24 complete. {"l1BlockNumber":24,"syncPoint":{"blocksSynchedTo":24,"messagesSynchedTo":{"l1BlockHash":"0x32908b2eb7cd14452ae11197a96654bd0e8aef3d5b2b199c8ea06b2fbbed1910","l1BlockNumber":24}},"latest":{"number":0},"proven":{"number":0},"finalized":{"number":0}} 19:53:16 aztec-1 | [19:53:16.094] INFO: world-state:database Creating world state data store at directory /tmp/aztec-world-state-qXn4wr/world_state with map sizes {"archiveTreeMapSizeKb":10485760,"nullifierTreeMapSizeKb":10485760,"noteHashTreeMapSizeKb":10485760,"messageTreeMapSizeKb":10485760,"publicDataTreeMapSizeKb":10485760} and 4 threads. 19:53:16 aztec-1 | [19:53:16.318] INFO: world_state Created world state synchroniser with block history of 64 19:53:16 aztec-1 | [19:53:16.318] WARN: node Aztec node is accepting fake proofs 19:53:16 aztec-1 | [19:53:16.327] INFO: p2p:lmdb-v2 Starting data store with maxReaders 16 19:53:16 aztec-1 | [19:53:16.342] INFO: p2p-archive:lmdb-v2 Starting data store with maxReaders 16 19:53:16 aztec-1 | [19:53:16.354] INFO: p2p-peer:lmdb-v2 Starting data store with maxReaders 16 19:53:16 aztec-1 | [19:53:16.366] INFO: p2p:tx_pool Setting maximum tx mempool size {"maxTxPoolSize":100000000} 19:53:16 aztec-1 | [19:53:16.371] INFO: world_state Started world state synchronizer from block 1 19:53:16 aztec-1 | [19:53:16.382] INFO: p2p Starting p2p client from block 0 with empty mempools 19:53:16 aztec-1 | [19:53:16.641] INFO: epoch-prune-watcher EpochPruneWatcher initialized 19:53:16 aztec-1 | [19:53:16.683] INFO: slasher Starting Slasher client... 19:53:16 aztec-1 | [19:53:16.692] INFO: sequencer-client Deploying forwarder contract 19:53:16 aztec-1 | [19:53:16.711] INFO: sequencer-client Forwarder contract deployed at 0x0fe4d493871b0c51332de8a330b02ba8172da4ac 19:53:16 aztec-1 | [19:53:16.718] INFO: validator Started validator with addresses: 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 19:53:16 aztec-1 | [19:53:16.718] INFO: sequencer Sequencer config set {"transactionPollingIntervalMS":50,"maxTxsPerBlock":32,"minTxsPerBlock":1,"maxL2BlockGas":10000000000,"publishTxsWithProposals":false,"maxDABlockGas":10000000000,"maxBlockSizeInBytes":1048576,"governanceProposerPayload":"0x0000000000000000000000000000000000000000","maxL1TxInclusionTimeIntoSlot":12,"enforceTimeTable":true} 19:53:16 aztec-1 | [19:53:16.720] INFO: sequencer Sequencer started with address 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 19:53:16 aztec-1 | [19:53:16.720] INFO: node Aztec Node version: 0.87.6 19:53:16 aztec-1 | [19:53:16.720] INFO: node Aztec Node started on chain 0x7a69 {"rollupAddress":"0x3aa5ebb10dc797cac828524e59a333d0a371443c","registryAddress":"0xcf7ed3acca5a467e9e704c703e8d87f634fb0fc9","inboxAddress":"0x4374eecaad0dcaa149cffc160d5a0552b1d092b0","outboxAddress":"0x44bf2a9217a2970a1bcc7529bf1d40828c594320","feeJuiceAddress":"0x5fbdb2315678afecb367f032d93f642f64180aa3","stakingAssetAddress":"0xe7f1725e7734ce288f8367e1bb143e90bb3f0512","feeJuicePortalAddress":"0xa0719ec6accbac2301f88bc71e2f5ddc8c29149b","coinIssuerAddress":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","rewardDistributorAddress":"0xd8058efe0198ae9dd7d563e1b4938dcbc86a1f81","governanceProposerAddress":"0xdc64a140aa3e981100a9beca4e685f962f0cf6c9","governanceAddress":"0x5fc8d32690cc91d4c39d9d3abcbd16989f875707","slashFactoryAddress":"0x59b670e9fa9d0a427751af201d676719a970857b","feeAssetHandlerAddress":"0x610178da211fef7d417bc0e6fed39f05609ad788","stakingAssetHandlerAddress":"0xa51c1fc2f0d1a1b8494ed1fe312d7c3a78ed91c0","gseAddress":"0x9fe46736679d2d9a65f0992f2272de9f3c7fa6e0","zkPassportVerifierAddress":"0xee9f10f38319eae2730dba28fb09081db806c5e5"} 19:53:16 aztec-1 | [19:53:16.725] INFO: pxe:data:lmdb Starting data store with maxReaders 16 19:53:16 aztec-1 | [19:53:16.731] WARN: sequencer Cannot propose block due to slot mismatch with rollup contract (this can be caused by a clock out of sync). Expected slot 1 but got 2. {"now":1750103877,"syncedToL1Ts":1750103876,"syncedToL2Slot":1,"nextL2Slot":1,"nextL2SlotTs":1750103864,"l1SlotDuration":12,"rollup":{"blockNumber":1,"slot":2,"timeOfNextL1Slot":1750103900},"newBlockNumber":1,"expectedSlot":1} 19:53:16 aztec-1 | [19:53:16.804] WARN: sequencer Cannot propose block due to slot mismatch with rollup contract (this can be caused by a clock out of sync). Expected slot 1 but got 2. {"now":1750103877,"syncedToL1Ts":1750103876,"syncedToL2Slot":1,"nextL2Slot":1,"nextL2SlotTs":1750103864,"l1SlotDuration":12,"rollup":{"blockNumber":1,"slot":2,"timeOfNextL1Slot":1750103900},"newBlockNumber":1,"expectedSlot":1} 19:53:16 aztec-1 | [19:53:16.871] WARN: sequencer Cannot propose block due to slot mismatch with rollup contract (this can be caused by a clock out of sync). Expected slot 1 but got 2. {"now":1750103877,"syncedToL1Ts":1750103888,"syncedToL2Slot":1,"nextL2Slot":1,"nextL2SlotTs":1750103864,"l1SlotDuration":12,"rollup":{"blockNumber":1,"slot":2,"timeOfNextL1Slot":1750103900},"newBlockNumber":1,"expectedSlot":1} 19:53:17 aztec-1 | [19:53:16.993] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:53:17 aztec-1 | [19:53:16.993] WARN: foundation:test-date-provider Time set to 2025-06-16T19:58:08.000Z {"offset":291007,"timeMs":1750103888000} 19:53:17 aztec-1 | Setting up funded test accounts... 19:53:17 aztec-1 | [19:53:17.141] INFO: pxe:service Started PXE connected to chain 31337 version 3633326044 19:53:17 aztec-1 | [19:53:17.233] INFO: pxe:service Registered account 0x1935497c24c66f601a7fd9b6b1e6b1f5f667f04034c621bde89755ba273e844e 19:53:17 aztec-1 | [19:53:17.321] WARN: pxe:service No artifact found for contract class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 when looking for its metadata 19:53:17 aztec-1 | [19:53:17.324] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 as part of deployment for 0x1935497c24c66f601a7fd9b6b1e6b1f5f667f04034c621bde89755ba273e844e 19:53:17 aztec-1 | [19:53:17.511] INFO: pxe:service Added contract SchnorrAccount at 0x1935497c24c66f601a7fd9b6b1e6b1f5f667f04034c621bde89755ba273e844e with class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 19:53:21 aztec-1 | [19:53:20.648] INFO: pxe:service Proving completed in 3100.8146080000006ms {"timings":{"total":3100.8146080000006,"sync":8.630707000000257,"perFunction":[{"functionName":"MultiCallEntrypoint:entrypoint","time":174.58135600000332,"oracles":{"callPrivateFunction":{"times":[1041.3648940000003,407.5188539999999,280.2989240000006]}}},{"functionName":"private_kernel_init","time":140.54385699999875},{"functionName":"ContractClassRegisterer:register","time":1017.657737999999,"oracles":{"loadCapsule":{"times":[19.28670499999862]},"notifyCreatedNullifier":{"times":[27.431979999999385]},"debugLog":{"times":[0.6548670000011043]},"notifyCreatedContractClassLog":{"times":[10.34009100000003]}}},{"functionName":"private_kernel_inner","time":169.91576600000008},{"functionName":"SchnorrAccount:constructor","time":379.3408440000003,"oracles":{"getContractInstance":{"times":[2.6729969999996683]},"debugLog":{"times":[0.19554500000049302,0.17087399999945774]},"fetchTaggedLogs":{"times":[77.52398999999969]},"loadCapsule":{"times":[0.9563340000004246,0.21388499999920896,1.3407530000004044]},"validateEnqueuedNotesAndEvents":{"times":[11.067798000000039]},"notifyCreatedNullifier":{"times":[0.2450059999991936,0.2591659999998228]},"notifyCreatedNote":{"times":[0.6386959999999817]},"getRandomField":{"times":[0.2580469999993511,0.21972600000117382,0.06965200000013283,0.06295200000022305,0.19838499999968917,0.07800200000019686,0.054320999999617925,0.0657019999998738,0.0908820000004198,0.08310200000050827,0.050640999999814085]},"getIndexedTaggingSecretAsSender":{"times":[49.81919300000118]},"incrementAppTaggingSecretIndexAsSender":{"times":[31.712007999998605]}}},{"functionName":"private_kernel_inner","time":142.85351400000036},{"functionName":"SchnorrAccount:entrypoint","time":247.41467499999817,"oracles":{"debugLog":{"times":[0.22683600000164006,0.1450940000013361,0.3650890000008076]},"fetchTaggedLogs":{"times":[68.87430300000051]},"loadCapsule":{"times":[3.6002410000000964,0.2995680000003631,0.5701540000009118]},"validateEnqueuedNotesAndEvents":{"times":[11.880828999999721]},"getNotes":{"times":[3.039286000001084]},"getAuthWitness":{"times":[0.5418939999999566]},"notifySetMinRevertibleSideEffectCounter":{"times":[1.088596999999936]}}},{"functionName":"private_kernel_inner","time":113.04260499999873},{"functionName":"private_kernel_reset","time":168.54041099999995},{"functionName":"private_kernel_tail","time":78.0363639999996}],"unaccounted":460.2567710000021}} 19:53:21 aztec-1 | [19:53:20.763] INFO: node Received tx 0x1e13d33085c93be686f078d49c0e75ceb5247ed6197720964e1500e09c1f21fd {"txHash":"0x1e13d33085c93be686f078d49c0e75ceb5247ed6197720964e1500e09c1f21fd"} 19:53:21 aztec-1 | [19:53:20.763] INFO: pxe:service Sent transaction 0x1e13d33085c93be686f078d49c0e75ceb5247ed6197720964e1500e09c1f21fd 19:53:21 aztec-1 | [19:53:20.869] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.04446795899999961s {"duration":0.04446795899999961,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":16896,"l2Gas":6324},"totalSizeInBytes":1344} 19:53:21 aztec-1 | [19:53:20.916] INFO: sequencer Built block 1 for slot 2 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x2ba1afa9f7c1fcf09d4445ee9ef359011bb073badf0ea46823368a40e019d410","globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1750103900,"version":3633326044},"txHashes":["0x1e13d33085c93be686f078d49c0e75ceb5247ed6197720964e1500e09c1f21fd"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":101.6315969999996,"publicProcessDuration":45.131986000000325,"rollupCircuitsDuration":94.25588199999947,"txCount":1,"blockNumber":1,"blockTimestamp":1750103900,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 19:53:24 aztec-1 | [19:53:24.340] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 1 19:53:24 aztec-1 | [19:53:24.343] INFO: aztecjs:cheat_codes Proven tip moved: 0 -> 1. Pending tip: 1. 19:53:24 aztec-1 | [19:53:24.345] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:24 aztec-1 | [19:53:24.446] INFO: archiver Downloaded L2 block 1 {"blockHash":"0x2ba1afa9f7c1fcf09d4445ee9ef359011bb073badf0ea46823368a40e019d410","blockNumber":1,"txCount":1,"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1750103900,"version":3633326044},"archiveRoot":"0x2b434916b2cba248cdd64dfbd0f3101df663b41b1276a9a39a19241f5ab78986","archiveNextLeafIndex":2} 19:53:24 aztec-1 | [19:53:24.454] INFO: archiver Updated proven chain to block 1 {"provenBlockNumber":1} 19:53:24 aztec-1 | [19:53:24.521] INFO: world_state World state updated with L2 block 1 {"eventName":"l2-block-handled","duration":44.558500000001004,"unfinalisedBlockNumber":1,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":1,"blockTimestamp":1750103900,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 19:53:24 aztec-1 | [19:53:24.534] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:53:24 aztec-1 | [19:53:24.534] WARN: foundation:test-date-provider Time set to 2025-06-16T19:58:20.000Z {"offset":295466,"timeMs":1750103900000} 19:53:24 aztec-1 | [19:53:24.556] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750103936 19:53:24 aztec-1 | [19:53:24.556] WARN: foundation:test-date-provider Time set to 2025-06-16T19:58:56.000Z {"offset":331444,"timeMs":1750103936000} 19:53:24 aztec-1 | [19:53:24.556] INFO: aztecjs:utils:watcher Slot 2 was filled, jumped to next slot 19:53:24 aztec-1 | [19:53:24.575] INFO: pxe:service Registered account 0x103e82c3da93031a6f52a945d8e3bc181f8e104e48672ada425382af022bbb3f 19:53:24 aztec-1 | [19:53:24.711] INFO: pxe:service Added contract SchnorrAccount at 0x103e82c3da93031a6f52a945d8e3bc181f8e104e48672ada425382af022bbb3f with class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 19:53:26 aztec-1 | [19:53:26.546] INFO: pxe:service Proving completed in 1800.7360709999994ms {"timings":{"total":1800.7360709999994,"sync":35.52808299999924,"perFunction":[{"functionName":"MultiCallEntrypoint:entrypoint","time":102.14106899999751,"oracles":{"callPrivateFunction":{"times":[408.168724000001,335.5976719999999]}}},{"functionName":"private_kernel_init","time":82.13941799999884},{"functionName":"SchnorrAccount:constructor","time":375.60521700000027,"oracles":{"getContractInstance":{"times":[3.8944940000001225]},"debugLog":{"times":[0.16233400000055553,0.10976300000038464]},"fetchTaggedLogs":{"times":[81.22937000000093]},"loadCapsule":{"times":[0.22965499999918393,0.4889920000005077,0.3707589999994525]},"validateEnqueuedNotesAndEvents":{"times":[6.495546000000104]},"notifyCreatedNullifier":{"times":[0.193993999999293,0.29842899999857764]},"notifyCreatedNote":{"times":[0.10677200000100129]},"getRandomField":{"times":[0.1478239999996731,0.16806399999950372,0.041691000000355416,0.03443100000004051,0.037491000000954955,0.028250999999727355,0.02840999999898486,0.05696200000056706,0.030220999999073683,0.03535999999985506,0.036740999999892665]},"getIndexedTaggingSecretAsSender":{"times":[65.59729499999958]},"incrementAppTaggingSecretIndexAsSender":{"times":[47.507120000000214]}}},{"functionName":"private_kernel_inner","time":139.60966000000008},{"functionName":"SchnorrAccount:entrypoint","time":311.78266000000076,"oracles":{"debugLog":{"times":[0.24000700000033248,0.12519400000019232,0.2451679999994667]},"fetchTaggedLogs":{"times":[133.90784299999905]},"loadCapsule":{"times":[1.051789999999528,0.3994220000004134,0.2547070000000531]},"validateEnqueuedNotesAndEvents":{"times":[7.612224000000424]},"getNotes":{"times":[1.5050549999996292]},"getAuthWitness":{"times":[0.17897499999889988]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.4657129999995959]}}},{"functionName":"private_kernel_inner","time":155.8174480000016},{"functionName":"private_kernel_reset","time":220.8540630000025},{"functionName":"private_kernel_tail","time":95.27404599999863}],"unaccounted":281.9844069999999}} 19:53:26 aztec-1 | [19:53:26.603] INFO: node Received tx 0x1a41bcc91ec4b580e704464a622bc68866c00d9ceb2b7f32352cb878101e9979 {"txHash":"0x1a41bcc91ec4b580e704464a622bc68866c00d9ceb2b7f32352cb878101e9979"} 19:53:26 aztec-1 | [19:53:26.603] INFO: pxe:service Sent transaction 0x1a41bcc91ec4b580e704464a622bc68866c00d9ceb2b7f32352cb878101e9979 19:53:26 aztec-1 | [19:53:26.659] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.0178977870000017s {"duration":0.0178977870000017,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":11776,"l2Gas":4814},"totalSizeInBytes":992} 19:53:26 aztec-1 | [19:53:26.684] INFO: sequencer Built block 2 for slot 3 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x0eb7241906081e497f7b01af01342071f04a855e051294e4e8613d2bda2b8228","globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1750103936,"version":3633326044},"txHashes":["0x1a41bcc91ec4b580e704464a622bc68866c00d9ceb2b7f32352cb878101e9979"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":49.72688500000004,"publicProcessDuration":17.993790000000445,"rollupCircuitsDuration":44.10987899999964,"txCount":1,"blockNumber":2,"blockTimestamp":1750103936,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 19:53:26 aztec-1 | [19:53:26.914] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:26 aztec-1 | [19:53:26.920] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750103972 19:53:26 aztec-1 | [19:53:26.920] WARN: foundation:test-date-provider Time set to 2025-06-16T19:59:32.000Z {"offset":365080,"timeMs":1750103972000} 19:53:26 aztec-1 | [19:53:26.920] INFO: aztecjs:utils:watcher Slot 3 was filled, jumped to next slot 19:53:26 aztec-1 | [19:53:26.921] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 2 19:53:26 aztec-1 | [19:53:26.924] INFO: aztecjs:cheat_codes Proven tip moved: 1 -> 2. Pending tip: 2. 19:53:27 aztec-1 | [19:53:27.022] INFO: archiver Downloaded L2 block 2 {"blockHash":"0x0eb7241906081e497f7b01af01342071f04a855e051294e4e8613d2bda2b8228","blockNumber":2,"txCount":1,"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1750103936,"version":3633326044},"archiveRoot":"0x03881d7faf240fc0fbec7301f1ae810d2e0f9c160ea1ae60cb46c7fa653ef461","archiveNextLeafIndex":3} 19:53:27 aztec-1 | [19:53:27.025] INFO: archiver Updated proven chain to block 2 {"provenBlockNumber":2} 19:53:27 aztec-1 | [19:53:27.089] INFO: world_state World state updated with L2 block 2 {"eventName":"l2-block-handled","duration":21.922404999997525,"unfinalisedBlockNumber":2,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":2,"blockTimestamp":1750103936,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 19:53:27 aztec-1 | [19:53:27.189] INFO: pxe:service Registered account 0x280737c4106e70a3391b796f1a2bbbdcb0b2fea06f75a7a5a4bfcb33c02727b7 19:53:27 aztec-1 | [19:53:27.295] INFO: pxe:service Added contract SchnorrAccount at 0x280737c4106e70a3391b796f1a2bbbdcb0b2fea06f75a7a5a4bfcb33c02727b7 with class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 19:53:29 aztec-1 | [19:53:29.071] INFO: pxe:service Proving completed in 1767.1681430000026ms {"timings":{"total":1767.1681430000026,"sync":22.589234999999462,"perFunction":[{"functionName":"MultiCallEntrypoint:entrypoint","time":92.55263600000035,"oracles":{"callPrivateFunction":{"times":[430.4384839999984,319.62043099999937]}}},{"functionName":"private_kernel_init","time":84.16443799999979},{"functionName":"SchnorrAccount:constructor","time":410.7038429999993,"oracles":{"getContractInstance":{"times":[2.582035999999789]},"debugLog":{"times":[0.17392499999914435,0.0914520000005723]},"fetchTaggedLogs":{"times":[146.60827699999936]},"loadCapsule":{"times":[0.21725599999990663,0.17924499999935506,0.2502779999995255]},"validateEnqueuedNotesAndEvents":{"times":[6.351627000000008]},"notifyCreatedNullifier":{"times":[0.36229099999764003,0.27000799999950686]},"notifyCreatedNote":{"times":[0.18832599999950617]},"getRandomField":{"times":[0.3421399999970163,0.2421570000005886,0.060512000000017,0.04548200000135694,0.043440999997983454,0.045680999999603955,0.050382000001263805,0.09092299999974784,0.04589199999827542,0.05114099999991595,0.041410999998333864]},"getIndexedTaggingSecretAsSender":{"times":[77.95146500000192]},"incrementAppTaggingSecretIndexAsSender":{"times":[33.022923000000446]}}},{"functionName":"private_kernel_inner","time":138.5844709999983},{"functionName":"SchnorrAccount:entrypoint","time":287.6956609999979,"oracles":{"debugLog":{"times":[0.2043760000015027,0.11036400000011781,0.18785600000046543]},"fetchTaggedLogs":{"times":[119.8707089999989]},"loadCapsule":{"times":[0.21188600000095903,0.15036399999735295,0.14288400000077672]},"validateEnqueuedNotesAndEvents":{"times":[12.178249000000505]},"getNotes":{"times":[2.5660550000029616]},"getAuthWitness":{"times":[0.23472700000274926]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.6277779999982158]}}},{"functionName":"private_kernel_inner","time":150.40067799999815},{"functionName":"private_kernel_reset","time":211.96960099999706},{"functionName":"private_kernel_tail","time":99.0518570000022}],"unaccounted":269.45572300001004}} 19:53:29 aztec-1 | [19:53:29.147] INFO: node Received tx 0x29660f69536d0c899d0bb1570c06c5d1130eb510ee06f5b3aea68bb4c22a13bc {"txHash":"0x29660f69536d0c899d0bb1570c06c5d1130eb510ee06f5b3aea68bb4c22a13bc"} 19:53:29 aztec-1 | [19:53:29.147] INFO: pxe:service Sent transaction 0x29660f69536d0c899d0bb1570c06c5d1130eb510ee06f5b3aea68bb4c22a13bc 19:53:29 aztec-1 | [19:53:29.214] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.0306801830000004s {"duration":0.0306801830000004,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":11776,"l2Gas":4814},"totalSizeInBytes":992} 19:53:29 aztec-1 | [19:53:29.250] INFO: sequencer Built block 3 for slot 4 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x183028d7153c6bf5696394727e0152c73e8383dd9b8881b479383b60dce7c210","globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1750103972,"version":3633326044},"txHashes":["0x29660f69536d0c899d0bb1570c06c5d1130eb510ee06f5b3aea68bb4c22a13bc"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":71.83921499999997,"publicProcessDuration":30.819416999998793,"rollupCircuitsDuration":67.50459799999953,"txCount":1,"blockNumber":3,"blockTimestamp":1750103972,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 19:53:29 aztec-1 | [19:53:29.443] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:29 aztec-1 | [19:53:29.520] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:53:29 aztec-1 | [19:53:29.521] WARN: foundation:test-date-provider Time set to 2025-06-16T19:59:44.000Z {"offset":374479,"timeMs":1750103984000} 19:53:29 aztec-1 | [19:53:29.524] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 3 19:53:29 aztec-1 | [19:53:29.525] INFO: aztecjs:cheat_codes Proven tip moved: 2 -> 3. Pending tip: 3. 19:53:29 aztec-1 | [19:53:29.528] INFO: archiver Downloaded L2 block 3 {"blockHash":"0x183028d7153c6bf5696394727e0152c73e8383dd9b8881b479383b60dce7c210","blockNumber":3,"txCount":1,"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1750103972,"version":3633326044},"archiveRoot":"0x09832f1ca63612b0356c36eb7b895ee3ff0c64ae2b01b436070330056a670a62","archiveNextLeafIndex":4} 19:53:29 aztec-1 | Initial Accounts: 19:53:29 aztec-1 | 19:53:29 aztec-1 | Address: 0x1935497c24c66f601a7fd9b6b1e6b1f5f667f04034c621bde89755ba273e844e 19:53:29 aztec-1 | Partial Address: 0x27b4888363d0f9eb0d43aa0b2ff08f21fbc6867b8e0baf8ec6062c4623c1eefc 19:53:29 aztec-1 | Secret Key: 0x2153536ff6628eee01cf4024889ff977a18d9fa61d0e414422f7681cf085c281 19:53:29 aztec-1 | Master nullifier public key: 0x1997041f7bef378b53f778a7e6dbe318581a74046c6d89d2a5c3541d3bd6499f2756b249eea865f51139100ec94a5f52e4e818dd0ebf4e276353fbd54d26047f 19:53:29 aztec-1 | Master incoming viewing public key: 0x16f717457ac6823102f11889f50751329847d5aeeb3ba846b7f0c337cc66de97154f56206fb1079022acad62e1b9af9392baca2c9f995d302b37923ee598025f 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master outgoing viewing public key: 0x04d3de24dac85211b9726c43b7029e039491f5e9f60551f30eaa37956ad74f2f2b8e64db900901c2b5c0f6e6e6644f480e31387dc5769078e16a937e08f2d1c5 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master tagging public key: 0x1bdebe239b3152cbfba5b6b1ea7e5ad98736d9ef92b6ccef8129e9ea59dbed4a0599b2ab4ed94c01fdddc06c4b8115a24e3dae480fb0e182c17cb5cfa545cb89 19:53:29 aztec-1 | 19:53:29 aztec-1 | Address: 0x103e82c3da93031a6f52a945d8e3bc181f8e104e48672ada425382af022bbb3f 19:53:29 aztec-1 | Partial Address: 0x2e19b56de1617cb3179d81be0173c7301621a2e820da7f2754fcfccdfc4418e0 19:53:29 aztec-1 | Secret Key: 0x0aebd1b4be76efa44f5ee655c20bf9ea60f7ae44b9a7fd1fd9f189c7a0b0cdae 19:53:29 aztec-1 | Master nullifier public key: 0x0dfb2c1f9425ac05d57c24a0aaf313ab9abb70def4c7fa973b5695a877528de8058c109f9c8851f67ff1a34e81683fb20baf87182ab8cc0b44bcddf3f705da57 19:53:29 aztec-1 | Master incoming viewing public key: 0x118abb6cbfb12f6d61f7c837d3a38a00938073002990388406714e3a30ef000e272f398119b8635dd875c8b35a0d5c2e7a739eefebf89e9172951b92abfb1f4d 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master outgoing viewing public key: 0x07b57b36fb6585f72636d7741cb49fcbe6d49c2151fee2098859c1f5c94113ce197e3bdc18ff96f058ff0d9b77e741a17e257e6ff1fc03b8753ead015757de4e 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master tagging public key: 0x05c11aef8517bdfa57b1ad0e12fccd75f7a6225eb651c8dafa894a87768863ad213d2de9a62211c1651f8ecb5638d4bcecefa23631b87b901c3e5f8869c0708d 19:53:29 aztec-1 | 19:53:29 aztec-1 | Address: 0x280737c4106e70a3391b796f1a2bbbdcb0b2fea06f75a7a5a4bfcb33c02727b7 19:53:29 aztec-1 | Partial Address: 0x2451b67547512eaaaad5ded43156c5b80220b7d5145ebefdd57295a9e05a610d 19:53:29 aztec-1 | Secret Key: 0x0f6addf0da06c33293df974a565b03d1ab096090d907d98055a8b7f4954e120c 19:53:29 aztec-1 | Master nullifier public key: 0x12087794c56b60efc7d90af9cc366b4a53f702ff08e18c2839a384dffc0afa2a21da640447f79013922b5028da3b3461c601d66a2f723d36b7437a709a02b3b3 19:53:29 aztec-1 | Master incoming viewing public key: 0x26ba3ba4980fb7b0d09936aec4b50839a652151afbb6eaac03a017132d41dae52f2ec73c5fa77d24999da6b4b5a5c98bdd9609dd940de6ea1b397bb21c2edbae 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master outgoing viewing public key: 0x046da42846259b1e229fb0675b7848186ebdc5df9a6d05808338142737a8accd11fc12819daaa9ba316e79412da522a2805dc6ceee04e22f666f1d54694f05da 19:53:29 aztec-1 | 19:53:29 aztec-1 | Master tagging public key: 0x0d7423bb9647cebcbbf1a4212e9cf3e2d56dfcd9b5b7300814ec4513734e6d6230365eb863aedc1e62de64d0f14479cf8ac23e461530acc6e7f9dfc0528e32ba 19:53:29 aztec-1 | 19:53:29 aztec-1 | 19:53:29 aztec-1 | [19:53:29.563] INFO: world_state World state updated with L2 block 3 {"eventName":"l2-block-handled","duration":19.78823299999931,"unfinalisedBlockNumber":3,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":3,"blockTimestamp":1750103972,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 19:53:30 aztec-1 | [19:53:30.303] WARN: pxe:service No artifact found for contract class 0x29dcd4953013697442c3dd70078007da6d27e978e725c3471dcafb67969f2164 when looking for its metadata 19:53:30 aztec-1 | [19:53:30.303] WARN: pxe:service No artifact found for contract class 0x02c03e14465d82e13534072f58c1e39d320b13cf92255a90ff4c99e1fca555a2 when looking for its metadata 19:53:30 aztec-1 | [19:53:30.305] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x29dcd4953013697442c3dd70078007da6d27e978e725c3471dcafb67969f2164 as part of deployment for 0x0723941b267b3ced905d304c517042f5c3f85d0f13232460da9a9f4d2a6b1c13 19:53:30 aztec-1 | [19:53:30.331] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x02c03e14465d82e13534072f58c1e39d320b13cf92255a90ff4c99e1fca555a2 as part of deployment for 0x131b1ba6febb2758f11effaa18660d879c3614cb411076276dfd197b94530547 19:53:30 aztec-1 | [19:53:30.691] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104008 19:53:30 aztec-1 | [19:53:30.691] WARN: foundation:test-date-provider Time set to 2025-06-16T20:00:08.000Z {"offset":397309,"timeMs":1750104008000} 19:53:30 aztec-1 | [19:53:30.691] INFO: aztecjs:utils:watcher Slot 4 was filled, jumped to next slot 19:53:31 aztec-1 | [19:53:31.244] INFO: pxe:service Added contract Token at 0x131b1ba6febb2758f11effaa18660d879c3614cb411076276dfd197b94530547 with class 0x02c03e14465d82e13534072f58c1e39d320b13cf92255a90ff4c99e1fca555a2 19:53:31 aztec-1 | [19:53:31.248] INFO: pxe:service Added contract FPC at 0x0723941b267b3ced905d304c517042f5c3f85d0f13232460da9a9f4d2a6b1c13 with class 0x29dcd4953013697442c3dd70078007da6d27e978e725c3471dcafb67969f2164 19:53:31 aztec-1 | [19:53:31.249] INFO: archiver Updated proven chain to block 3 {"provenBlockNumber":3} 19:53:34 aztec-1 | [19:53:33.989] INFO: pxe:service Proving completed in 2729.768933000003ms {"timings":{"total":2729.768933000003,"sync":17.977688999999373,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":350.7635349999946,"oracles":{"debugLog":{"times":[0.32910999999876367,0.1055129999986093,0.08727300000100513,0.19273600000087754,0.12393399999928079,0.10635299999921699,0.08293200000116485,0.14920399999755318]},"fetchTaggedLogs":{"times":[107.99505000000136]},"loadCapsule":{"times":[0.2962090000000899,0.13420399999813526,0.2636979999988398,0.20126600000003236,0.4021119999997609,0.8629849999997532,0.1815260000003036]},"getSharedSecret":{"times":[4.395819000001211]},"aes128Decrypt":{"times":[1.0267000000021653,0.7408920000016224]},"getPublicKeysAndPartialAddress":{"times":[3.3191980000010517]},"getKeyValidationRequest":{"times":[2.234076000000641]},"storeCapsule":{"times":[3.1817430000010063,3.0770899999988615,4.443660999997519]},"deleteCapsule":{"times":[3.201603999998042]},"validateEnqueuedNotesAndEvents":{"times":[27.566910999998072]},"getNotes":{"times":[2.6194570000006934]},"getAuthWitness":{"times":[0.1718250000012631]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.06354199999987031]},"callPrivateFunction":{"times":[885.2633889999997,142.01886000000013]},"notifyEnqueuedPublicFunctionCall":{"times":[0.29306699999870034]}}},{"functionName":"private_kernel_init","time":85.23268899999675},{"functionName":"ContractClassRegisterer:register","time":869.7026560000013,"oracles":{"loadCapsule":{"times":[2.545390999999654]},"notifyCreatedNullifier":{"times":[0.710226999999577]},"debugLog":{"times":[0.16363499999715714]},"notifyCreatedContractClassLog":{"times":[6.0994879999998375]}}},{"functionName":"private_kernel_inner","time":151.50271000000066},{"functionName":"ContractInstanceDeployer:deploy","time":90.7565140000006,"oracles":{"storeInExecutionCache":{"times":[0.2648269999990589]},"callPrivateFunction":{"times":[48.61351399999694]},"notifyCreatedNullifier":{"times":[0.2364159999997355]},"debugLog":{"times":[0.09673299999849405]}}},{"functionName":"private_kernel_inner","time":147.8096710000027},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":36.7959179999998,"oracles":{}},{"functionName":"private_kernel_inner","time":138.59659800000009},{"functionName":"private_kernel_reset","time":243.81638100000055},{"functionName":"private_kernel_tail","time":124.6259710000013}],"unaccounted":472.1886010000053}} 19:53:34 aztec-1 | [19:53:34.201] INFO: node Received tx 0x00a80fd809ceb4ed927489f711cc3f559ff464f6fca7fab79b00b8a77f5a27a2 {"txHash":"0x00a80fd809ceb4ed927489f711cc3f559ff464f6fca7fab79b00b8a77f5a27a2"} 19:53:34 aztec-1 | [19:53:34.201] INFO: pxe:service Sent transaction 0x00a80fd809ceb4ed927489f711cc3f559ff464f6fca7fab79b00b8a77f5a27a2 19:53:36 aztec-1 | [19:53:36.796] INFO: pxe:service Proving completed in 2805.470126ms {"timings":{"total":2805.470126,"sync":168.82794899999863,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":541.4171909999968,"oracles":{"debugLog":{"times":[0.17101399999955902,0.1250529999997525,0.07514100000116741,0.2343059999984689,0.07618200000069919,0.06471099999907892,0.09130200000072364,0.21647500000108266]},"fetchTaggedLogs":{"times":[183.55046500000026]},"loadCapsule":{"times":[0.17340400000102818,0.2188049999967916,42.08494700000301,0.2566159999987576,0.29542700000092736,0.31288800000038464,0.23054599999886705]},"getSharedSecret":{"times":[12.374808999997185]},"aes128Decrypt":{"times":[0.1904450000001816,0.5799839999999676]},"getPublicKeysAndPartialAddress":{"times":[1.555437000002712]},"getKeyValidationRequest":{"times":[5.747527999999875]},"storeCapsule":{"times":[4.449658000001364,6.550437999998394,3.009002999999211]},"deleteCapsule":{"times":[2.892700000000332]},"validateEnqueuedNotesAndEvents":{"times":[76.09807800000272]},"getNotes":{"times":[2.663903999997274]},"getAuthWitness":{"times":[0.23825600000054692]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.07589200000074925]},"callPrivateFunction":{"times":[754.0274759999993,221.20967400000154]},"notifyEnqueuedPublicFunctionCall":{"times":[0.09720200000083423]}}},{"functionName":"private_kernel_init","time":89.22602499999994},{"functionName":"ContractClassRegisterer:register","time":742.2715320000025,"oracles":{"loadCapsule":{"times":[2.6234330000006594]},"notifyCreatedNullifier":{"times":[1.4070539999993343]},"debugLog":{"times":[0.17639500000223052]},"notifyCreatedContractClassLog":{"times":[8.483844999998837]}}},{"functionName":"private_kernel_inner","time":159.56504499999937},{"functionName":"ContractInstanceDeployer:deploy","time":144.8617200000008,"oracles":{"storeInExecutionCache":{"times":[0.14745299999776762]},"callPrivateFunction":{"times":[66.96633699999802]},"notifyCreatedNullifier":{"times":[0.3601380000000063]},"debugLog":{"times":[0.18052499999976135]}}},{"functionName":"private_kernel_inner","time":130.74149899999975},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":52.156919000000926,"oracles":{}},{"functionName":"private_kernel_inner","time":129.40698600000178},{"functionName":"private_kernel_reset","time":175.18834199999765},{"functionName":"private_kernel_tail","time":83.60226999999941}],"unaccounted":388.20464800000263}} 19:53:36 aztec-1 | [19:53:36.903] INFO: node Received tx 0x14403eb30aa081487f338e5896f60ad30c17157c404040df75c91bc7acef1cc7 {"txHash":"0x14403eb30aa081487f338e5896f60ad30c17157c404040df75c91bc7acef1cc7"} 19:53:36 aztec-1 | [19:53:36.903] INFO: pxe:service Sent transaction 0x14403eb30aa081487f338e5896f60ad30c17157c404040df75c91bc7acef1cc7 19:53:36 aztec-1 | [19:53:36.913] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 2.5494344899999994s {"duration":2.5494344899999994,"rate":124126.35085987249,"totalPublicGas":{"daGas":10240,"l2Gas":316452},"totalBlockGas":{"daGas":380928,"l2Gas":341494},"totalSizeInBytes":24064} 19:53:36 aztec-1 | [19:53:36.950] INFO: sequencer Built block 4 for slot 5 with 1 txs and 0 messages. 121674.55203201412 mana/s {"blockHash":"0x2c2f916125d486c4722e97ca57a71674d2954bbe5ab13a5fab434903ad43565b","globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1750104008,"version":3633326044},"txHashes":["0x00a80fd809ceb4ed927489f711cc3f559ff464f6fca7fab79b00b8a77f5a27a2"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":2600.7508000000016,"publicProcessDuration":2549.5610530000013,"rollupCircuitsDuration":2591.025265,"txCount":1,"blockNumber":4,"blockTimestamp":1750104008,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":702} 19:53:37 aztec-1 | [19:53:37.203] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104044 19:53:37 aztec-1 | [19:53:37.203] WARN: foundation:test-date-provider Time set to 2025-06-16T20:00:44.000Z {"offset":426797,"timeMs":1750104044000} 19:53:37 aztec-1 | [19:53:37.203] INFO: aztecjs:utils:watcher Slot 5 was filled, jumped to next slot 19:53:37 aztec-1 | [19:53:37.205] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:37 aztec-1 | [19:53:37.288] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 4 19:53:37 aztec-1 | [19:53:37.290] INFO: aztecjs:cheat_codes Proven tip moved: 3 -> 4. Pending tip: 4. 19:53:37 aztec-1 | [19:53:37.290] INFO: archiver Downloaded L2 block 4 {"blockHash":"0x2c2f916125d486c4722e97ca57a71674d2954bbe5ab13a5fab434903ad43565b","blockNumber":4,"txCount":1,"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1750104008,"version":3633326044},"archiveRoot":"0x00e34299eb2d599623d16d603729627b3d8600d78fa6ecd511fcb6dd04ed758d","archiveNextLeafIndex":5} 19:53:37 aztec-1 | [19:53:37.366] INFO: world_state World state updated with L2 block 4 {"eventName":"l2-block-handled","duration":16.984849999997095,"unfinalisedBlockNumber":4,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":4,"blockTimestamp":1750104008,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":702} 19:53:37 aztec-1 | [19:53:37.379] INFO: archiver Updated proven chain to block 4 {"provenBlockNumber":4} 19:53:37 aztec-1 | [19:53:37.565] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.1413068740000017s {"duration":0.1413068740000017,"rate":281592.8119675163,"totalPublicGas":{"daGas":4096,"l2Gas":39791},"totalBlockGas":{"daGas":136192,"l2Gas":64833},"totalSizeInBytes":8768} 19:53:37 aztec-1 | [19:53:37.602] INFO: sequencer Built block 5 for slot 6 with 1 txs and 0 messages. 213671.4857638763 mana/s {"blockHash":"0x1cd11a38ea3a6acbe600747ecb0d1f234d45529f16df1c03ce1d3896fa12ce22","globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1750104044,"version":3633326044},"txHashes":["0x14403eb30aa081487f338e5896f60ad30c17157c404040df75c91bc7acef1cc7"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":186.1931680000016,"publicProcessDuration":141.7055330000003,"rollupCircuitsDuration":180.27815499999997,"txCount":1,"blockNumber":5,"blockTimestamp":1750104044,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":236} 19:53:37 aztec-1 | [19:53:37.854] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 5 19:53:37 aztec-1 | [19:53:37.858] INFO: aztecjs:cheat_codes Proven tip moved: 4 -> 5. Pending tip: 5. 19:53:37 aztec-1 | [19:53:37.860] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:38 aztec-1 | [19:53:38.094] INFO: aztecjs:deploy_sent_tx Contract 0x131b1ba6febb2758f11effaa18660d879c3614cb411076276dfd197b94530547 successfully deployed. 19:53:38 aztec-1 | [19:53:38.099] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:53:38 aztec-1 | [19:53:38.099] WARN: foundation:test-date-provider Time set to 2025-06-16T20:00:56.000Z {"offset":437901,"timeMs":1750104056000} 19:53:38 aztec-1 | [19:53:38.112] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104080 19:53:38 aztec-1 | [19:53:38.112] WARN: foundation:test-date-provider Time set to 2025-06-16T20:01:20.000Z {"offset":461888,"timeMs":1750104080000} 19:53:38 aztec-1 | [19:53:38.112] INFO: aztecjs:utils:watcher Slot 6 was filled, jumped to next slot 19:53:38 aztec-1 | [19:53:38.115] WARN: archiver Failed to reach L2 block 5 at 33 (latest is 4). Rolling back last synched L1 block number to 32. {"latestLocalL2BlockNumber":4,"latestLocalL2BlockArchive":"0x00e34299eb2d599623d16d603729627b3d8600d78fa6ecd511fcb6dd04ed758d","blocksSynchedTo":32,"currentL1BlockNumber":33,"provenBlockNumber":4,"provenArchive":"0x00e34299eb2d599623d16d603729627b3d8600d78fa6ecd511fcb6dd04ed758d","pendingBlockNumber":5,"pendingArchive":"0x1878910b34a2bf049358ad16ac92b7464726c2fe0c4ee67e5e9479779ca5f6cd"} 19:53:38 aztec-1 | [19:53:38.238] INFO: archiver Downloaded L2 block 5 {"blockHash":"0x1cd11a38ea3a6acbe600747ecb0d1f234d45529f16df1c03ce1d3896fa12ce22","blockNumber":5,"txCount":1,"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1750104044,"version":3633326044},"archiveRoot":"0x1878910b34a2bf049358ad16ac92b7464726c2fe0c4ee67e5e9479779ca5f6cd","archiveNextLeafIndex":6} 19:53:38 aztec-1 | [19:53:38.242] INFO: archiver Updated proven chain to block 5 {"provenBlockNumber":5} 19:53:38 aztec-1 | [19:53:38.304] INFO: world_state World state updated with L2 block 5 {"eventName":"l2-block-handled","duration":14.218142999998236,"unfinalisedBlockNumber":5,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":5,"blockTimestamp":1750104044,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":236} 19:53:39 aztec-1 | BananaCoin: 0x131b1ba6febb2758f11effaa18660d879c3614cb411076276dfd197b94530547 19:53:39 aztec-1 | FPC: 0x0723941b267b3ced905d304c517042f5c3f85d0f13232460da9a9f4d2a6b1c13 19:53:39 aztec-1 | [19:53:39.135] INFO: aztecjs:deploy_sent_tx Contract 0x0723941b267b3ced905d304c517042f5c3f85d0f13232460da9a9f4d2a6b1c13 successfully deployed. 19:53:39 aztec-1 | [19:53:39.161] WARN: pxe:service No artifact found for contract class 0x2dacfd02a8775d3a80d4f185f8765bd3af452cf0b5c53a542ff56b271af4e87e when looking for its metadata 19:53:39 aztec-1 | [19:53:39.164] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x2dacfd02a8775d3a80d4f185f8765bd3af452cf0b5c53a542ff56b271af4e87e as part of deployment for 0x0e68a7c0b68b13ddc5b1413195d70fd0611642afefe799a41314e1c70ade6354 19:53:39 aztec-1 | [19:53:39.338] INFO: pxe:service Added contract SponsoredFPC at 0x0e68a7c0b68b13ddc5b1413195d70fd0611642afefe799a41314e1c70ade6354 with class 0x2dacfd02a8775d3a80d4f185f8765bd3af452cf0b5c53a542ff56b271af4e87e 19:53:42 aztec-1 | [19:53:41.813] INFO: pxe:service Proving completed in 2450.6361789999974ms {"timings":{"total":2450.6361789999974,"sync":27.012752999999066,"perFunction":[{"functionName":"MultiCallEntrypoint:entrypoint","time":95.10927799999263,"oracles":{"callPrivateFunction":{"times":[864.3347710000016,154.76981899999737,38.602192999998806]}}},{"functionName":"private_kernel_init","time":86.13570099999924},{"functionName":"ContractClassRegisterer:register","time":846.9733810000034,"oracles":{"loadCapsule":{"times":[2.3506860000015877]},"notifyCreatedNullifier":{"times":[0.3701179999989108]},"debugLog":{"times":[0.13451299999724142]},"notifyCreatedContractClassLog":{"times":[5.3285090000026685]}}},{"functionName":"private_kernel_inner","time":142.60356500000125},{"functionName":"ContractInstanceDeployer:deploy","time":86.27066200000263,"oracles":{"storeInExecutionCache":{"times":[0.09611199999926612]},"callPrivateFunction":{"times":[74.8724289999991]},"notifyCreatedNullifier":{"times":[0.225986000001285]},"debugLog":{"times":[0.14331399999718997]}}},{"functionName":"private_kernel_inner","time":141.4304970000012},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":54.09014799999932,"oracles":{}},{"functionName":"private_kernel_inner","time":153.12955299999885},{"functionName":"SponsoredFPC:sponsor_unconditionally","time":30.041165999999066,"oracles":{"debugLog":{"times":[0.11820300000181305]}}},{"functionName":"private_kernel_inner","time":151.52337400000033},{"functionName":"private_kernel_reset","time":157.52523000000292},{"functionName":"private_kernel_tail","time":64.30435000000216}],"unaccounted":414.48652099999526}} 19:53:42 aztec-1 | [19:53:41.902] INFO: node Received tx 0x2d60989e9abef9927270455a34200e2b32d8260f39d72084722db1086b6ce0ea {"txHash":"0x2d60989e9abef9927270455a34200e2b32d8260f39d72084722db1086b6ce0ea"} 19:53:42 aztec-1 | [19:53:41.902] INFO: pxe:service Sent transaction 0x2d60989e9abef9927270455a34200e2b32d8260f39d72084722db1086b6ce0ea 19:53:42 aztec-1 | [19:53:42.000] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.025753445000002102s {"duration":0.025753445000002102,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":14336,"l2Gas":3532},"totalSizeInBytes":1152} 19:53:42 aztec-1 | [19:53:42.017] INFO: sequencer Built block 6 for slot 7 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x00acc1a35cf4bf519dda0f3286ded589a9e480923054bee43e13211edad4a1bc","globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1750104080,"version":3633326044},"txHashes":["0x2d60989e9abef9927270455a34200e2b32d8260f39d72084722db1086b6ce0ea"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":51.25127299999804,"publicProcessDuration":25.91183799999999,"rollupCircuitsDuration":45.19602600000144,"txCount":1,"blockNumber":6,"blockTimestamp":1750104080,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 19:53:42 aztec-1 | [19:53:42.173] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 19:53:42 aztec-1 | [19:53:42.179] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104116 19:53:42 aztec-1 | [19:53:42.179] WARN: foundation:test-date-provider Time set to 2025-06-16T20:01:56.000Z {"offset":493821,"timeMs":1750104116000} 19:53:42 aztec-1 | [19:53:42.179] INFO: aztecjs:utils:watcher Slot 7 was filled, jumped to next slot 19:53:42 aztec-1 | [19:53:42.184] WARN: archiver Failed to reach L2 block 6 at 35 (latest is 5). Rolling back last synched L1 block number to 34. {"latestLocalL2BlockNumber":5,"latestLocalL2BlockArchive":"0x1878910b34a2bf049358ad16ac92b7464726c2fe0c4ee67e5e9479779ca5f6cd","blocksSynchedTo":34,"currentL1BlockNumber":35,"provenBlockNumber":5,"provenArchive":"0x1878910b34a2bf049358ad16ac92b7464726c2fe0c4ee67e5e9479779ca5f6cd","pendingBlockNumber":6,"pendingArchive":"0x1a2c73717da0955fce8a033401d6e96ba20a598dbb7a89abbaab66fd9ad53b79"} 19:53:42 aztec-1 | [19:53:42.243] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 6 19:53:42 aztec-1 | [19:53:42.244] INFO: aztecjs:cheat_codes Proven tip moved: 5 -> 6. Pending tip: 6. 19:53:42 aztec-1 | [19:53:42.286] INFO: archiver Downloaded L2 block 6 {"blockHash":"0x00acc1a35cf4bf519dda0f3286ded589a9e480923054bee43e13211edad4a1bc","blockNumber":6,"txCount":1,"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32250,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1750104080,"version":3633326044},"archiveRoot":"0x1a2c73717da0955fce8a033401d6e96ba20a598dbb7a89abbaab66fd9ad53b79","archiveNextLeafIndex":7} 19:53:42 aztec-1 | [19:53:42.293] INFO: archiver Updated proven chain to block 6 {"provenBlockNumber":6} 19:53:42 aztec-1 | [19:53:42.343] INFO: world_state World state updated with L2 block 6 {"eventName":"l2-block-handled","duration":16.821256999999605,"unfinalisedBlockNumber":6,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":6,"blockTimestamp":1750104080,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 19:53:42 aztec-1 | SponsoredFPC: 0x0e68a7c0b68b13ddc5b1413195d70fd0611642afefe799a41314e1c70ade6354 19:53:43 aztec-1 | [19:53:42.919] INFO: aztecjs:deploy_sent_tx Contract 0x0e68a7c0b68b13ddc5b1413195d70fd0611642afefe799a41314e1c70ade6354 successfully deployed. 19:53:43 aztec-1 | [19:53:42.925] INFO: cli Aztec Server listening on port 8080 {"l2CircuitsVkTreeRoot":"0x27f24d2a1e99e49d4a27746a8374185b307a07325d0d743c1df56a03e39788d2","l2ProtocolContractsTreeRoot":"0x222b5a95b10e0a2dfba4648739629a01cecd69a0bef23a9fc22f846735d7cc71"} 19:53:50 box-1 | \ 19:53:50 box-1 | Running 1 test using 1 worker 19:53:50 box-1 | 19:53:51 box-1 | 1 [webkit] › browser.spec.ts:3:1 › test 19:54:18 aztec-1 | [19:54:18.329] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104152 19:54:18 aztec-1 | [19:54:18.330] WARN: foundation:test-date-provider Time set to 2025-06-16T20:02:32.000Z {"offset":493670,"timeMs":1750104152000} 19:54:18 aztec-1 | [19:54:18.330] INFO: aztecjs:utils:watcher Slot 8 was missed, jumped to next slot 19:54:54 aztec-1 | [19:54:54.350] WARN: aztecjs:utils:watcher L1 is more than 1 L2 slot behind wall time. Warping to wall time 19:54:54 aztec-1 | [19:54:54.356] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104189 19:54:54 aztec-1 | [19:54:54.558] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:54:54 aztec-1 | [19:54:54.558] WARN: foundation:test-date-provider Time set to 2025-06-16T20:03:09.000Z {"offset":494442,"timeMs":1750104189000} 19:55:23 1 [webkit] › browser.spec.ts:3:1 › test (1.5m) 2 [webkit] › browser.spec.ts:3:1 › test (retry #1) 19:55:30 aztec-1 | [19:55:29.730] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104224 19:55:30 aztec-1 | [19:55:29.730] WARN: foundation:test-date-provider Time set to 2025-06-16T20:03:44.000Z {"offset":494270,"timeMs":1750104224000} 19:55:30 aztec-1 | [19:55:29.730] INFO: aztecjs:utils:watcher Slot 10 was missed, jumped to next slot 19:56:06 aztec-1 | [19:56:05.881] WARN: aztecjs:utils:watcher L1 is more than 1 L2 slot behind wall time. Warping to wall time 19:56:06 aztec-1 | [19:56:05.895] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104260 19:56:06 aztec-1 | [19:56:05.895] WARN: foundation:test-date-provider Time set to 2025-06-16T20:04:20.000Z {"offset":494105,"timeMs":1750104260000} 19:56:06 aztec-1 | [19:56:05.895] INFO: aztecjs:utils:watcher Slot 11 was missed, jumped to next slot 19:56:06 aztec-1 | [19:56:05.895] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104261 19:56:06 aztec-1 | [19:56:06.098] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:56:06 aztec-1 | [19:56:06.098] WARN: foundation:test-date-provider Time set to 2025-06-16T20:04:32.000Z {"offset":505902,"timeMs":1750104272000} 19:56:30 aztec-1 | [19:56:30.239] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104296 19:56:30 aztec-1 | [19:56:30.239] WARN: foundation:test-date-provider Time set to 2025-06-16T20:04:56.000Z {"offset":505761,"timeMs":1750104296000} 19:56:30 aztec-1 | [19:56:30.239] INFO: aztecjs:utils:watcher Slot 12 was missed, jumped to next slot 19:56:59 2 [webkit] › browser.spec.ts:3:1 › test (retry #1) (1.6m) 3 [webkit] › browser.spec.ts:3:1 › test (retry #2) 19:57:06 aztec-1 | [19:57:06.299] WARN: aztecjs:utils:watcher L1 is more than 1 L2 slot behind wall time. Warping to wall time 19:57:06 aztec-1 | [19:57:06.303] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104333 19:57:06 aztec-1 | [19:57:06.506] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:57:06 aztec-1 | [19:57:06.506] WARN: foundation:test-date-provider Time set to 2025-06-16T20:05:33.000Z {"offset":506494,"timeMs":1750104333000} 19:57:42 aztec-1 | [19:57:41.580] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104368 19:57:42 aztec-1 | [19:57:41.580] WARN: foundation:test-date-provider Time set to 2025-06-16T20:06:08.000Z {"offset":506420,"timeMs":1750104368000} 19:57:42 aztec-1 | [19:57:41.580] INFO: aztecjs:utils:watcher Slot 14 was missed, jumped to next slot 19:58:18 aztec-1 | [19:58:17.655] WARN: aztecjs:utils:watcher L1 is more than 1 L2 slot behind wall time. Warping to wall time 19:58:18 aztec-1 | [19:58:17.657] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104405 19:58:18 aztec-1 | [19:58:17.858] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:58:18 aztec-1 | [19:58:17.858] WARN: foundation:test-date-provider Time set to 2025-06-16T20:06:45.000Z {"offset":507142,"timeMs":1750104405000} 19:58:30 3 [webkit] › browser.spec.ts:3:1 › test (retry #2) (1.5m) 4 [webkit] › browser.spec.ts:3:1 › test (retry #3) 19:58:53 aztec-1 | [19:58:53.008] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104440 19:58:53 aztec-1 | [19:58:53.009] WARN: foundation:test-date-provider Time set to 2025-06-16T20:07:20.000Z {"offset":506991,"timeMs":1750104440000} 19:58:53 aztec-1 | [19:58:53.009] INFO: aztecjs:utils:watcher Slot 16 was missed, jumped to next slot 19:59:29 aztec-1 | [19:59:29.097] WARN: aztecjs:utils:watcher L1 is more than 1 L2 slot behind wall time. Warping to wall time 19:59:29 aztec-1 | [19:59:29.099] WARN: ethereum:cheat_codes Warped L1 timestamp to 1750104477 19:59:29 aztec-1 | [19:59:29.300] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 19:59:29 aztec-1 | [19:59:29.300] WARN: foundation:test-date-provider Time set to 2025-06-16T20:07:57.000Z {"offset":507700,"timeMs":1750104477000} 20:00:01 4 [webkit] › browser.spec.ts:3:1 › test (retry #3) (1.5m) 20:00:01 box-1 | 20:00:01 box-1 | 1) [webkit] › browser.spec.ts:3:1 › test ───────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Test timeout of 90000ms exceeded. 20:00:01 box-1 | 20:00:01 box-1 | Error: locator.click: Test timeout of 90000ms exceeded. 20:00:01 box-1 | Call log: 20:00:01 box-1 | - waiting for getByRole('button', { name: 'Deploy dummy contract' }) 20:00:01 box-1 | 20:00:01 box-1 | 20:00:01 box-1 | 6 | 20:00:01 box-1 | 7 | // Deploy contract 20:00:01 box-1 | > 8 | await page.getByRole('button', { name: 'Deploy dummy contract' }).click(); 20:00:01 box-1 | | ^ 20:00:01 box-1 | 9 | await expect(page.getByText('Deploying contract...')).toBeVisible(); 20:00:01 box-1 | 10 | await expect(page.getByText('Address:')).toBeVisible(); 20:00:01 box-1 | 11 | 20:00:01 box-1 | at /root/aztec-packages/boxes/boxes/vite/tests/browser.spec.ts:8:69 20:00:01 box-1 | 20:00:01 box-1 | attachment #1: screenshot (image/png) ────────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit/test-failed-1.png 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Retry #1 ─────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Test timeout of 90000ms exceeded. 20:00:01 box-1 | 20:00:01 box-1 | Error: locator.click: Test timeout of 90000ms exceeded. 20:00:01 box-1 | Call log: 20:00:01 box-1 | - waiting for getByRole('button', { name: 'Deploy dummy contract' }) 20:00:01 box-1 | 20:00:01 box-1 | 20:00:01 box-1 | 6 | 20:00:01 box-1 | 7 | // Deploy contract 20:00:01 box-1 | > 8 | await page.getByRole('button', { name: 'Deploy dummy contract' }).click(); 20:00:01 box-1 | | ^ 20:00:01 box-1 | 9 | await expect(page.getByText('Deploying contract...')).toBeVisible(); 20:00:01 box-1 | 10 | await expect(page.getByText('Address:')).toBeVisible(); 20:00:01 box-1 | 11 | 20:00:01 box-1 | at /root/aztec-packages/boxes/boxes/vite/tests/browser.spec.ts:8:69 20:00:01 box-1 | 20:00:01 box-1 | attachment #1: screenshot (image/png) ────────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit-retry1/test-failed-1.png 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | attachment #2: video (video/webm) ────────────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit-retry1/video.webm 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | attachment #3: trace (application/zip) ───────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit-retry1/trace.zip 20:00:01 box-1 | Usage: 20:00:01 box-1 | 20:00:01 box-1 | yarn playwright show-trace test-results/browser-test-webkit-retry1/trace.zip 20:00:01 box-1 | 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Retry #2 ─────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Test timeout of 90000ms exceeded. 20:00:01 box-1 | 20:00:01 box-1 | Error: locator.click: Test timeout of 90000ms exceeded. 20:00:01 box-1 | Call log: 20:00:01 box-1 | - waiting for getByRole('button', { name: 'Deploy dummy contract' }) 20:00:01 box-1 | 20:00:01 box-1 | 20:00:01 box-1 | 6 | 20:00:01 box-1 | 7 | // Deploy contract 20:00:01 box-1 | > 8 | await page.getByRole('button', { name: 'Deploy dummy contract' }).click(); 20:00:01 box-1 | | ^ 20:00:01 box-1 | 9 | await expect(page.getByText('Deploying contract...')).toBeVisible(); 20:00:01 box-1 | 10 | await expect(page.getByText('Address:')).toBeVisible(); 20:00:01 box-1 | 11 | 20:00:01 box-1 | at /root/aztec-packages/boxes/boxes/vite/tests/browser.spec.ts:8:69 20:00:01 box-1 | 20:00:01 box-1 | attachment #1: screenshot (image/png) ────────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit-retry2/test-failed-1.png 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Retry #3 ─────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | Test timeout of 90000ms exceeded. 20:00:01 box-1 | 20:00:01 box-1 | Error: locator.click: Test timeout of 90000ms exceeded. 20:00:01 box-1 | Call log: 20:00:01 box-1 | - waiting for getByRole('button', { name: 'Deploy dummy contract' }) 20:00:01 box-1 | 20:00:01 box-1 | 20:00:01 box-1 | 6 | 20:00:01 box-1 | 7 | // Deploy contract 20:00:01 box-1 | > 8 | await page.getByRole('button', { name: 'Deploy dummy contract' }).click(); 20:00:01 box-1 | | ^ 20:00:01 box-1 | 9 | await expect(page.getByText('Deploying contract...')).toBeVisible(); 20:00:01 box-1 | 10 | await expect(page.getByText('Address:')).toBeVisible(); 20:00:01 box-1 | 11 | 20:00:01 box-1 | at /root/aztec-packages/boxes/boxes/vite/tests/browser.spec.ts:8:69 20:00:01 box-1 | 20:00:01 box-1 | attachment #1: screenshot (image/png) ────────────────────────────────────────────────────────── 20:00:01 box-1 | test-results/browser-test-webkit-retry3/test-failed-1.png 20:00:01 box-1 | ──────────────────────────────────────────────────────────────────────────────────────────────── 20:00:01 box-1 | 20:00:01 box-1 | 1 failed 20:00:01 box-1 | [webkit] › browser.spec.ts:3:1 › test ────────────────────────────────────────────────────────── 20:00:01 box-1 | \npm notice 20:00:01 box-1 | npm notice New major version of npm available! 10.9.2 -> 11.4.2 20:00:01 box-1 | npm notice Changelog: https://github.com/npm/cli/releases/tag/v11.4.2 20:00:01 box-1 | npm notice To update run: npm install -g npm@11.4.2 20:00:01 box-1 | npm notice 20:00:01 box-1 | \ 20:00:01 Aborting on container exit... 20:00:01 box-1 exited with code 1 20:00:01 [?25l[+] Stopping 3/3 20:00:01 Container vite-webkit-box-1 Stopped0.0s 20:00:01 Container vite-webkit-aztec-1 Stopped0.5s 20:00:01 Container vite-webkit-ethereum-1 Stopped0.1s 20:00:01 [?25h