search

ethereum / go-ethereum

Go implementation of the Ethereum protocol
https://geth.ethereum.org
GNU Lesser General Public License v3.0
47.53k stars 20.13k forks source link

GETH having synchronisation issue #28783

Closed nerdynaman closed 9 months ago

nerdynaman commented 10 months ago

System information

Geth version: 1.11.6 CL client & version: e.g. lighthouse/nimbus/prysm@v1.0.0 OS & Version: Ubuntu, 23.10 (Mantic Minotaur)

Actual behaviour

Miners are not able to properly import blocks mined by other miner due to synchronisation issue and further peers are dropped which get reconnected after some time

Steps to reproduce the behaviour

run following command 

geth --datadir node init genesis.json

./go-ethereum/build/bin/geth --datadir node/ --networkid 4480  --syncmode full  --http.api "eth,miner,net,personal,web3,admin" --http.corsdomain "https://remix.ethereum.org" --ipcpath node/geth.ipc --allow-insecure-unlock --cache 100 --maxpeers 256 --miner.threads 1 --password "seed" --nodiscover —nat extip:

Logs

INFO [01-10|09:26:06.555] Looking for peers                        peercount=1 tried=0 static=0                                 
ERROR[01-10|09:26:09.759] Failed to retrieve beacon bounds for bad block reporting err="beacon sync not yet started"            
WARN [01-10|09:26:09.759] Synchronisation failed, dropping peer    peer=5b80e9764f63a89e523ee0dcc2878ea58c21350ee2cf1da93897fb5d
eb658645 err="retrieved hash chain is invalid: block in the future"                                                             
INFO [01-10|09:26:14.491] Imported new chain segment               number=139 hash=d36b1d..6ab128 blocks=1 txs=0 mgas=0.000 elap
sed=4.932ms     mgasps=0.000 dirty=30.50KiB                                                                                     
INFO [01-10|09:26:41.544] Looking for peers                        peercount=1 tried=0 static=0                                 
ERROR[01-10|09:26:44.729] Failed to retrieve beacon bounds for bad block reporting err="beacon sync not yet started"            
WARN [01-10|09:26:44.729] Synchronisation failed, dropping peer    peer=5b80e9764f63a89e523ee0dcc2878ea58c21350ee2cf1da93897fb5d
eb658645 err="retrieved hash chain is invalid: block in the future"                                                             
INFO [01-10|09:26:49.491] Imported new chain segment               number=174 hash=d7721f..f43554 blocks=1 txs=0 mgas=0.000 elap
sed=5.007ms     mgasps=0.000 dirty=30.50KiB                                                                                     
INFO [01-10|09:27:16.611] Looking for peers                        peercount=1 tried=0 static=0                                 
ERROR[01-10|09:27:20.347] Failed to retrieve beacon bounds for bad block reporting err="beacon sync not yet started"            
WARN [01-10|09:27:20.347] Synchronisation failed, dropping peer    peer=5b80e9764f63a89e523ee0dcc2878ea58c21350ee2cf1da93897fb5d
eb658645 err="retrieved hash chain is invalid: block in the future"                                                             
INFO [01-10|09:27:24.491] Imported new chain segment               number=210 hash=556ad1..8dfc51 blocks=1 txs=0 mgas=0.000 elap
sed=5.108ms     mgasps=0.000 dirty=30.50KiB                                                                                     
INFO [01-10|09:27:51.591] Looking for peers                        peercount=1 tried=0 static=0                                 
ERROR[01-10|09:27:55.136] Failed to retrieve beacon bounds for bad block reporting err="beacon sync not yet started"            
WARN [01-10|09:27:55.136] Synchronisation failed, dropping peer    peer=5b80e9764f63a89e523ee0dcc2878ea58c21350ee2cf1da93897fb5d
eb658645 err="retrieved hash chain is invalid: block in the future"                                                             
INFO [01-10|09:27:59.491] Imported new chain segment               number=245 hash=e7d317..926adc blocks=1 txs=0 mgas=0.000 elap
sed=5.329ms     mgasps=0.000 dirty=30.50KiB                                                                                     
INFO [01-10|09:28:26.577] Looking for peers                        peercount=1 tried=0 static=0
MariusVanDerWijden commented 10 months ago

You seem to be using geth on a private network. There might be peers that you connect to that will feed you a wrong chain. Are you trying to run your own private network? Or are you trying to connect to an existing one?

nerdynaman commented 10 months ago

I am using a private blockchain on my own network. Both the miners on the network are controlled by me itself

holiman commented 9 months ago

Could you show the genesis.json? Also, the first ~150 lines of geth output after starting it, for both nodes on your network. You are using geth 1.11.6, which is very old. We don't support old versions, but we can keep this ticket open a bit longer and see if there's anything obvious that can be done to fix the situation.

nerdynaman commented 9 months ago

LOGS

NODE A [A.txt]

