Closed vikramdulani closed 6 years ago
Never mind, I found a workaround. For some reason $DOCKERHOST variable was not getting resolved to my host IP. For now, I've hardcoded the value and it seems to be behaving. Closing the issue.
Note: I got this fixed by updating the following in von_generate_transactions:
--ips "$DOCKERHOST","$DOCKERHOST","$DOCKERHOST","$DOCKERHOST"
to
--ips "${DOCKERHOST}","${DOCKERHOST}","${DOCKERHOST}","${DOCKERHOST}"
The problem should be that the nodes don't successfully connect to one another. If you notice, the last "CONNECTION" messages simply say that they're looking, but never achieve the "started connecting" message. Eventually this leads to a timeout error from von_web. I'm having a similar issue now and your braces {} fix doesn't help. It may have been a port issue in our cases.
Yup, like you said this has to do with nodes unable to connect to each other. There could be several reasons why this may be happenning. Have you changed the port number in docker-compose.yml? Can you try hard coding the docker host IP address instead of DockerHost variable?
You can get the IP by running the following on the host:
ifconfig | grep -E "([0-9]{1,3}.){3}[0-9]{1,3}" | grep -v 127.0.0.1 | awk '{ print $2 }' | cut -f2 -d: | head -n1
For some reason the nodes are looking at localhost (different from OP) at 127.0.0.1 instead of the new docker network created (172.17.0.1). Any idea why von_generate_transactions would be using DOCKERHOST=172.17.0.1 , but the nodes are at localhost? From what I can tell, I haven't adjusted the docker-compose.yml file.
Do you have an environment variable called IP set to 127.0.0.1? I think it checks if IP exists and creates a node with the value.
@vikramdulani In the manage script I've now removed the ifconfig parse line and directly hardcoded the DOCKERHOST: export DOCKERHOST=172.16.10.1 The nodes seem to be looking for the other nodes in the right place. For example: CONNECTION: Node4 looking for Node1 at 172.16.10.1:9701
But von-web still times out. Is this expected or is there more to the story?
I am also facing the same issue.Please help me
Clean build of von-network but I'm getting the 307 error starting the webserver. 4 indy nodes seem to have started without issues.
$ ./manage start e63527690a2f1ad64989a1f3a12014f794291b8dad607bc12a766f1cb988bb7f WARNING: The IP variable is not set. Defaulting to a blank string. WARNING: The IPS variable is not set. Defaulting to a blank string. Creating volume "von_node3-data" with default driver Creating volume "von_von-client-libindy" with default driver Creating volume "von_von-client-cli" with default driver Creating volume "von_node1-data" with default driver Creating volume "von_von-web-indy" with default driver Creating volume "von_node4-data" with default driver Creating von_node1_1 ... done Creating von_node3_1 ... done Creating von_node2_1 ... done Creating von_node4_1 ... done Creating von_node4_1 ... Creating von_von-web_1 ... done Attaching to von_node3_1, von_node2_1, von_node4_1, von_node1_1, von_von-web_1 node3_1 | Ledger does not exist - recreating... node3_1 | von_generate_transactions -n 3 node2_1 | Ledger does not exist - recreating... node2_1 | von_generate_transactions -n 2 node3_1 | init_indy_node Node3 9418 80 node4_1 | Ledger does not exist - recreating... node4_1 | von_generate_transactions -n 4 node3_1 | Node-stack name is Node3 node3_1 | Client-stack name is Node3C node3_1 | Generating keys for random seed b'1b8BcAA0c4eb7F1D87A93a0Ad896Db49' node3_1 | Init local keys for client-stack node3_1 | Public key is 8179088b9dc8e3ad76efc092070a2e1e2d41821044cda591334ec0faa4d0e33a node3_1 | Verification key is 3bdf73c8aa914081dd85281c1220f139b23a729d5105f95c532346f481328907 node3_1 | Init local keys for node-stack node2_1 | init_indy_node Node2 9418 80 node1_1 | Ledger does not exist - recreating... node4_1 | init_indy_node Node4 9418 80 node3_1 | Public key is 8179088b9dc8e3ad76efc092070a2e1e2d41821044cda591334ec0faa4d0e33a von-web_1 | Ledger does not exist - recreating... node1_1 | von_generate_transactions -n 1 node1_1 | init_indy_node Node1 9418 80 node2_1 | Node-stack name is Node2 von-web_1 | von_generate_transactions -n node3_1 | Verification key is 3bdf73c8aa914081dd85281c1220f139b23a729d5105f95c532346f481328907 node3_1 | BLS Public key is 28e1kvnVJwDzAzUSF7yyvGweSh2jKoaXqfbShuzFZGCCfeQuu8AzimYuiwjEsC5i4DGmMU5XDzL5x2cTcWL3rvByrsbrQJiC8chc8ZTNzrrMivdz5U46SuAb2TGsPEJo9sNJ7dRz1LMJKczgyKMphrfGaA1xpU71ZZ2iSiP2c67jpQb node3_1 | generate_indy_pool_transactions --nodes 4 --clients 0 --nodeNum 3 --ips 172.17.2.13,172.17.2.13,172.17.2.13,172.17.2.13 von-web_1 | generate_indy_pool_transactions --nodes 4 --clients 0 --ips 172.17.2.13,172.17.2.13,172.17.2.13,172.17.2.13 node2_1 | Client-stack name is Node2C node2_1 | Generating keys for random seed b'aEaDdB4c0b9969712CC10cD67fEBdaBf' node2_1 | Init local keys for client-stack node2_1 | Public key is 83dfacb66d1e31064c81fd1727f439a0108608bfe2ea5d76545232c09ac02d28 node2_1 | Verification key is d4f00e85f47ee532e014bbe72c93feeac822067b373d3a691c98cbee198d9964 node2_1 | Init local keys for node-stack node2_1 | Public key is 83dfacb66d1e31064c81fd1727f439a0108608bfe2ea5d76545232c09ac02d28 node2_1 | Verification key is d4f00e85f47ee532e014bbe72c93feeac822067b373d3a691c98cbee198d9964 node2_1 | BLS Public key is FfRwdSHnD8PLmsjNqaQW8sKvGjqgyge7SfDg1bLydVhhMtBdMGhHZh2XKTb39oPnUBnNTk82xovL672F5HbubHkti5BC3o5Lj4UxsnUheo71fE2iuBTtwQ1iNy9r8x4oJ72mbjRzqGu6eMDLv4gRTCAhL3C6hhNk2CP2LVFfwxDqQd node2_1 | generate_indy_pool_transactions --nodes 4 --clients 0 --nodeNum 2 --ips 172.17.2.13,172.17.2.13,172.17.2.13,172.17.2.13 node4_1 | Node-stack name is Node4 node4_1 | Client-stack name is Node4C node4_1 | Generating keys for random seed b'f09Ffd5aa3947CdFc83AB8CDff4cE99e' node4_1 | Init local keys for client-stack node4_1 | Public key is 79477bbdcfba05df8946d8205a01f9925d25af67c06a136caa533c21d12a9e53 node4_1 | Verification key is 86ae452b95630f01a9de8a36558295b05ac9f6c6ccea1445bcf9614fbc9c583e node4_1 | Init local keys for node-stack node4_1 | Public key is 79477bbdcfba05df8946d8205a01f9925d25af67c06a136caa533c21d12a9e53 node4_1 | Verification key is 86ae452b95630f01a9de8a36558295b05ac9f6c6ccea1445bcf9614fbc9c583e node4_1 | BLS Public key is NAUKyYqvKFMp96XyDFrHbAyHAiR6fgTwTVA3PMo7AZZS34uLjf2Y4EBwEZQZw88JtRUETDmVDxbTpPmwDGXWwPGJBhW8XEdDYzKP1CHui9dFKVKweDpcayZUvrr33zVCJStMWLezCKLedFntDDpsEiy2ujaSPsMkDWHoSKzcjSvpp1 node2_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node2_1 | Generating keys for provided seed b'000000000000000000000000000Node2' node2_1 | Init local keys for client-stack node2_1 | Public key is dd07d5194649c7e270fe474ba7fce50609a4afac632d98e534388079f6a09b0e node2_1 | Verification key is 6b6359eb98e5931bb517ec267a3081c011888ea78492a5575054b714b08786f0 node2_1 | Init local keys for node-stack node2_1 | Public key is dd07d5194649c7e270fe474ba7fce50609a4afac632d98e534388079f6a09b0e node2_1 | Verification key is 6b6359eb98e5931bb517ec267a3081c011888ea78492a5575054b714b08786f0 node2_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node2_1 | Nodes will not run locally, so writing /etc/indy/indy.env node2_1 | This node with name Node2 will use ports 9703 and 9704 for nodestack and clientstack respectively node2_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node2_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node2_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node2_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node2_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node2_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node4_1 | generate_indy_pool_transactions --nodes 4 --clients 0 --nodeNum 4 --ips 172.17.2.13,172.17.2.13,172.17.2.13,172.17.2.13 node2_1 | Generated genesis transaction file: node2_1 | /home/indy/.indy-cli/networks/sandbox/pool_transactions_genesis node1_1 | Node-stack name is Node1 node1_1 | Client-stack name is Node1C node1_1 | Generating keys for random seed b'a93a88bf28db7c8bbc9AE492bAD40E1D' node1_1 | Init local keys for client-stack node1_1 | Public key is dd6d622bfab8e2aca8cddedd0d91863f140a73d780eb24aab712d52877c04456 node1_1 | Verification key is c7330e9591513d78b0b743e2090904b485d143f51d383f1eeed3a79e1ac94344 node1_1 | Init local keys for node-stack node1_1 | Public key is dd6d622bfab8e2aca8cddedd0d91863f140a73d780eb24aab712d52877c04456 node1_1 | Verification key is c7330e9591513d78b0b743e2090904b485d143f51d383f1eeed3a79e1ac94344 node1_1 | BLS Public key is 3KMp24nFEFNTSdyr9kCUwNkq9MEunUfSWzs8JKhpSZ1hBbVcQjM6Bpu2NHuG7q8sJKWJo1htvZwJQezdZAMw8cp1FEzcR5x7J8rfBSpnmW9waCWzuQwhzB4BXxwFdmxJxYgJs2UYzh4fpAFK758rWXSpBf75CD6f2ZkM7g4ADjTidKz node2_1 | {"data":{"alias":"Node1","blskey":"4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba","client_ip":"172.17.2.13","client_port":9702,"node_ip":"172.17.2.13","node_port":9701,"services":["VALIDATOR"]},"dest":"Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv","identifier":"Th7MpTaRZVRYnPiabds81Y","txnId":"fea82e10e894419fe2bea7d96296a6d46f50f93f9eeda954ec461b2ed2950b62","type":"0"} node2_1 | {"data":{"alias":"Node2","blskey":"37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk","client_ip":"172.17.2.13","client_port":9704,"node_ip":"172.17.2.13","node_port":9703,"services":["VALIDATOR"]},"dest":"8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb","identifier":"EbP4aYNeTHL6q385GuVpRV","txnId":"1ac8aece2a18ced660fef8694b61aac3af08ba875ce3026a160acbc3a3af35fc","type":"0"} node2_1 | {"data":{"alias":"Node3","blskey":"3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5","client_ip":"172.17.2.13","client_port":9706,"node_ip":"172.17.2.13","node_port":9705,"services":["VALIDATOR"]},"dest":"DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya","identifier":"4cU41vWW82ArfxJxHkzXPG","txnId":"7e9f355dffa78ed24668f0e0e369fd8c224076571c51e2ea8be5f26479edebe4","type":"0"} node2_1 | {"data":{"alias":"Node4","blskey":"2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw","client_ip":"172.17.2.13","client_port":9708,"node_ip":"172.17.2.13","node_port":9707,"services":["VALIDATOR"]},"dest":"4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA","identifier":"TWwCRQRZ2ZHMJFn9TzLp7W","txnId":"aa5e817d7cc626170eca175822029339a444eb0ee8f0bd20d3b0b76e566fb008","type":"0"} node3_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node3_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node3_1 | Generating keys for provided seed b'000000000000000000000000000Node3' node3_1 | Init local keys for client-stack node3_1 | Public key is 4f0543aeae1d95e79b15e055927896943bf59e25531a9a874d8a1c93af2f1b77 node3_1 | Verification key is b7096f454798c7fe3131af0020c6dcefea0b6664ed344cd6b829d1bae388ba0d node3_1 | Init local keys for node-stack node3_1 | Public key is 4f0543aeae1d95e79b15e055927896943bf59e25531a9a874d8a1c93af2f1b77 node3_1 | Verification key is b7096f454798c7fe3131af0020c6dcefea0b6664ed344cd6b829d1bae388ba0d node3_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node3_1 | Nodes will not run locally, so writing /etc/indy/indy.env node3_1 | This node with name Node3 will use ports 9705 and 9706 for nodestack and clientstack respectively node3_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node3_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node3_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node3_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node3_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node2_1 | start_indy_node Node2 9703 9704 node1_1 | generate_indy_pool_transactions --nodes 4 --clients 0 --nodeNum 1 --ips 172.17.2.13,172.17.2.13,172.17.2.13,172.17.2.13 node3_1 | Generated genesis transaction file: node3_1 | /home/indy/.indy-cli/networks/sandbox/pool_transactions_genesis node3_1 | {"data":{"alias":"Node1","blskey":"4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba","client_ip":"172.17.2.13","client_port":9702,"node_ip":"172.17.2.13","node_port":9701,"services":["VALIDATOR"]},"dest":"Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv","identifier":"Th7MpTaRZVRYnPiabds81Y","txnId":"fea82e10e894419fe2bea7d96296a6d46f50f93f9eeda954ec461b2ed2950b62","type":"0"} node3_1 | {"data":{"alias":"Node2","blskey":"37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk","client_ip":"172.17.2.13","client_port":9704,"node_ip":"172.17.2.13","node_port":9703,"services":["VALIDATOR"]},"dest":"8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb","identifier":"EbP4aYNeTHL6q385GuVpRV","txnId":"1ac8aece2a18ced660fef8694b61aac3af08ba875ce3026a160acbc3a3af35fc","type":"0"} node3_1 | {"data":{"alias":"Node3","blskey":"3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5","client_ip":"172.17.2.13","client_port":9706,"node_ip":"172.17.2.13","node_port":9705,"services":["VALIDATOR"]},"dest":"DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya","identifier":"4cU41vWW82ArfxJxHkzXPG","txnId":"7e9f355dffa78ed24668f0e0e369fd8c224076571c51e2ea8be5f26479edebe4","type":"0"} node3_1 | {"data":{"alias":"Node4","blskey":"2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw","client_ip":"172.17.2.13","client_port":9708,"node_ip":"172.17.2.13","node_port":9707,"services":["VALIDATOR"]},"dest":"4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA","identifier":"TWwCRQRZ2ZHMJFn9TzLp7W","txnId":"aa5e817d7cc626170eca175822029339a444eb0ee8f0bd20d3b0b76e566fb008","type":"0"} node3_1 | start_indy_node Node3 9705 9706 von-web_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba von-web_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk von-web_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 von-web_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw von-web_1 | Generated genesis transaction file: von-web_1 | /home/indy/.indy-cli/networks/sandbox/pool_transactions_genesis von-web_1 | {"data":{"alias":"Node1","blskey":"4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba","client_ip":"172.17.2.13","client_port":9702,"node_ip":"172.17.2.13","node_port":9701,"services":["VALIDATOR"]},"dest":"Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv","identifier":"Th7MpTaRZVRYnPiabds81Y","txnId":"fea82e10e894419fe2bea7d96296a6d46f50f93f9eeda954ec461b2ed2950b62","type":"0"} von-web_1 | {"data":{"alias":"Node2","blskey":"37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk","client_ip":"172.17.2.13","client_port":9704,"node_ip":"172.17.2.13","node_port":9703,"services":["VALIDATOR"]},"dest":"8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb","identifier":"EbP4aYNeTHL6q385GuVpRV","txnId":"1ac8aece2a18ced660fef8694b61aac3af08ba875ce3026a160acbc3a3af35fc","type":"0"} von-web_1 | {"data":{"alias":"Node3","blskey":"3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5","client_ip":"172.17.2.13","client_port":9706,"node_ip":"172.17.2.13","node_port":9705,"services":["VALIDATOR"]},"dest":"DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya","identifier":"4cU41vWW82ArfxJxHkzXPG","txnId":"7e9f355dffa78ed24668f0e0e369fd8c224076571c51e2ea8be5f26479edebe4","type":"0"} von-web_1 | {"data":{"alias":"Node4","blskey":"2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw","client_ip":"172.17.2.13","client_port":9708,"node_ip":"172.17.2.13","node_port":9707,"services":["VALIDATOR"]},"dest":"4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA","identifier":"TWwCRQRZ2ZHMJFn9TzLp7W","txnId":"aa5e817d7cc626170eca175822029339a444eb0ee8f0bd20d3b0b76e566fb008","type":"0"} node4_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node4_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node4_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node4_1 | Generating keys for provided seed b'000000000000000000000000000Node4' node4_1 | Init local keys for client-stack node4_1 | Public key is c4188d1f69ed1b41c93e3b37c1f2b5352a9d22e78340b03c1ed27b6ea9bf851a node4_1 | Verification key is 3252264c2f6cda994feed5b30456bf5524f0183a65c509175471d3406a7f2f63 node4_1 | Init local keys for node-stack node4_1 | Public key is c4188d1f69ed1b41c93e3b37c1f2b5352a9d22e78340b03c1ed27b6ea9bf851a node4_1 | Verification key is 3252264c2f6cda994feed5b30456bf5524f0183a65c509175471d3406a7f2f63 node4_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node4_1 | Nodes will not run locally, so writing /etc/indy/indy.env node4_1 | This node with name Node4 will use ports 9707 and 9708 for nodestack and clientstack respectively node4_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node4_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node4_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node4_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node4_1 | Generated genesis transaction file: node4_1 | /home/indy/.indy-cli/networks/sandbox/pool_transactions_genesis node4_1 | {"data":{"alias":"Node1","blskey":"4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba","client_ip":"172.17.2.13","client_port":9702,"node_ip":"172.17.2.13","node_port":9701,"services":["VALIDATOR"]},"dest":"Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv","identifier":"Th7MpTaRZVRYnPiabds81Y","txnId":"fea82e10e894419fe2bea7d96296a6d46f50f93f9eeda954ec461b2ed2950b62","type":"0"} node4_1 | {"data":{"alias":"Node2","blskey":"37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk","client_ip":"172.17.2.13","client_port":9704,"node_ip":"172.17.2.13","node_port":9703,"services":["VALIDATOR"]},"dest":"8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb","identifier":"EbP4aYNeTHL6q385GuVpRV","txnId":"1ac8aece2a18ced660fef8694b61aac3af08ba875ce3026a160acbc3a3af35fc","type":"0"} node4_1 | {"data":{"alias":"Node3","blskey":"3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5","client_ip":"172.17.2.13","client_port":9706,"node_ip":"172.17.2.13","node_port":9705,"services":["VALIDATOR"]},"dest":"DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya","identifier":"4cU41vWW82ArfxJxHkzXPG","txnId":"7e9f355dffa78ed24668f0e0e369fd8c224076571c51e2ea8be5f26479edebe4","type":"0"} node4_1 | {"data":{"alias":"Node4","blskey":"2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw","client_ip":"172.17.2.13","client_port":9708,"node_ip":"172.17.2.13","node_port":9707,"services":["VALIDATOR"]},"dest":"4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA","identifier":"TWwCRQRZ2ZHMJFn9TzLp7W","txnId":"aa5e817d7cc626170eca175822029339a444eb0ee8f0bd20d3b0b76e566fb008","type":"0"} node4_1 | start_indy_node Node4 9707 9708 node1_1 | Generating keys for provided seed b'000000000000000000000000000Node1' node1_1 | Init local keys for client-stack node1_1 | Public key is f5a2927d4eb8e23cdd0167c2e786613993590dab50e6d68bc3821df3b8c34f1f node1_1 | Verification key is ecbb3dd3a659f1e94d160fb2a77d85b92fda9de1b62c46e80ebf78735970056d node1_1 | Init local keys for node-stack node1_1 | Public key is f5a2927d4eb8e23cdd0167c2e786613993590dab50e6d68bc3821df3b8c34f1f node1_1 | Verification key is ecbb3dd3a659f1e94d160fb2a77d85b92fda9de1b62c46e80ebf78735970056d node1_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node1_1 | Nodes will not run locally, so writing /etc/indy/indy.env node1_1 | This node with name Node1 will use ports 9701 and 9702 for nodestack and clientstack respectively node1_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node1_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node1_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node1_1 | BLS Public key is 4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba node1_1 | BLS Public key is 37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk node1_1 | BLS Public key is 3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5 node1_1 | BLS Public key is 2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw node1_1 | Generated genesis transaction file: node1_1 | /home/indy/.indy-cli/networks/sandbox/pool_transactions_genesis node1_1 | {"data":{"alias":"Node1","blskey":"4N8aUNHSgjQVgkpm8nhNEfDf6txHznoYREg9kirmJrkivgL4oSEimFF6nsQ6M41QvhM2Z33nves5vfSn9n1UwNFJBYtWVnHYMATn76vLuL3zU88KyeAYcHfsih3He6UHcXDxcaecHVz6jhCYz1P2UZn2bDVruL5wXpehgBfBaLKm3Ba","client_ip":"172.17.2.13","client_port":9702,"node_ip":"172.17.2.13","node_port":9701,"services":["VALIDATOR"]},"dest":"Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv","identifier":"Th7MpTaRZVRYnPiabds81Y","txnId":"fea82e10e894419fe2bea7d96296a6d46f50f93f9eeda954ec461b2ed2950b62","type":"0"} node1_1 | {"data":{"alias":"Node2","blskey":"37rAPpXVoxzKhz7d9gkUe52XuXryuLXoM6P6LbWDB7LSbG62Lsb33sfG7zqS8TK1MXwuCHj1FKNzVpsnafmqLG1vXN88rt38mNFs9TENzm4QHdBzsvCuoBnPH7rpYYDo9DZNJePaDvRvqJKByCabubJz3XXKbEeshzpz4Ma5QYpJqjk","client_ip":"172.17.2.13","client_port":9704,"node_ip":"172.17.2.13","node_port":9703,"services":["VALIDATOR"]},"dest":"8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb","identifier":"EbP4aYNeTHL6q385GuVpRV","txnId":"1ac8aece2a18ced660fef8694b61aac3af08ba875ce3026a160acbc3a3af35fc","type":"0"} node1_1 | {"data":{"alias":"Node3","blskey":"3WFpdbg7C5cnLYZwFZevJqhubkFALBfCBBok15GdrKMUhUjGsk3jV6QKj6MZgEubF7oqCafxNdkm7eswgA4sdKTRc82tLGzZBd6vNqU8dupzup6uYUf32KTHTPQbuUM8Yk4QFXjEf2Usu2TJcNkdgpyeUSX42u5LqdDDpNSWUK5deC5","client_ip":"172.17.2.13","client_port":9706,"node_ip":"172.17.2.13","node_port":9705,"services":["VALIDATOR"]},"dest":"DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya","identifier":"4cU41vWW82ArfxJxHkzXPG","txnId":"7e9f355dffa78ed24668f0e0e369fd8c224076571c51e2ea8be5f26479edebe4","type":"0"} node1_1 | {"data":{"alias":"Node4","blskey":"2zN3bHM1m4rLz54MJHYSwvqzPchYp8jkHswveCLAEJVcX6Mm1wHQD1SkPYMzUDTZvWvhuE6VNAkK3KxVeEmsanSmvjVkReDeBEMxeDaayjcZjFGPydyey1qxBHmTvAnBKoPydvuTAqx5f7YNNRAdeLmUi99gERUU7TD8KfAa6MpQ9bw","client_ip":"172.17.2.13","client_port":9708,"node_ip":"172.17.2.13","node_port":9707,"services":["VALIDATOR"]},"dest":"4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA","identifier":"TWwCRQRZ2ZHMJFn9TzLp7W","txnId":"aa5e817d7cc626170eca175822029339a444eb0ee8f0bd20d3b0b76e566fb008","type":"0"} node1_1 | start_indy_node Node1 9701 9702 von-web_1 | Creating a Pipfile for this project... node2_1 | 2018-06-26 05:02:43,538 | DEBUG | init.py (60) | register | Registered VCS backend: git node2_1 | 2018-06-26 05:02:43,548 | DEBUG | init.py (60) | register | Registered VCS backend: hg node2_1 | 2018-06-26 05:02:43,574 | DEBUG | init.py (60) | register | Registered VCS backend: svn node2_1 | 2018-06-26 05:02:43,575 | DEBUG | init.py (60) | register | Registered VCS backend: bzr node3_1 | 2018-06-26 05:02:43,745 | DEBUG | init.py (60) | register | Registered VCS backend: git node3_1 | 2018-06-26 05:02:43,764 | DEBUG | init.py (60) | register | Registered VCS backend: hg node3_1 | 2018-06-26 05:02:43,827 | DEBUG | init.py (60) | register | Registered VCS backend: svn node3_1 | 2018-06-26 05:02:43,828 | DEBUG | init.py (60) | register | Registered VCS backend: bzr node4_1 | 2018-06-26 05:02:44,914 | DEBUG | init.py (60) | register | Registered VCS backend: git node4_1 | 2018-06-26 05:02:44,933 | DEBUG | init.py (60) | register | Registered VCS backend: hg node2_1 | 2018-06-26 05:02:44,941 | DEBUG | selector_events.py (53) | init | Using selector: EpollSelector node2_1 | 2018-06-26 05:02:44,955 | DEBUG | ledger.py (201) | start | Starting ledger... node2_1 | 2018-06-26 05:02:44,961 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node2_1 | 2018-06-26 05:02:44,976 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.015433578999363817 seconds node2_1 | 2018-06-26 05:02:45,010 | DEBUG | ledger.py (201) | start | Starting ledger... node2_1 | 2018-06-26 05:02:45,024 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node2_1 | 2018-06-26 05:02:45,036 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.011547622998477891 seconds node4_1 | 2018-06-26 05:02:45,036 | DEBUG | init.py (60) | register | Registered VCS backend: svn node4_1 | 2018-06-26 05:02:45,045 | DEBUG | init.py (60) | register | Registered VCS backend: bzr node2_1 | 2018-06-26 05:02:45,047 | INFO | node.py (2636) | initStateFromLedger | Node2 found state to be empty, recreating from ledger node2_1 | 2018-06-26 05:02:45,052 | INFO | pool_manager.py (394) | _order_node | Node2 node Node1 ordered, NYM Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv node2_1 | 2018-06-26 05:02:45,052 | INFO | pool_manager.py (394) | _order_node | Node2 node Node2 ordered, NYM 8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb node2_1 | 2018-06-26 05:02:45,053 | INFO | pool_manager.py (394) | _order_node | Node2 node Node3 ordered, NYM DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya node2_1 | 2018-06-26 05:02:45,053 | INFO | pool_manager.py (394) | _order_node | Node2 node Node4 ordered, NYM 4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA node2_1 | 2018-06-26 05:02:45,099 | INFO | node.py (786) | _create_bls_bft | BLS: BLS Signatures will be used for Node Node2 node2_1 | 2018-06-26 05:02:45,125 | INFO | node.py (2636) | initStateFromLedger | Node2 found state to be empty, recreating from ledger node2_1 | 2018-06-26 05:02:45,133 | INFO | node.py (612) | setPoolParams | Node2 updated its pool parameters: f 1, totalNodes 4, allNodeNames {'Node4', 'Node3', 'Node2', 'Node1'}, requiredNumberOfInstances 2, minimumNodes 3, quorums {'prepare': Quorum(2), 'election': Quorum(3), 'reply': Quorum(2), 'view_change_done': Quorum(3), 'observer_data': Quorum(2), 'f': 1, 'commit': Quorum(3), 'ledger_status': Quorum(2), 'propagate_primary': Quorum(2), 'bls_signatures': Quorum(3), 'checkpoint': Quorum(2), 'view_change': Quorum(3), 'consistency_proof': Quorum(2), 'timestamp': Quorum(2), 'same_consistency_proof': Quorum(2), 'propagate': Quorum(2)} node3_1 | 2018-06-26 05:02:45,285 | DEBUG | selector_events.py (53) | init | Using selector: EpollSelector node2_1 | 2018-06-26 05:02:45,406 | INFO | plugin_loader.py (118) | _load | plugin FirebaseStatsConsumer successfully loaded from module plugin_firebase_stats_consumer node2_1 | 2018-06-26 05:02:45,407 | DISPLAY | replicas.py (41) | grow | Node2 added replica Node2:0 to instance 0 (master) node2_1 | 2018-06-26 05:02:45,415 | DISPLAY | replicas.py (41) | grow | Node2 added replica Node2:1 to instance 1 (backup) node2_1 | 2018-06-26 05:02:45,415 | DEBUG | plugin_helper.py (23) | loadPlugins | Plugin loading started to load plugins from plugins_dir: /var/lib/indy/plugins node2_1 | 2018-06-26 05:02:45,417 | DEBUG | plugin_helper.py (28) | loadPlugins | Plugin directory created at: /var/lib/indy/plugins node2_1 | 2018-06-26 05:02:45,417 | DEBUG | plugin_helper.py (63) | loadPlugins | Total plugins loaded from plugins_dir /var/lib/indy/plugins are : 0 node3_1 | 2018-06-26 05:02:45,419 | DEBUG | ledger.py (201) | start | Starting ledger... node3_1 | 2018-06-26 05:02:45,443 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node2_1 | 2018-06-26 05:02:45,468 | DEBUG | ledger.py (201) | start | Starting ledger... node3_1 | 2018-06-26 05:02:45,469 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.02672063300269656 seconds node2_1 | 2018-06-26 05:02:45,476 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node1_1 | 2018-06-26 05:02:45,495 | DEBUG | init.py (60) | register | Registered VCS backend: git node2_1 | 2018-06-26 05:02:45,507 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.031718833008199 seconds node2_1 | 2018-06-26 05:02:45,521 | INFO | node.py (2636) | initStateFromLedger | Node2 found state to be empty, recreating from ledger node2_1 | 2018-06-26 05:02:45,523 | DEBUG | ledger.py (199) | start | Ledger already started. node2_1 | 2018-06-26 05:02:45,524 | DEBUG | ledger.py (199) | start | Ledger already started. node2_1 | 2018-06-26 05:02:45,525 | DEBUG | ledger.py (199) | start | Ledger already started. node2_1 | 2018-06-26 05:02:45,535 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.1 node2_1 | 2018-06-26 05:02:45,535 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node2_1 | 2018-06-26 05:02:45,535 | DEBUG | base.py (112) | configure_curve | Configure curve: [/var/lib/indy/sandbox/keys/Node2/public_keys] node2_1 | 2018-06-26 05:02:45,543 | INFO | stacks.py (84) | start | CONNECTION: Node2 listening for other nodes at 0.0.0.0:9703 node2_1 | 2018-06-26 05:02:45,544 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.2 node2_1 | 2018-06-26 05:02:45,544 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node2_1 | 2018-06-26 05:02:45,554 | DEBUG | base.py (112) | configure_curve | Configure curve: [] node2_1 | 2018-06-26 05:02:45,555 | INFO | node.py (853) | start | Node2 first time running... node2_1 | 2018-06-26 05:02:45,569 | INFO | zstack.py (584) | connect | CONNECTION: Node2 looking for Node4 at 172.17.2.13:9707 node3_1 | 2018-06-26 05:02:45,576 | DEBUG | ledger.py (201) | start | Starting ledger... node2_1 | 2018-06-26 05:02:45,581 | INFO | zstack.py (584) | connect | CONNECTION: Node2 looking for Node3 at 172.17.2.13:9705 node1_1 | 2018-06-26 05:02:45,585 | DEBUG | init.py (60) | register | Registered VCS backend: hg node3_1 | 2018-06-26 05:02:45,588 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node2_1 | 2018-06-26 05:02:45,589 | INFO | zstack.py (584) | connect | CONNECTION: Node2 looking for Node1 at 172.17.2.13:9701 node3_1 | 2018-06-26 05:02:45,640 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.05182347599475179 seconds node3_1 | 2018-06-26 05:02:45,655 | INFO | node.py (2636) | initStateFromLedger | Node3 found state to be empty, recreating from ledger node3_1 | 2018-06-26 05:02:45,658 | INFO | pool_manager.py (394) | _order_node | Node3 node Node1 ordered, NYM Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv node3_1 | 2018-06-26 05:02:45,674 | INFO | pool_manager.py (394) | _order_node | Node3 node Node2 ordered, NYM 8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb node3_1 | 2018-06-26 05:02:45,675 | INFO | pool_manager.py (394) | _order_node | Node3 node Node3 ordered, NYM DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya node3_1 | 2018-06-26 05:02:45,676 | INFO | pool_manager.py (394) | _order_node | Node3 node Node4 ordered, NYM 4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA node1_1 | 2018-06-26 05:02:45,703 | DEBUG | init.py (60) | register | Registered VCS backend: svn node1_1 | 2018-06-26 05:02:45,704 | DEBUG | init.py (60) | register | Registered VCS backend: bzr node3_1 | 2018-06-26 05:02:45,710 | INFO | node.py (786) | _create_bls_bft | BLS: BLS Signatures will be used for Node Node3 node3_1 | 2018-06-26 05:02:45,721 | INFO | node.py (2636) | initStateFromLedger | Node3 found state to be empty, recreating from ledger node3_1 | 2018-06-26 05:02:45,733 | INFO | node.py (612) | setPoolParams | Node3 updated its pool parameters: f 1, totalNodes 4, allNodeNames {'Node2', 'Node3', 'Node4', 'Node1'}, requiredNumberOfInstances 2, minimumNodes 3, quorums {'propagate': Quorum(2), 'ledger_status': Quorum(2), 'bls_signatures': Quorum(3), 'f': 1, 'checkpoint': Quorum(2), 'propagate_primary': Quorum(2), 'timestamp': Quorum(2), 'commit': Quorum(3), 'election': Quorum(3), 'reply': Quorum(2), 'prepare': Quorum(2), 'consistency_proof': Quorum(2), 'observer_data': Quorum(2), 'view_change': Quorum(3), 'same_consistency_proof': Quorum(2), 'view_change_done': Quorum(3)} node3_1 | 2018-06-26 05:02:45,888 | INFO | plugin_loader.py (118) | _load | plugin FirebaseStatsConsumer successfully loaded from module plugin_firebase_stats_consumer node3_1 | 2018-06-26 05:02:45,890 | DISPLAY | replicas.py (41) | grow | Node3 added replica Node3:0 to instance 0 (master) node3_1 | 2018-06-26 05:02:45,890 | DISPLAY | replicas.py (41) | grow | Node3 added replica Node3:1 to instance 1 (backup) node3_1 | 2018-06-26 05:02:45,891 | DEBUG | plugin_helper.py (23) | loadPlugins | Plugin loading started to load plugins from plugins_dir: /var/lib/indy/plugins node3_1 | 2018-06-26 05:02:45,891 | DEBUG | plugin_helper.py (28) | loadPlugins | Plugin directory created at: /var/lib/indy/plugins node3_1 | 2018-06-26 05:02:45,892 | DEBUG | plugin_helper.py (63) | loadPlugins | Total plugins loaded from plugins_dir /var/lib/indy/plugins are : 0 node3_1 | 2018-06-26 05:02:45,934 | DEBUG | ledger.py (201) | start | Starting ledger... node3_1 | 2018-06-26 05:02:45,939 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node3_1 | 2018-06-26 05:02:45,955 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.015691149994381703 seconds node3_1 | 2018-06-26 05:02:45,963 | INFO | node.py (2636) | initStateFromLedger | Node3 found state to be empty, recreating from ledger node3_1 | 2018-06-26 05:02:45,964 | DEBUG | ledger.py (199) | start | Ledger already started. node3_1 | 2018-06-26 05:02:45,965 | DEBUG | ledger.py (199) | start | Ledger already started. node3_1 | 2018-06-26 05:02:45,966 | DEBUG | ledger.py (199) | start | Ledger already started. node3_1 | 2018-06-26 05:02:45,967 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.1 node3_1 | 2018-06-26 05:02:45,968 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node3_1 | 2018-06-26 05:02:45,969 | DEBUG | base.py (112) | configure_curve | Configure curve: [/var/lib/indy/sandbox/keys/Node3/public_keys] node3_1 | 2018-06-26 05:02:45,970 | INFO | stacks.py (84) | start | CONNECTION: Node3 listening for other nodes at 0.0.0.0:9705 node3_1 | 2018-06-26 05:02:45,984 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.2 node3_1 | 2018-06-26 05:02:45,985 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node3_1 | 2018-06-26 05:02:45,986 | DEBUG | base.py (112) | configure_curve | Configure curve: [] node3_1 | 2018-06-26 05:02:45,987 | INFO | node.py (853) | start | Node3 first time running... node3_1 | 2018-06-26 05:02:45,990 | INFO | zstack.py (584) | connect | CONNECTION: Node3 looking for Node2 at 172.17.2.13:9703 node3_1 | 2018-06-26 05:02:45,992 | INFO | zstack.py (584) | connect | CONNECTION: Node3 looking for Node4 at 172.17.2.13:9707 node3_1 | 2018-06-26 05:02:45,994 | INFO | zstack.py (584) | connect | CONNECTION: Node3 looking for Node1 at 172.17.2.13:9701 node4_1 | 2018-06-26 05:02:46,600 | DEBUG | selector_events.py (53) | init | Using selector: EpollSelector node4_1 | 2018-06-26 05:02:46,621 | DEBUG | ledger.py (201) | start | Starting ledger... node4_1 | 2018-06-26 05:02:46,627 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node4_1 | 2018-06-26 05:02:46,638 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.01186606400005985 seconds node4_1 | 2018-06-26 05:02:46,669 | DEBUG | ledger.py (201) | start | Starting ledger... node4_1 | 2018-06-26 05:02:46,676 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node4_1 | 2018-06-26 05:02:46,703 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.027089648006949574 seconds node4_1 | 2018-06-26 05:02:46,711 | INFO | node.py (2636) | initStateFromLedger | Node4 found state to be empty, recreating from ledger node4_1 | 2018-06-26 05:02:46,716 | INFO | pool_manager.py (394) | _order_node | Node4 node Node1 ordered, NYM Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv node4_1 | 2018-06-26 05:02:46,719 | INFO | pool_manager.py (394) | _order_node | Node4 node Node2 ordered, NYM 8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb node4_1 | 2018-06-26 05:02:46,719 | INFO | pool_manager.py (394) | _order_node | Node4 node Node3 ordered, NYM DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya node4_1 | 2018-06-26 05:02:46,720 | INFO | pool_manager.py (394) | _order_node | Node4 node Node4 ordered, NYM 4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA node4_1 | 2018-06-26 05:02:46,744 | INFO | node.py (786) | _create_bls_bft | BLS: BLS Signatures will be used for Node Node4 node4_1 | 2018-06-26 05:02:46,757 | INFO | node.py (2636) | initStateFromLedger | Node4 found state to be empty, recreating from ledger node4_1 | 2018-06-26 05:02:46,769 | INFO | node.py (612) | setPoolParams | Node4 updated its pool parameters: f 1, totalNodes 4, allNodeNames {'Node2', 'Node1', 'Node3', 'Node4'}, requiredNumberOfInstances 2, minimumNodes 3, quorums {'f': 1, 'observer_data': Quorum(2), 'consistency_proof': Quorum(2), 'propagate': Quorum(2), 'prepare': Quorum(2), 'commit': Quorum(3), 'view_change_done': Quorum(3), 'view_change': Quorum(3), 'ledger_status': Quorum(2), 'reply': Quorum(2), 'timestamp': Quorum(2), 'checkpoint': Quorum(2), 'election': Quorum(3), 'propagate_primary': Quorum(2), 'bls_signatures': Quorum(3), 'same_consistency_proof': Quorum(2)} node1_1 | 2018-06-26 05:02:46,771 | DEBUG | selector_events.py (53) | init | Using selector: EpollSelector node1_1 | 2018-06-26 05:02:46,789 | DEBUG | ledger.py (201) | start | Starting ledger... node1_1 | 2018-06-26 05:02:46,794 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node1_1 | 2018-06-26 05:02:46,811 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.01621078999596648 seconds node4_1 | 2018-06-26 05:02:46,860 | INFO | plugin_loader.py (118) | _load | plugin FirebaseStatsConsumer successfully loaded from module plugin_firebase_stats_consumer node4_1 | 2018-06-26 05:02:46,862 | DISPLAY | replicas.py (41) | grow | Node4 added replica Node4:0 to instance 0 (master) node4_1 | 2018-06-26 05:02:46,863 | DISPLAY | replicas.py (41) | grow | Node4 added replica Node4:1 to instance 1 (backup) node4_1 | 2018-06-26 05:02:46,864 | DEBUG | plugin_helper.py (23) | loadPlugins | Plugin loading started to load plugins from plugins_dir: /var/lib/indy/plugins node4_1 | 2018-06-26 05:02:46,865 | DEBUG | plugin_helper.py (28) | loadPlugins | Plugin directory created at: /var/lib/indy/plugins node4_1 | 2018-06-26 05:02:46,867 | DEBUG | plugin_helper.py (63) | loadPlugins | Total plugins loaded from plugins_dir /var/lib/indy/plugins are : 0 node1_1 | 2018-06-26 05:02:46,869 | DEBUG | ledger.py (201) | start | Starting ledger... node1_1 | 2018-06-26 05:02:46,890 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node4_1 | 2018-06-26 05:02:46,911 | DEBUG | ledger.py (201) | start | Starting ledger... node1_1 | 2018-06-26 05:02:46,918 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.02188445300271269 seconds node4_1 | 2018-06-26 05:02:46,934 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node1_1 | 2018-06-26 05:02:46,936 | INFO | node.py (2636) | initStateFromLedger | Node1 found state to be empty, recreating from ledger node1_1 | 2018-06-26 05:02:46,941 | INFO | pool_manager.py (394) | _order_node | Node1 node Node1 ordered, NYM Gw6pDLhcBcoQesN72qfotTgFa7cbuqZpkX3Xo6pLhPhv node1_1 | 2018-06-26 05:02:46,941 | INFO | pool_manager.py (394) | _order_node | Node1 node Node2 ordered, NYM 8ECVSk179mjsjKRLWiQtssMLgp6EPhWXtaYyStWPSGAb node1_1 | 2018-06-26 05:02:46,942 | INFO | pool_manager.py (394) | _order_node | Node1 node Node3 ordered, NYM DKVxG2fXXTU8yT5N7hGEbXB3dfdAnYv1JczDUHpmDxya node1_1 | 2018-06-26 05:02:46,944 | INFO | pool_manager.py (394) | _order_node | Node1 node Node4 ordered, NYM 4PS3EDQ3dW1tci1Bp6543CfuuebjFrg36kLAUcskGfaA node4_1 | 2018-06-26 05:02:46,954 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.020278755997424014 seconds node4_1 | 2018-06-26 05:02:46,969 | INFO | node.py (2636) | initStateFromLedger | Node4 found state to be empty, recreating from ledger node4_1 | 2018-06-26 05:02:46,972 | DEBUG | ledger.py (199) | start | Ledger already started. node1_1 | 2018-06-26 05:02:46,972 | INFO | node.py (786) | _create_bls_bft | BLS: BLS Signatures will be used for Node Node1 node4_1 | 2018-06-26 05:02:46,975 | DEBUG | ledger.py (199) | start | Ledger already started. node4_1 | 2018-06-26 05:02:46,976 | DEBUG | ledger.py (199) | start | Ledger already started. node4_1 | 2018-06-26 05:02:46,977 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.1 node4_1 | 2018-06-26 05:02:46,978 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node4_1 | 2018-06-26 05:02:46,982 | DEBUG | base.py (112) | configure_curve | Configure curve: [/var/lib/indy/sandbox/keys/Node4/public_keys] node4_1 | 2018-06-26 05:02:46,983 | INFO | stacks.py (84) | start | CONNECTION: Node4 listening for other nodes at 0.0.0.0:9707 node4_1 | 2018-06-26 05:02:46,984 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.2 node4_1 | 2018-06-26 05:02:46,985 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node4_1 | 2018-06-26 05:02:46,986 | DEBUG | base.py (112) | configure_curve | Configure curve: [] node4_1 | 2018-06-26 05:02:46,988 | INFO | node.py (853) | start | Node4 first time running... node4_1 | 2018-06-26 05:02:46,991 | INFO | zstack.py (584) | connect | CONNECTION: Node4 looking for Node3 at 172.17.2.13:9705 node1_1 | 2018-06-26 05:02:46,992 | INFO | node.py (2636) | initStateFromLedger | Node1 found state to be empty, recreating from ledger node4_1 | 2018-06-26 05:02:46,994 | INFO | zstack.py (584) | connect | CONNECTION: Node4 looking for Node2 at 172.17.2.13:9703 node4_1 | 2018-06-26 05:02:46,995 | INFO | zstack.py (584) | connect | CONNECTION: Node4 looking for Node1 at 172.17.2.13:9701 node1_1 | 2018-06-26 05:02:47,003 | INFO | node.py (612) | setPoolParams | Node1 updated its pool parameters: f 1, totalNodes 4, allNodeNames {'Node4', 'Node1', 'Node3', 'Node2'}, requiredNumberOfInstances 2, minimumNodes 3, quorums {'observer_data': Quorum(2), 'propagate_primary': Quorum(2), 'election': Quorum(3), 'propagate': Quorum(2), 'f': 1, 'bls_signatures': Quorum(3), 'checkpoint': Quorum(2), 'view_change_done': Quorum(3), 'timestamp': Quorum(2), 'consistency_proof': Quorum(2), 'view_change': Quorum(3), 'prepare': Quorum(2), 'same_consistency_proof': Quorum(2), 'reply': Quorum(2), 'ledger_status': Quorum(2), 'commit': Quorum(3)} node1_1 | 2018-06-26 05:02:47,058 | INFO | plugin_loader.py (118) | _load | plugin FirebaseStatsConsumer successfully loaded from module plugin_firebase_stats_consumer node1_1 | 2018-06-26 05:02:47,060 | DISPLAY | replicas.py (41) | grow | Node1 added replica Node1:0 to instance 0 (master) node1_1 | 2018-06-26 05:02:47,061 | DISPLAY | replicas.py (41) | grow | Node1 added replica Node1:1 to instance 1 (backup) node1_1 | 2018-06-26 05:02:47,063 | DEBUG | plugin_helper.py (23) | loadPlugins | Plugin loading started to load plugins from plugins_dir: /var/lib/indy/plugins node1_1 | 2018-06-26 05:02:47,064 | DEBUG | plugin_helper.py (28) | loadPlugins | Plugin directory created at: /var/lib/indy/plugins node1_1 | 2018-06-26 05:02:47,064 | DEBUG | plugin_helper.py (63) | loadPlugins | Total plugins loaded from plugins_dir /var/lib/indy/plugins are : 0 node1_1 | 2018-06-26 05:02:47,100 | DEBUG | ledger.py (201) | start | Starting ledger... node1_1 | 2018-06-26 05:02:47,106 | DEBUG | ledger.py (67) | recoverTree | Recovering tree from transaction log node1_1 | 2018-06-26 05:02:47,124 | DEBUG | ledger.py (82) | recoverTree | Recovered tree in 0.017890650007757358 seconds node1_1 | 2018-06-26 05:02:47,135 | INFO | node.py (2636) | initStateFromLedger | Node1 found state to be empty, recreating from ledger node1_1 | 2018-06-26 05:02:47,136 | DEBUG | ledger.py (199) | start | Ledger already started. node1_1 | 2018-06-26 05:02:47,137 | DEBUG | ledger.py (199) | start | Ledger already started. node1_1 | 2018-06-26 05:02:47,137 | DEBUG | ledger.py (199) | start | Ledger already started. node1_1 | 2018-06-26 05:02:47,138 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.1 node1_1 | 2018-06-26 05:02:47,140 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node1_1 | 2018-06-26 05:02:47,140 | DEBUG | base.py (112) | configure_curve | Configure curve: [/var/lib/indy/sandbox/keys/Node1/public_keys] node1_1 | 2018-06-26 05:02:47,154 | INFO | stacks.py (84) | start | CONNECTION: Node1 listening for other nodes at 0.0.0.0:9701 node1_1 | 2018-06-26 05:02:47,155 | DEBUG | authenticator.py (31) | start | Starting ZAP at inproc://zeromq.zap.2 node1_1 | 2018-06-26 05:02:47,155 | DEBUG | base.py (72) | allow | Allowing 0.0.0.0 node1_1 | 2018-06-26 05:02:47,156 | DEBUG | base.py (112) | configure_curve | Configure curve: [] node1_1 | 2018-06-26 05:02:47,157 | INFO | node.py (853) | start | Node1 first time running... node1_1 | 2018-06-26 05:02:47,159 | INFO | zstack.py (584) | connect | CONNECTION: Node1 looking for Node3 at 172.17.2.13:9705 node1_1 | 2018-06-26 05:02:47,161 | INFO | zstack.py (584) | connect | CONNECTION: Node1 looking for Node4 at 172.17.2.13:9707 node1_1 | 2018-06-26 05:02:47,167 | INFO | zstack.py (584) | connect | CONNECTION: Node1 looking for Node2 at 172.17.2.13:9703 von-web_1 | ERROR|indy::services::pool | src/services/pool/mod.rs:426 | Pool worker thread finished with error Timeout von-web_1 | ERROR|indy::errors::indy | src/errors/indy.rs:68 | Casting error to ErrorCode: Timeout von-web_1 | _indy_loop_callback: Function returned error 307 von-web_1 | Traceback (most recent call last): von-web_1 | File "server.py", line 295, in
von-web_1 | loop.run_until_complete(boot())
von-web_1 | File "/usr/lib/python3.5/asyncio/base_events.py", line 387, in run_until_complete
von-web_1 | return future.result()
von-web_1 | File "/usr/lib/python3.5/asyncio/futures.py", line 274, in result
von-web_1 | raise self._exception
von-web_1 | File "/usr/lib/python3.5/asyncio/tasks.py", line 241, in _step
von-web_1 | result = coro.throw(exc)
von-web_1 | File "server.py", line 112, in boot
von-web_1 | await pool.open()
von-web_1 | File "/home/indy/.local/share/virtualenvs/server-8XoupS0v/lib/python3.5/site-packages/von_agent/nodepool.py", line 125, in open
von-web_1 | self._handle = await pool.open_pool_ledger(self.name, None)
von-web_1 | File "/home/indy/.local/share/virtualenvs/server-8XoupS0v/lib/python3.5/site-packages/indy/pool.py", line 82, in open_pool_ledger
von-web_1 | open_pool_ledger.cb)
von-web_1 | File "/usr/lib/python3.5/asyncio/futures.py", line 361, in iter
von-web_1 | yield self # This tells Task to wait for completion.
von-web_1 | File "/usr/lib/python3.5/asyncio/tasks.py", line 296, in _wakeup
von-web_1 | future.result()
von-web_1 | File "/usr/lib/python3.5/asyncio/futures.py", line 274, in result
von-web_1 | raise self._exception
von-web_1 | indy.error.IndyError: ErrorCode.PoolLedgerTimeout
von_von-web_1 exited with code 1