builder: b2g-inbound_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-031 starttime: 1445514175.42 results: success (0) buildid: 20151022030524 builduid: e686f659867642cd81ca28ebb40739cb revision: eabcebb0e668c30b5429dfc9e92052bc6f37fe1d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.422142) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.422620) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.423027) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006366 basedir: '/builds/slave/test' ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.510288) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.510613) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.671053) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.671397) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004442 ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.720413) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.720700) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.721095) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:55.721426) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-10-22 04:42:55-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 225M=0s 2015-10-22 04:42:55 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.303096 ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.036928) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.037298) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015043 ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.087882) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.088239) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev eabcebb0e668c30b5429dfc9e92052bc6f37fe1d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/b2g-inbound --rev eabcebb0e668c30b5429dfc9e92052bc6f37fe1d --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-10-22 04:42:55,866 truncating revision to first 12 chars 2015-10-22 04:42:55,866 Setting DEBUG logging. 2015-10-22 04:42:55,866 attempt 1/10 2015-10-22 04:42:55,866 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/eabcebb0e668?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-10-22 04:42:56,107 unpacking tar archive at: b2g-inbound-eabcebb0e668/testing/mozharness/ program finished with exit code 0 elapsedTime=0.527389 ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.630288) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.632635) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.648265) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.648811) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-10-22 04:42:56.649465) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 41 secs) (at 2015-10-22 04:42:56.650060) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'B2G-Inbound-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'B2G-Inbound-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:42:56 INFO - MultiFileLogger online at 20151022 04:42:56 in /builds/slave/test 04:42:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO 04:42:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:42:56 INFO - {'append_to_log': False, 04:42:56 INFO - 'base_work_dir': '/builds/slave/test', 04:42:56 INFO - 'blob_upload_branch': 'B2G-Inbound-Non-PGO', 04:42:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:42:56 INFO - 'branch': 'B2G-Inbound-Non-PGO', 04:42:56 INFO - 'buildbot_json_path': 'buildprops.json', 04:42:56 INFO - 'config_files': ('talos/linux_config.py',), 04:42:56 INFO - 'default_actions': ('clobber', 04:42:56 INFO - 'read-buildbot-config', 04:42:56 INFO - 'download-and-extract', 04:42:56 INFO - 'populate-webroot', 04:42:56 INFO - 'create-virtualenv', 04:42:56 INFO - 'install', 04:42:56 INFO - 'run-tests'), 04:42:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:42:56 INFO - 'download_minidump_stackwalk': True, 04:42:56 INFO - 'download_symbols': 'ondemand', 04:42:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:42:56 INFO - 'tooltool.py': '/tools/tooltool.py', 04:42:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:42:56 INFO - '/tools/misc-python/virtualenv.py')}, 04:42:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:42:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:42:56 INFO - 'installer_path': 'installer.exe', 04:42:56 INFO - 'log_level': 'info', 04:42:56 INFO - 'log_name': 'talos', 04:42:56 INFO - 'log_to_console': True, 04:42:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:42:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:42:56 INFO - 'opt_config_files': (), 04:42:56 INFO - 'pip_index': False, 04:42:56 INFO - 'sps_profile': False, 04:42:56 INFO - 'sps_profile_interval': 0, 04:42:56 INFO - 'suite': 'dromaeojs', 04:42:56 INFO - 'system_bits': '64', 04:42:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:42:56 INFO - 'title': 'talos-linux64-ix-031', 04:42:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:42:56 INFO - 'use_talos_json': True, 04:42:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:42:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:42:56 INFO - 'work_dir': 'build'} 04:42:56 INFO - ##### 04:42:56 INFO - ##### Running clobber step. 04:42:56 INFO - ##### 04:42:56 INFO - Running pre-action listener: _resource_record_pre_action 04:42:56 INFO - Running main action method: clobber 04:42:56 INFO - rmtree: /builds/slave/test/build 04:42:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:42:57 INFO - Running post-action listener: _resource_record_post_action 04:42:57 INFO - ##### 04:42:57 INFO - ##### Running read-buildbot-config step. 04:42:57 INFO - ##### 04:42:57 INFO - Running pre-action listener: _resource_record_pre_action 04:42:57 INFO - Running main action method: read_buildbot_config 04:42:57 INFO - Using buildbot properties: 04:42:57 INFO - { 04:42:57 INFO - "properties": { 04:42:57 INFO - "buildnumber": 248, 04:42:57 INFO - "product": "firefox", 04:42:57 INFO - "script_repo_revision": "production", 04:42:57 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 04:42:57 INFO - "repository": "", 04:42:57 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound talos dromaeojs", 04:42:57 INFO - "buildid": "20151022030524", 04:42:57 INFO - "slavename": "talos-linux64-ix-031", 04:42:57 INFO - "pgo_build": "False", 04:42:57 INFO - "basedir": "/builds/slave/test", 04:42:57 INFO - "project": "", 04:42:57 INFO - "platform": "ubuntu64_hw", 04:42:57 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 04:42:57 INFO - "slavebuilddir": "test", 04:42:57 INFO - "scheduler": "tests-b2g-inbound-linux64-talos", 04:42:57 INFO - "branch": "b2g-inbound", 04:42:57 INFO - "repo_path": "integration/b2g-inbound", 04:42:57 INFO - "stage_platform": "linux64", 04:42:57 INFO - "builduid": "e686f659867642cd81ca28ebb40739cb", 04:42:57 INFO - "revision": "eabcebb0e668c30b5429dfc9e92052bc6f37fe1d" 04:42:57 INFO - }, 04:42:57 INFO - "sourcestamp": { 04:42:57 INFO - "repository": "", 04:42:57 INFO - "hasPatch": false, 04:42:57 INFO - "project": "", 04:42:57 INFO - "branch": "b2g-inbound-linux64-talos", 04:42:57 INFO - "changes": [ 04:42:57 INFO - { 04:42:57 INFO - "category": null, 04:42:57 INFO - "files": [ 04:42:57 INFO - { 04:42:57 INFO - "url": null, 04:42:57 INFO - "name": "https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2" 04:42:57 INFO - } 04:42:57 INFO - ], 04:42:57 INFO - "repository": "", 04:42:57 INFO - "rev": "eabcebb0e668c30b5429dfc9e92052bc6f37fe1d", 04:42:57 INFO - "who": "cbook@mozilla.com", 04:42:57 INFO - "when": 1445514119, 04:42:57 INFO - "number": 6559282, 04:42:57 INFO - "comments": "Merge m-c to b2g-inbound", 04:42:57 INFO - "project": "", 04:42:57 INFO - "at": "Thu 22 Oct 2015 04:41:59", 04:42:57 INFO - "branch": "b2g-inbound-linux64-talos", 04:42:57 INFO - "revlink": "", 04:42:57 INFO - "properties": [ 04:42:57 INFO - [ 04:42:57 INFO - "buildid", 04:42:57 INFO - "20151022030524", 04:42:57 INFO - "Change" 04:42:57 INFO - ], 04:42:57 INFO - [ 04:42:57 INFO - "builduid", 04:42:57 INFO - "e686f659867642cd81ca28ebb40739cb", 04:42:57 INFO - "Change" 04:42:57 INFO - ], 04:42:57 INFO - [ 04:42:57 INFO - "pgo_build", 04:42:57 INFO - "False", 04:42:57 INFO - "Change" 04:42:57 INFO - ] 04:42:57 INFO - ], 04:42:57 INFO - "revision": "eabcebb0e668c30b5429dfc9e92052bc6f37fe1d" 04:42:57 INFO - } 04:42:57 INFO - ], 04:42:57 INFO - "revision": "eabcebb0e668c30b5429dfc9e92052bc6f37fe1d" 04:42:57 INFO - } 04:42:57 INFO - } 04:42:57 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2. 04:42:57 INFO - Running post-action listener: _resource_record_post_action 04:42:57 INFO - ##### 04:42:57 INFO - ##### Running download-and-extract step. 04:42:57 INFO - ##### 04:42:57 INFO - Running pre-action listener: _resource_record_pre_action 04:42:57 INFO - Running main action method: download_and_extract 04:42:57 INFO - mkdir: /builds/slave/test/build/tests 04:42:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:42:57 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:42:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/test_packages.json 04:42:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/test_packages.json 04:42:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 04:42:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 04:42:59 INFO - Downloaded 1302 bytes. 04:42:59 INFO - Reading from file /builds/slave/test/build/test_packages.json 04:42:59 INFO - Using the following test package requirements: 04:42:59 INFO - {u'common': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'], 04:42:59 INFO - u'cppunittest': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:42:59 INFO - u'jittest': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'jsshell-linux-x86_64.zip'], 04:42:59 INFO - u'mochitest': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:42:59 INFO - u'mozbase': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'], 04:42:59 INFO - u'reftest': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:42:59 INFO - u'talos': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:42:59 INFO - u'web-platform': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:42:59 INFO - u'webapprt': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'], 04:42:59 INFO - u'xpcshell': [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 04:42:59 INFO - u'firefox-44.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:42:59 INFO - Downloading packages: [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:42:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:42:59 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:42:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:42:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:42:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:42:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:43:00 INFO - Downloaded 22675323 bytes. 04:43:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:43:00 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:43:00 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:43:01 INFO - Return code: 0 04:43:01 INFO - Downloading packages: [u'firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:43:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:01 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:43:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:43:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:43:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:43:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:43:03 INFO - Downloaded 22675323 bytes. 04:43:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:43:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip 04:43:03 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:43:04 INFO - Return code: 0 04:43:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:04 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:43:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip 04:43:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip 04:43:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip 04:43:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:43:06 INFO - Downloaded 11131307 bytes. 04:43:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 04:43:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip 04:43:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 04:43:06 INFO - Return code: 0 04:43:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:06 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:43:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 04:43:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 04:43:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 04:43:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:43:08 INFO - Downloaded 55665688 bytes. 04:43:08 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 04:43:08 INFO - mkdir: /builds/slave/test/properties 04:43:08 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:43:08 INFO - Writing to file /builds/slave/test/properties/build_url 04:43:08 INFO - Contents: 04:43:08 INFO - build_url:https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 04:43:08 INFO - Running post-action listener: _resource_record_post_action 04:43:08 INFO - Running post-action listener: set_extra_try_arguments 04:43:08 INFO - ##### 04:43:08 INFO - ##### Running populate-webroot step. 04:43:08 INFO - ##### 04:43:08 INFO - Running pre-action listener: _resource_record_pre_action 04:43:08 INFO - Running main action method: populate_webroot 04:43:08 INFO - Guessing talos json url... 04:43:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:08 INFO - https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.txt matches https://queue.taskcluster.net 04:43:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.txt 04:43:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.txt 04:43:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.txt to /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.txt 04:43:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.txt', 'file_name': '/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.txt'}, attempt #1 04:43:09 INFO - Downloaded 107 bytes. 04:43:09 INFO - Reading from file /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.txt 04:43:09 INFO - Contents: 04:43:09 INFO - 20151022030524 04:43:09 INFO - https://hg.mozilla.org/integration/b2g-inbound/rev/eabcebb0e668c30b5429dfc9e92052bc6f37fe1d 04:43:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:09 INFO - trying https://hg.mozilla.org/integration/b2g-inbound/raw-file/eabcebb0e6/testing/talos/talos.json 04:43:09 INFO - Downloading https://hg.mozilla.org/integration/b2g-inbound/raw-file/eabcebb0e6/testing/talos/talos.json to /builds/slave/test/build/talos.json 04:43:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/integration/b2g-inbound/raw-file/eabcebb0e6/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 04:43:10 INFO - Downloaded 4264 bytes. 04:43:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:43:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:43:10 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 04:43:10 INFO - '../fennec_ids.txt'], 04:43:10 INFO - 'tests': ['tcheck2']}, 04:43:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:43:10 INFO - '--tppagecycles', 04:43:10 INFO - '7'], 04:43:10 INFO - 'tests': ['tsvgm']}}, 04:43:10 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:43:10 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:43:10 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:43:10 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:43:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:43:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:43:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'tests': ['damp', 'tps']}, 04:43:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['damp', 'tps']}, 04:43:10 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:43:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:43:10 INFO - 'other': {'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'other_l64': {'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'other_nol64': {'tests': ['a11yr', 04:43:10 INFO - 'ts_paint', 04:43:10 INFO - 'tpaint', 04:43:10 INFO - 'sessionrestore', 04:43:10 INFO - 'sessionrestore_no_auto_restore']}, 04:43:10 INFO - 'svgr': {'tests': ['tsvgx', 04:43:10 INFO - 'tsvgr_opacity', 04:43:10 INFO - 'tart', 04:43:10 INFO - 'tscrollx', 04:43:10 INFO - 'cart']}, 04:43:10 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['tsvgx', 04:43:10 INFO - 'tsvgr_opacity', 04:43:10 INFO - 'tart', 04:43:10 INFO - 'tscrollx', 04:43:10 INFO - 'cart']}, 04:43:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'tests': ['tp5o']}, 04:43:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'talos_options': ['--e10s'], 04:43:10 INFO - 'tests': ['tp5o']}, 04:43:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'talos_options': ['--xperf_path', 04:43:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:43:10 INFO - 'tests': ['tp5n']}, 04:43:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:43:10 INFO - 'talos_options': ['--e10s', 04:43:10 INFO - '--xperf_path', 04:43:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 04:43:10 INFO - 'C:/slave/talos-data/talos/xperf.config'], 04:43:10 INFO - 'tests': ['tp5n']}}, 04:43:10 INFO - 'talos.zip': {'path': '', 04:43:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:43:10 INFO - Running post-action listener: _resource_record_post_action 04:43:10 INFO - ##### 04:43:10 INFO - ##### Running create-virtualenv step. 04:43:10 INFO - ##### 04:43:10 INFO - Running pre-action listener: _resource_record_pre_action 04:43:10 INFO - Running main action method: create_virtualenv 04:43:10 INFO - Creating virtualenv /builds/slave/test/build/venv 04:43:10 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:43:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:43:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:43:10 INFO - Using real prefix '/usr' 04:43:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:43:11 INFO - Installing distribute.............................................................................................................................................................................................done. 04:43:12 INFO - Installing pip.................done. 04:43:12 INFO - Return code: 0 04:43:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:43:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:43:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:43:12 INFO - Using env: {'DISPLAY': ':0', 04:43:12 INFO - 'HOME': '/home/cltbld', 04:43:12 INFO - 'LANG': 'en_US.UTF-8', 04:43:12 INFO - 'LANGUAGE': 'en_US:en', 04:43:13 INFO - 'LOGNAME': 'cltbld', 04:43:13 INFO - 'MAIL': '/var/mail/cltbld', 04:43:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:13 INFO - 'MOZ_NO_REMOTE': '1', 04:43:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:13 INFO - 'NO_EM_RESTART': '1', 04:43:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:13 INFO - 'PWD': '/builds/slave/test', 04:43:13 INFO - 'SHELL': '/bin/bash', 04:43:13 INFO - 'SHLVL': '1', 04:43:13 INFO - 'TERM': 'linux', 04:43:13 INFO - 'TMOUT': '86400', 04:43:13 INFO - 'USER': 'cltbld', 04:43:13 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:13 INFO - '_': '/tools/buildbot/bin/python'} 04:43:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:13 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:43:13 INFO - Cleaning up... 04:43:13 INFO - Return code: 0 04:43:13 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:43:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 04:43:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 04:43:13 INFO - Using env: {'DISPLAY': ':0', 04:43:13 INFO - 'HOME': '/home/cltbld', 04:43:13 INFO - 'LANG': 'en_US.UTF-8', 04:43:13 INFO - 'LANGUAGE': 'en_US:en', 04:43:13 INFO - 'LOGNAME': 'cltbld', 04:43:13 INFO - 'MAIL': '/var/mail/cltbld', 04:43:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:13 INFO - 'MOZ_NO_REMOTE': '1', 04:43:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:13 INFO - 'NO_EM_RESTART': '1', 04:43:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:13 INFO - 'PWD': '/builds/slave/test', 04:43:13 INFO - 'SHELL': '/bin/bash', 04:43:13 INFO - 'SHLVL': '1', 04:43:13 INFO - 'TERM': 'linux', 04:43:13 INFO - 'TMOUT': '86400', 04:43:13 INFO - 'USER': 'cltbld', 04:43:13 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:13 INFO - '_': '/tools/buildbot/bin/python'} 04:43:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:13 INFO - Downloading/unpacking psutil>=0.7.1 04:43:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:15 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 04:43:15 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 04:43:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:43:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:43:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:43:15 INFO - Installing collected packages: psutil 04:43:15 INFO - Running setup.py install for psutil 04:43:15 INFO - building 'psutil._psutil_linux' extension 04:43:15 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 04:43:16 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 04:43:16 INFO - building 'psutil._psutil_posix' extension 04:43:16 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:43:16 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:43:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:43:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:43:16 INFO - Successfully installed psutil 04:43:16 INFO - Cleaning up... 04:43:16 INFO - Return code: 0 04:43:16 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:43:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 04:43:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 04:43:16 INFO - Using env: {'DISPLAY': ':0', 04:43:16 INFO - 'HOME': '/home/cltbld', 04:43:16 INFO - 'LANG': 'en_US.UTF-8', 04:43:16 INFO - 'LANGUAGE': 'en_US:en', 04:43:16 INFO - 'LOGNAME': 'cltbld', 04:43:16 INFO - 'MAIL': '/var/mail/cltbld', 04:43:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:16 INFO - 'MOZ_NO_REMOTE': '1', 04:43:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:16 INFO - 'NO_EM_RESTART': '1', 04:43:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:16 INFO - 'PWD': '/builds/slave/test', 04:43:16 INFO - 'SHELL': '/bin/bash', 04:43:16 INFO - 'SHLVL': '1', 04:43:16 INFO - 'TERM': 'linux', 04:43:16 INFO - 'TMOUT': '86400', 04:43:16 INFO - 'USER': 'cltbld', 04:43:16 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:16 INFO - '_': '/tools/buildbot/bin/python'} 04:43:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:17 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:43:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:18 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:43:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 04:43:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:43:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 04:43:18 INFO - Installing collected packages: mozsystemmonitor 04:43:18 INFO - Running setup.py install for mozsystemmonitor 04:43:18 INFO - Successfully installed mozsystemmonitor 04:43:18 INFO - Cleaning up... 04:43:18 INFO - Return code: 0 04:43:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:43:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:43:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:43:18 INFO - Using env: {'DISPLAY': ':0', 04:43:18 INFO - 'HOME': '/home/cltbld', 04:43:18 INFO - 'LANG': 'en_US.UTF-8', 04:43:18 INFO - 'LANGUAGE': 'en_US:en', 04:43:18 INFO - 'LOGNAME': 'cltbld', 04:43:18 INFO - 'MAIL': '/var/mail/cltbld', 04:43:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:18 INFO - 'MOZ_NO_REMOTE': '1', 04:43:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:18 INFO - 'NO_EM_RESTART': '1', 04:43:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:18 INFO - 'PWD': '/builds/slave/test', 04:43:18 INFO - 'SHELL': '/bin/bash', 04:43:18 INFO - 'SHLVL': '1', 04:43:18 INFO - 'TERM': 'linux', 04:43:18 INFO - 'TMOUT': '86400', 04:43:18 INFO - 'USER': 'cltbld', 04:43:18 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:18 INFO - '_': '/tools/buildbot/bin/python'} 04:43:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:19 INFO - Downloading/unpacking blobuploader==1.2.4 04:43:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:20 INFO - Downloading blobuploader-1.2.4.tar.gz 04:43:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 04:43:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:43:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:43:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 04:43:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:43:21 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:21 INFO - Downloading docopt-0.6.1.tar.gz 04:43:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 04:43:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:43:21 INFO - Installing collected packages: blobuploader, requests, docopt 04:43:21 INFO - Running setup.py install for blobuploader 04:43:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:43:21 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:43:21 INFO - Running setup.py install for requests 04:43:21 INFO - Running setup.py install for docopt 04:43:22 INFO - Successfully installed blobuploader requests docopt 04:43:22 INFO - Cleaning up... 04:43:22 INFO - Return code: 0 04:43:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:43:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:43:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:43:22 INFO - Using env: {'DISPLAY': ':0', 04:43:22 INFO - 'HOME': '/home/cltbld', 04:43:22 INFO - 'LANG': 'en_US.UTF-8', 04:43:22 INFO - 'LANGUAGE': 'en_US:en', 04:43:22 INFO - 'LOGNAME': 'cltbld', 04:43:22 INFO - 'MAIL': '/var/mail/cltbld', 04:43:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:22 INFO - 'MOZ_NO_REMOTE': '1', 04:43:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:22 INFO - 'NO_EM_RESTART': '1', 04:43:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:22 INFO - 'PWD': '/builds/slave/test', 04:43:22 INFO - 'SHELL': '/bin/bash', 04:43:22 INFO - 'SHLVL': '1', 04:43:22 INFO - 'TERM': 'linux', 04:43:22 INFO - 'TMOUT': '86400', 04:43:22 INFO - 'USER': 'cltbld', 04:43:22 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:22 INFO - '_': '/tools/buildbot/bin/python'} 04:43:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:43:22 INFO - Running setup.py (path:/tmp/pip-7nizXn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:43:22 INFO - Running setup.py (path:/tmp/pip-ybv7BA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:43:22 INFO - Running setup.py (path:/tmp/pip-F65gOA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:43:22 INFO - Running setup.py (path:/tmp/pip-O8pzbb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:43:22 INFO - Running setup.py (path:/tmp/pip-xAibVg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:43:22 INFO - Running setup.py (path:/tmp/pip-UdF6Y3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:43:22 INFO - Running setup.py (path:/tmp/pip-alLl9T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:43:22 INFO - Running setup.py (path:/tmp/pip-Mz0wlB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:43:22 INFO - Running setup.py (path:/tmp/pip-ceJg6b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:43:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:43:22 INFO - Running setup.py (path:/tmp/pip-VDSRae-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:43:23 INFO - Running setup.py (path:/tmp/pip-BH1fQV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:43:23 INFO - Running setup.py (path:/tmp/pip-gCPnZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:43:23 INFO - Running setup.py (path:/tmp/pip-c0wnff-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:43:23 INFO - Running setup.py (path:/tmp/pip-z7lSFD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:43:23 INFO - Running setup.py (path:/tmp/pip-8mCt4c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:43:23 INFO - Running setup.py (path:/tmp/pip-tiWNaU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:43:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:43:23 INFO - Running setup.py (path:/tmp/pip-xgw4wi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:43:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:43:23 INFO - Running setup.py install for manifestparser 04:43:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:43:23 INFO - Running setup.py install for mozcrash 04:43:23 INFO - Running setup.py install for mozdebug 04:43:23 INFO - Running setup.py install for mozdevice 04:43:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:43:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:43:23 INFO - Running setup.py install for mozfile 04:43:24 INFO - Running setup.py install for mozhttpd 04:43:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for mozinfo 04:43:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for mozInstall 04:43:24 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for mozleak 04:43:24 INFO - Running setup.py install for mozlog 04:43:24 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for moznetwork 04:43:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for mozprocess 04:43:24 INFO - Running setup.py install for mozprofile 04:43:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:43:24 INFO - Running setup.py install for mozrunner 04:43:24 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:43:25 INFO - Running setup.py install for mozscreenshot 04:43:25 INFO - Running setup.py install for moztest 04:43:25 INFO - Running setup.py install for mozversion 04:43:25 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:43:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:43:25 INFO - Cleaning up... 04:43:25 INFO - Return code: 0 04:43:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:43:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:43:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:43:25 INFO - Using env: {'DISPLAY': ':0', 04:43:25 INFO - 'HOME': '/home/cltbld', 04:43:25 INFO - 'LANG': 'en_US.UTF-8', 04:43:25 INFO - 'LANGUAGE': 'en_US:en', 04:43:25 INFO - 'LOGNAME': 'cltbld', 04:43:25 INFO - 'MAIL': '/var/mail/cltbld', 04:43:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:25 INFO - 'MOZ_NO_REMOTE': '1', 04:43:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:25 INFO - 'NO_EM_RESTART': '1', 04:43:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:25 INFO - 'PWD': '/builds/slave/test', 04:43:25 INFO - 'SHELL': '/bin/bash', 04:43:25 INFO - 'SHLVL': '1', 04:43:25 INFO - 'TERM': 'linux', 04:43:25 INFO - 'TMOUT': '86400', 04:43:25 INFO - 'USER': 'cltbld', 04:43:25 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:25 INFO - '_': '/tools/buildbot/bin/python'} 04:43:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:43:25 INFO - Running setup.py (path:/tmp/pip-dbt3ho-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:43:25 INFO - Running setup.py (path:/tmp/pip-82NdEf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:43:25 INFO - Running setup.py (path:/tmp/pip-ywARIv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:43:25 INFO - Running setup.py (path:/tmp/pip-EAVg87-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.46 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:43:25 INFO - Running setup.py (path:/tmp/pip-bgGYdS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:43:25 INFO - Running setup.py (path:/tmp/pip-GoDzCt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:43:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:43:25 INFO - Running setup.py (path:/tmp/pip-LYeGR0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.8 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:43:26 INFO - Running setup.py (path:/tmp/pip-DHPY6o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:43:26 INFO - Running setup.py (path:/tmp/pip-ddQ2LJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:43:26 INFO - Running setup.py (path:/tmp/pip-GXuRvr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:43:26 INFO - Running setup.py (path:/tmp/pip-RrvhWN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:43:26 INFO - Running setup.py (path:/tmp/pip-uN3IBu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:43:26 INFO - Running setup.py (path:/tmp/pip-XKtJJ4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:43:26 INFO - Running setup.py (path:/tmp/pip-TZ5B2_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.10 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:43:26 INFO - Running setup.py (path:/tmp/pip-U7jZLT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:43:26 INFO - Running setup.py (path:/tmp/pip-TuhJxC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:43:26 INFO - Running setup.py (path:/tmp/pip-LGpA5D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:43:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.46->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:43:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:43:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:43:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:43:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:43:28 INFO - Downloading blessings-1.5.1.tar.gz 04:43:28 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 04:43:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:43:28 INFO - Installing collected packages: blessings 04:43:28 INFO - Running setup.py install for blessings 04:43:28 INFO - Successfully installed blessings 04:43:28 INFO - Cleaning up... 04:43:28 INFO - Return code: 0 04:43:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:43:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:43:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:43:28 INFO - Reading from file tmpfile_stdout 04:43:28 INFO - Current package versions: 04:43:28 INFO - argparse == 1.2.1 04:43:28 INFO - blessings == 1.5.1 04:43:28 INFO - blobuploader == 1.2.4 04:43:28 INFO - docopt == 0.6.1 04:43:28 INFO - manifestparser == 1.1 04:43:28 INFO - mozInstall == 1.12 04:43:28 INFO - mozcrash == 0.16 04:43:28 INFO - mozdebug == 0.1 04:43:28 INFO - mozdevice == 0.46 04:43:28 INFO - mozfile == 1.2 04:43:28 INFO - mozhttpd == 0.7 04:43:28 INFO - mozinfo == 0.8 04:43:28 INFO - mozleak == 0.1 04:43:28 INFO - mozlog == 3.0 04:43:28 INFO - moznetwork == 0.27 04:43:28 INFO - mozprocess == 0.22 04:43:28 INFO - mozprofile == 0.27 04:43:28 INFO - mozrunner == 6.10 04:43:28 INFO - mozscreenshot == 0.1 04:43:28 INFO - mozsystemmonitor == 0.0 04:43:28 INFO - moztest == 0.7 04:43:28 INFO - mozversion == 1.4 04:43:28 INFO - psutil == 3.1.1 04:43:28 INFO - requests == 1.2.3 04:43:28 INFO - wsgiref == 0.1.2 04:43:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:43:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:43:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:43:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:43:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9c428f1c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf287b0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xffaae0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:43:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:43:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:43:28 INFO - Using env: {'DISPLAY': ':0', 04:43:28 INFO - 'HOME': '/home/cltbld', 04:43:28 INFO - 'LANG': 'en_US.UTF-8', 04:43:28 INFO - 'LANGUAGE': 'en_US:en', 04:43:28 INFO - 'LOGNAME': 'cltbld', 04:43:28 INFO - 'MAIL': '/var/mail/cltbld', 04:43:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:28 INFO - 'MOZ_NO_REMOTE': '1', 04:43:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:28 INFO - 'NO_EM_RESTART': '1', 04:43:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:28 INFO - 'PWD': '/builds/slave/test', 04:43:28 INFO - 'SHELL': '/bin/bash', 04:43:28 INFO - 'SHLVL': '1', 04:43:28 INFO - 'TERM': 'linux', 04:43:28 INFO - 'TMOUT': '86400', 04:43:28 INFO - 'USER': 'cltbld', 04:43:28 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:28 INFO - '_': '/tools/buildbot/bin/python'} 04:43:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:43:29 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:43:29 INFO - Cleaning up... 04:43:29 INFO - Return code: 0 04:43:29 INFO - Running post-action listener: _resource_record_post_action 04:43:29 INFO - Running post-action listener: _start_resource_monitoring 04:43:29 INFO - Starting resource monitoring. 04:43:29 INFO - ##### 04:43:29 INFO - ##### Running install step. 04:43:29 INFO - ##### 04:43:29 INFO - Running pre-action listener: _resource_record_pre_action 04:43:29 INFO - Running main action method: install 04:43:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:43:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:43:29 INFO - Reading from file tmpfile_stdout 04:43:29 INFO - Detecting whether we're running mozinstall >=1.0... 04:43:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:43:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:43:29 INFO - Reading from file tmpfile_stdout 04:43:29 INFO - Output received: 04:43:29 INFO - Usage: mozinstall [options] installer 04:43:29 INFO - Options: 04:43:29 INFO - -h, --help show this help message and exit 04:43:29 INFO - -d DEST, --destination=DEST 04:43:29 INFO - Directory to install application into. [default: 04:43:29 INFO - "/builds/slave/test"] 04:43:29 INFO - --app=APP Application being installed. [default: firefox] 04:43:29 INFO - mkdir: /builds/slave/test/build/application 04:43:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:43:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:43:43 INFO - Reading from file tmpfile_stdout 04:43:43 INFO - Output received: 04:43:43 INFO - /builds/slave/test/build/application/firefox/firefox 04:43:43 INFO - Running post-action listener: _resource_record_post_action 04:43:43 INFO - ##### 04:43:43 INFO - ##### Running run-tests step. 04:43:43 INFO - ##### 04:43:43 INFO - Running pre-action listener: _resource_record_pre_action 04:43:43 INFO - Running main action method: run_tests 04:43:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:43:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:43:43 INFO - Python 2.7.3 04:43:43 INFO - Return code: 0 04:43:43 INFO - grabbing minidump binary from tooltool 04:43:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:43:43 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1089250>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xff90b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xff9540>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:43:43 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:43:43 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:43:43 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:43:43 INFO - Return code: 0 04:43:43 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:43:43 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:43:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:43:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:43:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:43:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--webServer', 'localhost'] in /builds/slave/test/build 04:43:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName B2G-Inbound-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-031 --webServer localhost 04:43:43 INFO - Using env: {'DISPLAY': ':0', 04:43:43 INFO - 'HOME': '/home/cltbld', 04:43:43 INFO - 'LANG': 'en_US.UTF-8', 04:43:43 INFO - 'LANGUAGE': 'en_US:en', 04:43:43 INFO - 'LOGNAME': 'cltbld', 04:43:43 INFO - 'MAIL': '/var/mail/cltbld', 04:43:43 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:43:43 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:43:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:43:43 INFO - 'MOZ_NO_REMOTE': '1', 04:43:43 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:43:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:43:43 INFO - 'NO_EM_RESTART': '1', 04:43:43 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:43:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:43:43 INFO - 'PWD': '/builds/slave/test', 04:43:43 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:43:43 INFO - 'SHELL': '/bin/bash', 04:43:43 INFO - 'SHLVL': '1', 04:43:43 INFO - 'TERM': 'linux', 04:43:43 INFO - 'TMOUT': '86400', 04:43:43 INFO - 'USER': 'cltbld', 04:43:43 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201', 04:43:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:43:43 INFO - '_': '/tools/buildbot/bin/python'} 04:43:43 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--webServer', 'localhost'] with output_timeout 3600 04:43:43 INFO - mozversion INFO | application_buildid: 20151022030524 04:43:43 INFO - mozversion INFO | application_changeset: eabcebb0e668c30b5429dfc9e92052bc6f37fe1d 04:43:43 INFO - mozversion INFO | application_display_name: Nightly 04:43:43 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:43:43 INFO - mozversion INFO | application_name: Firefox 04:43:43 INFO - mozversion INFO | application_remotingname: firefox 04:43:43 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/b2g-inbound 04:43:43 INFO - mozversion INFO | application_vendor: Mozilla 04:43:43 INFO - mozversion INFO | application_version: 44.0a1 04:43:43 INFO - mozversion INFO | platform_buildid: 20151022030524 04:43:43 INFO - mozversion INFO | platform_changeset: eabcebb0e668c30b5429dfc9e92052bc6f37fe1d 04:43:43 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/b2g-inbound 04:43:43 INFO - mozversion INFO | platform_version: 44.0a1 04:43:43 INFO - 2015-10-22 04:43:43,835 DEBUG : using testdate: 1445514223 04:43:43 INFO - 2015-10-22 04:43:43,835 DEBUG : actual date: 1445514223 04:43:43 INFO - 2015-10-22 04:43:43,845 INFO : starting webserver on 'localhost:43936' 04:43:43 INFO - 2015-10-22 04:43:43,846 INFO : Starting test suite talos-linux64-ix-031 04:43:43 INFO - 2015-10-22 04:43:43,846 INFO : Starting test dromaeo_css 04:43:43 INFO - 2015-10-22 04:43:43,846 DEBUG : operating with platform_type : linux_ 04:43:43 INFO - 2015-10-22 04:43:43,847 INFO : Initialising browser for dromaeo_css test... 04:43:43 INFO - 2015-10-22 04:43:43,862 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAo9mnP/profile http://localhost:43936/getInfo.html 04:43:49 INFO - 2015-10-22 04:43:49,017 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 04:43:49 INFO - 2015-10-22 04:43:49,017 DEBUG : BROWSER_OUTPUT: colorDepth:24 04:43:49 INFO - 2015-10-22 04:43:49,017 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 04:43:49 INFO - 2015-10-22 04:43:49,017 DEBUG : BROWSER_OUTPUT: __metrics 04:43:49 INFO - 2015-10-22 04:43:49,174 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:43:50 INFO - 2015-10-22 04:43:50,382 INFO : Browser initialized. 04:43:50 INFO - 2015-10-22 04:43:50,383 INFO : Running cycle 1/1 for dromaeo_css test... 04:43:50 INFO - 2015-10-22 04:43:50,383 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAo9mnP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 04:44:02 INFO - 2015-10-22 04:44:02,346 DEBUG : BROWSER_OUTPUT: RSS: Main: 141754368 04:44:02 INFO - 2015-10-22 04:44:02,346 DEBUG : BROWSER_OUTPUT: 04:44:53 INFO - 2015-10-22 04:44:53,212 DEBUG : BROWSER_OUTPUT: 1445514293206 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 04:47:06 INFO - 2015-10-22 04:47:06,757 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43936/tests/dromaeo/cssquery-ext.html) 04:47:07 INFO - 2015-10-22 04:47:07,845 DEBUG : BROWSER_OUTPUT: RSS: Main: 252125184 04:47:07 INFO - 2015-10-22 04:47:07,846 DEBUG : BROWSER_OUTPUT: 04:50:10 INFO - 2015-10-22 04:50:10,372 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-ext.html (next: http://localhost:43936/tests/dromaeo/cssquery-jquery.html) 04:50:10 INFO - 2015-10-22 04:50:10,939 DEBUG : BROWSER_OUTPUT: RSS: Main: 214802432 04:50:10 INFO - 2015-10-22 04:50:10,939 DEBUG : BROWSER_OUTPUT: 04:53:13 INFO - 2015-10-22 04:53:13,002 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43936/tests/dromaeo/cssquery-mootools.html) 04:53:13 INFO - 2015-10-22 04:53:13,584 DEBUG : BROWSER_OUTPUT: RSS: Main: 210604032 04:53:13 INFO - 2015-10-22 04:53:13,584 DEBUG : BROWSER_OUTPUT: 04:56:15 INFO - 2015-10-22 04:56:15,500 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43936/tests/dromaeo/cssquery-prototype.html) 04:56:16 INFO - 2015-10-22 04:56:16,082 DEBUG : BROWSER_OUTPUT: RSS: Main: 201695232 04:56:16 INFO - 2015-10-22 04:56:16,083 DEBUG : BROWSER_OUTPUT: 04:59:18 INFO - 2015-10-22 04:59:18,839 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43936/tests/dromaeo/cssquery-yui.html) 04:59:19 INFO - 2015-10-22 04:59:19,446 DEBUG : BROWSER_OUTPUT: RSS: Main: 204115968 04:59:19 INFO - 2015-10-22 04:59:19,446 DEBUG : BROWSER_OUTPUT: 05:02:21 INFO - 2015-10-22 05:02:21,811 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43936/tests/dromaeo/cssquery-yui.html (next: http://localhost:43936/tests/dromaeo/cssquery-dojo.html) 05:02:22 INFO - 2015-10-22 05:02:22,061 DEBUG : BROWSER_OUTPUT: RSS: Main: 245166080 05:02:22 INFO - 2015-10-22 05:02:22,062 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,063 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:02:22 INFO - 2015-10-22 05:02:22,063 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:02:22 INFO - 2015-10-22 05:02:22,063 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:02:22 INFO - 2015-10-22 05:02:22,063 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:02:22 INFO - 2015-10-22 05:02:22,065 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2658.9762941267613;2741.6847062587794;2773.1957732257647;2786.8049236553447;2794.259521226875;4801.423829140499;4916.164252077147;5016.849494515166;5029.748512574371;5040.9243861342065;4924.80300787968;4994.375703037121;4996.250562415639;5004.249362595612;5116.616253780962;4560.156371071363;4563.133004729108;4571.679982401233;4623.630109591241;4645.279981602857;4575.702579332349;4621.353010578522;4622.468416132154;4622.583967442946;4635.976820115895;4391.2534869072015;4495.730256184639;4498.932516012263;4529;4652.976735116303;4560.384348112995;4571.885702857422;4614.653900957442;4615.607673347769;4619.838305659319;4557.248054071074;4568.406107206075;4569;4571.405717256735;4591.449026116854;4709.1994360958715;4821.4696383397795;4822.324874517571;4878.317035615017;4896.975515122402;5161.096808058613;5245.344331958505;5247.475252474722;5251.081060814342;5292.391374991848;5268.578513718893;5284;5304;5305.65513241638;5338.306020217386;4729.716217026989;4844.15227335215;4854.902901941941;4900.8774780630765;4945.752712364368;5297.470252974749;5364.8122315718765;5412;5413.593980451403;5416.485433883775;5198.662086964335;5204.323437953118;5205.401378841406;5209.869753256123;5210.088234559013;5094.6688465249645;5212.40057393397;5220.138677118309;5299.178627312773;5350.571954243651;5142.331496905378;5225.660332078479;5226.660267082628;5228.816991405282;5271.262023316739;5187.948120518747;5195.714235716996;5199.2201169824075;5201.531862132426;5233.816816411408;4240.151969606091;4336.349547567827;4348.456442944632;4424.33634954753;4431.246688063037;3778.6977041837135;3818.045488627843;3844.38489841624;3844.7116466265143;3867.0719027433774;4452.443444569429;4511.165434394582;4515.345274935182;4552.430946131733;4557.248054071041;5082.034413461431;5216.061109000417;5240.659357141773;5287.4448182941005;5339.332583427072;4347.174036932973;4388.5830846069575;4403.801828917706;4418.293073108287;4434.977825110854;4685.531446855355;4690.132325519789;4696.882577935579;4704.50602686713;4737.526247375304;4775.5224477551965;4879.219324907997;4883.389576302962;5007.6494645375205;5013.949860501349;5159.355080614923;5219.217117432264;5230.2677625131755;5233.528982391603;5280.603954703336;4960.652754307164;5008.799648014185;5023.673461225008;5025.698458092526;5066.771995260296;5057.848264552069;5186.8962620748125;5202.4017238016595;5202.453742356998;5209.453007434165;5233.895322093461;5300.920486192787;5302;5302.151655735064;5348.946510535001;5074.594032477319;5090.185570308733;5100.413452453015;5109.9744501277255;5150.4592017837585;4914.803407863646;5017.122003649274;5017.347744793154;5047.217681259411;5061.342025536656;4891.657583969088;4947.678400903929;4952.603791696583;4972.279019542074;5007.048660754445;5148.30497882796;5160.716160611202;5179.274901513716;5183.429822719573;5184.533391994739;4783.904321913473;4924.926126108183;4936.75316234194;5037.1688671370275;5077.492250774893 05:02:22 INFO - 2015-10-22 05:02:22,065 DEBUG : BROWSER_OUTPUT: |1;ext.html;504.28643469490675;509.48541972607666;515.3223511082925;543.7688982182572;553.1426289251659;36675.63324366756;37223.255534889286;37566.43650345247;37581.43627845585;37592.43611345825;39754.8012259939;40286.59713402865;40317.39523907137;40353;40377.19245615086;7089.468289878254;7222.855542889139;8093.433459657841;8264.132266112061;9863.950680246624;10184.185265178769;10264.692059238198;10340;10350.792984140351;10351.223658225663;9894;9921.3055086144;9972.401655900632;9974.501274936225;9978.700638980843;7278.599677017762;7486.62566871657;10012;10213.080822725917;10223.437710925897;10069.395836249849;10245.231607629457;10247.948760256151;10251.231157663206;10252.282340236186;37851.43222851659;37871.431928521095;38188.80905595482;38228.42657360142;38242.61757382419;2777.6111344411797;2779.249602607305;3018.411409775095;3023.2139643692576;3503.404421248394;27792.664880214303;27831.16506504808;27992;28107;28272.858635706896;2564.1409081166166;2612.281622553794;2638.6833579970335;2659.8138130330885;2686.8790904409348;228948;229383;230085;230502;231080;49999.25001124986;51539;54530;55032;55038.449615504134;55856.44143558593;56297;56443.71778141083;56575.71712141413;56844;12327.568535101229;12491.687707807378;12540.372981350896;12561.434735436927;12582.81125783114;9718.416894986323;9794.804103918024;9822.214222862154;9842.80314393708;9869.407835529748;17811.109444527723;18068.63862722738;18092.27630894776;18094.095295235187;18150;7227.096612923385;7435.553866768011;7455.813604659818;7457.515261507984;7534.284242996907;813.9186081391813;824.6701319472259;836.9204925532065;854.6282367170301;925.564984457304;24611.87694061518;25775.58234297094;26578.468430631277;26622.6006609901;26648.866755666484;913.8857642794651;924.7919218175991;932.9813403731887;963.8219016106722;970.2868391732071;13356;13542.322883855964;13635.38640761168;13638.318084095756;14023.298835058205;268035;271657;272383;272484;273249;37525.24949500995;37768.811155944044;41004.38493422601;41155.588444115776;43146.35280470795;1079.4980334144504;1090.36758679967;1090.9509072091776;1103.6964834670368;1143.3711458697683;23952.52094958056;25561;26725.331866703487;27124.1862744118;27148.72851271541;40090.39864402095;41062.38406423846;41281;42107.57892421159;42123;173880;174018;175486;176028;176268;25039;25429.364265893502;25455.61816572716;25458.74541254564;25482.617760733974;33885.32229355448;33949.321013580084;34327.65672343344;35002;35176.82411587926;31862.58369004526;32395.676043239266;32544;32925.83537082299;33227.667723322455;32126.678733213303;32131;32504.187395315308;32518.674813251564;36723.816380917924;32274.838625806722;32742;32859;33042.834785825915;33110.66889331076;28528.57207141853;28908.566371504025;30026.849865751406;30130.84934575313;30320.39359212759;22481.550368992856;23682.289531314087;23728;23868.522629546966;25324.49351013006 05:02:22 INFO - 2015-10-22 05:02:22,066 DEBUG : BROWSER_OUTPUT: |2;jquery.html;342.4862705941088;342.80288833920497;345.23530380207836;350.29765320532346;353.9823008849557;13179.934100329485;13597.864021359783;15086.547403577897;15179.316930738129;15814.683706325866;14578.562643120697;14700.48548300807;15196.164210968393;15205.54383368498;15248.771268430983;4934.654574179809;4960.355153830006;5034.874128146789;5041.117804384218;5042.722650254234;3601.783892966417;3706.425504046877;5048.899022019557;5568.248286481334;5761.798337058204;5672.234248376458;5701.971490142543;5712.428757124275;5713.457221563945;5726.3700992890745;5545.500904918556;5620.522255608278;5624.15637654351;5628.437156284359;5653.349864765563;5005.074061298671;5005.6496045276845;5026.220935754964;5030.924536131961;5048.873778155576;19358.709619355723;19643.705344419846;19927.701084483746;20003.299884503973;20084.297049603192;1759.5952930825981;1807.1416077363147;1848.0759620189906;1850.2229063793238;1872.4757068020976;12420.565280215149;12544.686382840502;12650.177738447064;12724.491020359175;12895.613131606067;1756.3852651571847;1758.8153243909333;1798.0739918941756;1826.4794533558006;1840.162725959685;52807.207891881655;53281.73359133218;54353;54813.177802333;55881.1617825733;6087.665178415141;6119.755209791648;6120.112583675342;6158.261008678987;6158.476529495043;7593;7598.544087354666;7601.467897247139;7601.733939312097;7602.315791578784;4941.802327906916;4948.084604348207;4955.35580374549;4962.305277261186;4977.452480227172;4931.802727890916;4936.284238785356;4969.254611808257;4974.701517908937;4979.278004689299;2944.852757362123;2958.6153800005864;2959.201015725742;2987;2994.3412449261127;1054.4095306628312;1086.940218287986;1103.0679076180616;1128.6670432222513;1152.6945359479744;395.66763918308186;397.98607048753155;410.38852110355356;425.99787001064794;447.9148961697267;9364.812703745887;9754.512274386252;10148.949255253676;10273.640422585173;10355.94822025885;406.86980166347075;423.5425740200576;425.359833450661;435.17534272553337;444.27583039645174;5799.594028418054;6244.75020999164;6318.336574659686;6342.778002769881;6384.585001974857;489203;490769;501045;518065;518300;70368.64815675889;70638.64680676564;70884.2911570888;70980.2901970984;72498;492.9433115191727;497.01094821305344;499.36081815276503;499.5928318420476;499.8000799680157;9980.2514811388;10041.246906481896;10329.638462653771;10597.629082982367;10719.624813131502;31592.842035789676;32321.51517727283;32738.1815454606;32977.83511082429;33178.668213318524;41828.58171418247;41860.58139418567;42103.15793684048;42894;43037.784811077;6013.188219590299;6090.446936031461;6095.177151084724;6097.695115244309;6155.876882462236;10571.418571978615;10800.783984320113;11216.775664486502;11478.82781758291;11571.074314055024;9841.065098815601;9945.801083978424;9967.053129952643;10181.083702466814;10298.794024119625;9266.860997085185;9352.158305752515;9605.951970240105;9756.024397560188;9764.707058788248;8310.875336870073;8698.652053917773;8702.868627078693;9239.907600923905;9341;6026.0659597762415;6077.756889724538;6085.391460853879;6092.969535152296;6103.389661033861;9580.18568421692;9609.855852162083;9673.467959262309;10005.399676019462;10033.899661003297 05:02:22 INFO - 2015-10-22 05:02:22,067 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1284.7237843863568;1464.0629996802045;1644.3093900561767;1692.3907393338395;1843.235057451157;7353.191148973615;8330.91669083309;8459.154084591546;8482.787930301745;8494.532800695959;7963.2434918682775;8044.91955080449;8084.9595752021305;8115.797105072376;8116.107228204893;2201.9889900550515;2230.475838178027;2230.877301748403;2231.319447568491;2231.8102961248233;2197.4176843136584;2234.698315727372;2260.7174103237094;2266.252136794862;2271.954560908781;2160.438286045624;2180.029886700419;2180.9454763630956;2192.6382146945734;2199.9450013749624;2161.6109100361928;2213.513027134028;2217.4456385903522;2218.9778102218934;2223.8109760670363;2245.528439027806;2247.539254452833;2252.8873556322283;2255.5150642611916;2255.6503741919864;7018.789436316919;8178.7955301117945;8207.917920820775;8214.4660597061;8225.136360682101;4086.3053280942313;4561.087782443525;4699.154152252593;4716.3632909557455;4724.6928949618505;2821.2946763309174;2832.5892745551987;2861.5993760873494;2872.4111557130736;2961.7926745127847;899.0694631056825;918.9172974432333;919.2875521470846;920.6271460058687;1623.4886010906644;12121.33332666703;12140.45367958444;12176.81734773979;12201.877981220163;12226.449809758582;4265.87202383929;4332.978335108304;4369.781510924441;4373.693841431133;4391.604755572014;9241.584128714225;9247.768805779775;9251.398659087137;9251.861222081674;9254.259659227246;4770.332153498443;4773.11697335994;4775.450823155312;4780.928286075712;4783.521647835189;4325.286327755948;4327;4329;4331.805068771912;4334.4798624165305;3388.745844061705;3426.7258619310396;3451.4822776583715;3456.5679290088738;3456.948145777815;1022.987242629806;1023.4319952426326;1028.861103750984;1041.8437234414898;1042.8435734639866;1188.9762204755857;1197.988020119805;1208.6253261488966;1222.0284873525568;1227.4844565282604;7786.416018798613;7852.882206766903;7905.249001344863;8095.676172953016;8151.755447336589;460.41297345883595;467.7965085187954;470.545923184129;472.2892047468538;472.97871595778275;5375.086235340002;6099.512039036867;6112.113743507167;6172.475339596095;6174.073888916609;9461.668841590512;10739.83890241647;10762.192835537366;10766;10768.3000604962;10382.584696612052;10432.426216558011;10494.212934029825;10519.894801052045;10622.946885265525;7736.574488403079;7787.688492460238;7819.765407037798;7829.608519573999;7830.530168190041;7700.922990770245;7791.4935529190425;7806.88289675644;7937.365010799238;8003.39974501903;9082.682106126254;9190.080991900757;9297.535123243946;9310.534473276173;9339.066093390607;9275.30435217348;9412.294077944045;9415.858762118436;9430.669926552539;9530.761730956781;7959.482633628795;7998.080220774686;8059.43583949118;8081.393895457982;8112.959435203023;8078.474899131537;8121.79695507617;8127.268545830903;8132;8134.796630084295;7549.471536992577;7687.846243075219;7708.884366734392;7753.651085701044;7915.327197188303;7427.145878224073;7532.133804612539;7572.280633340044;7624.428167887319;7632.122305934889;7765.262300081483;7783.883241751265;7783.922160778547;7810.804729881798;7814.492058016438;6846.246912839683;6915.861682766216;6954.130733658293;6968.128983877015;7002.859942801014;6898.8620227596175;6941.548799328028;6944;6944.861102777815;6967.442604591722 05:02:22 INFO - 2015-10-22 05:02:22,069 DEBUG : BROWSER_OUTPUT: |4;prototype.html;297.6710734638225;307.9045495896272;310.5140455187633;314.4748270388451;315.7442471598004;5141.460146684596;5223.529882310591;5225.3990791059;5228.895422091556;5230.895382092356;5144.871378215537;5151.536361727443;5153.407358153813;5154.561862241704;5163.173892177252;3886.028492876781;3942.3889297158985;4077.3068578341754;4087.2847251730827;4088.7751173685438;3976.0855003349247;4015.217032678629;4042.4138499917494;4049.3318602430563;4050.392441133824;3997.220541994298;3999.8200080996426;4004.3793212052033;4005.178938317638;4006.1587066716024;3839.404892241721;3911.159100793343;3964.623360780721;3999.1601763629674;4030.0932290234755;3544.2557063016798;3544.468329750532;3545.94681079784;3548.609652938175;3553.3248682750454;4976.104301225778;4987.226979818134;4988.5260900214425;4989.925151122736;4995.725235112068;4493;4499.977500112511;4504.301833215857;4507.752073635948;4512.548745125461;5133.281340612317;5282.471752824726;5288.867778305535;5378.408375078778;5390.380106287748;3858.5176852893387;3861.015441062539;3861.7876016819064;3863.864764733249;3866.2267546490816;5617.887642247173;5619.943800561983;5623.297087864017;5636.323641163046;5636.464535869127;3943.4282029106193;3946.210757848442;3950.5259368875345;3951.0912490126857;3953.3872249801325;3778.2254637799183;3786.734928554975;4006.639402453793;4010.1177740897538;4015.4980627421573;4074.30736774749;4360.629346505519;4407.3168658857285;4408.206522825858;4450.287953927356;5179.19722443022;5270.077736396115;5288.286081379041;5291.232771248147;5291.708956007456;1400.649837540615;1425.3443416028535;1426.1300606629948;1427.3291552970088;1430.6137342917355;942.6088173407959;962.4273557233435;965.5751469353462;965.6089283839916;989.1345073061071;4692.41344831896;4694.155052090657;4696.694714843593;4699.389079419653;4702.741349225826;5531.1426728857095;5547.389787123413;5553.361363443175;5555.833325000256;5558.833235002957;4729.07782982322;4730.148573256847;4733.810647574059;4734.834280800155;4741.786619602126;2895.2038189498057;2923.4007028559517;3013.065949555601;3026.7124623160767;3048.710372514652;5202.193659982709;5219.582433405394;5223.399309079505;5229.581633469314;5233.476652334736;5619.100943848965;5624.746886390122;5636.577256705764;5637.548996080303;5637.943620563824;5177.534021937969;5186.611004174702;5194.636375453682;5195.610329225247;5204.193350030751;5398.78404863801;5574.749136288796;5579.051561234519;5579.386267510489;5581.302337207849;5455.290812194389;5460.208269800936;5462.699551524545;5464.863378415413;5466.262054622575;5289.41816400188;5289.656172348785;5290.391604965478;5291.8677033072945;5294.97352513235;3763.172102137525;3858.498395208605;3862.729608927348;3865.2849222893856;3874.573796882397;5579.358373787067;5584.832455026356;5585.581081418829;5590.440955904377;5591.04952158126;5335.519803217729;5366.195070739264;5369.221462887781;5372.677639341652;5375.489328513785;5309.893802124013;5337.733113344395;5350.384705758887;5357.598180136428;5367.4364191759305;5133.460986596503;5245.89508209826;5272.235525848654;5275.182346736262;5275.340582427197;5379.569634429158;5412.539934105645;5417.052015897281;5424.457554244544;5431.619786614899;5257.526822585985;5261.5264626183825;5267.920981185209;5271.736413179249;5283.339582552181 05:02:22 INFO - 2015-10-22 05:02:22,069 DEBUG : BROWSER_OUTPUT: |5;yui.html;725.1117381208018;757.2465396930052;759.9696012159513;765.1315756616241;770.7957391291307;10064.647737329195;10265.692029239117;10276.588936442551;10283.33158344707;10284;9540.570674319672;9611.086946740066;9620.182284505809;9628.662996795114;9629.807403851919;611.6299638718577;618.557731222176;764.2739397572301;770.8612449759041;779.6803310642638;778.0624347661084;779.6101949025488;785.9292663660298;786.4887822915123;787.3268355556003;826.2563692676579;829.2536716954729;831.4470876866907;832.3840358134997;832.4797001873828;633.0757094641806;641.8363317354092;809.1059379385812;821.1993306526149;824.2664029014182;608.1030480041903;611.4649681528663;611.788932818177;612.761023200952;613.2242712968099;9310.487923164223;9320.44077355354;9379.812403751886;9408.764780880465;9410.858837117448;9392.953035234848;9599.664011759625;9602.519874006342;9665.661701840401;10528.789424211549;8237;8384.421384212063;8392.706255281097;8411.116832732598;8433.19884610961;2938.823670579751;2960.2007457986224;2982.239528920133;2996.7602591792606;3022.969770302313;29375.55936660952;29641.407171856874;31851.84074079615;32030.519542206886;32067.198320041953;5814.30228372598;5829.242198514166;5847.06446968483;5862.443067908542;5877.147813567009;9642.614295428104;9745.707628771148;9757.12185903272;9758.804823903623;9762.560684769202;4919.827806026772;5003.674761140587;5128.333316668809;5186.325777648882;5204.661696989683;3249.821259830732;3259.674032596721;3259.951100733491;3282.14664187313;3301.125201821519;2265.4562904902705;2292.128990983449;2296.299628613289;2296.9655455168186;2300.7814257645496;405.705863249142;409.4697366909859;415.91265834175164;416.3234743541745;417.482321920816;412.60596130695114;462.40349948566643;465.55772016583705;481.74226788668597;569.6695916368496;6355.3644635536075;6548.607083575001;6623.635700036544;6795.116634837538;6907.412869906014;443.1690580162196;472.7825200407851;524.9028929648027;529.1956226535644;546.1207455995843;3003.849807509616;3125.7186853182866;3182.633997090364;3212.40985712074;3263.396271689745;42758;42821.78589107097;42870;42898.14203715908;43004.354934676005;33907.83046084803;34193.31613367719;34564.654353456644;34605.82697086498;34670.82664586661;29767;30126;30290.54564181539;30406.391872162432;30468.847655762023;6417.133686952388;6624.138861947916;6744.426723728342;6805.940346936229;6994.720211191496;22843.200487982842;22879.19922802694;22909.770902290762;22927.656085158404;23129.653055204522;29505.11484655464;29580.852095739385;30483.847580761954;31473.213169670027;31549.8422507886;9067.410618309788;9074.500902450429;9155.313351498797;9256.861147082664;9257.722268331961;8752.956235218782;8891.955540222258;8945.37382383227;8989.05614910425;9226.953865230631;9235.58439870194;9239.86140207884;9364.110409511086;9494.525273736424;9523.619055237712;8828.823423531621;8931.19619234272;8936.508492033001;8971.641134354553;8979.05719899401;8014.318782903285;8054.718084867001;8254.876176857231;8353.457025293337;8639.04970453237;6963.09479767627;7201.3518783309755;7494.250574942462;7503.737369192052;7675.961620191863;7445.4415918805225;7470.6264686766535;7523.774286771406;7547.132079810892;7745.070591529053 05:02:22 INFO - 2015-10-22 05:02:22,069 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:02:22 INFO - 2015-10-22 05:02:22,069 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:02:22 INFO - 2015-10-22 05:02:22,070 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,904 05:02:22 INFO - 2015-10-22 05:02:22,070 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:02:22 INFO - 2015-10-22 05:02:22,070 DEBUG : BROWSER_OUTPUT: __startTimestamp1445515342062__endTimestamp 05:02:22 INFO - 2015-10-22 05:02:22,070 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,070 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4846.37 Median:5004.25 stddev:510.36 (10.2%) stddev-sans-first:482.21 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: Values: 2659.0 2741.7 2773.2 2786.8 2794.3 4801.4 4916.2 5016.8 5029.7 5040.9 4924.8 4994.4 4996.3 5004.2 5116.6 4560.2 4563.1 4571.7 4623.6 4645.3 4575.7 4621.4 4622.5 4622.6 4636.0 4391.3 4495.7 4498.9 4529.0 4653.0 4560.4 4571.9 4614.7 4615.6 4619.8 4557.2 4568.4 4569.0 4571.4 4591.4 4709.2 4821.5 4822.3 4878.3 4897.0 5161.1 5245.3 5247.5 5251.1 5292.4 5268.6 5284.0 5304.0 5305.7 5338.3 4729.7 4844.2 4854.9 4900.9 4945.8 5297.5 5364.8 5412.0 5413.6 5416.5 5198.7 5204.3 5205.4 5209.9 5210.1 5094.7 5212.4 5220.1 5299.2 5350.6 5142.3 5225.7 5226.7 5228.8 5271.3 5187.9 5195.7 5199.2 5201.5 5233.8 4240.2 4336.3 4348.5 4424.3 4431.2 3778.7 3818.0 3844.4 3844.7 3867.1 4452.4 4511.2 4515.3 4552.4 4557.2 5082.0 5216.1 5240.7 5287.4 5339.3 4347.2 4388.6 4403.8 4418.3 4435.0 4685.5 4690.1 4696.9 4704.5 4737.5 4775.5 4879.2 4883.4 5007.6 5013.9 5159.4 5219.2 5230.3 5233.5 5280.6 4960.7 5008.8 5023.7 5025.7 5066.8 5057.8 5186.9 5202.4 5202.5 5209.5 5233.9 5300.9 5302.0 5302.2 5348.9 5074.6 5090.2 5100.4 5110.0 5150.5 4914.8 5017.1 5017.3 5047.2 5061.3 4891.7 4947.7 4952.6 4972.3 5007.0 5148.3 5160.7 5179.3 5183.4 5184.5 4783.9 4924.9 4936.8 5037.2 5077.5 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38707.98 Median:32335.26 stddev:59596.21 (184.3%) stddev-sans-first:59694.36 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: Values: 504.3 509.5 515.3 543.8 553.1 36675.6 37223.3 37566.4 37581.4 37592.4 39754.8 40286.6 40317.4 40353.0 40377.2 7089.5 7222.9 8093.4 8264.1 9864.0 10184.2 10264.7 10340.0 10350.8 10351.2 9894.0 9921.3 9972.4 9974.5 9978.7 7278.6 7486.6 10012.0 10213.1 10223.4 10069.4 10245.2 10247.9 10251.2 10252.3 37851.4 37871.4 38188.8 38228.4 38242.6 2777.6 2779.2 3018.4 3023.2 3503.4 27792.7 27831.2 27992.0 28107.0 28272.9 2564.1 2612.3 2638.7 2659.8 2686.9 228948.0 229383.0 230085.0 230502.0 231080.0 49999.3 51539.0 54530.0 55032.0 55038.4 55856.4 56297.0 56443.7 56575.7 56844.0 12327.6 12491.7 12540.4 12561.4 12582.8 9718.4 9794.8 9822.2 9842.8 9869.4 17811.1 18068.6 18092.3 18094.1 18150.0 7227.1 7435.6 7455.8 7457.5 7534.3 813.9 824.7 836.9 854.6 925.6 24611.9 25775.6 26578.5 26622.6 26648.9 913.9 924.8 933.0 963.8 970.3 13356.0 13542.3 13635.4 13638.3 14023.3 268035.0 271657.0 272383.0 272484.0 273249.0 37525.2 37768.8 41004.4 41155.6 43146.4 1079.5 1090.4 1091.0 1103.7 1143.4 23952.5 25561.0 26725.3 27124.2 27148.7 40090.4 41062.4 41281.0 42107.6 42123.0 173880.0 174018.0 175486.0 176028.0 176268.0 25039.0 25429.4 25455.6 25458.7 25482.6 33885.3 33949.3 34327.7 35002.0 35176.8 31862.6 32395.7 32544.0 32925.8 33227.7 32126.7 32131.0 32504.2 32518.7 36723.8 32274.8 32742.0 32859.0 33042.8 33110.7 28528.6 28908.6 30026.8 30130.8 30320.4 22481.6 23682.3 23728.0 23868.5 25324.5 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:25357.38 Median:4951.72 stddev:82463.57 (1665.4%) stddev-sans-first:82673.51 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: Values: 342.5 342.8 345.2 350.3 354.0 13179.9 13597.9 15086.5 15179.3 15814.7 14578.6 14700.5 15196.2 15205.5 15248.8 4934.7 4960.4 5034.9 5041.1 5042.7 3601.8 3706.4 5048.9 5568.2 5761.8 5672.2 5702.0 5712.4 5713.5 5726.4 5545.5 5620.5 5624.2 5628.4 5653.3 5005.1 5005.6 5026.2 5030.9 5048.9 19358.7 19643.7 19927.7 20003.3 20084.3 1759.6 1807.1 1848.1 1850.2 1872.5 12420.6 12544.7 12650.2 12724.5 12895.6 1756.4 1758.8 1798.1 1826.5 1840.2 52807.2 53281.7 54353.0 54813.2 55881.2 6087.7 6119.8 6120.1 6158.3 6158.5 7593.0 7598.5 7601.5 7601.7 7602.3 4941.8 4948.1 4955.4 4962.3 4977.5 4931.8 4936.3 4969.3 4974.7 4979.3 2944.9 2958.6 2959.2 2987.0 2994.3 1054.4 1086.9 1103.1 1128.7 1152.7 395.7 398.0 410.4 426.0 447.9 9364.8 9754.5 10148.9 10273.6 10355.9 406.9 423.5 425.4 435.2 444.3 5799.6 6244.8 6318.3 6342.8 6384.6 489203.0 490769.0 501045.0 518065.0 518300.0 70368.6 70638.6 70884.3 70980.3 72498.0 492.9 497.0 499.4 499.6 499.8 9980.3 10041.2 10329.6 10597.6 10719.6 31592.8 32321.5 32738.2 32977.8 33178.7 41828.6 41860.6 42103.2 42894.0 43037.8 6013.2 6090.4 6095.2 6097.7 6155.9 10571.4 10800.8 11216.8 11478.8 11571.1 9841.1 9945.8 9967.1 10181.1 10298.8 9266.9 9352.2 9606.0 9756.0 9764.7 8310.9 8698.7 8702.9 9239.9 9341.0 6026.1 6077.8 6085.4 6093.0 6103.4 9580.2 9609.9 9673.5 10005.4 10033.9 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,071 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5800.37 Median:5737.30 stddev:3225.48 (56.2%) stddev-sans-first:3216.67 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: Values: 1284.7 1464.1 1644.3 1692.4 1843.2 7353.2 8330.9 8459.2 8482.8 8494.5 7963.2 8044.9 8085.0 8115.8 8116.1 2202.0 2230.5 2230.9 2231.3 2231.8 2197.4 2234.7 2260.7 2266.3 2272.0 2160.4 2180.0 2180.9 2192.6 2199.9 2161.6 2213.5 2217.4 2219.0 2223.8 2245.5 2247.5 2252.9 2255.5 2255.7 7018.8 8178.8 8207.9 8214.5 8225.1 4086.3 4561.1 4699.2 4716.4 4724.7 2821.3 2832.6 2861.6 2872.4 2961.8 899.1 918.9 919.3 920.6 1623.5 12121.3 12140.5 12176.8 12201.9 12226.4 4265.9 4333.0 4369.8 4373.7 4391.6 9241.6 9247.8 9251.4 9251.9 9254.3 4770.3 4773.1 4775.5 4780.9 4783.5 4325.3 4327.0 4329.0 4331.8 4334.5 3388.7 3426.7 3451.5 3456.6 3456.9 1023.0 1023.4 1028.9 1041.8 1042.8 1189.0 1198.0 1208.6 1222.0 1227.5 7786.4 7852.9 7905.2 8095.7 8151.8 460.4 467.8 470.5 472.3 473.0 5375.1 6099.5 6112.1 6172.5 6174.1 9461.7 10739.8 10762.2 10766.0 10768.3 10382.6 10432.4 10494.2 10519.9 10622.9 7736.6 7787.7 7819.8 7829.6 7830.5 7700.9 7791.5 7806.9 7937.4 8003.4 9082.7 9190.1 9297.5 9310.5 9339.1 9275.3 9412.3 9415.9 9430.7 9530.8 7959.5 7998.1 8059.4 8081.4 8113.0 8078.5 8121.8 8127.3 8132.0 8134.8 7549.5 7687.8 7708.9 7753.7 7915.3 7427.1 7532.1 7572.3 7624.4 7632.1 7765.3 7783.9 7783.9 7810.8 7814.5 6846.2 6915.9 6954.1 6968.1 7002.9 6898.9 6941.5 6944.0 6944.9 6967.4 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4464.24 Median:5153.98 stddev:1290.91 (25.0%) stddev-sans-first:1256.08 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: Values: 297.7 307.9 310.5 314.5 315.7 5141.5 5223.5 5225.4 5228.9 5230.9 5144.9 5151.5 5153.4 5154.6 5163.2 3886.0 3942.4 4077.3 4087.3 4088.8 3976.1 4015.2 4042.4 4049.3 4050.4 3997.2 3999.8 4004.4 4005.2 4006.2 3839.4 3911.2 3964.6 3999.2 4030.1 3544.3 3544.5 3545.9 3548.6 3553.3 4976.1 4987.2 4988.5 4989.9 4995.7 4493.0 4500.0 4504.3 4507.8 4512.5 5133.3 5282.5 5288.9 5378.4 5390.4 3858.5 3861.0 3861.8 3863.9 3866.2 5617.9 5619.9 5623.3 5636.3 5636.5 3943.4 3946.2 3950.5 3951.1 3953.4 3778.2 3786.7 4006.6 4010.1 4015.5 4074.3 4360.6 4407.3 4408.2 4450.3 5179.2 5270.1 5288.3 5291.2 5291.7 1400.6 1425.3 1426.1 1427.3 1430.6 942.6 962.4 965.6 965.6 989.1 4692.4 4694.2 4696.7 4699.4 4702.7 5531.1 5547.4 5553.4 5555.8 5558.8 4729.1 4730.1 4733.8 4734.8 4741.8 2895.2 2923.4 3013.1 3026.7 3048.7 5202.2 5219.6 5223.4 5229.6 5233.5 5619.1 5624.7 5636.6 5637.5 5637.9 5177.5 5186.6 5194.6 5195.6 5204.2 5398.8 5574.7 5579.1 5579.4 5581.3 5455.3 5460.2 5462.7 5464.9 5466.3 5289.4 5289.7 5290.4 5291.9 5295.0 3763.2 3858.5 3862.7 3865.3 3874.6 5579.4 5584.8 5585.6 5590.4 5591.0 5335.5 5366.2 5369.2 5372.7 5375.5 5309.9 5337.7 5350.4 5357.6 5367.4 5133.5 5245.9 5272.2 5275.2 5275.3 5379.6 5412.5 5417.1 5424.5 5431.6 5257.5 5261.5 5267.9 5271.7 5283.3 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,073 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:9733.87 Median:3529.49 stddev:10815.22 (306.4%) stddev-sans-first:10824.40 05:02:22 INFO - 2015-10-22 05:02:22,074 DEBUG : BROWSER_OUTPUT: Values: 725.1 757.2 760.0 765.1 770.8 10064.6 10265.7 10276.6 10283.3 10284.0 9540.6 9611.1 9620.2 9628.7 9629.8 611.6 618.6 764.3 770.9 779.7 778.1 779.6 785.9 786.5 787.3 826.3 829.3 831.4 832.4 832.5 633.1 641.8 809.1 821.2 824.3 608.1 611.5 611.8 612.8 613.2 9310.5 9320.4 9379.8 9408.8 9410.9 9393.0 9599.7 9602.5 9665.7 10528.8 8237.0 8384.4 8392.7 8411.1 8433.2 2938.8 2960.2 2982.2 2996.8 3023.0 29375.6 29641.4 31851.8 32030.5 32067.2 5814.3 5829.2 5847.1 5862.4 5877.1 9642.6 9745.7 9757.1 9758.8 9762.6 4919.8 5003.7 5128.3 5186.3 5204.7 3249.8 3259.7 3260.0 3282.1 3301.1 2265.5 2292.1 2296.3 2297.0 2300.8 405.7 409.5 415.9 416.3 417.5 412.6 462.4 465.6 481.7 569.7 6355.4 6548.6 6623.6 6795.1 6907.4 443.2 472.8 524.9 529.2 546.1 3003.8 3125.7 3182.6 3212.4 3263.4 42758.0 42821.8 42870.0 42898.1 43004.4 33907.8 34193.3 34564.7 34605.8 34670.8 29767.0 30126.0 30290.5 30406.4 30468.8 6417.1 6624.1 6744.4 6805.9 6994.7 22843.2 22879.2 22909.8 22927.7 23129.7 29505.1 29580.9 30483.8 31473.2 31549.8 9067.4 9074.5 9155.3 9256.9 9257.7 8753.0 8892.0 8945.4 8989.1 9227.0 9235.6 9239.9 9364.1 9494.5 9523.6 8828.8 8931.2 8936.5 8971.6 8979.1 8014.3 8054.7 8254.9 8353.5 8639.0 6963.1 7201.4 7494.3 7503.7 7676.0 7445.4 7470.6 7523.8 7547.1 7745.1 05:02:22 INFO - 2015-10-22 05:02:22,074 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:02:22 INFO - 2015-10-22 05:02:22,074 DEBUG : BROWSER_OUTPUT: 05:02:22 INFO - 2015-10-22 05:02:22,701 INFO : Browser exited with error code: 0 05:02:22 INFO - 2015-10-22 05:02:22,722 INFO : Completed test dromaeo_css (00:18:38) 05:02:22 INFO - 2015-10-22 05:02:22,723 INFO : Starting test kraken 05:02:22 INFO - 2015-10-22 05:02:22,723 DEBUG : operating with platform_type : linux_ 05:02:22 INFO - 2015-10-22 05:02:22,723 INFO : Initialising browser for kraken test... 05:02:22 INFO - 2015-10-22 05:02:22,729 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp06tu1U/profile http://localhost:43936/getInfo.html 05:02:26 INFO - 2015-10-22 05:02:26,926 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:02:26 INFO - 2015-10-22 05:02:26,926 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:02:26 INFO - 2015-10-22 05:02:26,926 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:02:26 INFO - 2015-10-22 05:02:26,926 DEBUG : BROWSER_OUTPUT: __metrics 05:02:27 INFO - 2015-10-22 05:02:27,069 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:02:27 INFO - 2015-10-22 05:02:27,690 DEBUG : BROWSER_OUTPUT: console.error: 05:02:27 INFO - 2015-10-22 05:02:27,693 DEBUG : BROWSER_OUTPUT: Message: [Exception... "Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [mozIStorageAsyncStatement.executeAsync]" nsresult: "0x80040111 (NS_ERROR_NOT_AVAILABLE)" location: "JS frame :: resource://gre/modules/Sqlite.jsm :: ConnectionData.prototype<._executeStatement :: line 758" data: no] 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: Stack: 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<._executeStatement@resource://gre/modules/Sqlite.jsm:758:19 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached/<@resource://gre/modules/Sqlite.jsm:493:9 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeCached@resource://gre/modules/Sqlite.jsm:491:1 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeBeforeShutdown/loggedDb<.executeCached.value<@resource://gre/modules/Sqlite.jsm:368:51 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: transaction@resource://gre/modules/Bookmarks.jsm:791:13 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:314:40 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: TaskImpl@resource://gre/modules/Task.jsm:275:3 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: createAsyncFunction/asyncFunction@resource://gre/modules/Task.jsm:249:14 05:02:27 INFO - 2015-10-22 05:02:27,694 DEBUG : BROWSER_OUTPUT: Task_spawn@resource://gre/modules/Task.jsm:164:12 05:02:27 INFO - 2015-10-22 05:02:27,695 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeTransaction/promisedromaeo_css: 6013.07 05:04:03 INFO - RETURN: kraken: 1492.30 05:04:03 INFO - RETURN: v8_7: 19911.05 05:04:03 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,203,35]]", "result": "19911.05"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,203,35]]", "result": "1492.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,203,35]]", "result": "6013.07"}}} 05:04:03 INFO - Return code: 0 05:04:03 INFO - # TBPL SUCCESS # 05:04:03 INFO - Running post-action listener: _resource_record_post_action 05:04:03 INFO - Running post-run listener: _resource_record_post_run 05:04:04 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 7766016; Write bytes: 397467648; Read time: 1164; Write time: 272828 05:04:04 INFO - install - Wall time: 14s; CPU: 13.0%; Read bytes: 0; Write bytes: 102105088; Read time: 0; Write time: 62044 05:04:04 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 5500928; Write bytes: 295362560; Read time: 916; Write time: 210784 05:04:04 INFO - Running post-run listener: _upload_blobber_files 05:04:04 INFO - Blob upload gear active. 05:04:04 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:04:04 INFO - Copying logs to upload dir... 05:04:04 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1268.284629 ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 41 secs) (at 2015-10-22 05:04:37.736582) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-10-22 05:04:37.740231) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009773 build_url: 'https://queue.taskcluster.net/v1/task/ZygM4hiaQuyePZFz-1QzCw/artifacts/public/build/firefox-44.0a1.en-US.linux-x86_64.tar.bz2' ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-10-22 05:04:37.763390) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 05:04:37.763730) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a9e534cca236dfa67d42a089000001c1-1445514118.844840-48650201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004451 ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-10-22 05:04:37.813920) ========= ========= Started reboot slave lost (results: 0, elapsed: 3 secs) (at 2015-10-22 05:04:37.814233) ========= ========= Finished reboot slave lost (results: 0, elapsed: 3 secs) (at 2015-10-22 05:04:41.727655) =========