INFO [01-12|13:18:33.577] Maximum peer count                       ETH=50 LES=0 total=50
INFO [01-12|13:18:33.581] Set global gas cap                       cap=50,000,000
INFO [01-12|13:18:33.583] Allocated trie memory caches             clean=154.00MiB dirty=256.00MiB
INFO [01-12|13:18:33.583] Using leveldb as the backing database 
INFO [01-12|13:18:33.584] Allocated cache and file handles         database=/Users/namanaggarwal/Desktop/gnitov/testing/nodeA/geth/chaindata cache=512.00MiB handles=5120
INFO [01-12|13:18:33.617] Using LevelDB as the backing database 
INFO [01-12|13:18:33.622] Opened ancient database                  database=/Users/namanaggarwal/Desktop/gnitov/testing/nodeA/geth/chaindata/ancient/chain readonly=false
INFO [01-12|13:18:33.623] Disk storage enabled for ethash caches   dir=/Users/namanaggarwal/Desktop/gnitov/testing/nodeA/geth/ethash count=3
INFO [01-12|13:18:33.623] Disk storage enabled for ethash DAGs     dir=/Users/namanaggarwal/Library/Ethash count=2
INFO [01-12|13:18:33.624] Initialising Ethereum protocol           network=4480 dbversion=<nil>
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.626] --------------------------------------------------------------------------------------------------------------------------------------------------------- 
INFO [01-12|13:18:33.626] Chain ID:  4480 (unknown) 
INFO [01-12|13:18:33.626] Consensus: unknown 
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.626] Pre-Merge hard forks (block based): 
INFO [01-12|13:18:33.626]  - Homestead:                   #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/homestead.md) 
INFO [01-12|13:18:33.626]  - Tangerine Whistle (EIP 150): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/tangerine-whistle.md) 
INFO [01-12|13:18:33.626]  - Spurious Dragon/1 (EIP 155): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/spurious-dragon.md) 
INFO [01-12|13:18:33.626]  - Spurious Dragon/2 (EIP 158): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/spurious-dragon.md) 
INFO [01-12|13:18:33.626]  - Byzantium:                   #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/byzantium.md) 
INFO [01-12|13:18:33.626]  - Constantinople:              #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/constantinople.md) 
INFO [01-12|13:18:33.626]  - Petersburg:                  #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/petersburg.md) 
INFO [01-12|13:18:33.626]  - Istanbul:                    #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/istanbul.md) 
INFO [01-12|13:18:33.626]  - Berlin:                      #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/berlin.md) 
INFO [01-12|13:18:33.626]  - London:                      #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/london.md) 
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.626] The Merge is not yet available for this network! 
INFO [01-12|13:18:33.626]  - Hard-fork specification: https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/paris.md 
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.626] Post-Merge hard forks (timestamp based): 
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.626] --------------------------------------------------------------------------------------------------------------------------------------------------------- 
INFO [01-12|13:18:33.626]  
INFO [01-12|13:18:33.627] Loaded most recent local header          number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:18:33.627] Loaded most recent local full block      number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:18:33.627] Loaded most recent local fast block      number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
WARN [01-12|13:18:33.627] Failed to load snapshot                  err="missing or corrupted snapshot"
INFO [01-12|13:18:33.628] Rebuilding state snapshot 
INFO [01-12|13:18:33.629] Resuming state snapshot generation       root=56e81f..63b421 accounts=0 slots=0 storage=0.00B dangling=0 elapsed="706.125µs"
INFO [01-12|13:18:33.629] Generated state snapshot                 accounts=0 slots=0 storage=0.00B dangling=0 elapsed=1.100ms
INFO [01-12|13:18:33.630] Regenerated local transaction journal    transactions=0 accounts=0
INFO [01-12|13:18:33.632] Gasprice oracle is ignoring threshold set threshold=2
WARN [01-12|13:18:33.633] Error reading unclean shutdown markers   error="leveldb: not found"
WARN [01-12|13:18:33.633] Engine API enabled                       protocol=eth
WARN [01-12|13:18:33.633] Engine API started but chain not configured for merge yet 
INFO [01-12|13:18:33.634] Starting peer-to-peer node               instance=Geth/v1.11.2-stable/darwin-arm64/go1.20.1
INFO [01-12|13:18:33.661] New local node record                    seq=1,705,045,713,659 id=a311159407651ca7 ip=127.0.0.1 udp=0 tcp=3001
INFO [01-12|13:18:33.661] Started P2P networking                   self="enode://c4524065e0e2b212529724715573e52017a4b41555a4366ca09f48b28380b0d8d7a246d29ef33afd646f75c73f97174745de86ed50d26df96e5df7c98bb78ebd@127.0.0.1:3001?discport=0"
INFO [01-12|13:18:33.665] IPC endpoint opened                      url=nodeA/geth.ipc
INFO [01-12|13:18:33.665] Generated JWT secret                     path=/Users/namanaggarwal/Desktop/gnitov/testing/nodeA/geth/jwtsecret
INFO [01-12|13:18:33.666] HTTP server started                      endpoint=127.0.0.1:8101 auth=false prefix= cors= vhosts=localhost
INFO [01-12|13:18:33.667] WebSocket enabled                        url=ws://127.0.0.1:8551
INFO [01-12|13:18:33.667] HTTP server started                      endpoint=127.0.0.1:8551 auth=true  prefix= cors=localhost vhosts=localhost
INFO [01-12|13:20:10.343] Looking for peers                        peercount=1 tried=0 static=0
INFO [01-12|13:20:27.895] Updated mining threads                   threads=8
INFO [01-12|13:20:27.897] Transaction pool price threshold updated price=1,000,000,000
INFO [01-12|13:20:27.898] Commit new sealing work                  number=1 sealhash=98499c..b71850 uncles=0 txs=0 gas=0 fees=0 elapsed=1.135ms
INFO [01-12|13:20:27.898] Commit new sealing work                  number=1 sealhash=98499c..b71850 uncles=0 txs=0 gas=0 fees=0 elapsed=1.576ms
INFO [01-12|13:20:29.004] Successfully sealed new block            number=1 sealhash=98499c..b71850 hash=24a2db..9d5d3d elapsed=1.106s
INFO [01-12|13:20:29.004] "🔨 mined potential block"                number=1 hash=24a2db..9d5d3d
INFO [01-12|13:20:29.004] Commit new sealing work                  number=2 sealhash=940563..84a682 uncles=0 txs=0 gas=0 fees=0 elapsed="290.667µs"
INFO [01-12|13:20:29.004] Commit new sealing work                  number=2 sealhash=940563..84a682 uncles=0 txs=0 gas=0 fees=0 elapsed="364.417µs"
INFO [01-12|13:20:29.128] Successfully sealed new block            number=2 sealhash=940563..84a682 hash=1d47f6..9ed2b1 elapsed=124.146ms
INFO [01-12|13:20:29.128] "🔨 mined potential block"                number=2 hash=1d47f6..9ed2b1
INFO [01-12|13:20:29.128] Commit new sealing work                  number=3 sealhash=a50526..48922d uncles=0 txs=0 gas=0 fees=0 elapsed="131.5µs"
INFO [01-12|13:20:29.128] Commit new sealing work                  number=3 sealhash=a50526..48922d uncles=0 txs=0 gas=0 fees=0 elapsed="234.792µs"
INFO [01-12|13:20:29.992] Successfully sealed new block            number=3 sealhash=a50526..48922d hash=dabb43..df8f0e elapsed=863.899ms
INFO [01-12|13:20:29.992] "🔨 mined potential block"                number=3 hash=dabb43..df8f0e
INFO [01-12|13:20:29.992] Commit new sealing work                  number=4 sealhash=914e86..86fd15 uncles=0 txs=0 gas=0 fees=0 elapsed="162.166µs"
INFO [01-12|13:20:29.992] Commit new sealing work                  number=4 sealhash=914e86..86fd15 uncles=0 txs=0 gas=0 fees=0 elapsed="265.625µs"
INFO [01-12|13:20:30.205] Successfully sealed new block            number=4 sealhash=914e86..86fd15 hash=d1679e..13b0ef elapsed=212.280ms
INFO [01-12|13:20:30.205] "🔨 mined potential block"                number=4 hash=d1679e..13b0ef
INFO [01-12|13:20:30.205] Commit new sealing work                  number=5 sealhash=bd36b9..199fd0 uncles=0 txs=0 gas=0 fees=0 elapsed="207.667µs"
INFO [01-12|13:20:30.205] Commit new sealing work                  number=5 sealhash=bd36b9..199fd0 uncles=0 txs=0 gas=0 fees=0 elapsed="326.25µs"
INFO [01-12|13:20:30.482] Successfully sealed new block            number=5 sealhash=bd36b9..199fd0 hash=415741..689fc1 elapsed=276.951ms
INFO [01-12|13:20:30.482] "🔨 mined potential block"                number=5 hash=415741..689fc1
INFO [01-12|13:20:30.482] Commit new sealing work                  number=6 sealhash=0a63ba..33944a uncles=0 txs=0 gas=0 fees=0 elapsed="124.292µs"
INFO [01-12|13:20:30.482] Commit new sealing work                  number=6 sealhash=0a63ba..33944a uncles=0 txs=0 gas=0 fees=0 elapsed="199.792µs"
INFO [01-12|13:20:31.096] Successfully sealed new block            number=6 sealhash=0a63ba..33944a hash=7b38c3..0fec8d elapsed=614.130ms
INFO [01-12|13:20:31.096] "🔨 mined potential block"                number=6 hash=7b38c3..0fec8d
INFO [01-12|13:20:31.096] Commit new sealing work                  number=7 sealhash=2d11bb..605b76 uncles=0 txs=0 gas=0 fees=0 elapsed="130.791µs"
INFO [01-12|13:20:31.096] Commit new sealing work                  number=7 sealhash=2d11bb..605b76 uncles=0 txs=0 gas=0 fees=0 elapsed="219.75µs"
INFO [01-12|13:20:31.460] Successfully sealed new block            number=7 sealhash=2d11bb..605b76 hash=1bfdb9..d1c575 elapsed=363.559ms
INFO [01-12|13:20:31.460] "🔨 mined potential block"                number=7 hash=1bfdb9..d1c575
INFO [01-12|13:20:31.460] Commit new sealing work                  number=8 sealhash=41aeb7..da5c5f uncles=0 txs=0 gas=0 fees=0 elapsed="115.834µs"
INFO [01-12|13:20:31.460] Commit new sealing work                  number=8 sealhash=41aeb7..da5c5f uncles=0 txs=0 gas=0 fees=0 elapsed="202.625µs"
INFO [01-12|13:20:31.929] Successfully sealed new block            number=8 sealhash=41aeb7..da5c5f hash=a6a3f1..1d3e3f elapsed=468.978ms
INFO [01-12|13:20:31.929] "🔗 block reached canonical chain"        number=1 hash=24a2db..9d5d3d
INFO [01-12|13:20:31.929] "🔨 mined potential block"                number=8 hash=a6a3f1..1d3e3f
INFO [01-12|13:20:31.929] Commit new sealing work                  number=9 sealhash=78beea..552c32 uncles=0 txs=0 gas=0 fees=0 elapsed="158.042µs"
INFO [01-12|13:20:31.929] Commit new sealing work                  number=9 sealhash=78beea..552c32 uncles=0 txs=0 gas=0 fees=0 elapsed="241.917µs"
INFO [01-12|13:20:31.932] Successfully sealed new block            number=9 sealhash=78beea..552c32 hash=048355..2d019e elapsed=2.538ms
INFO [01-12|13:20:31.932] "🔗 block reached canonical chain"        number=2 hash=1d47f6..9ed2b1
INFO [01-12|13:20:31.932] "🔨 mined potential block"                number=9 hash=048355..2d019e
INFO [01-12|13:20:31.932] Commit new sealing work                  number=10 sealhash=ed35d5..8995d7 uncles=0 txs=0 gas=0 fees=0 elapsed="134.875µs"
INFO [01-12|13:20:31.932] Commit new sealing work                  number=10 sealhash=ed35d5..8995d7 uncles=0 txs=0 gas=0 fees=0 elapsed="212µs"
INFO [01-12|13:20:32.430] Successfully sealed new block            number=10 sealhash=ed35d5..8995d7 hash=ed596a..0fcdb0 elapsed=498.359ms
INFO [01-12|13:20:32.430] "🔗 block reached canonical chain"        number=3  hash=dabb43..df8f0e
INFO [01-12|13:20:32.430] "🔨 mined potential block"                number=10 hash=ed596a..0fcdb0
INFO [01-12|13:20:32.430] Commit new sealing work                  number=11 sealhash=435a51..748f00 uncles=0 txs=0 gas=0 fees=0 elapsed="114µs"
INFO [01-12|13:20:32.430] Commit new sealing work                  number=11 sealhash=435a51..748f00 uncles=0 txs=0 gas=0 fees=0 elapsed="195.125µs"
INFO [01-12|13:20:32.558] Successfully sealed new block            number=11 sealhash=435a51..748f00 hash=4596c4..96c07c elapsed=127.990ms
INFO [01-12|13:20:32.558] "🔗 block reached canonical chain"        number=4  hash=d1679e..13b0ef
INFO [01-12|13:20:32.558] "🔨 mined potential block"                number=11 hash=4596c4..96c07c
INFO [01-12|13:20:32.558] Commit new sealing work                  number=12 sealhash=f28534..b855ec uncles=0 txs=0 gas=0 fees=0 elapsed="101µs"
INFO [01-12|13:20:32.558] Commit new sealing work                  number=12 sealhash=f28534..b855ec uncles=0 txs=0 gas=0 fees=0 elapsed="167.667µs"
INFO [01-12|13:20:32.566] Successfully sealed new block            number=12 sealhash=f28534..b855ec hash=a4441d..9f5ad3 elapsed=7.487ms
INFO [01-12|13:20:32.566] "🔗 block reached canonical chain"        number=5  hash=415741..689fc1
INFO [01-12|13:20:32.566] "🔨 mined potential block"                number=12 hash=a4441d..9f5ad3
INFO [01-12|13:20:32.566] Commit new sealing work                  number=13 sealhash=93e266..188831 uncles=0 txs=0 gas=0 fees=0 elapsed="109.333µs"
INFO [01-12|13:20:32.566] Commit new sealing work                  number=13 sealhash=93e266..188831 uncles=0 txs=0 gas=0 fees=0 elapsed="191.541µs"
INFO [01-12|13:20:32.607] Successfully sealed new block            number=13 sealhash=93e266..188831 hash=9323da..b9912c elapsed=40.854ms
INFO [01-12|13:20:32.607] "🔗 block reached canonical chain"        number=6  hash=7b38c3..0fec8d
INFO [01-12|13:20:32.607] "🔨 mined potential block"                number=13 hash=9323da..b9912c
INFO [01-12|13:20:32.607] Commit new sealing work                  number=14 sealhash=f24545..0d61e7 uncles=0 txs=0 gas=0 fees=0 elapsed="116.459µs"
INFO [01-12|13:20:32.607] Commit new sealing work                  number=14 sealhash=f24545..0d61e7 uncles=0 txs=0 gas=0 fees=0 elapsed="192.542µs"
INFO [01-12|13:20:33.658] Successfully sealed new block            number=14 sealhash=f24545..0d61e7 hash=7d1a33..e62ab6 elapsed=1.050s
INFO [01-12|13:20:33.658] "🔗 block reached canonical chain"        number=7  hash=1bfdb9..d1c575
INFO [01-12|13:20:33.658] "🔨 mined potential block"                number=14 hash=7d1a33..e62ab6
INFO [01-12|13:20:33.658] Commit new sealing work                  number=15 sealhash=88802c..a36342 uncles=0 txs=0 gas=0 fees=0 elapsed="133.542µs"
INFO [01-12|13:20:33.658] Commit new sealing work                  number=15 sealhash=88802c..a36342 uncles=0 txs=0 gas=0 fees=0 elapsed="217.917µs"
INFO [01-12|13:20:33.882] Successfully sealed new block            number=15 sealhash=88802c..a36342 hash=7d1cc5..4428bc elapsed=224.5ms
INFO [01-12|13:20:33.883] "🔗 block reached canonical chain"        number=8  hash=a6a3f1..1d3e3f
INFO [01-12|13:20:33.883] "🔨 mined potential block"                number=15 hash=7d1cc5..4428bc
INFO [01-12|13:20:33.883] Commit new sealing work                  number=16 sealhash=bee48c..82bfbc uncles=0 txs=0 gas=0 fees=0 elapsed="176.5µs"
INFO [01-12|13:20:33.883] Commit new sealing work                  number=16 sealhash=bee48c..82bfbc uncles=0 txs=0 gas=0 fees=0 elapsed="252.875µs"
INFO [01-12|13:20:34.293] Successfully sealed new block            number=16 sealhash=bee48c..82bfbc hash=5a360a..ac2cea elapsed=410.039ms
INFO [01-12|13:20:34.293] "🔗 block reached canonical chain"        number=9  hash=048355..2d019e
INFO [01-12|13:20:34.293] "🔨 mined potential block"                number=16 hash=5a360a..ac2cea
INFO [01-12|13:20:34.293] Commit new sealing work                  number=17 sealhash=30f878..3f99e1 uncles=0 txs=0 gas=0 fees=0 elapsed="111.542µs"
INFO [01-12|13:20:34.293] Commit new sealing work                  number=17 sealhash=30f878..3f99e1 uncles=0 txs=0 gas=0 fees=0 elapsed="213.417µs"
INFO [01-12|13:20:34.491] Successfully sealed new block            number=17 sealhash=30f878..3f99e1 hash=965147..0114a8 elapsed=198.087ms
INFO [01-12|13:20:34.491] "🔗 block reached canonical chain"        number=10 hash=ed596a..0fcdb0
INFO [01-12|13:20:34.491] "🔨 mined potential block"                number=17 hash=965147..0114a8
INFO [01-12|13:20:34.491] Commit new sealing work                  number=18 sealhash=798459..976ab7 uncles=0 txs=0 gas=0 fees=0 elapsed="126.583µs"
INFO [01-12|13:20:34.491] Commit new sealing work                  number=18 sealhash=798459..976ab7 uncles=0 txs=0 gas=0 fees=0 elapsed="214.5µs"
INFO [01-12|13:20:34.579] Successfully sealed new block            number=18 sealhash=798459..976ab7 hash=369310..9bdde5 elapsed=88.075ms
INFO [01-12|13:20:34.579] "🔗 block reached canonical chain"        number=11 hash=4596c4..96c07c
INFO [01-12|13:20:34.579] "🔨 mined potential block"                number=18 hash=369310..9bdde5
INFO [01-12|13:20:34.579] Commit new sealing work                  number=19 sealhash=48c3e8..7af3fb uncles=0 txs=0 gas=0 fees=0 elapsed="94.667µs"
INFO [01-12|13:20:34.579] Commit new sealing work                  number=19 sealhash=48c3e8..7af3fb uncles=0 txs=0 gas=0 fees=0 elapsed="160.75µs"
INFO [01-12|13:20:34.803] Successfully sealed new block            number=19 sealhash=48c3e8..7af3fb hash=e0244f..087a26 elapsed=223.377ms
INFO [01-12|13:20:34.803] "🔗 block reached canonical chain"        number=12 hash=a4441d..9f5ad3
INFO [01-12|13:20:34.803] "🔨 mined potential block"                number=19 hash=e0244f..087a26
INFO [01-12|13:20:34.803] Commit new sealing work                  number=20 sealhash=527da1..94c60a uncles=0 txs=0 gas=0 fees=0 elapsed="122.375µs"
INFO [01-12|13:20:34.803] Commit new sealing work                  number=20 sealhash=527da1..94c60a uncles=0 txs=0 gas=0 fees=0 elapsed="206.167µs"
INFO [01-12|13:20:34.817] Successfully sealed new block            number=20 sealhash=527da1..94c60a hash=249138..8a8fee elapsed=14.408ms
INFO [01-12|13:20:34.817] "🔗 block reached canonical chain"        number=13 hash=9323da..b9912c
INFO [01-12|13:20:34.817] "🔨 mined potential block"                number=20 hash=249138..8a8fee
INFO [01-12|13:20:34.817] Commit new sealing work                  number=21 sealhash=511a88..e4116c uncles=0 txs=0 gas=0 fees=0 elapsed="96.583µs"
INFO [01-12|13:20:34.817] Commit new sealing work                  number=21 sealhash=511a88..e4116c uncles=0 txs=0 gas=0 fees=0 elapsed="166.708µs"
INFO [01-12|13:20:35.017] Successfully sealed new block            number=21 sealhash=511a88..e4116c hash=b1499c..815835 elapsed=199.985ms
INFO [01-12|13:20:35.017] "🔗 block reached canonical chain"        number=14 hash=7d1a33..e62ab6
INFO [01-12|13:20:35.017] "🔨 mined potential block"                number=21 hash=b1499c..815835
INFO [01-12|13:20:35.017] Commit new sealing work                  number=22 sealhash=daa521..390776 uncles=0 txs=0 gas=0 fees=0 elapsed="99.833µs"
INFO [01-12|13:20:35.017] Commit new sealing work                  number=22 sealhash=daa521..390776 uncles=0 txs=0 gas=0 fees=0 elapsed="170.583µs"
INFO [01-12|13:20:35.165] Successfully sealed new block            number=22 sealhash=daa521..390776 hash=f9deda..655298 elapsed=147.43ms
INFO [01-12|13:20:35.165] "🔗 block reached canonical chain"        number=15 hash=7d1cc5..4428bc
INFO [01-12|13:20:35.165] "🔨 mined potential block"                number=22 hash=f9deda..655298

