search

BOXFoundation / boxd

Blockchain for BOX Payout
MIT License
40 stars 10 forks source link

One peer cannot find a peer to sync blocks after it was isolated and re-joined this network #195

Closed Jerick26 closed 5 years ago

Jerick26 commented 5 years ago

This moment I isolated the peer via setting a different network id, so this node cannot sync message with other peers. 

INFO[0068] Eternal block has changed! Hash: 1c0ce15ad2d50358f16c5fdd48cb11857f9c29e3c86dbee64f3bfe660c36b3bd Height: 78  source="dpos/bft_service.go:162" tag=dpos
INFO[0072] received network message. Code: 4             source="p2p/notifier.go:79" tag=p2p
INFO[0072] Prepare to process block. Hash: 4798d434e49237bdc0d6e9a40b3aec00db020bbf7a7636d5f16a5621cb733545, Height: 79  source="chain/blockchain.go:232" tag=chain
DEBU[0072] UTXO: apply block with 1 transactions         source="chain/utxoset.go:162" tag=chain
DEBU[0072] Create Block filter with 0 inputs and 1 outputs  source="chain/blockchain.go:1019" tag=chain
INFO[0072] Change New Tail. Hash: 4798d434e49237bdc0d6e9a40b3aec00db020bbf7a7636d5f16a5621cb733545 Height: 79  source="chain/blockchain.go:710" tag=chain
INFO[0072] Block 4798d434e49237bdc0d6e9a40b3aec00db020bbf7a7636d5f16a5621cb733545 connects to main chain  source="txpool/transaction_pool.go:140" tag=txpool
INFO[0073] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0073] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0073] Accepted block hash: 4798d434e49237bdc0d6e9a40b3aec00db020bbf7a7636d5f16a5621cb733545  source="chain/blockchain.go:283" tag=chain
INFO[0073] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0073] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0073] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0073] Eternal block has changed! Hash: 4798d434e49237bdc0d6e9a40b3aec00db020bbf7a7636d5f16a5621cb733545 Height: 79  source="dpos/bft_service.go:162" tag=dpos
ERRO[0077] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0077] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0077] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
ERRO[0078] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0078] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0078] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
ERRO[0078] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0078] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
INFO[0078] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
ERRO[0078] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0078] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0078] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0078] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0078] Quit conn message loop with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:93" tag=p2p
INFO[0078] Closing connection with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:286" tag=p2p
INFO[0086] My turn to mint a block, time: 1542799850     source="dpos/dpos.go:162" tag=dpos
INFO[0086] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0086] Prepare to process block. Hash: 859f8beceea21432bfe85559a57fea9ba34588fd06dd2bc7d955cdbe056dab5c, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0086] Failed to verify miner epoch. Hash: 859f8beceea21432bfe85559a57fea9ba34588fd06dd2bc7d955cdbe056dab5c, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0086] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0086] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
WARN[0090] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0090] Peers: 5, connected: 5, opened: 5             source="p2p/connmgr.go:281" tag=p2p
INFO[0092] do peer discover                              source="p2p/table.go:89" tag=p2p
ERRO[0092] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0092] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
INFO[0092] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
ERRO[0092] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0092] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
ERRO[0092] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
ERRO[0092] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0092] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0092] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
DEBU[0092] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
ERRO[0092] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0092] Quit conn message loop with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:93" tag=p2p
INFO[0092] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
INFO[0092] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
INFO[0092] Closing connection with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:286" tag=p2p
INFO[0116] My turn to mint a block, time: 1542799880     source="dpos/dpos.go:162" tag=dpos
INFO[0116] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0116] Prepare to process block. Hash: 0204e3ec564bf86d5e7ea0d3ce07ad4e48262815b93d9f1ae0351072fc7d9e10, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0116] Failed to verify miner epoch. Hash: 0204e3ec564bf86d5e7ea0d3ce07ad4e48262815b93d9f1ae0351072fc7d9e10, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0116] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0116] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
DEBU[0120] checking expired peers......                  source="pstore/addrbook.go:151" tag=p2p/pstore
WARN[0120] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0120] Peers: 5, connected: 5, opened: 5             source="p2p/connmgr.go:281" tag=p2p
ERRO[0120] Failed to ping peer. PeerID: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:165" tag=p2p
ERRO[0120] Failed to ping peer. PeerID: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:165" tag=p2p
ERRO[0120] Failed to ping peer. PeerID: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:165" tag=p2p
ERRO[0120] Failed to ping peer. PeerID: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:165" tag=p2p
ERRO[0120] Failed to ping peer. PeerID: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:165" tag=p2p
ERRO[0122] Failed to sync route table from peer: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0122] Failed to sync route table from peer: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0122] Failed to sync route table from peer: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0122] Failed to sync route table from peer: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0122] Failed to sync route table from peer: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0129] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0129] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
INFO[0129] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
ERRO[0130] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0130] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0130] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
ERRO[0131] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0131] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0131] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0133] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0133] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0133] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
INFO[0140] do peer discover                              source="p2p/table.go:89" tag=p2p
ERRO[0140] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0140] Quit conn message loop with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:93" tag=p2p
ERRO[0140] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0140] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
ERRO[0140] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0140] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0140] Closing connection with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:286" tag=p2p
ERRO[0140] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0140] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0140] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
INFO[0140] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
INFO[0140] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0140] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0140] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0140] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
INFO[0146] My turn to mint a block, time: 1542799910     source="dpos/dpos.go:162" tag=dpos
INFO[0146] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0146] Prepare to process block. Hash: 36c9d836b6d636d36c7d23abebc714376f9d05d1d5a3899da74f909b4650e556, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0146] Failed to verify miner epoch. Hash: 36c9d836b6d636d36c7d23abebc714376f9d05d1d5a3899da74f909b4650e556, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0146] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0146] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
WARN[0150] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0150] Peers: 5, connected: 5, opened: 9             source="p2p/connmgr.go:281" tag=p2p
ERRO[0170] Failed to sync route table from peer: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0170] Failed to sync route table from peer: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0170] Failed to sync route table from peer: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0170] Failed to sync route table from peer: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0170] Failed to sync route table from peer: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
INFO[0176] My turn to mint a block, time: 1542799940     source="dpos/dpos.go:162" tag=dpos
INFO[0176] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0176] Prepare to process block. Hash: b7a7c1ae35eb3d46d3e882725d8e777ed9b12916655ec95017e8b5e74b50b0f7, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0176] Failed to verify miner epoch. Hash: b7a7c1ae35eb3d46d3e882725d8e777ed9b12916655ec95017e8b5e74b50b0f7, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0176] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0176] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
DEBU[0180] checking expired peers......                  source="pstore/addrbook.go:151" tag=p2p/pstore
WARN[0180] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0180] Peers: 5, connected: 5, opened: 9             source="p2p/connmgr.go:281" tag=p2p
INFO[0198] do peer discover                              source="p2p/table.go:89" tag=p2p
ERRO[0198] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0198] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
ERRO[0198] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0198] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0198] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
INFO[0198] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0198] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
ERRO[0198] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0198] Quit conn message loop with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:93" tag=p2p
DEBU[0198] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0198] Closing connection with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:286" tag=p2p
INFO[0198] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
ERRO[0198] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0198] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0198] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
INFO[0206] My turn to mint a block, time: 1542799970     source="dpos/dpos.go:162" tag=dpos
INFO[0206] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0206] Prepare to process block. Hash: 0dea23e64e5ef6a3a1c625b60b7428df60afe6793e6767ad4aa4a56cff6d2ca5, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0206] Failed to verify miner epoch. Hash: 0dea23e64e5ef6a3a1c625b60b7428df60afe6793e6767ad4aa4a56cff6d2ca5, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0206] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0206] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
WARN[0210] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0210] Peers: 5, connected: 5, opened: 9             source="p2p/connmgr.go:281" tag=p2p
ERRO[0225] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0225] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
INFO[0225] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
ERRO[0226] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0226] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0226] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
ERRO[0227] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0227] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0227] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0228] Failed to sync route table from peer: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0228] Failed to sync route table from peer: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0228] Failed to sync route table from peer: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0228] Failed to sync route table from peer: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0228] Failed to sync route table from peer: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0229] ReadMessage occurs error. Err: magic is error  source="p2p/conn.go:92" tag=p2p
DEBU[0229] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0229] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
INFO[0236] My turn to mint a block, time: 1542800000     source="dpos/dpos.go:162" tag=dpos
INFO[0236] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0236] Prepare to process block. Hash: a919f57bdc04b6bfad57356d86a2bc7470cc0bca54a30c732edb770b54cb49c0, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0236] Failed to verify miner epoch. Hash: a919f57bdc04b6bfad57356d86a2bc7470cc0bca54a30c732edb770b54cb49c0, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0236] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0236] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
DEBU[0240] checking expired peers......                  source="pstore/addrbook.go:151" tag=p2p/pstore
WARN[0240] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0240] Peers: 5, connected: 5, opened: 13            source="p2p/connmgr.go:281" tag=p2p
ERRO[0240] Failed to ping peer. PeerID: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:165" tag=p2p
ERRO[0240] Failed to ping peer. PeerID: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:165" tag=p2p
ERRO[0240] Failed to ping peer. PeerID: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:165" tag=p2p
ERRO[0240] Failed to ping peer. PeerID: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:165" tag=p2p
ERRO[0240] Failed to ping peer. PeerID: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:165" tag=p2p
INFO[0266] do peer discover                              source="p2p/table.go:89" tag=p2p
ERRO[0266] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0266] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
ERRO[0266] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
ERRO[0266] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0266] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p

