I have created a new deployment using chef in EC2. After a few attempts, deletes, edits, retries, it ran smoothly [nice job on that people!!]. I then visit the ellis web page and try a signup. I fill in the form and submit. I get the Please Wait screen and then an error popup "Failed to update server (see detailed diagnostics in developer console). Please refresh the page." I can click "Logout", and then I can login using the new user. Now I get the screen to Add Private Identity, and after some seconds the popup is displayed again. Clicking Create....wait...same popup.
I included relevant pieces of the ellis log below. Not sure if the stack trace leads to the timeout OR if the py code does not deal with timeouts very well 8-) Thanks, -John PS. I have done an install, signup, and made a test call using the All-In-One on a vm. I'm moving up to more complex networks now. /var/log/ellis-0.log... 2013-10-23 10:35:57,339 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.34ms 2013-10-23 10:36:17,353 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.33ms 2013-10-23 10:36:37,366 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.33ms 2013-10-23 10:36:51,338 I users:75 1045:140710677980928] Request to create new account 2013-10-23 10:36:51,338 D _base:141 1045:140710677980928] No NGV-Signup-Code code in header, looking in body 2013-10-23 10:36:51,340 I users:61 1045:140710677980928] User email [email protected] not found 2013-10-23 10:36:51,597 I web:1447 1045:140710677980928] 302 POST /accounts/?onsuccess=/index.html%23first&onfailure=/signup.html (135.245.48.12) 260.54ms 2013-10-23 10:36:51,760 D static:80 1045:140710677980928] Checking if index.html is allowed 2013-10-23 10:36:51,802 I web:1447 1045:140710677980928] 200 GET /index.html?data=%7B%22username%22%3A%20%22only1jpl%40gmail.com%22%2C%20%22full_name%22%3A%20%22john%22%7D&message=Created&status=201&success=true (135.245.48.12) 42.71ms 2013-10-23 10:36:52,159 D static:80 1045:140710677980928] Checking if js/bootstrap.min.js is allowed 2013-10-23 10:36:52,159 D static:87 1045:140710677980928] Path matches regex /js/(jquery|backbone|underscore|fileuploader|bootstrap|login|signup|forgotpassword|resetpassword|common|zxcvbn|zxcvbn-async|pwstrength|validate).*, allowed 2013-10-23 10:36:52,160 I web:1447 1045:140710677980928] 304 GET /js/bootstrap.min.js (135.245.48.12) 1.15ms 2013-10-23 10:36:52,250 D static:80 1045:140710677980928] Checking if js/app.js is allowed 2013-10-23 10:36:52,253 I web:1447 1045:140710677980928] 304 GET /js/app.js (135.245.48.12) 2.74ms 2013-10-23 10:36:52,357 D numbers:119 1045:140710677980928] Number allocation API call (PSTN = false) 2013-10-23 10:36:52,359 D numbers:120 1045:140710677980928] Allocating a non-PSTN number 2013-10-23 10:36:52,360 D numbers:133 1045:140710677980928] Fetched 0101d9b6-953f-4cc5-8055-370d5474a732 2013-10-23 10:36:52,361 D numbers:140 1045:140710677980928] Updated the owner 2013-10-23 10:36:52,361 D numbers:128 1045:140710677980928] SIP URI sip:[email protected] 2013-10-23 10:36:52,366 D numbers:157 1045:140710677980928] Populating other servers... 2013-10-23 10:36:52,366 W homestead:229 1045:140710677980928] Passing SIP password in the clear over http 2013-10-23 10:37:12,387 E _base:171 1045:140710677980928] Uncaught exception POST /accounts/only1jpl%40gmail.com/numbers/?cb=ab1a77f0aP0(135.245.48.12) HTTPRequest(protocol='http', host='ellis.micro.neartothis.com', method='POST', uri='/accounts/only1jpl%40gmail.com/numbers/?cb=ab1a77f0aP0', version='HTTP/1.1', remote_ip='135.245.48.12', body='', headers={'Origin': ' http://ellis.micro.neartothis.com', 'Content-Length': '0', 'Accept-Language': 'en-US,en;q=0.8', 'Accept-Encoding': 'gzip,deflate,sdch', 'X-Bluecoat-Via': '951d499292535715', 'Host': ' ellis.micro.neartothis.com', 'Accept': '*/*', 'User-Agent': 'Mozilla/5.0 (Windows NT 6.1; WOW64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/30.0.1599.101 Safari/537.36', 'Connection': 'Keep-Alive', 'X-Requested-With': 'XMLHttpRequest', 'Cache-Control': 'max-age=0', 'Referer': ' http://ellis.micro.neartothis.com/index.html?data=%7B%22username%22%3A%20%22only1jpl%40gmail.com%22%2C%20%22full_name%22%3A%20%22john%22%7D&message=Created&status=201&success=true', 'Cookie': 'username=b25seTFqcGxAZ21haWwuY29t|1382524611|644843769d89583b25a29f7c0e10728b40eee7e4'}) Traceback (most recent call last): File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/tornado-2.3-py2.7.egg/tornado/web.py", line 1000, in _stack_context_handle_exception raise_exc_info((type, value, traceback)) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/tornado-2.3-py2.7.egg/tornado/web.py", line 1118, in wrapper return method(self, *args, **kwargs) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/api/numbers.py", line 170, in post self._request_group.callback()) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 88, in create_private_id put_password(private_id, password, None) # No callback makes this synchronous File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 110, in put_password return _sync_http_request(url, method="PUT", headers=headers, body=body) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 224, in _sync_http_request raise e HTTPError: HTTP 599: Timeout 2013-10-23 10:37:12,389 E web:1447 1045:140710677980928] 500 POST /accounts/only1jpl%40gmail.com/numbers/?cb=ab1a77f0aP0 (135.245.48.12) 20031.63ms 2013-10-23 10:37:47,410 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.34ms 2013-10-23 10:38:07,423 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.35ms <snip> 2013-10-23 10:39:27,474 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.34ms 2013-10-23 10:39:41,795 D users:136 1045:140710677980928] User email [email protected] ([email protected]) has hashed password '$2a$10$RmONSsmLtmDJhVOSzbn6pu5M/QOTLRyewVGVA3cfHWFq0NqnkdL5.' 2013-10-23 10:39:42,045 D session:58 1045:140710677980928] User [email protected] provided correct password ([email protected]) ({'hashed_password': '$2a$10$RmONSsmLtmDJhVOSzbn6pu5M/QOTLRyewVGVA3cfHWFq0NqnkdL5.', 'expires': None, 'user_id': '9e8e9b84-bdb5-49bf-bb53-145b2b1f9641', 'email': u'[email protected]', 'full_name': u'john'}) 2013-10-23 10:39:42,046 I web:1447 1045:140710677980928] 302 POST /session?onsuccess=/index.html&onfailure=/login.html (135.245.48.12) 253.51ms 2013-10-23 10:39:42,653 W homestead:229 1045:140710677980928] Passing SIP password in the clear over http 2013-10-23 10:40:02,673 W utils:73 1045:140710677980928] Non-OK HTTP response. HTTPResponse(code=599,request_time=20.019735097885132,buffer=None,_body=None,time_info={},request=<tornado.httpclient.HTTPRequest object at 0x36b8ad0>,effective_url=' http://hs.micro.neartothis.com:8888/public/sip%3A6505550826%40micro.neartothis.com/associated_private_ids',headers={},error=HTTPError('HTTP 599: Timeout',)) 2013-10-23 10:40:02,674 W numbers:113 1045:140710677980928] Failed to fetch private identities from homestead 2013-10-23 10:40:02,677 E web:1447 1045:140710677980928] 502 GET /accounts/only1jpl%40gmail.com/numbers/?cb=ab1aa16daT0 (135.245.48.12) 20027.42ms 2013-10-23 10:40:02,677 D utils:89 1045:140710677980928] Still expecting 0 callbacks 2013-10-23 10:40:37,521 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.33ms <snip> 2013-10-23 10:41:49,868 D numbers:119 1045:140710677980928] Number allocation API call (PSTN = false) 2013-10-23 10:41:49,870 D numbers:120 1045:140710677980928] Allocating a non-PSTN number 2013-10-23 10:41:49,871 D numbers:133 1045:140710677980928] Fetched 0138ca2c-e8b2-4ca2-9575-29be489b985b 2013-10-23 10:41:49,872 D numbers:140 1045:140710677980928] Updated the owner 2013-10-23 10:41:49,873 D numbers:128 1045:140710677980928] SIP URI sip:[email protected] 2013-10-23 10:41:49,878 D numbers:157 1045:140710677980928] Populating other servers... 2013-10-23 10:41:49,878 W homestead:229 1045:140710677980928] Passing SIP password in the clear over http 2013-10-23 10:42:09,898 E _base:171 1045:140710677980928] Uncaught exception POST /accounts/only1jpl%40gmail.com/numbers/?cb=ab1aa16daT1(135.245.48.12) HTTPRequest(protocol='http', host='ellis.micro.neartothis.com', method='POST', uri='/accounts/only1jpl%40gmail.com/numbers/?cb=ab1aa16daT1', version='HTTP/1.1', remote_ip='135.245.48.12', body='pstn=false', headers={'Origin': 'http://ellis.micro.neartothis.com', 'Content-Length': '10', 'Accept-Language': 'en-US,en;q=0.8', 'Accept-Encoding': 'gzip,deflate,sdch', 'X-Bluecoat-Via': '951d499292535715', 'Host': ' ellis.micro.neartothis.com', 'Accept': '*/*', 'User-Agent': 'Mozilla/5.0 (Windows NT 6.1; WOW64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/30.0.1599.101 Safari/537.36', 'Connection': 'Keep-Alive', 'X-Requested-With': 'XMLHttpRequest', 'Referer': ' http://ellis.micro.neartothis.com/index.html?data=%7B%22username%22%3A%20%22only1jpl%40gmail.com%22%2C%20%22full_name%22%3A%20%22john%22%7D&message=Created&status=201&success=true', 'Cookie': 'username=b25seTFqcGxAZ21haWwuY29t|1382524782|adea82860ca78afa56cdb7230cf2ace5f811e6b6', 'Content-Type': 'application/x-www-form-urlencoded; charset=UTF-8'}) Traceback (most recent call last): File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/tornado-2.3-py2.7.egg/tornado/web.py", line 1000, in _stack_context_handle_exception raise_exc_info((type, value, traceback)) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/tornado-2.3-py2.7.egg/tornado/web.py", line 1118, in wrapper return method(self, *args, **kwargs) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/api/numbers.py", line 170, in post self._request_group.callback()) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 88, in create_private_id put_password(private_id, password, None) # No callback makes this synchronous File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 110, in put_password return _sync_http_request(url, method="PUT", headers=headers, body=body) File "/usr/share/clearwater/ellis/env/local/lib/python2.7/site-packages/ellis-0.1-py2.7.egg/metaswitch/ellis/remote/homestead.py", line 224, in _sync_http_request raise e HTTPError: HTTP 599: Timeout 2013-10-23 10:42:09,900 E web:1447 1045:140710677980928] 500 POST /accounts/only1jpl%40gmail.com/numbers/?cb=ab1aa16daT1 (135.245.48.12) 20031.78ms 2013-10-23 10:42:47,603 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.33ms 2013-10-23 10:43:07,616 I web:1447 1045:140710677980928] 200 GET /ping (127.0.0.1) 0.33ms
_______________________________________________ Clearwater mailing list [email protected] http://lists.projectclearwater.org/listinfo/clearwater