NODE B [B.txt]

namanaggarwal@nerdy testing % cat B.txt  
INFO [01-12|13:19:02.589] Maximum peer count                       ETH=50 LES=0 total=50
INFO [01-12|13:19:02.593] Set global gas cap                       cap=50,000,000
INFO [01-12|13:19:02.595] Allocated trie memory caches             clean=154.00MiB dirty=256.00MiB
INFO [01-12|13:19:02.595] Using leveldb as the backing database 
INFO [01-12|13:19:02.595] Allocated cache and file handles         database=/Users/namanaggarwal/Desktop/gnitov/testing/nodeB/geth/chaindata cache=512.00MiB handles=5120
INFO [01-12|13:19:02.653] Using LevelDB as the backing database 
INFO [01-12|13:19:02.659] Opened ancient database                  database=/Users/namanaggarwal/Desktop/gnitov/testing/nodeB/geth/chaindata/ancient/chain readonly=false
INFO [01-12|13:19:02.660] Disk storage enabled for ethash caches   dir=/Users/namanaggarwal/Desktop/gnitov/testing/nodeB/geth/ethash count=3
INFO [01-12|13:19:02.660] Disk storage enabled for ethash DAGs     dir=/Users/namanaggarwal/Library/Ethash count=2
INFO [01-12|13:19:02.660] Initialising Ethereum protocol           network=4480 dbversion=<nil>
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] --------------------------------------------------------------------------------------------------------------------------------------------------------- 
INFO [01-12|13:19:02.660] Chain ID:  4480 (unknown) 
INFO [01-12|13:19:02.660] Consensus: unknown 
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] Pre-Merge hard forks (block based): 
INFO [01-12|13:19:02.660]  - Homestead:                   #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/homestead.md) 
INFO [01-12|13:19:02.660]  - Tangerine Whistle (EIP 150): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/tangerine-whistle.md) 
INFO [01-12|13:19:02.660]  - Spurious Dragon/1 (EIP 155): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/spurious-dragon.md) 
INFO [01-12|13:19:02.660]  - Spurious Dragon/2 (EIP 158): #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/spurious-dragon.md) 
INFO [01-12|13:19:02.660]  - Byzantium:                   #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/byzantium.md) 
INFO [01-12|13:19:02.660]  - Constantinople:              #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/constantinople.md) 
INFO [01-12|13:19:02.660]  - Petersburg:                  #0        (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/petersburg.md) 
INFO [01-12|13:19:02.660]  - Istanbul:                    #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/istanbul.md) 
INFO [01-12|13:19:02.660]  - Berlin:                      #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/berlin.md) 
INFO [01-12|13:19:02.660]  - London:                      #<nil> (https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/london.md) 
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] The Merge is not yet available for this network! 
INFO [01-12|13:19:02.660]  - Hard-fork specification: https://github.com/ethereum/execution-specs/blob/master/network-upgrades/mainnet-upgrades/paris.md 
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] Post-Merge hard forks (timestamp based): 
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] --------------------------------------------------------------------------------------------------------------------------------------------------------- 
INFO [01-12|13:19:02.660]  
INFO [01-12|13:19:02.660] Loaded most recent local header          number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:19:02.660] Loaded most recent local full block      number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:19:02.660] Loaded most recent local fast block      number=0 hash=1a898e..1b95bb td=0 age=54y9mo3w
WARN [01-12|13:19:02.660] Failed to load snapshot                  err="missing or corrupted snapshot"
INFO [01-12|13:19:02.660] Rebuilding state snapshot 
INFO [01-12|13:19:02.660] Resuming state snapshot generation       root=56e81f..63b421 accounts=0 slots=0 storage=0.00B dangling=0 elapsed="117.208µs"
INFO [01-12|13:19:02.661] Generated state snapshot                 accounts=0 slots=0 storage=0.00B dangling=0 elapsed="206.791µs"
INFO [01-12|13:19:02.661] Regenerated local transaction journal    transactions=0 accounts=0
INFO [01-12|13:19:02.661] Gasprice oracle is ignoring threshold set threshold=2
WARN [01-12|13:19:02.661] Error reading unclean shutdown markers   error="leveldb: not found"
WARN [01-12|13:19:02.661] Engine API enabled                       protocol=eth
WARN [01-12|13:19:02.661] Engine API started but chain not configured for merge yet 
INFO [01-12|13:19:02.661] Starting peer-to-peer node               instance=Geth/v1.11.2-stable/darwin-arm64/go1.20.1
INFO [01-12|13:19:02.686] New local node record                    seq=1,705,045,742,686 id=ee44c2ea95f3617a ip=127.0.0.1 udp=0 tcp=3002
INFO [01-12|13:19:02.687] Started P2P networking                   self="enode://cfdd506d6b18fae63a7f5d24dcbf62ce57f0a441178279318b7280cf44f11ae0f4771169937397abc35ec5c8dd62cb546f844f53fa0d4c573cb3c0dbb8f44a58@127.0.0.1:3002?discport=0"
INFO [01-12|13:19:02.687] IPC endpoint opened                      url=nodeB/geth.ipc
INFO [01-12|13:19:02.687] Generated JWT secret                     path=/Users/namanaggarwal/Desktop/gnitov/testing/nodeB/geth/jwtsecret
INFO [01-12|13:19:02.688] HTTP server started                      endpoint=127.0.0.1:8102 auth=false prefix= cors= vhosts=localhost
INFO [01-12|13:19:02.688] WebSocket enabled                        url=ws://127.0.0.1:8552
INFO [01-12|13:19:02.688] HTTP server started                      endpoint=127.0.0.1:8552 auth=true  prefix= cors=localhost vhosts=localhost
INFO [01-12|13:20:10.338] Looking for peers                        peercount=0 tried=0 static=1
INFO [01-12|13:20:29.130] Block synchronisation started 
WARN [01-12|13:20:30.443] Snap syncing, discarded propagated block number=1 hash=24a2db..9d5d3d
INFO [01-12|13:20:30.451] Imported new chain segment               number=2 hash=1d47f6..9ed2b1 blocks=2 txs=0 mgas=0.000 elapsed=18.575ms    mgasps=0.000 dirty=486.00B
INFO [01-12|13:20:30.451] Syncing: chain download in progress      synced=+Inf% chain=18.00B headers=2@6.00B bodies=2@6.00B receipts=2@6.00B eta=-19.862ms
WARN [01-12|13:20:30.452] Synchronisation failed, retrying         err="sync cancelled"
WARN [01-12|13:20:30.487] Snap syncing, discarded propagated block number=3 hash=dabb43..df8f0e
WARN [01-12|13:20:40.698] Invalid header encountered               number=29 hash=2f0e04..d97249 parent=cf73cc..2031db err="block in the future"
WARN [01-12|13:20:40.699] Rewinding blockchain to block            target=0
INFO [01-12|13:20:40.699] Loaded most recent local header          number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:20:40.699] Loaded most recent local full block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:20:40.699] Loaded most recent local fast block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
WARN [01-12|13:20:40.699] Rolled back chain segment                header=2->0 snap=2->0 block=2->0 reason="block in the future"
WARN [01-12|13:20:40.700] Synchronisation failed, dropping peer    peer=a311159407651ca79c3a28d40960fa233ba83345898f9b515ca05d85d3ea0ca3 err="retrieved hash chain is invalid: block in the future"
INFO [01-12|13:20:40.700] Looking for peers                        peercount=0 tried=1 static=1
WARN [01-12|13:20:50.871] Invalid header encountered               number=39 hash=1a9f60..9460d6 parent=4d1980..fd5130 err="block in the future"
WARN [01-12|13:20:50.871] Rewinding blockchain to block            target=0
INFO [01-12|13:20:50.871] Loaded most recent local header          number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:20:50.871] Loaded most recent local full block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:20:50.871] Loaded most recent local fast block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:20:50.871] Loaded last fast-sync pivot marker       number=6
WARN [01-12|13:20:50.871] Rolled back chain segment                header=0->0 snap=0->0 block=0->0 reason="block in the future"
WARN [01-12|13:20:50.871] Synchronisation failed, dropping peer    peer=a311159407651ca79c3a28d40960fa233ba83345898f9b515ca05d85d3ea0ca3 err="retrieved hash chain is invalid: block in the future"
INFO [01-12|13:20:50.872] Looking for peers                        peercount=0 tried=1 static=1
INFO [01-12|13:21:20.340] Looking for peers                        peercount=0 tried=0 static=1
INFO [01-12|13:21:20.401] Syncing: state download in progress      synced=49.75% state=196.00B accounts=1@196.00B slots=0@0.00B codes=0@0.00B eta=51.785s
INFO [01-12|13:21:20.405] Syncing: state download in progress      synced=100.00% state=196.00B accounts=1@196.00B slots=0@0.00B codes=0@0.00B eta=-183ns
WARN [01-12|13:21:20.405] Invalid header encountered               number=69 hash=d1e412..a7ce94 parent=d36b9e..00f966 err="block in the future"
WARN [01-12|13:21:20.405] Rewinding blockchain to block            target=0
INFO [01-12|13:21:20.407] Loaded most recent local header          number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:20.407] Loaded most recent local full block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:20.407] Loaded most recent local fast block      number=0  hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:20.407] Loaded last fast-sync pivot marker       number=50
WARN [01-12|13:21:20.407] Rolled back chain segment                header=0->0 snap=0->0 block=0->0 reason="block in the future"
INFO [01-12|13:21:20.407] Syncing: state healing in progress       accounts=0@0.00B   slots=0@0.00B codes=0@0.00B nodes=0@0.00B pending=1
WARN [01-12|13:21:20.407] Unexpected trienode heal packet          peer=a3111594 reqid=8,209,962,919,373,327,197
WARN [01-12|13:21:20.407] Synchronisation failed, dropping peer    peer=a311159407651ca79c3a28d40960fa233ba83345898f9b515ca05d85d3ea0ca3 err="retrieved hash chain is invalid: block in the future"
INFO [01-12|13:21:55.345] Looking for peers                        peercount=0 tried=1 static=1
WARN [01-12|13:21:55.421] Invalid header encountered               number=104 hash=43ff17..393145 parent=42d67c..f801b5 err="block in the future"
WARN [01-12|13:21:55.422] Rewinding blockchain to block            target=0
INFO [01-12|13:21:55.423] Loaded most recent local header          number=0   hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:55.423] Loaded most recent local full block      number=0   hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:55.423] Loaded most recent local fast block      number=0   hash=1a898e..1b95bb td=0 age=54y9mo3w
INFO [01-12|13:21:55.423] Loaded last fast-sync pivot marker       number=50
WARN [01-12|13:21:55.423] Rolled back chain segment                header=0->0 snap=0->0 block=0->0 reason="block in the future"
WARN [01-12|13:21:55.424] Synchronisation failed, dropping peer    peer=a311159407651ca79c3a28d40960fa233ba83345898f9b515ca05d85d3ea0ca3 err="retrieved hash chain is invalid: block in the future"
INFO [01-12|13:22:30.344] Looking for peers                        peercount=0 tried=1 static=1
INFO [01-12|13:22:30.506] Rebuilding state snapshot 
INFO [01-12|13:22:30.507] Committed new head block                 number=50  hash=c45128..e1e1c6
INFO [01-12|13:22:30.508] Resuming state snapshot generation       root=d46771..9563be accounts=0         slots=0       storage=0.00B dangling=0 elapsed=1.358ms
INFO [01-12|13:22:30.510] Generated state snapshot                 accounts=1         slots=0       storage=48.00B dangling=0 elapsed=4.108ms
INFO [01-12|13:22:30.566] Imported new chain segment               number=112 hash=eddf4c..3c9285 blocks=62 txs=0 mgas=0.000 elapsed=57.658ms    mgasps=0.000 dirty=15.25KiB
INFO [01-12|13:22:33.370] Syncing: chain download in progress      synced=224.00% chain=18.00B headers=114@6.00B bodies=112@6.00B receipts=112@6.00B eta=-1m8.059s
INFO [01-12|13:22:33.379] Imported new chain segment               number=114 hash=9a39ec..b27382 blocks=2  txs=0 mgas=0.000 elapsed=7.935ms     mgasps=0.000 dirty=15.72KiB
INFO [01-12|13:22:33.379] Syncing: chain download in progress      synced=228.00% chain=18.00B headers=114@6.00B bodies=114@6.00B receipts=114@6.00B eta=-1m9.027s
INFO [01-12|13:22:33.379] Snap sync complete, auto disabling 
INFO [01-12|13:23:05.343] Looking for peers                        peercount=1 tried=1 static=1