......
......

INFO[0506] My turn to mint a block, time: 1542800270     source="dpos/dpos.go:162" tag=dpos
INFO[0506] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0506] Prepare to process block. Hash: 47271cb151fdcd947c56b3e3fc5988abff9b1007d02a983d63ef0822b0542860, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0506] Failed to verify miner epoch. Hash: 47271cb151fdcd947c56b3e3fc5988abff9b1007d02a983d63ef0822b0542860, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0506] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0506] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
WARN[0510] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0510] Peers: 5, connected: 5, opened: 21            source="p2p/connmgr.go:281" tag=p2p
INFO[0519] do peer discover                              source="p2p/table.go:89" tag=p2p
ERRO[0519] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0519] Quit conn message loop with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:93" tag=p2p
INFO[0519] Closing connection with 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA  source="p2p/conn.go:286" tag=p2p
ERRO[0519] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
ERRO[0519] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0519] Quit conn message loop with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:93" tag=p2p
INFO[0519] Closing connection with 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu  source="p2p/conn.go:286" tag=p2p
DEBU[0519] Quit conn message loop with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:93" tag=p2p
INFO[0519] Closing connection with 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ  source="p2p/conn.go:286" tag=p2p
ERRO[0519] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
ERRO[0519] ReadMessage occurs error. Err: EOF            source="p2p/conn.go:92" tag=p2p
DEBU[0519] Quit conn message loop with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:93" tag=p2p
INFO[0519] Closing connection with 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi  source="p2p/conn.go:286" tag=p2p
DEBU[0519] Quit conn message loop with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:93" tag=p2p
INFO[0519] Closing connection with 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza  source="p2p/conn.go:286" tag=p2p

