Skip to content

initializating Soledad: TypeError

we delpoyed a new node from scratch, using leap_platform:develop and leap_cli:develop. after registering with latest bitmask client (https://dl.bitmask.net/client/linux/release-candidates/Bitmask-linux64-2014-08-11-6defc610.tar.bz2), we get this soledad error:

--- client/bitmask » ./bitmask --ca-cert-file ~/thoughtworks/git/puppet/modules/proxy/files/example.wazokazi.is.ca.crt     
No updates found
/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./apps/:/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/
GnuPG logging disabled...
ERROR: No updater mirrors found (missing or not well formed launcher.conf)
2014-09-30 10:23:05,182 - DEBUG    - L#51   : leap:create_logger() - Console handler plugged!
2014-09-30 10:23:05,182 - DEBUG    - L#58   : leap:create_logger() - Leap handler plugged!
2014-09-30 10:23:05,182 - DEBUG    - L#62   : leap:create_logger() - Setting logfile to bitmask.log 
2014-09-30 10:23:05,183 - DEBUG    - L#68   : leap:create_logger() - File handler plugged!
2014-09-30 10:23:05,183 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] Log opened.
2014-09-30 10:23:05,185 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] ----------------------------------------
2014-09-30 10:23:05,185 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] Exception happened during processing of request from ('127.0.0.1', 40828)
2014-09-30 10:23:05,185 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] Traceback (most recent call last):
2014-09-30 10:23:05,185 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/SocketServer.py", line 593, in process_request_thread
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     self.finish_request(request, client_address)
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/protobuf/socketrpc/server.py", line 244, in finish_request
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     request, client_address, self, self.socket_rpc_server)
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/protobuf/socketrpc/server.py", line 83, in __init__
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     self, request, client_address, server)
2014-09-30 10:23:05,186 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/SocketServer.py", line 649, in __init__
2014-09-30 10:23:05,187 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     self.handle()
2014-09-30 10:23:05,187 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/protobuf/socketrpc/server.py", line 98, in handle
2014-09-30 10:23:05,187 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     self.request.shutdown(socket.SHUT_WR)
2014-09-30 10:23:05,187 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]   File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./lib/socket.py", line 224, in meth
2014-09-30 10:23:05,188 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-]     return getattr(self._sock,name)(*args)
2014-09-30 10:23:05,188 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] error: [Errno 107] Transport endpoint is not connected
2014-09-30 10:23:05,188 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:05+0200 [-] ----------------------------------------
2014-09-30 10:23:05,189 - DEBUG    - L#72   : leap.bitmask.util.requirement_checker:check_requirements() - Checking requirements...
2014-09-30 10:23:05,190 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - requests>=1.1.0 ... OK
2014-09-30 10:23:05,190 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - srp>=1.0.2 ... OK
2014-09-30 10:23:05,191 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - pyopenssl ... OK
2014-09-30 10:23:05,191 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - python-dateutil ... OK
2014-09-30 10:23:05,191 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - psutil ... OK
2014-09-30 10:23:05,191 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - ipaddr ... OK
2014-09-30 10:23:05,192 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - python-daemon # this should not be needed for Windows. ... OK
2014-09-30 10:23:05,192 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - keyring ... OK
2014-09-30 10:23:05,192 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - zope.proxy ... OK
2014-09-30 10:23:05,193 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - pyzmq ... OK
2014-09-30 10:23:05,193 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - leap.common>=0.3.7 ... OK
2014-09-30 10:23:05,194 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - leap.soledad.client>=0.5.0 ... OK
2014-09-30 10:23:05,195 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - leap.keymanager>=0.3.8 ... OK
2014-09-30 10:23:05,195 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - leap.mail>=0.3.9 ... OK
2014-09-30 10:23:05,196 - DEBUG    - L#100  : leap.bitmask.util.requirement_checker:check_requirements() - oauth ... OK
2014-09-30 10:23:05,196 - DEBUG    - L#102  : leap.bitmask.util.requirement_checker:check_requirements() - Done
2014-09-30 10:23:05,196 - INFO     - L#172  : leap:start_app() - ~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~
2014-09-30 10:23:05,197 - INFO     - L#173  : leap:start_app() - Bitmask version 0.6.0-63-g3274c7c
2014-09-30 10:23:05,197 - INFO     - L#174  : leap:start_app() - leap.mail version unknown
2014-09-30 10:23:05,197 - INFO     - L#175  : leap:start_app() - ~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~
2014-09-30 10:23:05,198 - INFO     - L#177  : leap:start_app() - Starting app
2014-09-30 10:23:05,208 - DEBUG    - L#49   : leap.bitmask.backend.signaler:__init__() - Connecting to signaling server...
Fontconfig error: "/etc/fonts/conf.d/10-scale-bitmap-fonts.conf", line 70: non-double matrix element
Fontconfig error: "/etc/fonts/conf.d/10-scale-bitmap-fonts.conf", line 70: non-double matrix element
Fontconfig warning: "/etc/fonts/conf.d/10-scale-bitmap-fonts.conf", line 78: saw unknown, expected number
2014-09-30 10:23:07,132 - DEBUG    - L#56   : leap.bitmask.backend.backend_proxy:__init__() - Connecting to server...
2014-09-30 10:23:07,139 - DEBUG    - L#66   : leap.bitmask.backend.signaler_qt:_run() - Running SignalerQt loop
2014-09-30 10:23:07,177 - DEBUG    - L#68   : leap.bitmask.platform_init.initializers:init_platform() - Running initializer for Linux
2014-09-30 10:23:07,202 - DEBUG    - L#132  : leap.bitmask.platform_init.initializers:check_missing() - MISSING OTHER: []
2014-09-30 10:23:07,229 - DEBUG    - L#111  : leap.bitmask.services.eip.conductor:start_eip_machine() - eip machine started
2014-09-30 10:23:07,230 - DEBUG    - L#233  : leap.bitmask.services.mail.conductor:start_mail_machine() - Starting mail state machine...
2014-09-30 10:23:07,232 - DEBUG    - L#136  : leap.bitmask.config.leapsettings:get_configured_providers() - Error listing providers, assume there are none. OSError(2, 'No such file or directory')
2014-09-30 10:23:07,244 - DEBUG    - L#59   : leap.bitmask.gui.statemachines:onEntry() - State Encrypted Internet::off entered. Emitting signal ...
2014-09-30 10:23:07,245 - DEBUG    - L#59   : leap.bitmask.gui.statemachines:onEntry() - State Mail::off entered. Emitting signal ...
2014-09-30 10:23:07,245 - DEBUG    - L#59   : leap.bitmask.gui.statemachines:onEntry() - State IMAP::off entered. Emitting signal ...
2014-09-30 10:23:07,245 - DEBUG    - L#59   : leap.bitmask.gui.statemachines:onEntry() - State IMAP::off entered. Emitting signal ...
2014-09-30 10:23:07,321 - DEBUG    - L#136  : leap.bitmask.config.leapsettings:get_configured_providers() - Error listing providers, assume there are none. OSError(2, 'No such file or directory')
2014-09-30 10:23:17,340 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:17+0200 [-] Setting up provider example.wazokazi.is...
2014-09-30 10:23:17,341 - DEBUG    - L#120  : leap.bitmask.provider.providerbootstrapper:_check_name_resolution() - Checking name resolution for u'example.wazokazi.is'
2014-09-30 10:23:17,346 - DEBUG    - L#134  : leap.bitmask.provider.providerbootstrapper:_check_https() - Checking https for u'example.wazokazi.is'
2014-09-30 10:23:17,754 - DEBUG    - L#169  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Downloading provider info for u'example.wazokazi.is'
2014-09-30 10:23:17,755 - DEBUG    - L#212  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Requesting for provider.json... uri: https://example.wazokazi.is/provider.json, verify: /home/varac/thoughtworks/git/puppet/modules/proxy/files/example.wazokazi.is.ca.crt, headers: {}
2014-09-30 10:23:18,021 - DEBUG    - L#216  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Request status code: 200
2014-09-30 10:23:18,030 - DEBUG    - L#245  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Provider definition has been modified
2014-09-30 10:23:19,271 - DEBUG    - L#307  : leap.bitmask.provider.providerbootstrapper:_download_ca_cert() - Downloading ca cert for u'example.wazokazi.is' at u'https://example.wazokazi.is/ca.crt'
2014-09-30 10:23:19,346 - WARNING  - L#44   : leap.common.files:check_and_fix_urw_only() - Bad permission on /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem attempting to set 600
2014-09-30 10:23:19,348 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:19,349 - DEBUG    - L#339  : leap.bitmask.provider.providerbootstrapper:_check_ca_fingerprint() - Checking ca fingerprint for u'example.wazokazi.is' and cert u'/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem'
2014-09-30 10:23:19,350 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:19,350 - DEBUG    - L#371  : leap.bitmask.provider.providerbootstrapper:_check_api_certificate() - Checking api certificate for https://api.example.wazokazi.is:4430 and cert /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:26,987 - DEBUG    - L#135  : leap.bitmask.crypto.srpregister:register_user() - Post to uri: https://api.example.wazokazi.is:4430/1/users
2014-09-30 10:23:26,987 - DEBUG    - L#136  : leap.bitmask.crypto.srpregister:register_user() - Will try to register user = test04
2014-09-30 10:23:26,988 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:28,315 - DEBUG    - L#177  : leap.bitmask.crypto.srpregister:_emit_result() - Status code is: 201
2014-09-30 10:23:29,873 - DEBUG    - L#53   : leap:write() - 2014-09-30 12:23:29+0200 [-] Setting up provider example.wazokazi.is...
2014-09-30 10:23:29,874 - DEBUG    - L#120  : leap.bitmask.provider.providerbootstrapper:_check_name_resolution() - Checking name resolution for u'example.wazokazi.is'
2014-09-30 10:23:29,879 - DEBUG    - L#134  : leap.bitmask.provider.providerbootstrapper:_check_https() - Checking https for u'example.wazokazi.is'
2014-09-30 10:23:30,160 - DEBUG    - L#169  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Downloading provider info for u'example.wazokazi.is'
2014-09-30 10:23:30,169 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:30,170 - DEBUG    - L#212  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Requesting for provider.json... uri: https://api.example.wazokazi.is:4430/provider.json, verify: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem, headers: {'if-modified-since': 'Tue Sep 30 09:45:38 2014 GMT'}
2014-09-30 10:23:30,383 - DEBUG    - L#216  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Request status code: 200
2014-09-30 10:23:30,393 - DEBUG    - L#245  : leap.bitmask.provider.providerbootstrapper:_download_provider_info() - Provider definition has been modified
2014-09-30 10:23:30,455 - DEBUG    - L#307  : leap.bitmask.provider.providerbootstrapper:_download_ca_cert() - Downloading ca cert for u'example.wazokazi.is' at u'https://example.wazokazi.is/ca.crt'
2014-09-30 10:23:30,456 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:30,457 - DEBUG    - L#339  : leap.bitmask.provider.providerbootstrapper:_check_ca_fingerprint() - Checking ca fingerprint for u'example.wazokazi.is' and cert u'/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem'
2014-09-30 10:23:30,458 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:30,458 - DEBUG    - L#371  : leap.bitmask.provider.providerbootstrapper:_check_api_certificate() - Checking api certificate for https://api.example.wazokazi.is:4430 and cert /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:30,556 - DEBUG    - L#220  : leap.bitmask.crypto.srpauth:_authentication_preprocessing() - Authentication preprocessing...
2014-09-30 10:23:30,557 - DEBUG    - L#249  : leap.bitmask.crypto.srpauth:_start_authentication() - Starting authentication process...
2014-09-30 10:23:30,558 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:30,949 - DEBUG    - L#322  : leap.bitmask.crypto.srpauth:_process_challenge() - Processing challenge...
2014-09-30 10:23:30,951 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:31,465 - DEBUG    - L#426  : leap.bitmask.crypto.srpauth:_verify_session() - Verifying session...
2014-09-30 10:23:31,466 - DEBUG    - L#438  : leap.bitmask.crypto.srpauth:_verify_session() - Session verified.
2014-09-30 10:23:31,467 - DEBUG    - L#593  : leap.bitmask.crypto.srpauth:_authenticate_ok() - Successful login!
2014-09-30 10:23:31,478 - DEBUG    - L#307  : leap.bitmask.gui.eip_status:disable_eip_start() - Hiding EIP start button
2014-09-30 10:23:31,478 - DEBUG    - L#372  : leap.bitmask.gui.eip_status:set_eip_status() - Disabled
2014-09-30 10:23:31,498 - DEBUG    - L#493  : leap.bitmask.services.soledad.soledadbootstrapper:_download_config() - Downloading Soledad config for example.wazokazi.is
2014-09-30 10:23:31,500 - DEBUG    - L#127  : leap.bitmask.services:download_service_config() - Downloading SOLEDAD config from: https://api.example.wazokazi.is:4430/1/config/soledad-service.json
2014-09-30 10:23:31,500 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:31,629 - DEBUG    - L#219  : leap.bitmask.services.soledad.soledadbootstrapper:_get_soledad_local_params() - secrets_path:/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,629 - DEBUG    - L#220  : leap.bitmask.services.soledad.soledadbootstrapper:_get_soledad_local_params() - local_db:/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.db
2014-09-30 10:23:31,630 - DEBUG    - L#354  : leap.bitmask.services.soledad.soledadbootstrapper:_pick_server() - Using soledad server url: https://pixelated.example.wazokazi.is:2323/user-4375f1b33aacce610b955d12509ea42b
2014-09-30 10:23:31,630 - DEBUG    - L#202  : leap.bitmask.config.providerconfig:get_ca_cert_path() - Going to verify SSL against /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/providers/example.wazokazi.is/keys/ca/cacert.pem
2014-09-30 10:23:31,631 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,632 - INFO     - L#448  : leap.soledad.client:_init_dirs() - Creating directory: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad.
2014-09-30 10:23:31,632 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,633 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,744 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,745 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 2 of 10)
2014-09-30 10:23:31,745 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,746 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,747 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,776 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,777 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 3 of 10)
2014-09-30 10:23:31,777 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,778 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,778 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,797 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,798 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 4 of 10)
2014-09-30 10:23:31,798 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,799 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,799 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,828 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,829 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 5 of 10)
2014-09-30 10:23:31,829 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,830 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,830 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,849 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,849 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 6 of 10)
2014-09-30 10:23:31,850 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,850 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,851 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,875 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,876 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 7 of 10)
2014-09-30 10:23:31,876 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,877 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,877 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,900 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,900 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 8 of 10)
2014-09-30 10:23:31,901 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,901 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,901 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,930 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,931 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 9 of 10)
2014-09-30 10:23:31,931 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,932 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,932 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,952 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,952 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 10 of 10)
2014-09-30 10:23:31,952 - DEBUG    - L#273  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Trying to init soledad....
2014-09-30 10:23:31,953 - WARNING  - L#573  : leap.soledad.client:_has_secret() - IOError: File does not exist: /home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/config/leap/soledad/4375f1b33aacce610b955d12509ea42b.secret
2014-09-30 10:23:31,953 - INFO     - L#388  : leap.soledad.client:_bootstrap() - Trying to fetch cryptographic secrets from shared recovery database...
2014-09-30 10:23:31,982 - WARNING  - L#446  : leap.bitmask.services.soledad.soledadbootstrapper:_try_soledad_init() - Error while initializing Soledad
2014-09-30 10:23:31,983 - WARNING  - L#283  : leap.bitmask.services.soledad.soledadbootstrapper:_do_soledad_init() - Init failed, retrying... (retry 11 of 10)
2014-09-30 10:23:31,983 - ERROR    - L#673  : leap.bitmask.services.soledad.soledadbootstrapper:run_soledad_setup_checks() - Error while bootstrapping Soledad: SoledadInitError()
Traceback (most recent call last):
  File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./apps/leap/bitmask/services/soledad/soledadbootstrapper.py", line 663, in run_soledad_setup_checks
    self.load_and_sync_soledad(uuid)
  File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./apps/leap/bitmask/services/soledad/soledadbootstrapper.py", line 306, in load_and_sync_soledad
    server_url, cert_file, token)
  File "/home/varac/dev/projects/leap/client/Bitmask-linux64-2014-08-11-6defc610/./apps/leap/bitmask/services/soledad/soledadbootstrapper.py", line 286, in _do_soledad_init
    raise SoledadInitError()
SoledadInitError

(from redmine: created on 2014-09-30, closed on 2014-10-22, relates #6186 (closed), relates #5786 (closed), relates #6162, precedes #6195 (closed))