Parent Log: http://ci.aztec-labs.com/2bc89da969d757b0 Command: cc29e5be8dda3ca3:ISOLATE=1:NAME=e2e_nested_contract/manual_public yarn-project/end-to-end/scripts/run_test.sh simple src/e2e_nested_contract/manual_public.test.ts Commit: https://github.com/AztecProtocol/aztec-packages/commit/d3bba2d69dbc070d51bcd50607354193573876ba Env: REF_NAME=gh-readonly-queue/next/pr-14877-314d7622c6bacc8333ae49fe9583967cab78349b CURRENT_VERSION=0.87.6 CI_FULL=0 Date: Fri Jun 13 12:51:44 UTC 2025 System: ARCH=arm64 CPUS=64 MEM=247Gi HOSTNAME=pr-14877_arm64_a1-fast Resources: CPU_LIST=0-63 CPUS=2 MEM=8g TIMEOUT=600s History: http://ci.aztec-labs.com/list/history_d4c4a9987398261c_next 12:51:44 +++ id -u 12:51:44 +++ id -g 12:51:44 ++ docker run -d --name e2e_nested_contract_manual_public --net=none --cpuset-cpus=0-63 --cpus=2 --memory=8g --user 1000:1000 -v/home/aztec-dev:/home/aztec-dev --mount type=tmpfs,target=/tmp,tmpfs-size=1g --workdir /home/aztec-dev/aztec-packages -e HOME -e VERBOSE -e GIT_CONFIG_GLOBAL=/home/aztec-dev/aztec-packages/build-images/src/home/.gitconfig -e FORCE_COLOR=true -e CPUS -e MEM aztecprotocol/build:3.0 /bin/bash -c 'timeout -v 600s bash -c '\''yarn-project/end-to-end/scripts/run_test.sh simple src/e2e_nested_contract/manual_public.test.ts'\''' 12:51:45 + cid=e47c154d97fe30d0ec09d685764d3492defaef35ccbd46b9ba9451d5e8fb2efc 12:51:45 + set +x 12:51:45 {"level":25,"time":1749819105702,"pid":12,"hostname":"e47c154d97fe","module":"logger","msg":"Logger initialized with level verbose"} 12:51:49 [12:51:49.980] WARN: e2e:snapshot_manager:e2e_nested_contract/manual-1 No data path given, will not persist any snapshots. 12:51:49 [12:51:49.986] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Initializing state... 12:51:49 [12:51:49.990] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Starting anvil... 12:51:50 [12:51:50.061] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deploying L1 contracts... 12:51:50 [12:51:50.871] INFO: world-state:database Creating world state data store at directory /tmp/aztec-world-state-Umr0ND/world_state with map sizes {"archiveTreeMapSizeKb":10485760,"nullifierTreeMapSizeKb":10485760,"noteHashTreeMapSizeKb":10485760,"messageTreeMapSizeKb":10485760,"publicDataTreeMapSizeKb":10485760} and 2 threads. 12:51:50 [12:51:50.901] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Calling anvil_setBlockTimestampInterval with params: [12] 12:51:50 [12:51:50.922] WARN: e2e:snapshot_manager:e2e_nested_contract/manual-1 Set block interval to 12 12:51:50 [12:51:50.923] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deploying contracts from 0xf39Fd6e51aad88F6F4ce6aB8827279cffFb92266 12:51:50 [12:51:50.969] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x5f6007147b276ec3270f42c9cc4c2453661a1882dd03ebb0a7663e0351326302 {"gasLimit":854274,"maxFeePerGas":"2.80180664","maxPriorityFeePerGas":"1.2"} 12:51:50 [12:51:50.977] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed Fee Asset at 0x5fbdb2315678afecb367f032d93f642f64180aa3 12:51:50 [12:51:50.996] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xaf47cdb235bd1f13781af7e220955c2cdc0e084c2ebf03be2e261fd9e4cd20e4 {"gasLimit":854259,"maxFeePerGas":"3.04180664","maxPriorityFeePerGas":"1.44"} 12:51:51 [12:51:51.001] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed Staking Asset at 0xe7f1725e7734ce288f8367e1bb143e90bb3f0512 12:51:51 [12:51:51.019] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x127d08cafb8afc3d7c988fa49d05483d6d2b44a017de0544d9d53ed8e954f028 {"gasLimit":3068916,"maxFeePerGas":"3.139083461","maxPriorityFeePerGas":"1.728"} 12:51:51 [12:51:51.024] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed GSE at 0x9fe46736679d2d9a65f0992f2272de9f3c7fa6e0 12:51:51 [12:51:51.038] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xfc3bb231ea2e0264b6b8a23fcec61ebed62743e19c10191aa7d3875f497a4fc5 {"gasLimit":1014448,"maxFeePerGas":"3.316669081","maxPriorityFeePerGas":"2.0736"} 12:51:51 [12:51:51.043] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed Registry at 0xcf7ed3acca5a467e9e704c703e8d87f634fb0fc9 12:51:51 [12:51:51.059] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xaacf48e3ead9dacb86aefdd338f36304a4c3b8bdadb4187cfbb423b08432e58a {"gasLimit":1966641,"maxFeePerGas":"3.602497631","maxPriorityFeePerGas":"2.48832"} 12:51:51 [12:51:51.064] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed GovernanceProposer at 0xdc64a140aa3e981100a9beca4e685f962f0cf6c9 12:51:51 [12:51:51.080] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xcf7fae7529f61533c0371ef7e48806ba22d388f75045a1622f395013a5b5e54f {"gasLimit":3042380,"maxFeePerGas":"3.968738569","maxPriorityFeePerGas":"2.985984"} 12:51:51 [12:51:51.085] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed Governance at 0x5fc8d32690cc91d4c39d9d3abcbd16989f875707 12:51:51 [12:51:51.099] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xb29d797f3bb96de645ca7dd851a6032ca329416604467637fe1951b3bb7b0b01 {"gasLimit":100000,"maxFeePerGas":"4.456512757","maxPriorityFeePerGas":"3.5831808"} 12:51:51 [12:51:51.099] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Set governance on GSE in 0xb29d797f3bb96de645ca7dd851a6032ca329416604467637fe1951b3bb7b0b01 12:51:51 [12:51:51.112] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xdaee13dd4ae15bf81db210af4783afc6cbf2b215185b42f20240f368ff886b6d {"gasLimit":391705,"maxFeePerGas":"5.082433867","maxPriorityFeePerGas":"4.29981696"} 12:51:51 [12:51:51.116] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed CoinIssuer at 0xa513e6e4b8f2a923d98304ec87f64353c4d5c853 12:51:51 [12:51:51.117] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for deployments to complete 12:51:51 [12:51:51.117] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for 7 transactions to be mined... 12:51:51 [12:51:51.140] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions mined successfully 12:51:51 [12:51:51.149] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xc97d0f282e81d6acf0266ec5cdcdb45adbbf99cf2d9581bb2da1379b9cac796e {"gasLimit":100000,"maxFeePerGas":"5.844872039","maxPriorityFeePerGas":"5.159780352"} 12:51:51 [12:51:51.149] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Added coin issuer 0xa513e6e4b8f2a923d98304ec87f64353c4d5c853 as minter on fee asset in 0xc97d0f282e81d6acf0266ec5cdcdb45adbbf99cf2d9581bb2da1379b9cac796e 12:51:51 [12:51:51.162] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xda437c67c6630bea5aae1701426f52c1ceba6a305b57100136d879f0d4f4ff4f {"gasLimit":56661,"maxFeePerGas":"6.793055218","maxPriorityFeePerGas":"6.191736422"} 12:51:51 [12:51:51.175] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x9421528809324b074f7b12e837e8700957b74c23137ab6df0ff810691dc02a31 {"gasLimit":339705,"maxFeePerGas":"7.956474858","maxPriorityFeePerGas":"7.430083706"} 12:51:51 [12:51:51.179] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed FeeAssetHandler at 0x610178da211fef7d417bc0e6fed39f05609ad788 12:51:51 [12:51:51.192] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x341116a696f7ed2a3dc443139ac50fffd79e3e067087c43a2240134f6fb35525 {"gasLimit":56804,"maxFeePerGas":"9.376899832","maxPriorityFeePerGas":"8.916100447"} 12:51:51 [12:51:51.192] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Added fee asset handler 0x610178da211fef7d417bc0e6fed39f05609ad788 as minter on fee asset in 0x341116a696f7ed2a3dc443139ac50fffd79e3e067087c43a2240134f6fb35525 12:51:51 [12:51:51.212] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xac78260316a277bb5d441eb23a59ce308f0c100c008eb97fe50eb9c009198b6f {"gasLimit":2474287,"maxFeePerGas":"11.103607055","maxPriorityFeePerGas":"10.699320536"} 12:51:51 [12:51:51.218] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed StakingAssetHandler at 0xa51c1fc2f0d1a1b8494ed1fe312d7c3a78ed91c0 12:51:51 [12:51:51.230] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x5661870be8b9a12f5c3c3c213c1391d9cf393efa297371bb54379ed94b6bc4bc {"gasLimit":56804,"maxFeePerGas":"13.193094829","maxPriorityFeePerGas":"12.839184643"} 12:51:51 [12:51:51.230] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Added staking asset handler 0xa51c1fc2f0d1a1b8494ed1fe312d7c3a78ed91c0 as minter on staking asset in 0x5661870be8b9a12f5c3c3c213c1391d9cf393efa297371bb54379ed94b6bc4bc 12:51:51 [12:51:51.231] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for deployments to complete 12:51:51 [12:51:51.231] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for 9 transactions to be mined... 12:51:51 [12:51:51.252] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions mined successfully 12:51:51 [12:51:51.263] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed shared contracts 12:51:51 [12:51:51.279] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xd90cf8a0e81d7b37254a461afbfd25c573e0f4e71a0dafa05b5e5c79e078319a {"gasLimit":84837,"maxFeePerGas":"15.722774064","maxPriorityFeePerGas":"15.407021571"} 12:51:51 [12:51:51.280] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Funded reward distributor with 10000000000000000000000000 fee asset in 0xd90cf8a0e81d7b37254a461afbfd25c573e0f4e71a0dafa05b5e5c79e078319a 12:51:51 [12:51:51.296] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xfeae23e8411e86586b0801a8b0762aee8d5db68ce5dfc490d884124edfea75fb {"gasLimit":152965,"maxFeePerGas":"18.764833872","maxPriorityFeePerGas":"18.488425885"} 12:51:51 [12:51:51.301] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Rollup will use the mock verifier at 0x0b306bf915c4d645ff596e518faf3f9669b97016 12:51:51 [12:51:51.301] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Rollup config args {"aztecSlotDuration":36,"aztecEpochDuration":32,"targetCommitteeSize":48,"aztecProofSubmissionWindow":64,"slashingQuorum":6,"slashingRoundSize":10,"manaTarget":10000000000,"provingCostPerMana":100,"rewardConfig":{"sequencerBps":5000,"increment":200000,"maxScore":5000000,"a":5000,"k":1000000,"minimum":100000}} 12:51:51 [12:51:51.313] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x86efa52cd6e7a8e4983f7552f0d5929cd56259d4356ce60b551340a7d62b2779 {"gasLimit":86397,"maxFeePerGas":"22.428130897","maxPriorityFeePerGas":"22.186111062"} 12:51:51 [12:51:51.336] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x9dc3865a666f3d95a9ee25ba7f4dbc84d3e68d3b3aa4ce578c9195909b4620ee {"gasLimit":5075920,"maxFeePerGas":"26.835357719","maxPriorityFeePerGas":"26.623333274"} 12:51:51 [12:51:51.355] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x2790704c94b1b07d13950d308ef31e16ca98f2e7649cd9a5491b9061bfb0d399 {"gasLimit":2439043,"maxFeePerGas":"32.133648529","maxPriorityFeePerGas":"31.947999928"} 12:51:51 [12:51:51.360] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Awaiting for linked libraries to be deployed 12:51:51 [12:51:51.399] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x77a02a4dc053a5cb27fbeee877cd8fc3667bc7c34ba270a28220e59aab5c1d77 {"gasLimit":10701132,"maxFeePerGas":"38.506586452","maxPriorityFeePerGas":"38.337599913"} 12:51:51 [12:51:51.405] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed Rollup at 0x3aa5ebb10dc797cac828524e59a333d0a371443c {"aztecSlotDuration":36,"aztecEpochDuration":32,"targetCommitteeSize":48,"aztecProofSubmissionWindow":64,"slashingQuorum":6,"slashingRoundSize":10,"manaTarget":10000000000,"provingCostPerMana":100,"rewardConfig":{"sequencerBps":5000,"increment":200000,"maxScore":5000000,"a":5000,"k":1000000,"minimum":100000}} 12:51:51 [12:51:51.406] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for 11 transactions to be mined... 12:51:51 [12:51:51.429] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions mined successfully 12:51:51 [12:51:51.430] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 All core contracts have been deployed 12:51:51 [12:51:51.445] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x2c60db7509a170991a65a94e8833b2935105765660ed5571929996e63f082795 {"gasLimit":64317,"maxFeePerGas":"46.155845376","maxPriorityFeePerGas":"46.005119895"} 12:51:51 [12:51:51.446] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Funding fee juice portal with 110000000000000000000000 fee juice in 0x2c60db7509a170991a65a94e8833b2935105765660ed5571929996e63f082795 (accelerated test deployments) 12:51:51 [12:51:51.460] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xcb45e9f5ec86872fc95b2bd00fb4f6c1f0fe9b71d92515eebf2176f3f3818350 {"gasLimit":1040131,"maxFeePerGas":"55.349229596","maxPriorityFeePerGas":"55.206143874"} 12:51:51 [12:51:51.464] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Deployed SlashFactory at 0x59b670e9fa9d0a427751af201d676719a970857b 12:51:51 [12:51:51.484] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0xfe77dfaa20c4296fd359369f21668c4413ea647628127928dc5de8338463c9a5 {"gasLimit":116979,"maxFeePerGas":"66.372636566","maxPriorityFeePerGas":"66.247372648"} 12:51:51 [12:51:51.485] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Adding rollup 0x3aa5ebb10dc797cac828524e59a333d0a371443c to registry 0xcf7ed3acca5a467e9e704c703e8d87f634fb0fc9 in tx 0xfe77dfaa20c4296fd359369f21668c4413ea647628127928dc5de8338463c9a5 12:51:51 [12:51:51.499] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Sent L1 transaction 0x46ed1486d6d9d793502b3d021a0766425fa02be2d0da0feeaacdf0caddcc1faa {"gasLimit":109478,"maxFeePerGas":"79.607357901","maxPriorityFeePerGas":"79.496847177"} 12:51:51 [12:51:51.499] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Adding rollup 0x3aa5ebb10dc797cac828524e59a333d0a371443c to GSE 0x9fe46736679d2d9a65f0992f2272de9f3c7fa6e0 in tx 0x46ed1486d6d9d793502b3d021a0766425fa02be2d0da0feeaacdf0caddcc1faa 12:51:51 [12:51:51.503] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for 12 transactions to be mined... 12:51:51 [12:51:51.526] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions mined successfully 12:51:51 [12:51:51.532] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Rollup deployed 12:51:51 [12:51:51.532] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for rollup and slash factory to be deployed 12:51:51 [12:51:51.533] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Waiting for 12 transactions to be mined... 12:51:51 [12:51:51.560] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions mined successfully 12:51:51 [12:51:51.560] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 All transactions for L1 deployment have been mined 12:51:51 [12:51:51.578] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 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"} 12:51:51 [12:51:51.578] INFO: e2e:snapshot_manager:e2e_nested_contract/manual-1 Handing over to governance 12:51:51 [12:51:51.587] INFO: aztecjs:utils:watcher Watcher started for rollup at 0x3Aa5ebB10DC797CAC828524e59A333d0A371443c 12:51:51 [12:51:51.591] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 12:51:51 [12:51:51.591] WARN: foundation:test-date-provider Time set to 2025-06-13T12:56:38.000Z {"offset":286409,"timeMs":1749819398000} 12:51:51 [12:51:51.594] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Using native ACVM binary at ../../noir/noir-repo/target/release/acvm with working directory /tmp/2a291ff5/acvm 12:51:51 [12:51:51.596] INFO: telemetry:client Using NoopTelemetryClient 12:51:51 [12:51:51.596] INFO: kv-store:lmdb-v2:blob-sink Creating blob-sink data store at directory /tmp/b00cc247ffe8eb6f/blob-sink with map size 134217728 KB (LMDB v2) 12:51:51 [12:51:51.598] INFO: kv-store:lmdb-v2:blob-sink Starting data store with maxReaders 16 12:51:51 [12:51:51.603] INFO: blob-sink:server Server is running on http://localhost:36911 12:51:51 [12:51:51.603] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Creating and synching an aztec node... 12:51:51 [12:51:51.604] INFO: node:blob-sink:client Creating HTTP blob sink client. {"blobSinkUrl":"http://127.0.0.1:36911"} 12:51:51 [12:51:51.622] VERBOSE: node Snapshot sync is disabled. No snapshots URL provided. 12:51:51 [12:51:51.622] INFO: archiver:lmdb Creating archiver data store at directory /tmp/b00cc247ffe8eb6f/archiver with map size 134217728 KB (LMDB v2) 12:51:51 [12:51:51.623] INFO: archiver:lmdb Starting data store with maxReaders 16 12:51:51 [12:51:51.902] INFO: node:blob-sink:client Testing configured blob sources {"blobSinkUrl":"http://127.0.0.1:36911"} 12:51:51 [12:51:51.910] INFO: node:blob-sink:client Blob sink is reachable {"blobSinkUrl":"http://127.0.0.1:36911"} 12:51:51 [12:51:51.911] WARN: node:blob-sink:client No L1 consensus host urls configured 12:51:51 [12:51:51.911] WARN: node:blob-sink:client No archive client configured 12:51:51 [12:51:51.913] INFO: archiver Starting archiver sync to rollup contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c from L1 block 20 to current L1 block 24 with hash 0x5b3da09a016b4d8e00a0ac3a7addbc7491f8f008289f7f904fd19af2bbe39988 {"blocksSynchedTo":20,"messagesSynchedTo":{"l1BlockHash":"0xb4b182296d7d39e20c067d8339f65672d8cb3d632cbe2264e6e31c6cdeac98ad","l1BlockNumber":20}} 12:51:51 [12:51:51.926] INFO: archiver Initial archiver sync to L1 block 24 complete. {"l1BlockNumber":24,"syncPoint":{"blocksSynchedTo":24,"messagesSynchedTo":{"l1BlockHash":"0x5b3da09a016b4d8e00a0ac3a7addbc7491f8f008289f7f904fd19af2bbe39988","l1BlockNumber":24}},"latest":{"number":0},"proven":{"number":0},"finalized":{"number":0}} 12:51:51 [12:51:51.930] INFO: world-state:database Creating world state data store at directory /tmp/b00cc247ffe8eb6f/world_state with map sizes {"archiveTreeMapSizeKb":134217728,"nullifierTreeMapSizeKb":134217728,"noteHashTreeMapSizeKb":134217728,"messageTreeMapSizeKb":134217728,"publicDataTreeMapSizeKb":134217728} and 2 threads. 12:51:51 [12:51:51.952] INFO: world_state Created world state synchroniser with block history of 64 12:51:51 [12:51:51.953] WARN: node Aztec node is accepting fake proofs 12:51:51 [12:51:51.962] INFO: p2p:lmdb-v2 Creating p2p data store at directory /tmp/b00cc247ffe8eb6f/p2p with map size 134217728 KB (LMDB v2) 12:51:51 [12:51:51.963] INFO: p2p:lmdb-v2 Starting data store with maxReaders 16 12:51:51 [12:51:51.964] INFO: p2p-archive:lmdb-v2 Creating p2p-archive data store at directory /tmp/b00cc247ffe8eb6f/p2p-archive with map size 134217728 KB (LMDB v2) 12:51:51 [12:51:51.965] INFO: p2p-archive:lmdb-v2 Starting data store with maxReaders 16 12:51:51 [12:51:51.965] INFO: p2p-peer:lmdb-v2 Creating p2p-peers data store at directory /tmp/b00cc247ffe8eb6f/p2p-peers with map size 134217728 KB (LMDB v2) 12:51:51 [12:51:51.966] INFO: p2p-peer:lmdb-v2 Starting data store with maxReaders 16 12:51:51 [12:51:51.967] INFO: p2p:tx_pool Setting maximum tx mempool size {"maxTxPoolSize":100000000} 12:51:51 [12:51:51.968] VERBOSE: p2p P2P is disabled. Using dummy P2P service. 12:51:51 [12:51:51.970] VERBOSE: world-state:block_stream Starting L2 block stream {"proven":false,"pollIntervalMS":100} 12:51:51 [12:51:51.971] INFO: world_state Started world state synchronizer from block 1 12:51:51 [12:51:51.973] VERBOSE: world-state:block_stream Starting sync from block number 0 12:51:51 [12:51:51.975] INFO: p2p Starting p2p client from block 0 with empty mempools 12:51:51 [12:51:51.975] VERBOSE: p2p:l2-block-stream Starting L2 block stream {"batchSize":20,"pollIntervalMS":100,"startingBlock":0} 12:51:52 [12:51:52.204] INFO: epoch-prune-watcher EpochPruneWatcher initialized 12:51:52 [12:51:52.236] VERBOSE: validator Initialized validator with addresses: 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 12:51:52 [12:51:52.236] VERBOSE: node All Aztec Node subsystems synced 12:51:52 [12:51:52.248] INFO: slasher Starting Slasher client... 12:51:52 [12:51:52.257] INFO: sequencer-client Deploying forwarder contract 12:51:52 [12:51:52.261] VERBOSE: p2p:l2-block-stream Starting sync from block number 0 12:51:52 [12:51:52.275] VERBOSE: sequencer-client Sent L1 transaction 0x510ce307e51d5fdb14e4eecdc8e83c31e8d507c13e462475f9dfbc28309958b5 {"gasLimit":323704,"maxFeePerGas":"95.493003271","maxPriorityFeePerGas":"95.396216612"} 12:51:52 [12:51:52.275] VERBOSE: sequencer-client Deployed contract with salt 0x0000000000000000000000000000000000000000000000000000000000000042 to address 0x0fe4d493871B0C51332De8A330B02BA8172Da4aC in tx 0x510ce307e51d5fdb14e4eecdc8e83c31e8d507c13e462475f9dfbc28309958b5. 12:51:52 [12:51:52.280] INFO: sequencer-client Forwarder contract deployed at 0x0fe4d493871b0c51332de8a330b02ba8172da4ac 12:51:52 [12:51:52.286] INFO: validator Started validator with addresses: 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 12:51:52 [12:51:52.287] VERBOSE: validator Validators 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 are not on the validator committee for epoch 0 12:51:52 [12:51:52.287] INFO: sequencer Sequencer config set {"transactionPollingIntervalMS":500,"maxTxsPerBlock":32,"minTxsPerBlock":1,"maxL2BlockGas":10000000000,"publishTxsWithProposals":false,"maxDABlockGas":10000000000,"acvmWorkingDirectory":"/tmp/2a291ff5/acvm","acvmBinaryPath":"../../noir/noir-repo/target/release/acvm","maxBlockSizeInBytes":1048576,"governanceProposerPayload":"0x0000000000000000000000000000000000000000","maxL1TxInclusionTimeIntoSlot":12,"enforceTimeTable":false} 12:51:52 [12:51:52.288] VERBOSE: sequencer Sequencer timetable updated {"enforceTimeTable":false} 12:51:52 [12:51:52.289] INFO: sequencer Sequencer started with address 0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266 12:51:52 [12:51:52.290] VERBOSE: node Sequencer started 12:51:52 [12:51:52.290] INFO: node Aztec Node version: 0.87.6 12:51:52 [12:51:52.290] INFO: node Aztec Node started on chain 0x7a69 {"registryAddress":"0xcf7ed3acca5a467e9e704c703e8d87f634fb0fc9","governanceAddress":"0x5fc8d32690cc91d4c39d9d3abcbd16989f875707","governanceProposerAddress":"0xdc64a140aa3e981100a9beca4e685f962f0cf6c9","rollupAddress":"0x3aa5ebb10dc797cac828524e59a333d0a371443c","inboxAddress":"0x4374eecaad0dcaa149cffc160d5a0552b1d092b0","outboxAddress":"0x44bf2a9217a2970a1bcc7529bf1d40828c594320","feeJuicePortalAddress":"0xa0719ec6accbac2301f88bc71e2f5ddc8c29149b","feeJuiceAddress":"0x5fbdb2315678afecb367f032d93f642f64180aa3","stakingAssetAddress":"0xe7f1725e7734ce288f8367e1bb143e90bb3f0512","rewardDistributorAddress":"0xd8058efe0198ae9dd7d563e1b4938dcbc86a1f81","gseAddress":"0x9fe46736679d2d9a65f0992f2272de9f3c7fa6e0","coinIssuerAddress":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","slashFactoryAddress":"0x59b670e9fa9d0a427751af201d676719a970857b","feeAssetHandlerAddress":"0x610178da211fef7d417bc0e6fed39f05609ad788","stakingAssetHandlerAddress":"0xa51c1fc2f0d1a1b8494ed1fe312d7c3a78ed91c0","zkPassportVerifierAddress":"0xee9f10f38319eae2730dba28fb09081db806c5e5"} 12:51:52 [12:51:52.291] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Creating pxe... 12:51:52 [12:51:52.296] INFO: pxe:data:lmdb Creating pxe_data data store at directory /tmp/b00cc247ffe8eb6f/8e9fab7f57900e4a/pxe_data with map size 134217728 KB (LMDB v2) 12:51:52 [12:51:52.299] 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":1749819398,"syncedToL1Ts":1749819398,"syncedToL2Slot":1,"nextL2Slot":1,"nextL2SlotTs":1749819386,"l1SlotDuration":12,"rollup":{"blockNumber":1,"slot":2,"timeOfNextL1Slot":1749819422},"newBlockNumber":1,"expectedSlot":1} 12:51:52 [12:51:52.300] INFO: pxe:data:lmdb Starting data store with maxReaders 16 12:51:52 [12:51:52.480] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 12:51:52 [12:51:52.481] WARN: foundation:test-date-provider Time set to 2025-06-13T12:56:50.000Z {"offset":297519,"timeMs":1749819410000} 12:51:52 [12:51:52.583] VERBOSE: pxe:service Registered protocol contracts in pxe {"AuthRegistry":"0x0000000000000000000000000000000000000000000000000000000000000001","ContractInstanceDeployer":"0x0000000000000000000000000000000000000000000000000000000000000002","ContractClassRegisterer":"0x0000000000000000000000000000000000000000000000000000000000000003","MultiCallEntrypoint":"0x0000000000000000000000000000000000000000000000000000000000000004","FeeJuice":"0x0000000000000000000000000000000000000000000000000000000000000005","Router":"0x0000000000000000000000000000000000000000000000000000000000000006"} 12:51:52 [12:51:52.583] INFO: pxe:service Started PXE connected to chain 31337 version 2277307715 12:51:52 [12:51:52.584] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Applying state transition for accounts... 12:51:52 [12:51:52.584] VERBOSE: e2e:e2e_nested_contract:manual Deploying accounts funded with fee juice... 12:51:52 [12:51:52.624] INFO: pxe:service Registered account 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:51:52 [12:51:52.686] WARN: pxe:service No artifact found for contract class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 when looking for its metadata 12:51:52 [12:51:52.689] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 as part of deployment for 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:51:52 [12:51:52.816] INFO: pxe:service Added contract SchnorrAccount at 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a with class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 12:51:52 [12:51:52.835] VERBOSE: sequencer Preparing proposal for block 1 at slot 2 {"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:52 [12:51:52.859] VERBOSE: sequencer Not enough txs to build block 1 at slot 2 (got 0 txs, need 1) {"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:52 [12:51:52.862] VERBOSE: pxe:block_stream Starting sync from block number 0 12:51:52 [12:51:52.900] VERBOSE: simulator:private_execution Executing private function MultiCallEntrypoint:entrypoint {"contract":"0x0000000000000000000000000000000000000000000000000000000000000004"} 12:51:52 [12:51:52.996] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:register {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:51:53 [12:51:53.414] VERBOSE: simulator:client_execution_context:debug_log ContractClassRegistered: 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097,0x1957d1ce818946c748798e559ad49f7f8cde3f3354114d1283b33b6a89100d84,0x25001159661e67f498b5874e31e434e254a328f93390888fe41be70dca9d8f41,0x136df56b2c789090458197f8589ee9a9215579138440b4fe7cd9d33e8d88151c 12:51:53 [12:51:53.487] VERBOSE: simulator:client_execution_context Emitted log from ContractClassRegisterer: "0000000000000000000000000000000000000000000000000000000000000003000000006999d1e02b08a447a463563453cb..." 12:51:53 [12:51:53.570] VERBOSE: sequencer Preparing proposal for block 1 at slot 2 {"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:53 [12:51:53.571] VERBOSE: sequencer Not enough txs to build block 1 at slot 2 (got 0 txs, need 1) {"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:53 [12:51:53.644] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:constructor {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.686] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:51:53 [12:51:53.686] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.723] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.726] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:51:53 [12:51:53.899] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.935] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:51:53 [12:51:53.936] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.971] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:53 [12:51:53.974] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:51:53 [12:51:53.990] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:51:54 [12:51:54.132] VERBOSE: sequencer Preparing proposal for block 1 at slot 2 {"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:54 [12:51:54.133] VERBOSE: sequencer Not enough txs to build block 1 at slot 2 (got 0 txs, need 1) {"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:54 [12:51:54.770] VERBOSE: sequencer Preparing proposal for block 1 at slot 2 {"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:54 [12:51:54.771] VERBOSE: sequencer Not enough txs to build block 1 at slot 2 (got 0 txs, need 1) {"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:55 [12:51:55.138] INFO: pxe:service Proving completed in 2278.536671ms {"timings":{"total":2278.536671,"sync":3.0675430000001143,"perFunction":[{"functionName":"MultiCallEntrypoint:entrypoint","time":134.52293100000043,"oracles":{"callPrivateFunction":{"times":[605.4984570000006,283.1016359999994,177.82518100000016]}}},{"functionName":"private_kernel_init","time":94.10837100000026},{"functionName":"ContractClassRegisterer:register","time":587.8001849999991,"oracles":{"loadCapsule":{"times":[8.712255000000368]},"notifyCreatedNullifier":{"times":[0.5611649999991641]},"debugLog":{"times":[0.7630329999992682]},"notifyCreatedContractClassLog":{"times":[7.126643999999942]}}},{"functionName":"private_kernel_inner","time":120.97969300000113},{"functionName":"SchnorrAccount:constructor","time":257.83192600000075,"oracles":{"getContractInstance":{"times":[1.2049409999999625]},"debugLog":{"times":[0.46805400000084774,0.3731550000011339]},"fetchTaggedLogs":{"times":[38.508277999999336]},"loadCapsule":{"times":[0.3146919999999227,0.21381599999949685,0.24171100000057777]},"validateEnqueuedNotesAndEvents":{"times":[1.6713999999992666]},"notifyCreatedNullifier":{"times":[0.20333299999947485,0.22163600000021688]},"notifyCreatedNote":{"times":[0.5141060000005382]},"getRandomField":{"times":[0.20159099999909813,0.15806399999928544,0.08630099999936647,0.08074699999997392,0.06893399999898975,0.06860799999958545,0.06568700000025274,0.07930099999975937,0.06477300000005926,0.08371299999998882,0.06259999999929278]},"getIndexedTaggingSecretAsSender":{"times":[40.75519400000121]},"incrementAppTaggingSecretIndexAsSender":{"times":[23.93716400000085]}}},{"functionName":"private_kernel_inner","time":108.6782660000008},{"functionName":"SchnorrAccount:entrypoint","time":152.106135,"oracles":{"debugLog":{"times":[0.4572779999998602,0.37572799999907147,0.6146960000005492]},"fetchTaggedLogs":{"times":[37.02140599999984]},"loadCapsule":{"times":[0.2326229999998759,0.2160729999995965,1.936082999998689]},"validateEnqueuedNotesAndEvents":{"times":[1.3295609999986482]},"getNotes":{"times":[1.5174820000011096]},"getAuthWitness":{"times":[0.39653999999973166]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.9160730000003241]}}},{"functionName":"private_kernel_inner","time":107.3190080000004},{"functionName":"private_kernel_reset","time":181.97464200000104},{"functionName":"private_kernel_tail","time":70.08608399999866}],"unaccounted":460.0618869999971}} 12:51:55 [12:51:55.225] VERBOSE: p2p:tx_pool Adding tx 0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929 to pool {"eventName":"tx-added-to-pool","txHash":"0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929","noteHashCount":1,"nullifierCount":3,"privateLogCount":1,"classRegisteredCount":1,"contractClassLogSize":7,"proofSize":172052,"size":292848,"feePaymentMethod":"fee_juice"} 12:51:55 [12:51:55.242] INFO: node Received tx 0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929 {"txHash":"0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929"} 12:51:55 [12:51:55.242] INFO: pxe:service Sent transaction 0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929 12:51:55 [12:51:55.279] VERBOSE: sequencer Preparing proposal for block 1 at slot 2 {"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"chainTipArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","blockNumber":1,"slot":2} 12:51:55 [12:51:55.291] VERBOSE: block-builder Building block 1 for slot 2 {"slot":2,"slotStart":"2025-06-13T12:57:02.000Z","now":"2025-06-13T12:56:52.810Z","blockNumber":1,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:51:55 [12:51:55.333] VERBOSE: simulator:public-processor Processed tx 0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929 with no public calls in 19.97117000000071ms {"txHash":"0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929","txFee":2101212240,"revertCode":0,"gasUsed":{"totalGas":{"daGas":16896,"l2Gas":6324},"billedGas":{"daGas":16896,"l2Gas":6324},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":0,"l2Gas":0}},"publicDataWriteCount":1,"nullifierCount":3,"noteHashCount":1,"contractClassLogCount":1,"publicLogCount":0,"privateLogCount":1,"l2ToL1MessageCount":0,"durationMs":19.97117000000071} 12:51:55 [12:51:55.334] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.040816093999999796s {"duration":0.040816093999999796,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":16896,"l2Gas":6324},"totalSizeInBytes":1344} 12:51:55 [12:51:55.356] INFO: sequencer Built block 1 for slot 2 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x2005ed538c47e261f69ac88a96705b096b82398561201406d383f145cb9b959e","globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"txHashes":["0x2d5e9535d1a21179cea8d5919bbc2e07c881aa34fd0dfaae86cef26450e5b929"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":72.15759900000012,"publicProcessDuration":41.565841999999975,"rollupCircuitsDuration":65.90011799999957,"txCount":1,"blockNumber":1,"blockTimestamp":1749819422,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 12:51:55 [12:51:55.361] VERBOSE: sequencer Attesting committee is empty 12:51:58 [12:51:58.062] VERBOSE: node Sent L1 transaction 0x10e77c5c1ba5925968e8d71925827aa95f0b1c72a2496d756ec80581437b6e98 {"gasLimit":487142,"maxFeePerGas":"114.560221845","maxPriorityFeePerGas":"114.475459934","maxFeePerBlobGas":"0.000000001"} 12:51:58 [12:51:58.073] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:51:58 [12:51:58.074] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0x10e77c5c1ba5925968e8d71925827aa95f0b1c72a2496d756ec80581437b6e98","calldataSize":1252,"calldataGas":9952,"txCount":1,"blockNumber":1,"blockTimestamp":1749819422,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 12:51:58 [12:51:58.074] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:51:58 [12:51:58.091] INFO: blob-sink:server Received blob sidecar for block 0xd54e61879c69310720b7153e0984510aadb524366c21a538a36b190323ab8b58 12:51:58 [12:51:58.096] INFO: blob-sink:server Blob sidecar stored successfully for block 0xd54e61879c69310720b7153e0984510aadb524366c21a538a36b190323ab8b58 12:51:58 [12:51:58.130] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819458 12:51:58 [12:51:58.131] WARN: foundation:test-date-provider Time set to 2025-06-13T12:57:38.000Z {"offset":339869,"timeMs":1749819458000} 12:51:58 [12:51:58.131] INFO: aztecjs:utils:watcher Slot 2 was filled, jumped to next slot 12:51:58 [12:51:58.189] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 1 12:51:58 [12:51:58.190] INFO: aztecjs:cheat_codes Proven tip moved: 0 -> 1. Pending tip: 1. 12:51:58 [12:51:58.300] VERBOSE: archiver:block-helper Store contract class 0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097 12:51:58 [12:51:58.305] INFO: archiver Downloaded L2 block 1 {"blockHash":"0x2005ed538c47e261f69ac88a96705b096b82398561201406d383f145cb9b959e","blockNumber":1,"txCount":1,"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"archiveRoot":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","archiveNextLeafIndex":2} 12:51:58 [12:51:58.313] INFO: archiver Updated proven chain to block 1 {"provenBlockNumber":1} 12:51:58 [12:51:58.402] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 State transition for accounts complete. 12:51:58 [12:51:58.408] VERBOSE: e2e:e2e_nested_contract:manual Wallet 0 address: 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:51:58 [12:51:58.408] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Applying state transition for public_deploy... 12:51:58 [12:51:58.408] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 State transition for public_deploy complete. 12:51:58 [12:51:58.408] VERBOSE: e2e:e2e_nested_contract:manual Public deploy accounts... 12:51:58 [12:51:58.410] INFO: world_state World state updated with L2 block 1 {"eventName":"l2-block-handled","duration":6.975033999999141,"unfinalisedBlockNumber":1,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":1,"blockTimestamp":1749819422,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":7} 12:51:58 [12:51:58.536] VERBOSE: p2p Synched to latest block 1 12:51:58 [12:51:58.566] VERBOSE: pxe:service Updated pxe last block to 1 {"blockHash":{},"archive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","header":{"contentCommitment":{"blobsHash":"0x00cd5f4c9637295ba9abdf90bd512c7e555551da086cea53cfc363aa9440a30b","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":1,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":2,"timestamp":1749819422,"version":2277307715},"lastArchive":"0x1841211b8313f32bd74dfb5c6bd9f5b6ff676f26dfaca2baadadb72de3608338","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x1dc676649cf69604f4e1d313ba32f0bb8e266a66cdd1401e797b957668fed400","publicDataTree":"0x17f4666dd9d78b53c9ebbc5bb6de2e590fbfbc3e55bb9ecb534221667b364fa2"},"totalFees":2101212240,"totalManaUsed":6324}} 12:51:58 [12:51:58.647] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:58 [12:51:58.683] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:51:58 [12:51:58.684] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:58 [12:51:58.727] VERBOSE: sequencer Preparing proposal for block 2 at slot 3 {"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"chainTipArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","blockNumber":2,"slot":3} 12:51:58 [12:51:58.728] VERBOSE: sequencer Not enough txs to build block 2 at slot 3 (got 0 txs, need 1) {"chainTipArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","blockNumber":2,"slot":3} 12:51:58 [12:51:58.743] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:51:58 [12:51:58.747] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:51:58 [12:51:58.761] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:51:58 [12:51:58.762] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:51:58 [12:51:58.772] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:51:58 [12:51:58.772] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:51:58 [12:51:58.775] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:51:58 [12:51:58.780] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:51:58 [12:51:58.792] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:51:58 [12:51:58.839] VERBOSE: simulator:private_execution Executing private function ContractInstanceDeployer:deploy {"contract":"0x0000000000000000000000000000000000000000000000000000000000000002"} 12:51:58 [12:51:58.899] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:assert_class_id_is_registered {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:51:58 [12:51:58.910] VERBOSE: simulator:client_execution_context:debug_log ContractInstanceDeployed: 0x0000000085864497636cf755ae7bde03f267ce01a520981c21c3682aaf82a631,0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a,0x0000000000000000000000000000000000000000000000000000000000000001,0x09060446b17223a7af06c9d8a7c564003ccade6cf03e8ce741086256d85ab98b,0x0b89e6f8d5ceea693e15799442ccf7b89aac377f557925144092ccd99080e097,0x1740e9af094c216e0a027c611e87f5853cf4ffcec91f45bbffd5bb1c17d29b88,0x222a21053414b6a7600afff85a57fb656680600382505ed4175d42d272c8616e,0x18a22ddc9048b199ea653425fe4cd29b983fe0ae4d0e0f68562ee156b9fbb9bb,0x1186c5b16cd7ec5766d55981a38f97b4fe95da1fbf5ce26b4f6bcf9930057a01,0x1a2a0caa517abbe48f34b0ccbeb87be49be6a4ace556d5dd8ff135262a921e9e,0x1b5e040a0816f3a3d96c664ff02bcecfcdbd653f96b288d3391adcf31195f353,0x164f58056daf6456db6d6936e501ccaeb3c455d53ac1c750abb391bbe36d1d49,0x21b78753207f22eb118fa56a1416d4253262c9a879a8c1ffa5b8b2880c720f1b,0x0b53c90d1b17398c158e034fc25c15ba04a8184506df3f59720159513c26668a,0x0000000000000000000000000000000000000000000000000000000000000000 12:51:59 [12:51:59.354] VERBOSE: sequencer Preparing proposal for block 2 at slot 3 {"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"chainTipArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","blockNumber":2,"slot":3} 12:51:59 [12:51:59.359] VERBOSE: sequencer Not enough txs to build block 2 at slot 3 (got 0 txs, need 1) {"chainTipArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","blockNumber":2,"slot":3} 12:51:59 [12:51:59.729] INFO: pxe:service Proving completed in 1172.2322560000011ms {"timings":{"total":1172.2322560000011,"sync":10.10334900000089,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":223.40044999999918,"oracles":{"debugLog":{"times":[0.5033519999997225,0.4186339999996562,0.42788199999995413,0.5226800000000367,0.4046620000008261,0.36551200000030803,0.38637999999991735,0.45326399999976275]},"fetchTaggedLogs":{"times":[61.4773839999998]},"loadCapsule":{"times":[0.21739699999852746,0.41601300000002084,0.4042809999991732,0.2583070000000589,0.1652169999997568,0.1896680000008928,0.21091400000113936]},"getSharedSecret":{"times":[6.198518999999578]},"aes128Decrypt":{"times":[0.9907730000013544,0.96240299999954]},"getPublicKeysAndPartialAddress":{"times":[5.784028999998554]},"getKeyValidationRequest":{"times":[1.784750000000713]},"storeCapsule":{"times":[0.4759460000004765,0.26036200000089593,0.21545399999922665]},"deleteCapsule":{"times":[0.3994399999992311]},"validateEnqueuedNotesAndEvents":{"times":[5.176531000000978]},"getNotes":{"times":[1.3653439999998227]},"getAuthWitness":{"times":[0.20794200000091223]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.05429600000024948]},"callPrivateFunction":{"times":[121.0795020000005]}}},{"functionName":"private_kernel_init","time":59.28659400000106},{"functionName":"ContractInstanceDeployer:deploy","time":59.758599000000686,"oracles":{"storeInExecutionCache":{"times":[0.17331600000034086]},"callPrivateFunction":{"times":[61.64526400000068]},"notifyCreatedNullifier":{"times":[0.2426340000001801]},"debugLog":{"times":[0.42644300000029034]}}},{"functionName":"private_kernel_inner","time":106.46022900000025},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":44.63342899999952,"oracles":{}},{"functionName":"private_kernel_inner","time":109.31492700000126},{"functionName":"private_kernel_reset","time":187.8495520000015},{"functionName":"private_kernel_tail","time":69.01489299999957}],"unaccounted":302.4102339999972}} 12:51:59 [12:51:59.768] VERBOSE: p2p:tx_pool Adding tx 0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602 to pool {"eventName":"tx-added-to-pool","txHash":"0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602","noteHashCount":0,"nullifierCount":2,"privateLogCount":1,"classRegisteredCount":0,"contractClassLogSize":0,"proofSize":172052,"size":196240,"feePaymentMethod":"fee_juice"} 12:51:59 [12:51:59.772] INFO: node Received tx 0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602 {"txHash":"0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602"} 12:51:59 [12:51:59.773] INFO: pxe:service Sent transaction 0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602 12:51:59 [12:51:59.872] VERBOSE: sequencer Preparing proposal for block 2 at slot 3 {"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"chainTipArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","blockNumber":2,"slot":3} 12:51:59 [12:51:59.881] VERBOSE: block-builder Building block 2 for slot 3 {"slot":3,"slotStart":"2025-06-13T12:57:38.000Z","now":"2025-06-13T12:57:39.750Z","blockNumber":2,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:51:59 [12:51:59.900] VERBOSE: simulator:public-processor Processed tx 0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602 with no public calls in 12.545554999998785ms {"txHash":"0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602","txFee":1173542320,"revertCode":0,"gasUsed":{"totalGas":{"daGas":9728,"l2Gas":3532},"billedGas":{"daGas":9728,"l2Gas":3532},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":0,"l2Gas":0}},"publicDataWriteCount":1,"nullifierCount":2,"noteHashCount":0,"contractClassLogCount":0,"publicLogCount":0,"privateLogCount":1,"l2ToL1MessageCount":0,"durationMs":12.545554999998785} 12:51:59 [12:51:59.901] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.01886057100000107s {"duration":0.01886057100000107,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":9728,"l2Gas":3532},"totalSizeInBytes":832} 12:51:59 [12:51:59.920] INFO: sequencer Built block 2 for slot 3 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x2e3bbda072b3af5c9fbe4e3e91b697f7216238a44ec27ba0fdbb8d1c303c5d44","globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"txHashes":["0x2acd5cf51852a111fced998c2be4a10bbf106eabb365b676f6736785c428f602"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":44.137823999999455,"publicProcessDuration":19.206389999999374,"rollupCircuitsDuration":39.52691699999923,"txCount":1,"blockNumber":2,"blockTimestamp":1749819458,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:51:59 [12:51:59.922] VERBOSE: sequencer Attesting committee is empty 12:52:00 [12:52:00.083] VERBOSE: node Sent L1 transaction 0x04bd1922e1c36f17b48c18fbeb6f2ae57f2e8eb73b7315bd38bb8c24b4b7466d {"gasLimit":407440,"maxFeePerGas":"1.265272909","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:00 [12:52:00.093] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:00 [12:52:00.094] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0x04bd1922e1c36f17b48c18fbeb6f2ae57f2e8eb73b7315bd38bb8c24b4b7466d","calldataSize":1252,"calldataGas":9952,"txCount":1,"blockNumber":2,"blockTimestamp":1749819458,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:00 [12:52:00.094] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:00 [12:52:00.097] INFO: blob-sink:server Received blob sidecar for block 0x41de21506f23fe1d6ba94f3095c066cb6ffa6f27daab1194763a4e4f647c7a2c 12:52:00 [12:52:00.101] INFO: blob-sink:server Blob sidecar stored successfully for block 0x41de21506f23fe1d6ba94f3095c066cb6ffa6f27daab1194763a4e4f647c7a2c 12:52:00 [12:52:00.164] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 12:52:00 [12:52:00.164] WARN: foundation:test-date-provider Time set to 2025-06-13T12:57:50.000Z {"offset":349836,"timeMs":1749819470000} 12:52:00 [12:52:00.165] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 2 12:52:00 [12:52:00.166] INFO: aztecjs:cheat_codes Proven tip moved: 1 -> 2. Pending tip: 2. 12:52:00 [12:52:00.191] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819494 12:52:00 [12:52:00.192] WARN: foundation:test-date-provider Time set to 2025-06-13T12:58:14.000Z {"offset":373808,"timeMs":1749819494000} 12:52:00 [12:52:00.192] INFO: aztecjs:utils:watcher Slot 3 was filled, jumped to next slot 12:52:00 [12:52:00.326] VERBOSE: archiver:block-helper Store contract instance at 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:52:00 [12:52:00.327] INFO: archiver Downloaded L2 block 2 {"blockHash":"0x2e3bbda072b3af5c9fbe4e3e91b697f7216238a44ec27ba0fdbb8d1c303c5d44","blockNumber":2,"txCount":1,"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"archiveRoot":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","archiveNextLeafIndex":3} 12:52:00 [12:52:00.329] INFO: archiver Updated proven chain to block 2 {"provenBlockNumber":2} 12:52:00 [12:52:00.407] INFO: world_state World state updated with L2 block 2 {"eventName":"l2-block-handled","duration":5.830738000000565,"unfinalisedBlockNumber":2,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":2,"blockTimestamp":1749819458,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:00 [12:52:00.434] VERBOSE: p2p Synched to latest block 2 12:52:00 [12:52:00.618] VERBOSE: sequencer Preparing proposal for block 3 at slot 4 {"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:00 [12:52:00.619] VERBOSE: sequencer Not enough txs to build block 3 at slot 4 (got 0 txs, need 1) {"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:00 [12:52:00.774] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 Applying state transition for manual... 12:52:00 [12:52:00.922] WARN: pxe:service No artifact found for contract class 0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a when looking for its metadata 12:52:00 [12:52:00.925] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a as part of deployment for 0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071 12:52:01 [12:52:01.187] INFO: pxe:service Added contract Parent at 0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071 with class 0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a 12:52:01 [12:52:01.201] VERBOSE: sequencer Preparing proposal for block 3 at slot 4 {"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:01 [12:52:01.208] VERBOSE: sequencer Not enough txs to build block 3 at slot 4 (got 0 txs, need 1) {"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:01 [12:52:01.219] VERBOSE: pxe:service Updated pxe last block to 2 {"blockHash":{},"archive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","header":{"contentCommitment":{"blobsHash":"0x00adb4678c033f90d125522803d570eccdc8a3ba4ad5cbc6db18cfeabbf92c64","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":2,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":3,"timestamp":1749819458,"version":2277307715},"lastArchive":"0x18aaa1a8b92913efbeef85366524881534847f065f6cceeabd3b44cc8788fea6","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x120b3ddf2a8064f4f8b136d4f300d70fbd55f1d64aaedc0e683537876339dce5","publicDataTree":"0x01d2255e2c2ee8b592f0eaa95751fdbc8512d19862ec6e1b488dcb3d28407932"},"totalFees":1173542320,"totalManaUsed":3532}} 12:52:01 [12:52:01.297] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:01 [12:52:01.333] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:01 [12:52:01.333] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:01 [12:52:01.374] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:01 [12:52:01.379] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:52:01 [12:52:01.388] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:52:01 [12:52:01.388] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:52:01 [12:52:01.393] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:52:01 [12:52:01.394] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:52:01 [12:52:01.396] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:01 [12:52:01.401] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:52:01 [12:52:01.413] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:52:01 [12:52:01.463] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:register {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:52:01 [12:52:01.785] VERBOSE: simulator:client_execution_context:debug_log ContractClassRegistered: 0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a,0x1b944d7f90bd88bb0613d690b2a312f5a3547780045de887f4ca3de5b0a5781c,0x021899e7cffbb1ae31bff64e738d354365c960ac8e5132e12b28f31fa882cce2,0x116e467754e7fd162cc4477f2dcf4344f3f77e7aaaa82058462fd53b187dde4c 12:52:01 [12:52:01.857] VERBOSE: simulator:client_execution_context Emitted log from ContractClassRegisterer: "0000000000000000000000000000000000000000000000000000000000000003000000006999d1e02b08a447a463563453cb..." 12:52:01 [12:52:01.981] VERBOSE: simulator:private_execution Executing private function ContractInstanceDeployer:deploy {"contract":"0x0000000000000000000000000000000000000000000000000000000000000002"} 12:52:01 [12:52:01.990] VERBOSE: sequencer Preparing proposal for block 3 at slot 4 {"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:01 [12:52:01.993] VERBOSE: sequencer Not enough txs to build block 3 at slot 4 (got 0 txs, need 1) {"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:02 [12:52:02.029] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:assert_class_id_is_registered {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:52:02 [12:52:02.040] VERBOSE: simulator:client_execution_context:debug_log ContractInstanceDeployed: 0x0000000085864497636cf755ae7bde03f267ce01a520981c21c3682aaf82a631,0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071,0x0000000000000000000000000000000000000000000000000000000000000001,0x2199fa9f65f4e2bbed8b75717273e19a0a426fcc560a765ad1386b1abd2374b0,0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a,0x0000000000000000000000000000000000000000000000000000000000000000,0x01498945581e0eb9f8427ad6021184c700ef091d570892c437d12c7d90364bbd,0x170ae506787c5c43d6ca9255d571c10fa9ffa9d141666e290c347c5c9ab7e344,0x00c044b05b6ca83b9c2dbae79cc1135155956a64e136819136e9947fe5e5866c,0x1c1f0ca244c7cd46b682552bff8ae77dea40b966a71de076ec3b7678f2bdb151,0x1b00316144359e9a3ec8e49c1cdb7eeb0cedd190dfd9dc90eea5115aa779e287,0x080ffc74d7a8b0bccb88ac11f45874172f3847eb8b92654aaa58a3d2b8dc7833,0x019c111f36ad3fc1d9b7a7a14344314d2864b94f030594cd67f753ef774a1efb,0x2039907fe37f08d10739255141bb066c506a12f7d1e8dfec21abc58494705b6f,0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:52:02 [12:52:02.565] VERBOSE: sequencer Preparing proposal for block 3 at slot 4 {"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:02 [12:52:02.678] VERBOSE: sequencer Not enough txs to build block 3 at slot 4 (got 0 txs, need 1) {"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:03 [12:52:03.115] INFO: pxe:service Proving completed in 1908.8571129999982ms {"timings":{"total":1908.8571129999982,"sync":13.907341000000088,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":215.47585400000025,"oracles":{"debugLog":{"times":[0.4511449999990873,0.365245999999388,0.36549399999967136,0.49767699999938486,0.3739949999999226,0.32766300000002957,0.4123270000000048,0.42015299999911804]},"fetchTaggedLogs":{"times":[43.99280100000033]},"loadCapsule":{"times":[0.1961429999992106,0.1503309999989142,0.3187469999993482,0.19705099999919184,0.13677800000004936,0.18867999999929452,0.1821540000000823]},"getSharedSecret":{"times":[2.4911799999990762]},"aes128Decrypt":{"times":[0.19495199999983015,0.8074349999988044]},"getPublicKeysAndPartialAddress":{"times":[1.1366980000002513]},"getKeyValidationRequest":{"times":[1.39513099999931]},"storeCapsule":{"times":[0.27273299999978917,0.2052480000002106,0.17502500000045984]},"deleteCapsule":{"times":[0.19441600000027393]},"validateEnqueuedNotesAndEvents":{"times":[5.534679000000324]},"getNotes":{"times":[1.1587070000005042]},"getAuthWitness":{"times":[0.21547000000100525]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.048264999999446445]},"callPrivateFunction":{"times":[492.0086530000008,137.65575499999977]}}},{"functionName":"private_kernel_init","time":72.63040700000056},{"functionName":"ContractClassRegisterer:register","time":475.3090220000013,"oracles":{"loadCapsule":{"times":[3.619843000000401]},"notifyCreatedNullifier":{"times":[0.27526900000157184]},"debugLog":{"times":[0.41542199999821605]},"notifyCreatedContractClassLog":{"times":[7.754041000000143]}}},{"functionName":"private_kernel_inner","time":108.51240099999995},{"functionName":"ContractInstanceDeployer:deploy","time":83.75237899999775,"oracles":{"storeInExecutionCache":{"times":[0.08092000000033295]},"callPrivateFunction":{"times":[49.342249999997875]},"notifyCreatedNullifier":{"times":[0.2459709999966435]},"debugLog":{"times":[0.4459869999991497]}}},{"functionName":"private_kernel_inner","time":109.13974099999905},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":34.976715000000695,"oracles":{}},{"functionName":"private_kernel_inner","time":111.2669249999999},{"functionName":"private_kernel_reset","time":180.48096599999917},{"functionName":"private_kernel_tail","time":71.10318299999926}],"unaccounted":432.30217900000025}} 12:52:03 [12:52:03.204] VERBOSE: p2p:tx_pool Adding tx 0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf to pool {"eventName":"tx-added-to-pool","txHash":"0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf","noteHashCount":0,"nullifierCount":3,"privateLogCount":1,"classRegisteredCount":1,"contractClassLogSize":260,"proofSize":172052,"size":292848,"feePaymentMethod":"fee_juice"} 12:52:03 [12:52:03.222] INFO: node Received tx 0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf {"txHash":"0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf"} 12:52:03 [12:52:03.222] INFO: pxe:service Sent transaction 0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf 12:52:03 [12:52:03.225] VERBOSE: sequencer Preparing proposal for block 3 at slot 4 {"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"chainTipArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","blockNumber":3,"slot":4} 12:52:03 [12:52:03.234] VERBOSE: block-builder Building block 3 for slot 4 {"slot":4,"slotStart":"2025-06-13T12:58:14.000Z","now":"2025-06-13T12:58:17.042Z","blockNumber":3,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:52:03 [12:52:03.292] VERBOSE: simulator:public-processor Processed tx 0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf with no public calls in 28.17809099999795ms {"txHash":"0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf","txFee":1675254920,"revertCode":0,"gasUsed":{"totalGas":{"daGas":144384,"l2Gas":5042},"billedGas":{"daGas":144384,"l2Gas":5042},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":0,"l2Gas":0}},"publicDataWriteCount":1,"nullifierCount":3,"noteHashCount":0,"contractClassLogCount":1,"publicLogCount":0,"privateLogCount":1,"l2ToL1MessageCount":0,"durationMs":28.17809099999795} 12:52:03 [12:52:03.293] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.057367809999999735s {"duration":0.057367809999999735,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":144384,"l2Gas":5042},"totalSizeInBytes":9280} 12:52:03 [12:52:03.321] INFO: sequencer Built block 3 for slot 4 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x026b9782a4ab7661da108b6f21d8f7bb7dd28c1f8f3a85bc5c824143f1fc4a48","globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"txHashes":["0x1f7c521e018a548cdfa0e59c3cb38db7119a2623f3859f6a29a89cec48c119bf"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":92.49053400000048,"publicProcessDuration":57.75457199999801,"rollupCircuitsDuration":87.52984500000093,"txCount":1,"blockNumber":3,"blockTimestamp":1749819494,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":260} 12:52:03 [12:52:03.324] VERBOSE: sequencer Attesting committee is empty 12:52:03 [12:52:03.505] VERBOSE: node Sent L1 transaction 0x2bcbe5e9c816187af0f7086e7cd615dcb117e5eb11b933cbcac918c075584d13 {"gasLimit":407440,"maxFeePerGas":"1.250105997","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:03 [12:52:03.513] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:03 [12:52:03.514] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0x2bcbe5e9c816187af0f7086e7cd615dcb117e5eb11b933cbcac918c075584d13","calldataSize":1252,"calldataGas":9952,"txCount":1,"blockNumber":3,"blockTimestamp":1749819494,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":260} 12:52:03 [12:52:03.514] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:03 [12:52:03.519] INFO: blob-sink:server Received blob sidecar for block 0xcf4483910afdfe0f6824a1044dd75d097844e82606c045b8562872e6058441a3 12:52:03 [12:52:03.522] INFO: blob-sink:server Blob sidecar stored successfully for block 0xcf4483910afdfe0f6824a1044dd75d097844e82606c045b8562872e6058441a3 12:52:03 [12:52:03.558] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 12:52:03 [12:52:03.558] WARN: foundation:test-date-provider Time set to 2025-06-13T12:58:26.000Z {"offset":382442,"timeMs":1749819506000} 12:52:03 [12:52:03.562] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 3 12:52:03 [12:52:03.563] INFO: aztecjs:cheat_codes Proven tip moved: 2 -> 3. Pending tip: 3. 12:52:03 [12:52:03.572] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819530 12:52:03 [12:52:03.572] WARN: foundation:test-date-provider Time set to 2025-06-13T12:58:50.000Z {"offset":406428,"timeMs":1749819530000} 12:52:03 [12:52:03.572] INFO: aztecjs:utils:watcher Slot 4 was filled, jumped to next slot 12:52:03 [12:52:03.842] VERBOSE: archiver:block-helper Store contract instance at 0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071 12:52:03 [12:52:03.852] VERBOSE: archiver:block-helper Store contract class 0x10b6b3884db5af6bc7625f62213e409ac276ea1cc5830550902030e34b7a3a4a 12:52:03 [12:52:03.869] INFO: archiver Downloaded L2 block 3 {"blockHash":"0x026b9782a4ab7661da108b6f21d8f7bb7dd28c1f8f3a85bc5c824143f1fc4a48","blockNumber":3,"txCount":1,"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"archiveRoot":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","archiveNextLeafIndex":4} 12:52:03 [12:52:03.873] INFO: archiver Updated proven chain to block 3 {"provenBlockNumber":3} 12:52:03 [12:52:03.946] INFO: world_state World state updated with L2 block 3 {"eventName":"l2-block-handled","duration":6.06297899999845,"unfinalisedBlockNumber":3,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":3,"blockTimestamp":1749819494,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":260} 12:52:03 [12:52:03.991] VERBOSE: p2p Synched to latest block 3 12:52:04 [12:52:04.029] VERBOSE: sequencer Preparing proposal for block 4 at slot 5 {"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:04 [12:52:04.030] VERBOSE: sequencer Not enough txs to build block 4 at slot 5 (got 0 txs, need 1) {"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:04 [12:52:04.300] INFO: aztecjs:deploy_sent_tx Contract 0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071 successfully deployed. 12:52:04 [12:52:04.367] WARN: pxe:service No artifact found for contract class 0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8 when looking for its metadata 12:52:04 [12:52:04.371] INFO: aztecjs:contract_interaction Creating request for registering contract class 0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8 as part of deployment for 0x0c25e253ebe8d550c1796230e394429cdee74c35758bf1c9b0efa687decd4c51 12:52:04 [12:52:04.550] INFO: pxe:service Added contract Child at 0x0c25e253ebe8d550c1796230e394429cdee74c35758bf1c9b0efa687decd4c51 with class 0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8 12:52:04 [12:52:04.566] VERBOSE: sequencer Preparing proposal for block 4 at slot 5 {"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:04 [12:52:04.577] VERBOSE: sequencer Not enough txs to build block 4 at slot 5 (got 0 txs, need 1) {"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:04 [12:52:04.584] VERBOSE: pxe:service Updated pxe last block to 3 {"blockHash":{},"archive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","header":{"contentCommitment":{"blobsHash":"0x00f474917533329798bcb8e5c92d736e3eb79b89b591f04dcc779fc5e61fcffd","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":3,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":332260,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":4,"timestamp":1749819494,"version":2277307715},"lastArchive":"0x0f42a6aff91584503d6774218cab19f818fcd20d06833f8826d5ca0152823a16","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x188ec3e3c4f10e8eecd22bfff3267b2bbf06984fc28ac7b9cb725bd83969bde1","publicDataTree":"0x0008d700d295478fd6bb8939f21cbeeb096c4523c8fdf9eda9f624200544e0a1"},"totalFees":1675254920,"totalManaUsed":5042}} 12:52:04 [12:52:04.658] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:04 [12:52:04.694] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:04 [12:52:04.695] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:04 [12:52:04.742] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:04 [12:52:04.746] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:52:04 [12:52:04.755] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:52:04 [12:52:04.756] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:52:04 [12:52:04.762] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:52:04 [12:52:04.763] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:52:04 [12:52:04.765] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:04 [12:52:04.768] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:52:04 [12:52:04.780] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:52:04 [12:52:04.822] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:register {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:52:05 [12:52:05.142] VERBOSE: simulator:client_execution_context:debug_log ContractClassRegistered: 0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8,0x1b538cf4c7ce0bbf69e1522b539720f46bb04b97d03edec8dfc82ae11de2f82c,0x2ce936b9470ef50a2499c9fb9f8d1cdf24650ab6d8f29c95e8c9993555d68130,0x0dff2f9dedc2b93ae3827754471296d5aee7f778c7a6b9f9951d146d26e234f5 12:52:05 [12:52:05.213] VERBOSE: simulator:client_execution_context Emitted log from ContractClassRegisterer: "0000000000000000000000000000000000000000000000000000000000000003000000006999d1e02b08a447a463563453cb..." 12:52:05 [12:52:05.340] VERBOSE: simulator:private_execution Executing private function ContractInstanceDeployer:deploy {"contract":"0x0000000000000000000000000000000000000000000000000000000000000002"} 12:52:05 [12:52:05.347] VERBOSE: sequencer Preparing proposal for block 4 at slot 5 {"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:05 [12:52:05.353] VERBOSE: sequencer Not enough txs to build block 4 at slot 5 (got 0 txs, need 1) {"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:05 [12:52:05.389] VERBOSE: simulator:private_execution Executing private function ContractClassRegisterer:assert_class_id_is_registered {"contract":"0x0000000000000000000000000000000000000000000000000000000000000003"} 12:52:05 [12:52:05.399] VERBOSE: simulator:client_execution_context:debug_log ContractInstanceDeployed: 0x0000000085864497636cf755ae7bde03f267ce01a520981c21c3682aaf82a631,0x0c25e253ebe8d550c1796230e394429cdee74c35758bf1c9b0efa687decd4c51,0x0000000000000000000000000000000000000000000000000000000000000001,0x2b3169abedeee6afea9af952972e640f2342e13cf856618c7becc96c75530fed,0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8,0x0000000000000000000000000000000000000000000000000000000000000000,0x01498945581e0eb9f8427ad6021184c700ef091d570892c437d12c7d90364bbd,0x170ae506787c5c43d6ca9255d571c10fa9ffa9d141666e290c347c5c9ab7e344,0x00c044b05b6ca83b9c2dbae79cc1135155956a64e136819136e9947fe5e5866c,0x1c1f0ca244c7cd46b682552bff8ae77dea40b966a71de076ec3b7678f2bdb151,0x1b00316144359e9a3ec8e49c1cdb7eeb0cedd190dfd9dc90eea5115aa779e287,0x080ffc74d7a8b0bccb88ac11f45874172f3847eb8b92654aaa58a3d2b8dc7833,0x019c111f36ad3fc1d9b7a7a14344314d2864b94f030594cd67f753ef774a1efb,0x2039907fe37f08d10739255141bb066c506a12f7d1e8dfec21abc58494705b6f,0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a 12:52:06 [12:52:06.006] VERBOSE: sequencer Preparing proposal for block 4 at slot 5 {"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:06 [12:52:06.120] VERBOSE: sequencer Not enough txs to build block 4 at slot 5 (got 0 txs, need 1) {"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:06 [12:52:06.370] INFO: pxe:service Proving completed in 1799.4043300000012ms {"timings":{"total":1799.4043300000012,"sync":14.572576999999,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":218.12330099999963,"oracles":{"debugLog":{"times":[0.46810200000254554,0.3887899999972433,0.3925699999999779,0.4834069999997155,0.3855330000005779,0.3207349999975122,0.33859600000141654,0.4407040000005509]},"fetchTaggedLogs":{"times":[49.85830899999928]},"loadCapsule":{"times":[0.18552599999748054,0.17919400000027963,0.3110430000015185,0.20628500000020722,0.13483700000142562,0.15793000000121538,0.19133299999884912]},"getSharedSecret":{"times":[2.5493920000008075]},"aes128Decrypt":{"times":[0.22902500000054715,0.8566170000012789]},"getPublicKeysAndPartialAddress":{"times":[2.9643700000015087]},"getKeyValidationRequest":{"times":[1.2551120000025549]},"storeCapsule":{"times":[0.2573240000019723,0.19951900000160094,0.31806700000015553]},"deleteCapsule":{"times":[0.19196199999714736]},"validateEnqueuedNotesAndEvents":{"times":[3.896624000000884]},"getNotes":{"times":[1.1227490000019316]},"getAuthWitness":{"times":[0.19983800000045449]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.05550100000255043]},"callPrivateFunction":{"times":[480.3091090000016,140.79363899999953]}}},{"functionName":"private_kernel_init","time":53.47549699999945},{"functionName":"ContractClassRegisterer:register","time":463.6110929999995,"oracles":{"loadCapsule":{"times":[3.2413129999986268]},"notifyCreatedNullifier":{"times":[0.2666560000034224]},"debugLog":{"times":[0.46526799999992363]},"notifyCreatedContractClassLog":{"times":[7.349204999998619]}}},{"functionName":"private_kernel_inner","time":104.96205099999861},{"functionName":"ContractInstanceDeployer:deploy","time":83.06166500000108,"oracles":{"storeInExecutionCache":{"times":[0.07164299999931245]},"callPrivateFunction":{"times":[50.664388999997755]},"notifyCreatedNullifier":{"times":[0.26769599999897764]},"debugLog":{"times":[0.4560219999984838]}}},{"functionName":"private_kernel_inner","time":107.43823599999814},{"functionName":"ContractClassRegisterer:assert_class_id_is_registered","time":37.18104999999923,"oracles":{}},{"functionName":"private_kernel_inner","time":107.71574099999998},{"functionName":"private_kernel_reset","time":179.6498270000011},{"functionName":"private_kernel_tail","time":70.45904299999893}],"unaccounted":359.15424900000653}} 12:52:06 [12:52:06.447] VERBOSE: p2p:tx_pool Adding tx 0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e to pool {"eventName":"tx-added-to-pool","txHash":"0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e","noteHashCount":0,"nullifierCount":3,"privateLogCount":1,"classRegisteredCount":1,"contractClassLogSize":145,"proofSize":172052,"size":292848,"feePaymentMethod":"fee_juice"} 12:52:06 [12:52:06.461] INFO: node Received tx 0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e {"txHash":"0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e"} 12:52:06 [12:52:06.461] INFO: pxe:service Sent transaction 0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e 12:52:06 [12:52:06.639] VERBOSE: sequencer Preparing proposal for block 4 at slot 5 {"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"chainTipArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","blockNumber":4,"slot":5} 12:52:06 [12:52:06.652] VERBOSE: block-builder Building block 4 for slot 5 {"slot":5,"slotStart":"2025-06-13T12:58:50.000Z","now":"2025-06-13T12:58:53.080Z","blockNumber":4,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:52:06 [12:52:06.695] VERBOSE: simulator:public-processor Processed tx 0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e with no public calls in 21.50317499999801ms {"txHash":"0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e","txFee":162251560,"revertCode":0,"gasUsed":{"totalGas":{"daGas":85504,"l2Gas":5042},"billedGas":{"daGas":85504,"l2Gas":5042},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":0,"l2Gas":0}},"publicDataWriteCount":1,"nullifierCount":3,"noteHashCount":0,"contractClassLogCount":1,"publicLogCount":0,"privateLogCount":1,"l2ToL1MessageCount":0,"durationMs":21.50317499999801} 12:52:06 [12:52:06.698] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.044148767000002406s {"duration":0.044148767000002406,"rate":0,"totalPublicGas":{"daGas":0,"l2Gas":0},"totalBlockGas":{"daGas":85504,"l2Gas":5042},"totalSizeInBytes":5600} 12:52:06 [12:52:06.723] INFO: sequencer Built block 4 for slot 5 with 1 txs and 0 messages. 0 mana/s {"blockHash":"0x17744a8526b30ccb0ec0db11c8c6c7ea276066a8ac24807ad2ac68374ff0e7af","globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"txHashes":["0x0b5c1365e02c24c34066de1dfe931e4ffdf595873dc363478abf64f7c19c085e"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":75.63802299999952,"publicProcessDuration":44.48761200000081,"rollupCircuitsDuration":71.11576599999898,"txCount":1,"blockNumber":4,"blockTimestamp":1749819530,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":145} 12:52:06 [12:52:06.725] VERBOSE: sequencer Attesting committee is empty 12:52:06 [12:52:06.896] VERBOSE: node Sent L1 transaction 0xcd997e20afd7b16ec1a3337c598005f15ca64aace8b016143b80c783241ae256 {"gasLimit":407438,"maxFeePerGas":"1.238463289","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:06 [12:52:06.907] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:06 [12:52:06.908] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0xcd997e20afd7b16ec1a3337c598005f15ca64aace8b016143b80c783241ae256","calldataSize":1252,"calldataGas":9940,"txCount":1,"blockNumber":4,"blockTimestamp":1749819530,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":145} 12:52:06 [12:52:06.908] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:06 [12:52:06.910] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819566 12:52:06 [12:52:06.910] WARN: foundation:test-date-provider Time set to 2025-06-13T12:59:26.000Z {"offset":439090,"timeMs":1749819566000} 12:52:06 [12:52:06.910] INFO: aztecjs:utils:watcher Slot 5 was filled, jumped to next slot 12:52:06 [12:52:06.912] INFO: blob-sink:server Received blob sidecar for block 0x53f4ba36a79ca2082e57b1ba7010d4d5f7a713fe3973eed0e5cf2d662034fdd7 12:52:06 [12:52:06.915] INFO: blob-sink:server Blob sidecar stored successfully for block 0x53f4ba36a79ca2082e57b1ba7010d4d5f7a713fe3973eed0e5cf2d662034fdd7 12:52:07 [12:52:07.096] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 4 12:52:07 [12:52:07.098] INFO: aztecjs:cheat_codes Proven tip moved: 3 -> 4. Pending tip: 4. 12:52:07 [12:52:07.210] VERBOSE: archiver:block-helper Store contract instance at 0x0c25e253ebe8d550c1796230e394429cdee74c35758bf1c9b0efa687decd4c51 12:52:07 [12:52:07.216] VERBOSE: archiver:block-helper Store contract class 0x086bb2034696e868dc9e6889d8a4df63942b0e5cacba9aacf9ffff6e710e6ae8 12:52:07 [12:52:07.227] INFO: archiver Downloaded L2 block 4 {"blockHash":"0x17744a8526b30ccb0ec0db11c8c6c7ea276066a8ac24807ad2ac68374ff0e7af","blockNumber":4,"txCount":1,"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"archiveRoot":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","archiveNextLeafIndex":5} 12:52:07 [12:52:07.231] INFO: archiver Updated proven chain to block 4 {"provenBlockNumber":4} 12:52:07 [12:52:07.314] INFO: world_state World state updated with L2 block 4 {"eventName":"l2-block-handled","duration":5.759136000000581,"unfinalisedBlockNumber":4,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":4,"blockTimestamp":1749819530,"privateLogCount":1,"publicLogCount":0,"contractClassLogCount":1,"contractClassLogSize":145} 12:52:07 [12:52:07.345] VERBOSE: p2p Synched to latest block 4 12:52:07 [12:52:07.426] VERBOSE: sequencer Preparing proposal for block 5 at slot 6 {"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"chainTipArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","blockNumber":5,"slot":6} 12:52:07 [12:52:07.427] VERBOSE: sequencer Not enough txs to build block 5 at slot 6 (got 0 txs, need 1) {"chainTipArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","blockNumber":5,"slot":6} 12:52:07 [12:52:07.494] INFO: aztecjs:deploy_sent_tx Contract 0x0c25e253ebe8d550c1796230e394429cdee74c35758bf1c9b0efa687decd4c51 successfully deployed. 12:52:07 [12:52:07.494] VERBOSE: e2e:snapshot_manager:e2e_nested_contract/manual-1 State transition for manual complete. 12:52:07 [12:52:07.612] INFO: e2e:manual_public Running test: e2e_nested_contract manual performs public nested calls 12:52:07 [12:52:07.635] VERBOSE: pxe:service Updated pxe last block to 4 {"blockHash":{},"archive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","header":{"contentCommitment":{"blobsHash":"0x001da5d0f4cc46ee553fbffdb3e19eb8c4350f2a9503a2d5de665306d0f8a254","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":4,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":5,"timestamp":1749819530,"version":2277307715},"lastArchive":"0x027efd1a4747cc3bc7ebfe6ba75ba9543a87eb8a86d8831ed095776857e0d27b","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x1f3443a18842f74d6e9ed112a443af1d13c6aad5d76d5a941219ff871a388666","publicDataTree":"0x004459a38ee4c4bf133f8bf2be88f24d47e7b83627959b92a645f8c9d526d217"},"totalFees":162251560,"totalManaUsed":5042}} 12:52:07 [12:52:07.708] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:07 [12:52:07.744] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:07 [12:52:07.744] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:07 [12:52:07.796] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:07 [12:52:07.800] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:52:07 [12:52:07.809] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:52:07 [12:52:07.809] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:52:07 [12:52:07.814] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:52:07 [12:52:07.815] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:52:07 [12:52:07.817] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:07 [12:52:07.824] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:52:07 [12:52:07.836] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:52:08 [12:52:08.251] INFO: pxe:service Proving completed in 622.6390780000002ms {"timings":{"total":622.6390780000002,"sync":8.108792999999423,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":185.66728299999886,"oracles":{"debugLog":{"times":[0.43488000000070315,0.36010299999907147,0.3891220000004978,0.5199899999970512,0.39180800000031013,0.33998499999870546,0.29504199999792036,0.4157749999976659]},"fetchTaggedLogs":{"times":[53.97815100000298]},"loadCapsule":{"times":[0.16901200000211247,0.1384939999989001,0.35297199999695295,0.19301699999778066,0.14671799999996438,0.14073500000085915,0.17688300000008894]},"getSharedSecret":{"times":[2.423844000000827]},"aes128Decrypt":{"times":[0.2231339999998454,0.8265819999978703]},"getPublicKeysAndPartialAddress":{"times":[1.2283839999981865]},"getKeyValidationRequest":{"times":[1.2101140000013402]},"storeCapsule":{"times":[0.2796870000020135,0.19115400000009686,0.16284400000222377]},"deleteCapsule":{"times":[0.173651000000973]},"validateEnqueuedNotesAndEvents":{"times":[8.803067000000738]},"getNotes":{"times":[1.0241249999999127]},"getAuthWitness":{"times":[0.20644899999751942]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.05019999999785796]},"notifyEnqueuedPublicFunctionCall":{"times":[0.1938350000018545]}}},{"functionName":"private_kernel_init","time":57.67700699999841},{"functionName":"private_kernel_reset","time":179.99417800000083},{"functionName":"private_kernel_tail","time":87.40557600000102}],"unaccounted":103.78624100000161}} 12:52:08 [12:52:08.311] VERBOSE: p2p:tx_pool Adding tx 0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df to pool {"eventName":"tx-added-to-pool","txHash":"0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df","noteHashCount":0,"nullifierCount":1,"privateLogCount":0,"classRegisteredCount":0,"contractClassLogSize":0,"proofSize":172052,"size":226105,"feePaymentMethod":"fee_juice"} 12:52:08 [12:52:08.314] VERBOSE: sequencer Preparing proposal for block 5 at slot 6 {"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"chainTipArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","blockNumber":5,"slot":6} 12:52:08 [12:52:08.321] INFO: node Received tx 0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df {"txHash":"0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df"} 12:52:08 [12:52:08.321] INFO: pxe:service Sent transaction 0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df 12:52:08 [12:52:08.322] VERBOSE: sequencer Not enough txs to build block 5 at slot 6 (got 0 txs, need 1) {"chainTipArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","blockNumber":5,"slot":6} 12:52:08 [12:52:08.841] VERBOSE: sequencer Preparing proposal for block 5 at slot 6 {"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"chainTipArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","blockNumber":5,"slot":6} 12:52:08 [12:52:08.856] VERBOSE: block-builder Building block 5 for slot 6 {"slot":6,"slotStart":"2025-06-13T12:59:26.000Z","now":"2025-06-13T12:59:27.946Z","blockNumber":5,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:52:08 [12:52:08.910] VERBOSE: simulator:public_tx_simulator Simulation of enqueued public call 0x6efc2c54 completed successfully. {"eventName":"avm-simulation","appCircuitName":"0x6efc2c54","duration":34.11298400000305} 12:52:08 [12:52:08.930] VERBOSE: simulator:public-processor Processed tx 0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df with 1 public calls in 62.543563999999606ms {"txHash":"0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df","txFee":907733440,"revertCode":0,"gasUsed":{"totalGas":{"daGas":1024,"l2Gas":28208},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":0,"l2Gas":6186},"billedGas":{"daGas":1024,"l2Gas":28208}},"publicDataWriteCount":1,"nullifierCount":1,"noteHashCount":0,"contractClassLogCount":0,"publicLogCount":0,"privateLogCount":0,"l2ToL1MessageCount":0,"durationMs":62.543563999999606} 12:52:08 [12:52:08.932] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.07404552299999705s {"duration":0.07404552299999705,"rate":83543.20084956719,"totalPublicGas":{"daGas":0,"l2Gas":6186},"totalBlockGas":{"daGas":1024,"l2Gas":28208},"totalSizeInBytes":256} 12:52:08 [12:52:08.953] INFO: sequencer Built block 5 for slot 6 with 1 txs and 0 messages. 60611.26014944649 mana/s {"blockHash":"0x0d65ed6f9deb612d497442779b019f2a2b42fa26574db812be537314ba1ba264","globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"txHashes":["0x187d4c3de1325f681174631bcb89a168ab9e6a507286b1277e7c16b65c8a37df"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":102.03080100000079,"publicProcessDuration":74.86354100000244,"rollupCircuitsDuration":97.31720499999938,"txCount":1,"blockNumber":5,"blockTimestamp":1749819566,"privateLogCount":0,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:08 [12:52:08.955] VERBOSE: sequencer Attesting committee is empty 12:52:09 [12:52:09.100] VERBOSE: node Sent L1 transaction 0x0e2ffb3522d0f1b3be78530dfed3a56139e68cff99624bf656218e9e5e62393d {"gasLimit":407467,"maxFeePerGas":"1.229525901","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:09 [12:52:09.109] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:09 [12:52:09.109] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0x0e2ffb3522d0f1b3be78530dfed3a56139e68cff99624bf656218e9e5e62393d","calldataSize":1252,"calldataGas":9964,"txCount":1,"blockNumber":5,"blockTimestamp":1749819566,"privateLogCount":0,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:09 [12:52:09.109] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:09 [12:52:09.112] INFO: blob-sink:server Received blob sidecar for block 0xd8e834a9924325b05c6bc31307a3624f0988ee90cb50dabe76fd0d9ae6532ec6 12:52:09 [12:52:09.115] INFO: blob-sink:server Blob sidecar stored successfully for block 0xd8e834a9924325b05c6bc31307a3624f0988ee90cb50dabe76fd0d9ae6532ec6 12:52:09 [12:52:09.144] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819602 12:52:09 [12:52:09.144] WARN: foundation:test-date-provider Time set to 2025-06-13T13:00:02.000Z {"offset":472856,"timeMs":1749819602000} 12:52:09 [12:52:09.145] INFO: aztecjs:utils:watcher Slot 6 was filled, jumped to next slot 12:52:09 [12:52:09.303] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 5 12:52:09 [12:52:09.304] INFO: aztecjs:cheat_codes Proven tip moved: 4 -> 5. Pending tip: 5. 12:52:09 [12:52:09.402] INFO: archiver Downloaded L2 block 5 {"blockHash":"0x0d65ed6f9deb612d497442779b019f2a2b42fa26574db812be537314ba1ba264","blockNumber":5,"txCount":1,"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"archiveRoot":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","archiveNextLeafIndex":6} 12:52:09 [12:52:09.403] INFO: archiver Updated proven chain to block 5 {"provenBlockNumber":5} 12:52:09 [12:52:09.417] INFO: world_state World state updated with L2 block 5 {"eventName":"l2-block-handled","duration":7.0095410000030824,"unfinalisedBlockNumber":5,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":5,"blockTimestamp":1749819566,"privateLogCount":0,"publicLogCount":0,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:09 [12:52:09.421] VERBOSE: p2p Synched to latest block 5 12:52:09 [12:52:09.626] VERBOSE: sequencer Preparing proposal for block 6 at slot 7 {"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"chainTipArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","blockNumber":6,"slot":7} 12:52:09 [12:52:09.628] VERBOSE: sequencer Not enough txs to build block 6 at slot 7 (got 0 txs, need 1) {"chainTipArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","blockNumber":6,"slot":7} 12:52:10 [12:52:10.141] VERBOSE: sequencer Preparing proposal for block 6 at slot 7 {"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"chainTipArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","blockNumber":6,"slot":7} 12:52:10 [12:52:10.142] VERBOSE: sequencer Not enough txs to build block 6 at slot 7 (got 0 txs, need 1) {"chainTipArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","blockNumber":6,"slot":7} 12:52:10 [12:52:10.325] INFO: e2e:manual_public Running test: e2e_nested_contract manual reads fresh value after write within the same tx 12:52:10 [12:52:10.342] VERBOSE: pxe:service Updated pxe last block to 5 {"blockHash":{},"archive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","header":{"contentCommitment":{"blobsHash":"0x002e2e647fbd3817372b712bef0f152c7bf260d866189c4ba0a636957bacd63d","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":5,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":6,"timestamp":1749819566,"version":2277307715},"lastArchive":"0x198684412c860a77c85001acfa8e959a379a68b4a21563a7d450d9154808279e","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x15ab0f8390ba83b4a4a771861c9ee4fe7d355428e30a3f29c474a1dd33aec600","publicDataTree":"0x155362bede7c7d2e0bb8effea0637f44f2e9409218ae1578b1831fe13f4aefbe"},"totalFees":907733440,"totalManaUsed":28208}} 12:52:10 [12:52:10.417] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:10 [12:52:10.456] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:10 [12:52:10.456] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:10 [12:52:10.506] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:10 [12:52:10.510] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:52:10 [12:52:10.522] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:52:10 [12:52:10.523] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:52:10 [12:52:10.527] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:52:10 [12:52:10.528] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:52:10 [12:52:10.530] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:10 [12:52:10.533] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:52:10 [12:52:10.544] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:52:10 [12:52:10.959] INFO: pxe:service Proving completed in 621.940977000002ms {"timings":{"total":621.940977000002,"sync":6.795210000000225,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":187.26772800000253,"oracles":{"debugLog":{"times":[0.43002700000215555,0.3721759999971255,0.38201399999888963,0.4719629999999597,0.3960449999976845,0.3197389999986626,0.32541499999933876,0.445821999997861]},"fetchTaggedLogs":{"times":[51.805145999998786]},"loadCapsule":{"times":[0.22895100000096136,0.13835000000108266,0.31549399999857997,0.18186399999831337,0.19401699999798439,0.14662099999986822,0.18754400000034366]},"getSharedSecret":{"times":[5.54003499999817]},"aes128Decrypt":{"times":[0.3953849999998056,1.0192859999988286]},"getPublicKeysAndPartialAddress":{"times":[1.1654620000008435]},"getKeyValidationRequest":{"times":[1.1787069999991218]},"storeCapsule":{"times":[0.2830690000009781,0.1986510000024282,0.18132300000070245]},"deleteCapsule":{"times":[0.19104700000025332]},"validateEnqueuedNotesAndEvents":{"times":[3.477576000001136]},"getNotes":{"times":[0.9725740000030783]},"getAuthWitness":{"times":[0.197678000000451]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.05234700000073644]},"notifyEnqueuedPublicFunctionCall":{"times":[0.055649000001722015]}}},{"functionName":"private_kernel_init","time":59.49203800000032},{"functionName":"private_kernel_reset","time":178.01713599999857},{"functionName":"private_kernel_tail","time":86.54385100000218}],"unaccounted":103.82501399999819}} 12:52:11 [12:52:11.015] VERBOSE: p2p:tx_pool Adding tx 0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7 to pool {"eventName":"tx-added-to-pool","txHash":"0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7","noteHashCount":0,"nullifierCount":1,"privateLogCount":0,"classRegisteredCount":0,"contractClassLogSize":0,"proofSize":172052,"size":226105,"feePaymentMethod":"fee_juice"} 12:52:11 [12:52:11.023] VERBOSE: sequencer Preparing proposal for block 6 at slot 7 {"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"chainTipArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","blockNumber":6,"slot":7} 12:52:11 [12:52:11.024] INFO: node Received tx 0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7 {"txHash":"0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7"} 12:52:11 [12:52:11.024] INFO: pxe:service Sent transaction 0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7 12:52:11 [12:52:11.034] VERBOSE: block-builder Building block 6 for slot 7 {"slot":7,"slotStart":"2025-06-13T13:00:02.000Z","now":"2025-06-13T13:00:03.890Z","blockNumber":6,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:52:11 [12:52:11.086] VERBOSE: simulator:public_tx_simulator Simulation of enqueued public call 0x132874f5 completed successfully. {"eventName":"avm-simulation","appCircuitName":"0x132874f5","duration":35.019930999998905} 12:52:11 [12:52:11.103] VERBOSE: simulator:public-processor Processed tx 0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7 with 1 public calls in 58.71275400000013ms {"txHash":"0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7","txFee":1148665100,"revertCode":0,"gasUsed":{"totalGas":{"daGas":3072,"l2Gas":35695},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":2048,"l2Gas":13673},"billedGas":{"daGas":3072,"l2Gas":35695}},"publicDataWriteCount":2,"nullifierCount":1,"noteHashCount":0,"contractClassLogCount":0,"publicLogCount":2,"privateLogCount":0,"l2ToL1MessageCount":0,"durationMs":58.71275400000013} 12:52:11 [12:52:11.105] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.06859227100000134s {"duration":0.06859227100000134,"rate":199337.32767063117,"totalPublicGas":{"daGas":2048,"l2Gas":13673},"totalBlockGas":{"daGas":3072,"l2Gas":35695},"totalSizeInBytes":544} 12:52:11 [12:52:11.125] INFO: sequencer Built block 6 for slot 7 with 1 txs and 0 messages. 142789.4159384503 mana/s {"blockHash":"0x2dee4535b4bc0cbbc3e81bb2803badac13196a3b0d64e5a6eef1d228c1cf9c59","globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"txHashes":["0x27e9abdeb7f0020f9963e1776dee4ec6581dd229462a983f93dad27175fc76a7"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":95.72904699999708,"publicProcessDuration":68.92600700000185,"rollupCircuitsDuration":91.1574870000004,"txCount":1,"blockNumber":6,"blockTimestamp":1749819602,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:11 [12:52:11.127] VERBOSE: sequencer Attesting committee is empty 12:52:11 [12:52:11.278] VERBOSE: node Sent L1 transaction 0x4b3b610b4558fd9af61065217145ac1b0f24e09a93318b0f680b90780cdc9066 {"gasLimit":407467,"maxFeePerGas":"1.222665222","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:11 [12:52:11.290] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:11 [12:52:11.290] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0x4b3b610b4558fd9af61065217145ac1b0f24e09a93318b0f680b90780cdc9066","calldataSize":1252,"calldataGas":9964,"txCount":1,"blockNumber":6,"blockTimestamp":1749819602,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:11 [12:52:11.290] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:11 [12:52:11.292] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819638 12:52:11 [12:52:11.292] WARN: foundation:test-date-provider Time set to 2025-06-13T13:00:38.000Z {"offset":506708,"timeMs":1749819638000} 12:52:11 [12:52:11.292] INFO: aztecjs:utils:watcher Slot 7 was filled, jumped to next slot 12:52:11 [12:52:11.293] INFO: blob-sink:server Received blob sidecar for block 0xe85f9b709afb4a4ce0b60a78ba6ad30ce69c0e8f81121cd58e321dbab700af37 12:52:11 [12:52:11.297] INFO: blob-sink:server Blob sidecar stored successfully for block 0xe85f9b709afb4a4ce0b60a78ba6ad30ce69c0e8f81121cd58e321dbab700af37 12:52:11 [12:52:11.479] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 6 12:52:11 [12:52:11.482] INFO: aztecjs:cheat_codes Proven tip moved: 5 -> 6. Pending tip: 6. 12:52:11 [12:52:11.580] INFO: archiver Downloaded L2 block 6 {"blockHash":"0x2dee4535b4bc0cbbc3e81bb2803badac13196a3b0d64e5a6eef1d228c1cf9c59","blockNumber":6,"txCount":1,"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"archiveRoot":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","archiveNextLeafIndex":7} 12:52:11 [12:52:11.581] INFO: archiver Updated proven chain to block 6 {"provenBlockNumber":6} 12:52:11 [12:52:11.592] INFO: world_state World state updated with L2 block 6 {"eventName":"l2-block-handled","duration":5.972003999999288,"unfinalisedBlockNumber":6,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":6,"blockTimestamp":1749819602,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:11 [12:52:11.599] VERBOSE: p2p Synched to latest block 6 12:52:11 [12:52:11.806] VERBOSE: sequencer Preparing proposal for block 7 at slot 8 {"globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:11 [12:52:11.809] VERBOSE: sequencer Not enough txs to build block 7 at slot 8 (got 0 txs, need 1) {"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:12 [12:52:12.028] INFO: e2e:manual_public Running test: e2e_nested_contract manual executes public calls in expected order 12:52:12 [12:52:12.045] VERBOSE: pxe:service Updated pxe last block to 6 {"blockHash":{},"archive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","header":{"contentCommitment":{"blobsHash":"0x00cf4309701d06e8fb346f4bbc0abbc9a624ff8353fe56b7b5ace65252ca9828","inHash":"0x00089a9d421a82c4a25f7acbebe69e638d5b064fa8a60e018793dcb0be53752c","outHash":"0x0000000000000000000000000000000000000000000000000000000000000000"},"globalVariables":{"blockNumber":6,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":7,"timestamp":1749819602,"version":2277307715},"lastArchive":"0x187701f61cc0d8829063d91a9859e99cd4707cbcca767964d5ab9397d8c1958c","state":{"l1ToL2MessageTree":"0x2e33ee2008411c04b99c24b313513d097a0d21a5040b6193d1f978b8226892d6","noteHashTree":"0x098ef4a797eb3c5b60e1f1fafc83daae65e4e610f58a4402021ed652807f0ff8","nullifierTree":"0x0292eddd35612b70566aa6bc37f34cbc5c54f3204ce25ce9da701ab2c96f1f6a","publicDataTree":"0x0272b46b925126e6a7917ec35007c2cac44f678c21403f8b6d5047511afa3ce4"},"totalFees":1148665100,"totalManaUsed":35695}} 12:52:12 [12:52:12.121] VERBOSE: simulator:private_execution Executing private function SchnorrAccount:entrypoint {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:12 [12:52:12.160] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:12 [12:52:12.160] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:12 [12:52:12.210] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a"} 12:52:12 [12:52:12.214] VERBOSE: simulator:client_execution_context:debug_log Processing log with tag 0x06a058f40e14e14c1da945782211b2da597ac45418703e59f66ba640ba467075 12:52:12 [12:52:12.222] VERBOSE: simulator:client_execution_context:debug_log Processing private note msg 12:52:12 [12:52:12.223] VERBOSE: simulator:client_execution_context:debug_log Attempting nonce discovery on 0x0000000000000000000000000000000000000000000000000000000000000001 potential notes on contract 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a for storage slot 0x0000000000000000000000000000000000000000000000000000000000000001 12:52:12 [12:52:12.228] VERBOSE: simulator:client_execution_context:debug_log Discovered a total of 0x0000000000000000000000000000000000000000000000000000000000000001 notes 12:52:12 [12:52:12.228] VERBOSE: simulator:client_execution_context:debug_log Discovered 0x0000000000000000000000000000000000000000000000000000000000000001 notes from a private message 12:52:12 [12:52:12.231] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:12 [12:52:12.234] VERBOSE: pxe:service Added note {"index":0,"contract":"0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a","slot":"0x0000000000000000000000000000000000000000000000000000000000000001","noteHash":"0x2a3dc40ffe2a3201fb0c5dc9288768a8c9a5fc0b403f8b68e9448489275fab5d","nullifier":"0x15f3e9635a5b5678c61fec9645de33c384a0e481541b52a4712d415cf39d303b"} 12:52:12 [12:52:12.245] VERBOSE: simulator:client_execution_context:debug_log Setting 0x0eb46f964fd72c68998cf509e6101751fb8e50e973550fb217659187442daf1a as fee payer 12:52:12 [12:52:12.402] VERBOSE: simulator:private_execution Executing private function Parent:enqueue_call_to_child {"contract":"0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071"} 12:52:12 [12:52:12.416] VERBOSE: simulator:client_execution_context:debug_log Performing message discovery 12:52:12 [12:52:12.416] VERBOSE: pxe:service Searching for tagged logs {"contract":"0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071"} 12:52:12 [12:52:12.491] VERBOSE: sequencer Preparing proposal for block 7 at slot 8 {"globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:12 [12:52:12.492] VERBOSE: sequencer Not enough txs to build block 7 at slot 8 (got 0 txs, need 1) {"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:12 [12:52:12.496] VERBOSE: pxe:service Searching for nullifiers of known notes {"contract":"0x2546edb14a989acb0cfbfcfeb2d8339a4a27fe4d4dd13432182df5ceaf253071"} 12:52:12 [12:52:12.499] VERBOSE: simulator:client_execution_context:debug_log 0x0000000000000000000000000000000000000000000000000000000000000000 pending partial notes 12:52:13 [12:52:13.318] INFO: pxe:service Proving completed in 1277.299028999998ms {"timings":{"total":1277.299028999998,"sync":5.465148999999656,"perFunction":[{"functionName":"SchnorrAccount:entrypoint","time":237.4317979999978,"oracles":{"debugLog":{"times":[0.5102550000010524,0.3607110000011744,0.4000530000012077,0.46913300000232994,0.3932390000009036,0.32265900000129477,0.33262099999774364,0.4669880000001285]},"fetchTaggedLogs":{"times":[51.91997700000138]},"loadCapsule":{"times":[0.19594000000142842,0.13454499999716063,0.3492499999993015,0.20255900000120164,0.14438000000154716,0.20084499999938998,0.17120900000008987]},"getSharedSecret":{"times":[2.3534879999970144]},"aes128Decrypt":{"times":[0.20702300000266405,0.8040070000024571]},"getPublicKeysAndPartialAddress":{"times":[1.1126979999971809]},"getKeyValidationRequest":{"times":[1.1478989999995974]},"storeCapsule":{"times":[0.3830180000004475,0.20058599999902071,0.17628200000035577]},"deleteCapsule":{"times":[0.20219100000031176]},"validateEnqueuedNotesAndEvents":{"times":[3.4777819999981148]},"getNotes":{"times":[1.0665909999988799]},"getAuthWitness":{"times":[0.20702900000105728]},"notifySetMinRevertibleSideEffectCounter":{"times":[0.05592700000124751]},"notifyEnqueuedPublicFunctionCall":{"times":[0.061642000000574626]},"callPrivateFunction":{"times":[258.3337279999978]}}},{"functionName":"private_kernel_init","time":54.20825899999909},{"functionName":"Parent:enqueue_call_to_child","time":203.1154319999987,"oracles":{"debugLog":{"times":[0.4169389999988198,0.3527310000026773]},"fetchTaggedLogs":{"times":[81.78189199999906]},"loadCapsule":{"times":[0.17253399999754038,0.16365500000028987,0.17340800000238232]},"validateEnqueuedNotesAndEvents":{"times":[1.1138780000001134]},"storeInExecutionCache":{"times":[0.07056699999884586]},"notifyEnqueuedPublicFunctionCall":{"times":[0.047854000000370434]}}},{"functionName":"private_kernel_inner","time":105.62474799999836},{"functionName":"private_kernel_reset","time":180.19354999999996},{"functionName":"private_kernel_tail","time":84.32947899999999}],"unaccounted":406.9306140000044}} 12:52:13 [12:52:13.371] VERBOSE: sequencer Preparing proposal for block 7 at slot 8 {"globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:13 [12:52:13.375] VERBOSE: p2p:tx_pool Adding tx 0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac to pool {"eventName":"tx-added-to-pool","txHash":"0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac","noteHashCount":0,"nullifierCount":1,"privateLogCount":0,"classRegisteredCount":0,"contractClassLogSize":0,"proofSize":172052,"size":226141,"feePaymentMethod":"fee_juice"} 12:52:13 [12:52:13.378] VERBOSE: sequencer Not enough txs to build block 7 at slot 8 (got 0 txs, need 1) {"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:13 [12:52:13.382] INFO: node Received tx 0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac {"txHash":"0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac"} 12:52:13 [12:52:13.382] INFO: pxe:service Sent transaction 0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac 12:52:13 [12:52:13.889] VERBOSE: sequencer Preparing proposal for block 7 at slot 8 {"globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"chainTipArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blockNumber":7,"slot":8} 12:52:13 [12:52:13.897] VERBOSE: block-builder Building block 7 for slot 8 {"slot":8,"slotStart":"2025-06-13T13:00:38.000Z","now":"2025-06-13T13:00:40.605Z","blockNumber":7,"msgCount":0,"opts":{"maxTransactions":32,"maxBlockSize":1048576,"maxBlockGas":{"daGas":10000000000,"l2Gas":10000000000}}} 12:52:13 [12:52:13.926] VERBOSE: simulator:public_tx_simulator Simulation of enqueued public call 0xeb1e3342 completed successfully. {"eventName":"avm-simulation","appCircuitName":"0xeb1e3342","duration":10.788492000003316} 12:52:13 [12:52:13.935] VERBOSE: simulator:public_tx_simulator Simulation of enqueued public call 0xeb1e3342 completed successfully. {"eventName":"avm-simulation","appCircuitName":"0xeb1e3342","duration":9.26050000000032} 12:52:13 [12:52:13.953] VERBOSE: simulator:public-processor Processed tx 0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac with 2 public calls in 43.043516000001546ms {"txHash":"0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac","txFee":1541164560,"revertCode":0,"gasUsed":{"totalGas":{"daGas":3072,"l2Gas":47892},"teardownGas":{"daGas":0,"l2Gas":0},"publicGas":{"daGas":2048,"l2Gas":5870},"billedGas":{"daGas":3072,"l2Gas":47892}},"publicDataWriteCount":2,"nullifierCount":1,"noteHashCount":0,"contractClassLogCount":0,"publicLogCount":2,"privateLogCount":0,"l2ToL1MessageCount":0,"durationMs":43.043516000001546} 12:52:13 [12:52:13.953] INFO: simulator:public-processor Processed 1 successful txs and 0 failed txs in 0.054481824999998936s {"duration":0.054481824999998936,"rate":107742.35261025332,"totalPublicGas":{"daGas":2048,"l2Gas":5870},"totalBlockGas":{"daGas":3072,"l2Gas":47892},"totalSizeInBytes":544} 12:52:13 [12:52:13.975] INFO: sequencer Built block 7 for slot 8 with 1 txs and 0 messages. 70918.4676111491 mana/s {"blockHash":"0x14ee02946f78707a5ff4352d09c298e3144873710b8ae5d6a1aef5d5e37694b4","globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"txHashes":["0x20c8df8ba369d88d2ebb12ce586a7da4459e9f1e4a7ce2867c37dc47eee494ac"],"eventName":"l2-block-built","creator":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","duration":82.68844600000011,"publicProcessDuration":54.84708800000226,"rollupCircuitsDuration":78.0302589999992,"txCount":1,"blockNumber":7,"blockTimestamp":1749819638,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:13 [12:52:13.977] VERBOSE: sequencer Attesting committee is empty 12:52:14 [12:52:14.130] VERBOSE: node Sent L1 transaction 0xad79418e60c215279dc7cc97be4a7d48ddfafc54ac3202658f22dc49cda1d8f7 {"gasLimit":423916,"maxFeePerGas":"1.217398702","maxPriorityFeePerGas":"1.2","maxFeePerBlobGas":"0.000000001"} 12:52:14 [12:52:14.140] INFO: sequencer:publisher Bundled [propose] transaction [succeeded] 12:52:14 [12:52:14.140] VERBOSE: sequencer:publisher Published L2 block to L1 rollup contract {"sender":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","transactionHash":"0xad79418e60c215279dc7cc97be4a7d48ddfafc54ac3202658f22dc49cda1d8f7","calldataSize":1252,"calldataGas":9964,"txCount":1,"blockNumber":7,"blockTimestamp":1749819638,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:14 [12:52:14.140] VERBOSE: node:blob-sink:client Sending 1 blobs to blob sink 12:52:14 [12:52:14.143] INFO: blob-sink:server Received blob sidecar for block 0x1252ea3d9b363c9698e784c8eb42d39937704c9a2d944f892ccb48317108e9de 12:52:14 [12:52:14.147] INFO: blob-sink:server Blob sidecar stored successfully for block 0x1252ea3d9b363c9698e784c8eb42d39937704c9a2d944f892ccb48317108e9de 12:52:14 [12:52:14.150] WARN: archiver Failed to reach L2 block 7 at 37 (latest is 6). Rolling back last synched L1 block number to 36. {"latestLocalL2BlockNumber":6,"latestLocalL2BlockArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","blocksSynchedTo":36,"currentL1BlockNumber":37,"provenBlockNumber":6,"provenArchive":"0x2dbf31b55d51f11c7c59c2bd89d772dbf969379188a0f1f8705a72af333e747a","pendingBlockNumber":7,"pendingArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15"} 12:52:14 [12:52:14.172] WARN: aztecjs:utils:watcher L1 is ahead of wall time. Syncing wall time to L1 time 12:52:14 [12:52:14.172] WARN: foundation:test-date-provider Time set to 2025-06-13T13:00:50.000Z {"offset":515828,"timeMs":1749819650000} 12:52:14 [12:52:14.175] WARN: ethereum:cheat_codes Set L1 storage for contract 0x3aa5ebb10dc797cac828524e59a333d0a371443c at 4226519774845294989066245638914502055781420935494253450203740607592046551906 to 7 12:52:14 [12:52:14.176] INFO: aztecjs:cheat_codes Proven tip moved: 6 -> 7. Pending tip: 7. 12:52:14 [12:52:14.208] WARN: ethereum:cheat_codes Warped L1 timestamp to 1749819674 12:52:14 [12:52:14.209] WARN: foundation:test-date-provider Time set to 2025-06-13T13:01:14.000Z {"offset":539792,"timeMs":1749819674000} 12:52:14 [12:52:14.209] INFO: aztecjs:utils:watcher Slot 8 was filled, jumped to next slot 12:52:14 [12:52:14.696] INFO: archiver Downloaded L2 block 7 {"blockHash":"0x14ee02946f78707a5ff4352d09c298e3144873710b8ae5d6a1aef5d5e37694b4","blockNumber":7,"txCount":1,"globalVariables":{"blockNumber":7,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":8,"timestamp":1749819638,"version":2277307715},"archiveRoot":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","archiveNextLeafIndex":8} 12:52:14 [12:52:14.697] INFO: archiver Updated proven chain to block 7 {"provenBlockNumber":7} 12:52:14 [12:52:14.746] INFO: world_state World state updated with L2 block 7 {"eventName":"l2-block-handled","duration":6.00159899999926,"unfinalisedBlockNumber":7,"finalisedBlockNumber":0,"oldestHistoricBlock":1,"txCount":1,"blockNumber":7,"blockTimestamp":1749819638,"privateLogCount":0,"publicLogCount":2,"contractClassLogCount":0,"contractClassLogSize":0} 12:52:14 [12:52:14.753] VERBOSE: p2p Synched to latest block 7 12:52:15 [12:52:15.161] VERBOSE: sequencer Preparing proposal for block 8 at slot 9 {"globalVariables":{"blockNumber":8,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":9,"timestamp":1749819674,"version":2277307715},"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:15 [12:52:15.163] VERBOSE: sequencer Not enough txs to build block 8 at slot 9 (got 0 txs, need 1) {"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:15 [12:52:15.388] INFO: e2e:e2e_nested_contract Tearing down subsystems 12:52:15 [12:52:15.389] INFO: node Stopping Aztec Node 12:52:15 [12:52:15.677] VERBOSE: sequencer Preparing proposal for block 8 at slot 9 {"globalVariables":{"blockNumber":8,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":9,"timestamp":1749819674,"version":2277307715},"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:15 [12:52:15.678] VERBOSE: sequencer Not enough txs to build block 8 at slot 9 (got 0 txs, need 1) {"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:16 [12:52:16.189] VERBOSE: sequencer Preparing proposal for block 8 at slot 9 {"globalVariables":{"blockNumber":8,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":9,"timestamp":1749819674,"version":2277307715},"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:16 [12:52:16.191] VERBOSE: sequencer Not enough txs to build block 8 at slot 9 (got 0 txs, need 1) {"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:16 [12:52:16.701] VERBOSE: sequencer Preparing proposal for block 8 at slot 9 {"globalVariables":{"blockNumber":8,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":9,"timestamp":1749819674,"version":2277307715},"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:16 [12:52:16.702] VERBOSE: sequencer Not enough txs to build block 8 at slot 9 (got 0 txs, need 1) {"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:17 [12:52:17.212] VERBOSE: sequencer Preparing proposal for block 8 at slot 9 {"globalVariables":{"blockNumber":8,"chainId":31337,"coinbase":"0xf39fd6e51aad88f6f4ce6ab8827279cfffb92266","feePerDaGas":0,"feePerL2Gas":32180,"feeRecipient":"0x0000000000000000000000000000000000000000000000000000000000000000","slotNumber":9,"timestamp":1749819674,"version":2277307715},"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:17 [12:52:17.213] VERBOSE: sequencer Not enough txs to build block 8 at slot 9 (got 0 txs, need 1) {"chainTipArchive":"0x1adadb3e229183c38f7d4353c8691887d7787211475718d91611e68d17271f15","blockNumber":8,"slot":9} 12:52:17 [12:52:17.390] INFO: slasher Slasher client stopped. 12:52:17 [12:52:17.390] INFO: sequencer Stopped sequencer 12:52:17 [12:52:17.391] INFO: p2p P2P client stopped 12:52:17 [12:52:17.392] INFO: world_state Stopped world state synchronizer 12:52:17 [12:52:17.392] INFO: archiver Stopped. 12:52:17 [12:52:17.392] INFO: node Stopped Aztec Node 12:52:17 [12:52:17.418] ERROR: aztecjs:utils:watcher Error in running promise: HttpRequestError: HTTP request failed. 12:52:17 12:52:17 URL: http://127.0.0.1:8545 12:52:17 Request body: {"method":"eth_getBlockByNumber","params":["latest",true]} 12:52:17 12:52:17 Details: fetch failed 12:52:17 Version: viem@2.23.7 12:52:17 at Object.request (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/utils/rpc/http.ts:161:15) 12:52:17 at fn (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/clients/transports/http.ts:145:19) 12:52:17 at request (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/clients/transports/http.ts:150:39) 12:52:17 at withRetry.delay.count.count (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/utils/buildRequest.ts:129:22) 12:52:17 at attemptRetry (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/utils/promise/withRetry.ts:44:22) { 12:52:17 details: 'fetch failed', 12:52:17 docsPath: undefined, 12:52:17 metaMessages: [ 12:52:17 'URL: http://127.0.0.1:8545', 12:52:17 'Request body: {"method":"eth_getBlockByNumber","params":["latest",true]}' 12:52:17 ], 12:52:17 shortMessage: 'HTTP request failed.', 12:52:17 version: '2.23.7', 12:52:17 body: { method: 'eth_getBlockByNumber', params: [ 'latest', true ] }, 12:52:17 headers: undefined, 12:52:17 status: undefined, 12:52:17 url: 'http://127.0.0.1:8545', 12:52:17 [cause]: TypeError: fetch failed 12:52:17 at node:internal/deps/undici/undici:13510:13 12:52:17 at withTimeout.errorInstance.TimeoutError.body.body (/home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/utils/rpc/http.ts:120:30) 12:52:17 at /home/aztec-dev/aztec-packages/yarn-project/node_modules/viem/utils/promise/withTimeout.ts:36:17 { 12:52:17 [cause]: SocketError: other side closed 12:52:17 at Socket.<anonymous> (node:internal/deps/undici/undici:6294:28) 12:52:17 at Socket.emit (node:events:530:35) 12:52:17 at endReadableNT (node:internal/streams/readable:1698:12) 12:52:17 at processTicksAndRejections (node:internal/process/task_queues:90:21) { 12:52:17 code: 'UND_ERR_SOCKET', 12:52:17 socket: [Object] 12:52:17 } 12:52:17 } 12:52:17 } 12:52:17 [12:52:17.418] INFO: blob-sink:server Stopping blob sink 12:52:17 [12:52:17.419] INFO: blob-sink:server Blob sink stopped 12:52:17 PASS src/e2e_nested_contract/manual_public.test.ts 12:52:17 e2e_nested_contract manual 12:52:17 performs public nested calls (2713 ms) 12:52:17 reads fresh value after write within the same tx (1703 ms) 12:52:17 executes public calls in expected order (3360 ms) 12:52:17 12:52:17 Test Suites: 1 passed, 1 total 12:52:17 Tests: 3 passed, 3 total 12:52:17 Snapshots: 0 total 12:52:17 Time: 31.875 s 12:52:17 Ran all test suites matching /src\/e2e_nested_contract\/manual_public.test.ts/i. 12:52:17 Force exiting Jest: Have you considered using `--detectOpenHandles` to detect async operations that kept running after all tests finished?