**At this point, I change the network id to testnet via rpc to let the node re-join test net.

But it cannot find a peer to sync blocks.**

INFO[0536] My turn to mint a block, time: 1542800300     source="dpos/dpos.go:162" tag=dpos
INFO[0536] Finish packing txs. Height: 80, TxsNum: 1     source="dpos/dpos.go:329" tag=dpos
INFO[0536] Prepare to process block. Hash: 4e30a21eaf1f9049297df508382c54ca03c03fd460510903096ccc934953e7f3, Height: 80  source="chain/blockchain.go:232" tag=chain
ERRO[0536] Failed to verify miner epoch. Hash: 4e30a21eaf1f9049297df508382c54ca03c03fd460510903096ccc934953e7f3, Height: 80, Err: Invalid miner epoch  source="chain/blockchain.go:319" tag=chain
ERRO[0536] Failed to accept the block into the main chain. Err: Failed to verify block with consensus  source="chain/blockchain.go:268" tag=chain
WARN[0536] Failed to process block. err: Failed to verify block with consensus  source="dpos/dpos.go:228" tag=dpos
INFO[0538] Succeed to establish connection with peer 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA, addrs: {<peer.ID 12*ByZDpA> [/ip4/192.168.31.14/tcp/19189 /ip4/192.168.1.2/tcp/54800 /ip4/127.0.0.1/tcp/19189]}  source="p2p/conn.go:325" tag=p2p
INFO[0539] Succeed to establish connection with peer 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi, addrs: {<peer.ID 12*i7itsi> [/ip4/192.168.31.14/tcp/19179 /ip4/127.0.0.1/tcp/19179 /ip4/192.168.1.2/tcp/36783]}  source="p2p/conn.go:325" tag=p2p
DEBU[0540] checking expired peers......                  source="pstore/addrbook.go:151" tag=p2p/pstore
WARN[0540] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0540] Peers: 5, connected: 5, opened: 23            source="p2p/connmgr.go:281" tag=p2p
INFO[0540] Succeed to establish connection with peer 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ, addrs: {<peer.ID 12*ngzFSJ> [/ip4/127.0.0.1/tcp/19169 /ip4/192.168.1.2/tcp/12210 /ip4/192.168.31.14/tcp/19169]}  source="p2p/conn.go:325" tag=p2p
INFO[0542] Succeed to establish connection with peer 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu, addrs: {<peer.ID 12*5Hqtcu> [/ip4/192.168.31.14/tcp/19149 /ip4/127.0.0.1/tcp/19149 /ip4/192.168.1.2/tcp/52954]}  source="p2p/conn.go:325" tag=p2p
INFO[0542] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0542] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0542] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0542] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0548] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0548] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0548] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0548] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
ERRO[0549] Failed to sync route table from peer: 12D3KooWRHVAwymCVcA8jqyjpP3r3HBkCW2q5AZRTBvtaungzFSJ err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0549] Failed to sync route table from peer: 12D3KooWKPRAK7vBBrVv9szEin55kBnJEEuHG4gDTQEM72ByZDpA err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0549] Failed to sync route table from peer: 12D3KooWNcJQzHaNpW5vZDQbTcoLXVCyGS755hTpendGzb5Hqtcu err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0549] Failed to sync route table from peer: 12D3KooWSdXLNeoRQQ2a7yiS6xLpTn3LdCr8B8fqPz94Bbi7itsi err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
ERRO[0549] Failed to sync route table from peer: 12D3KooWFQ2naj8XZUVyGhFzBTEMrMc6emiCEDKLjaJMsK7p8Cza err: Handshaking timeout  source="p2p/table.go:153" tag=p2p
INFO[0552] received network message. Code: 4             source="p2p/notifier.go:79" tag=p2p
INFO[0552] Prepare to process block. Hash: b4704bb313ee2062eb70225c4739f359bac45a47ef055e9140a2e83c4d4717d2, Height: 159  source="chain/blockchain.go:232" tag=chain
INFO[0552] Adding orphan block b4704bb313ee2062eb70225c4739f359bac45a47ef055e9140a2e83c4d4717d2 with parent 6bd77711c42e5c9bcfc9f0f24ff241c3a34f0f4e402dd2796e1a0765d8ec4f0d  source="chain/blockchain.go:253" tag=chain
INFO[0552] StartSync                                     source="blocksync/manager.go:175" tag=blocksync
INFO[0553] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0553] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0553] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0553] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0553] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0553] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0554] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0554] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0555] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0555] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0556] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0556] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0557] received network message. Code: 4             source="p2p/notifier.go:79" tag=p2p
INFO[0557] Prepare to process block. Hash: 8b1eba5ae7caf862e20e6a73a38cccba859640063976f32eea4526cd222978cb, Height: 160  source="chain/blockchain.go:232" tag=chain
INFO[0557] Adding orphan block 8b1eba5ae7caf862e20e6a73a38cccba859640063976f32eea4526cd222978cb with parent b4704bb313ee2062eb70225c4739f359bac45a47ef055e9140a2e83c4d4717d2  source="chain/blockchain.go:253" tag=chain
INFO[0557] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0557] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0558] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0558] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0558] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0558] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0558] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0558] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0559] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0559] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0560] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0560] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0561] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0561] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0562] received network message. Code: 4             source="p2p/notifier.go:79" tag=p2p
INFO[0562] Prepare to process block. Hash: 0ec2449f286e6d6bf72f23e48bfc994dcded198a73eb2ae4963331a6f9654a79, Height: 161  source="chain/blockchain.go:232" tag=chain
INFO[0562] Adding orphan block 0ec2449f286e6d6bf72f23e48bfc994dcded198a73eb2ae4963331a6f9654a79 with parent 8b1eba5ae7caf862e20e6a73a38cccba859640063976f32eea4526cd222978cb  source="chain/blockchain.go:253" tag=chain
INFO[0562] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0562] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0563] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0563] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0563] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0563] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0563] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0563] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0564] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0564] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0565] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0565] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0566] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0566] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0567] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0567] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0568] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0568] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0569] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0569] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
WARN[0570] TrimOpenConns was called, but not implemented.  source="p2p/connmgr.go:266" tag=p2p
INFO[0570] Peers: 5, connected: 5, opened: 25            source="p2p/connmgr.go:281" tag=p2p
INFO[0570] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0570] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0571] locateHashes get lastestBlockLocator 13 hashes  source="blocksync/manager.go:381" tag=blocksync
WARN[0571] locateHashes error: no peer to sync           source="blocksync/manager.go:229" tag=blocksync
INFO[0571] received network message. Code: 4             source="p2p/notifier.go:79" tag=p2p
INFO[0571] Prepare to process block. Hash: f6fa529f5acd66ee5d8714792f674ded4008005ce855b1ebb0fb4f30399d3021, Height: 162  source="chain/blockchain.go:232" tag=chain
INFO[0571] Adding orphan block f6fa529f5acd66ee5d8714792f674ded4008005ce855b1ebb0fb4f30399d3021 with parent 0ec2449f286e6d6bf72f23e48bfc994dcded198a73eb2ae4963331a6f9654a79  source="chain/blockchain.go:253" tag=chain
WARN[0572] exceed max retry times(20)                    source="blocksync/manager.go:219" tag=blocksync
INFO[0572] sync completed and exit!                      source="blocksync/manager.go:207" tag=blocksync
INFO[0572] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
INFO[0572] received network message. Code: 22            source="p2p/notifier.go:79" tag=p2p
Jerick26 commented 5 years ago

use rpc command to change node's network id. testnet network id is 299792458. http --json http://127.0.0.1:19190/v1/ctl/networkid id=1234

Jerick26 commented 5 years ago

Now I cannot reproduce it.