Genesis

{
    "config":
    {
        "chainId": 4480,
        "homesteadBlock": 0,
        "eip155Block": 0,
        "eip158Block": 0,
        "eip150Block": 0,
        "eip150Hash": "0x0000000000000000000000000000000000000000000000000000000000000000",
        "byzantiumBlock": 0,
        "constantinopleBlock": 0,
        "petersburgBlock": 0
    },
    "difficulty": "0x0",
    "gasLimit": "0x8000000",
    "alloc": {}

}
holiman commented 9 months ago

So, you're sealing them several blocks per second. But the timestamp of a block must progress, at least one second per block. So if you seal 10 blocks in the same second, then the tenth block will be mined with a timestamp 10 seconds from now.

I think the root problem is that you use a difficulty of 0x0. There is a minimum difficulty, which I thought that geth would not accept to go below. (Did you modify geth?)

Anyway, this problem should resolve itself after a while, when some time has passed and the blocks are no longer in the future.

holiman commented 9 months ago

Also, you're apparently using v1.11.2-stable, not 1.11.6

nerdynaman commented 9 months ago
phpmac commented 5 months ago

How was it resolved in the end?

phpmac commented 5 months ago

I didn’t see proof-of-work being used. You used unknown. Is there any problem?

nerdynaman commented 5 months ago

This was on proof of work only, we were able to fix it by increasing difficulty. You need to find optimal difficulty for you machines