builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-022 starttime: 1458696677.75 results: success (0) buildid: 20160322165927 builduid: cbbbd54e7e254011b2755e6e5b6a1712 revision: f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:17.751825) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:17.753039) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:17.753788) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006458 basedir: '/builds/slave/test' ========= master_lag: 0.53 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:18.293499) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-22 18:31:18.293873) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-22 18:31:20.126577) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:20.128739) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004629 ========= master_lag: 0.48 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:20.613981) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:20.614343) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:20.614809) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:20.615124) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-22 18:31:20-- 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% 96.2M=0s 2016-03-22 18:31:21 (96.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.631937 ========= master_lag: 0.23 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:21.477480) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:21.477854) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020373 ========= master_lag: 0.46 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:21.954373) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2016-03-22 18:31:21.955362) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 --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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-22 18:31:22,059 truncating revision to first 12 chars 2016-03-22 18:31:22,059 Setting DEBUG logging. 2016-03-22 18:31:22,059 attempt 1/10 2016-03-22 18:31:22,059 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f9e8d838c9ee?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-22 18:31:23,974 unpacking tar archive at: fx-team-f9e8d838c9ee/testing/mozharness/ program finished with exit code 0 elapsedTime=2.172494 ========= master_lag: 1.23 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 3 secs) (at 2016-03-22 18:31:25.354479) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:25.354874) ========= echo f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4'] 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 program finished with exit code 0 elapsedTime=0.004724 script_repo_revision: 'f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4' ========= master_lag: 0.42 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:25.776291) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:25.776653) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-22 18:31:26.542082) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 40 secs) (at 2016-03-22 18:31:26.542542) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:31:26 INFO - MultiFileLogger online at 20160322 18:31:26 in /builds/slave/test 18:31:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 18:31:26 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:31:26 INFO - {'append_to_log': False, 18:31:26 INFO - 'base_work_dir': '/builds/slave/test', 18:31:26 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 18:31:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:31:26 INFO - 'branch': 'Fx-Team-Non-PGO', 18:31:26 INFO - 'buildbot_json_path': 'buildprops.json', 18:31:26 INFO - 'config_files': ('talos/linux_config.py',), 18:31:26 INFO - 'default_actions': ('clobber', 18:31:26 INFO - 'read-buildbot-config', 18:31:26 INFO - 'download-and-extract', 18:31:26 INFO - 'populate-webroot', 18:31:26 INFO - 'create-virtualenv', 18:31:26 INFO - 'install', 18:31:26 INFO - 'run-tests'), 18:31:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:31:26 INFO - 'download_minidump_stackwalk': True, 18:31:26 INFO - 'download_symbols': 'ondemand', 18:31:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:31:26 INFO - 'tooltool.py': '/tools/tooltool.py', 18:31:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:31:26 INFO - '/tools/misc-python/virtualenv.py')}, 18:31:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:31:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:31:26 INFO - 'installer_path': 'installer.exe', 18:31:26 INFO - 'log_level': 'info', 18:31:26 INFO - 'log_name': 'talos', 18:31:26 INFO - 'log_to_console': True, 18:31:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:31:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:31:26 INFO - 'opt_config_files': (), 18:31:26 INFO - 'pip_index': False, 18:31:26 INFO - 'sps_profile': False, 18:31:26 INFO - 'sps_profile_interval': 0, 18:31:26 INFO - 'suite': 'dromaeojs-e10s', 18:31:26 INFO - 'system_bits': '32', 18:31:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:31:26 INFO - 'title': 'talos-linux64-ix-022', 18:31:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:31:26 INFO - 'use_talos_json': True, 18:31:26 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:31:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:31:26 INFO - 'work_dir': 'build'} 18:31:26 INFO - ##### 18:31:26 INFO - ##### Running clobber step. 18:31:26 INFO - ##### 18:31:26 INFO - Running pre-action listener: _resource_record_pre_action 18:31:26 INFO - Running main action method: clobber 18:31:26 INFO - rmtree: /builds/slave/test/build 18:31:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:31:27 INFO - Running post-action listener: _resource_record_post_action 18:31:27 INFO - ##### 18:31:27 INFO - ##### Running read-buildbot-config step. 18:31:27 INFO - ##### 18:31:27 INFO - Running pre-action listener: _resource_record_pre_action 18:31:27 INFO - Running main action method: read_buildbot_config 18:31:27 INFO - Using buildbot properties: 18:31:27 INFO - { 18:31:27 INFO - "project": "", 18:31:27 INFO - "product": "firefox", 18:31:27 INFO - "script_repo_revision": "production", 18:31:27 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 18:31:27 INFO - "repository": "", 18:31:27 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 18:31:27 INFO - "buildid": "20160322165927", 18:31:27 INFO - "pgo_build": "False", 18:31:27 INFO - "basedir": "/builds/slave/test", 18:31:27 INFO - "buildnumber": 1042, 18:31:27 INFO - "slavename": "talos-linux64-ix-022", 18:31:27 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 18:31:27 INFO - "platform": "ubuntu64_hw", 18:31:27 INFO - "scheduler": "tests-fx-team-linux64-talos", 18:31:27 INFO - "branch": "fx-team", 18:31:27 INFO - "repo_path": "integration/fx-team", 18:31:27 INFO - "revision": "f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4", 18:31:27 INFO - "stage_platform": "linux64", 18:31:27 INFO - "builduid": "cbbbd54e7e254011b2755e6e5b6a1712", 18:31:27 INFO - "slavebuilddir": "test" 18:31:27 INFO - } 18:31:27 INFO - Found installer url https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 18:31:27 INFO - Running post-action listener: _resource_record_post_action 18:31:27 INFO - ##### 18:31:27 INFO - ##### Running download-and-extract step. 18:31:27 INFO - ##### 18:31:27 INFO - Running pre-action listener: _resource_record_pre_action 18:31:27 INFO - Running main action method: download_and_extract 18:31:27 INFO - mkdir: /builds/slave/test/build/tests 18:31:27 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')]} 18:31:27 INFO - https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 18:31:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 18:31:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 18:31:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 18:31:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 18:31:28 INFO - Downloaded 1361 bytes. 18:31:28 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 18:31:28 INFO - Using the following test package requirements: 18:31:28 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 18:31:28 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:31:28 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 18:31:28 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'jsshell-linux-x86_64.zip'], 18:31:28 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:31:28 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 18:31:28 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:31:28 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:31:28 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:31:28 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 18:31:28 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:31:28 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:31: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')]} 18:31:28 INFO - https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:31:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:31:44 INFO - Downloaded 22037236 bytes. 18:31:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:31:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:31:45 INFO - Return code: 0 18:31:45 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:31:45 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')]} 18:31:45 INFO - https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:31:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 18:31:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:31:48 INFO - Downloaded 22037236 bytes. 18:31:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:31:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:31:49 INFO - Return code: 0 18:31:49 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')]} 18:31:49 INFO - https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:31:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 18:31:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 18:31:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 18:31:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:31:51 INFO - Downloaded 10848120 bytes. 18:31:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:31:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 18:31:51 INFO - Return code: 0 18:31:51 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')]} 18:31:51 INFO - https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:31:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 18:31:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 18:31:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 18:31:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:32:16 INFO - Downloaded 54189379 bytes. 18:32:16 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 18:32:16 INFO - mkdir: /builds/slave/test/properties 18:32:16 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:32:16 INFO - Writing to file /builds/slave/test/properties/build_url 18:32:16 INFO - Contents: 18:32:16 INFO - build_url:https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 18:32:20 INFO - Running post-action listener: _resource_record_post_action 18:32:20 INFO - Running post-action listener: set_extra_try_arguments 18:32:20 INFO - ##### 18:32:20 INFO - ##### Running populate-webroot step. 18:32:20 INFO - ##### 18:32:20 INFO - Running pre-action listener: _resource_record_pre_action 18:32:20 INFO - Running main action method: populate_webroot 18:32:20 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:32:20 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:32:20 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:32:20 INFO - '--tppagecycles', 18:32:20 INFO - '7'], 18:32:20 INFO - 'tests': ['tsvgm']}}, 18:32:20 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:32:20 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:32:20 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 18:32:20 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:32:20 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:32:20 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:32:20 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'tests': ['damp', 'tps']}, 18:32:20 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['damp', 'tps']}, 18:32:20 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:32:20 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:32:20 INFO - 'other': {'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'other_l64': {'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'other_nol64': {'tests': ['a11yr', 18:32:20 INFO - 'ts_paint', 18:32:20 INFO - 'tpaint', 18:32:20 INFO - 'sessionrestore', 18:32:20 INFO - 'sessionrestore_no_auto_restore', 18:32:20 INFO - 'tabpaint']}, 18:32:20 INFO - 'svgr': {'tests': ['tsvgx', 18:32:20 INFO - 'tsvgr_opacity', 18:32:20 INFO - 'tart', 18:32:20 INFO - 'tscrollx', 18:32:20 INFO - 'cart']}, 18:32:20 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['tsvgx', 18:32:20 INFO - 'tsvgr_opacity', 18:32:20 INFO - 'tart', 18:32:20 INFO - 'tscrollx', 18:32:20 INFO - 'cart']}, 18:32:20 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'tests': ['tp5o']}, 18:32:20 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'talos_options': ['--e10s'], 18:32:20 INFO - 'tests': ['tp5o']}, 18:32:20 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'talos_options': ['--xperf_path', 18:32:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:32:20 INFO - 'tests': ['tp5n']}, 18:32:20 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:32:20 INFO - 'talos_options': ['--e10s', 18:32:20 INFO - '--xperf_path', 18:32:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:32:20 INFO - 'tests': ['tp5n']}}, 18:32:20 INFO - 'talos.zip': {'path': '', 18:32:20 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:32:20 INFO - Running post-action listener: _resource_record_post_action 18:32:20 INFO - ##### 18:32:20 INFO - ##### Running create-virtualenv step. 18:32:20 INFO - ##### 18:32:20 INFO - Running pre-action listener: _resource_record_pre_action 18:32:20 INFO - Running main action method: create_virtualenv 18:32:20 INFO - Creating virtualenv /builds/slave/test/build/venv 18:32:20 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 18:32:20 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:32:20 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:32:20 INFO - Using real prefix '/usr' 18:32:20 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:32:20 INFO - Installing distribute.............................................................................................................................................................................................done. 18:32:22 INFO - Installing pip.................done. 18:32:22 INFO - Return code: 0 18:32:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:32: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')]} 18:32:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32: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')]} 18:32:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:22 INFO - Using env: {'DISPLAY': ':0', 18:32:22 INFO - 'HOME': '/home/cltbld', 18:32:22 INFO - 'LANG': 'en_US.UTF-8', 18:32:22 INFO - 'LANGUAGE': 'en_US:en', 18:32:22 INFO - 'LOGNAME': 'cltbld', 18:32:22 INFO - 'MAIL': '/var/mail/cltbld', 18:32:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:22 INFO - 'MOZ_NO_REMOTE': '1', 18:32:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:22 INFO - 'NO_EM_RESTART': '1', 18:32:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:22 INFO - 'PWD': '/builds/slave/test', 18:32:22 INFO - 'SHELL': '/bin/bash', 18:32:22 INFO - 'SHLVL': '1', 18:32:22 INFO - 'TERM': 'linux', 18:32:22 INFO - 'TMOUT': '86400', 18:32:22 INFO - 'USER': 'cltbld', 18:32:22 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:22 INFO - '_': '/tools/buildbot/bin/python'} 18:32:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:23 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 18:32:23 INFO - Cleaning up... 18:32:23 INFO - Return code: 0 18:32:23 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 18:32:23 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')]} 18:32:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:23 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')]} 18:32:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:23 INFO - Using env: {'DISPLAY': ':0', 18:32:23 INFO - 'HOME': '/home/cltbld', 18:32:23 INFO - 'LANG': 'en_US.UTF-8', 18:32:23 INFO - 'LANGUAGE': 'en_US:en', 18:32:23 INFO - 'LOGNAME': 'cltbld', 18:32:23 INFO - 'MAIL': '/var/mail/cltbld', 18:32:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:23 INFO - 'MOZ_NO_REMOTE': '1', 18:32:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:23 INFO - 'NO_EM_RESTART': '1', 18:32:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:23 INFO - 'PWD': '/builds/slave/test', 18:32:23 INFO - 'SHELL': '/bin/bash', 18:32:23 INFO - 'SHLVL': '1', 18:32:23 INFO - 'TERM': 'linux', 18:32:23 INFO - 'TMOUT': '86400', 18:32:23 INFO - 'USER': 'cltbld', 18:32:23 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:23 INFO - '_': '/tools/buildbot/bin/python'} 18:32:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:23 INFO - Downloading/unpacking psutil>=0.7.1 18:32:23 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 18:32:23 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 18:32:23 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 18:32:23 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 18:32:23 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 18:32:23 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 18:32:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:32:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:32:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:32:31 INFO - Installing collected packages: psutil 18:32:31 INFO - Running setup.py install for psutil 18:32:31 INFO - building 'psutil._psutil_linux' extension 18:32:31 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 18:32:31 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 18:32:31 INFO - building 'psutil._psutil_posix' extension 18:32:31 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 18:32:31 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 18:32:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:32:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:32:31 INFO - Successfully installed psutil 18:32:31 INFO - Cleaning up... 18:32:31 INFO - Return code: 0 18:32:31 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 18:32:31 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')]} 18:32:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:31 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')]} 18:32:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:31 INFO - Using env: {'DISPLAY': ':0', 18:32:31 INFO - 'HOME': '/home/cltbld', 18:32:31 INFO - 'LANG': 'en_US.UTF-8', 18:32:31 INFO - 'LANGUAGE': 'en_US:en', 18:32:31 INFO - 'LOGNAME': 'cltbld', 18:32:31 INFO - 'MAIL': '/var/mail/cltbld', 18:32:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:31 INFO - 'MOZ_NO_REMOTE': '1', 18:32:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:31 INFO - 'NO_EM_RESTART': '1', 18:32:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:31 INFO - 'PWD': '/builds/slave/test', 18:32:31 INFO - 'SHELL': '/bin/bash', 18:32:31 INFO - 'SHLVL': '1', 18:32:31 INFO - 'TERM': 'linux', 18:32:31 INFO - 'TMOUT': '86400', 18:32:31 INFO - 'USER': 'cltbld', 18:32:31 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:31 INFO - '_': '/tools/buildbot/bin/python'} 18:32:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:32 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:32:32 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 18:32:32 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 18:32:32 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 18:32:32 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 18:32:32 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 18:32:32 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 18:32:37 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:32:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:32:37 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:32:37 INFO - Installing collected packages: mozsystemmonitor 18:32:37 INFO - Running setup.py install for mozsystemmonitor 18:32:37 INFO - Successfully installed mozsystemmonitor 18:32:37 INFO - Cleaning up... 18:32:37 INFO - Return code: 0 18:32:37 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:32:37 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')]} 18:32:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:37 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')]} 18:32:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:37 INFO - Using env: {'DISPLAY': ':0', 18:32:37 INFO - 'HOME': '/home/cltbld', 18:32:37 INFO - 'LANG': 'en_US.UTF-8', 18:32:37 INFO - 'LANGUAGE': 'en_US:en', 18:32:37 INFO - 'LOGNAME': 'cltbld', 18:32:37 INFO - 'MAIL': '/var/mail/cltbld', 18:32:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:37 INFO - 'MOZ_NO_REMOTE': '1', 18:32:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:37 INFO - 'NO_EM_RESTART': '1', 18:32:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:37 INFO - 'PWD': '/builds/slave/test', 18:32:37 INFO - 'SHELL': '/bin/bash', 18:32:37 INFO - 'SHLVL': '1', 18:32:37 INFO - 'TERM': 'linux', 18:32:37 INFO - 'TMOUT': '86400', 18:32:37 INFO - 'USER': 'cltbld', 18:32:37 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:37 INFO - '_': '/tools/buildbot/bin/python'} 18:32:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:37 INFO - Downloading/unpacking blobuploader==1.2.4 18:32:37 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 18:32:37 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 18:32:37 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 18:32:37 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 18:32:37 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 18:32:37 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 18:32:42 INFO - Downloading blobuploader-1.2.4.tar.gz 18:32:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:32:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:32:42 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 18:32:42 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 18:32:42 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 18:32:42 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 18:32:42 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 18:32:42 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 18:32:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:32:43 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:32:43 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 18:32:43 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 18:32:43 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 18:32:43 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 18:32:43 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 18:32:43 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 18:32:43 INFO - Downloading docopt-0.6.1.tar.gz 18:32:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:32:43 INFO - Installing collected packages: blobuploader, requests, docopt 18:32:43 INFO - Running setup.py install for blobuploader 18:32:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:32:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:32:44 INFO - Running setup.py install for requests 18:32:44 INFO - Running setup.py install for docopt 18:32:44 INFO - Successfully installed blobuploader requests docopt 18:32:44 INFO - Cleaning up... 18:32:44 INFO - Return code: 0 18:32:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:32:44 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')]} 18:32:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:44 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')]} 18:32:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 18:32:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --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 18:32:44 INFO - Using env: {'DISPLAY': ':0', 18:32:44 INFO - 'HOME': '/home/cltbld', 18:32:44 INFO - 'LANG': 'en_US.UTF-8', 18:32:44 INFO - 'LANGUAGE': 'en_US:en', 18:32:44 INFO - 'LOGNAME': 'cltbld', 18:32:44 INFO - 'MAIL': '/var/mail/cltbld', 18:32:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:44 INFO - 'MOZ_NO_REMOTE': '1', 18:32:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:44 INFO - 'NO_EM_RESTART': '1', 18:32:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:44 INFO - 'PWD': '/builds/slave/test', 18:32:44 INFO - 'SHELL': '/bin/bash', 18:32:44 INFO - 'SHLVL': '1', 18:32:44 INFO - 'TERM': 'linux', 18:32:44 INFO - 'TMOUT': '86400', 18:32:44 INFO - 'USER': 'cltbld', 18:32:44 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:44 INFO - '_': '/tools/buildbot/bin/python'} 18:32:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:32:44 INFO - Running setup.py (path:/tmp/pip-tSU842-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:32:44 INFO - Running setup.py (path:/tmp/pip-ughu3Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:32:44 INFO - Running setup.py (path:/tmp/pip-wskpqa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:32:45 INFO - Running setup.py (path:/tmp/pip-loYHLF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:32:45 INFO - Running setup.py (path:/tmp/pip-nN18HI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:32:45 INFO - Running setup.py (path:/tmp/pip-iq7T3V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:32:45 INFO - Running setup.py (path:/tmp/pip-EmboJX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:32:45 INFO - Running setup.py (path:/tmp/pip-esPgcB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:32:45 INFO - Running setup.py (path:/tmp/pip-kx180X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:32:45 INFO - Running setup.py (path:/tmp/pip-3HUlxz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:32:45 INFO - Running setup.py (path:/tmp/pip-LTY_dZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:32:45 INFO - Running setup.py (path:/tmp/pip-yf5ful-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:32:45 INFO - Running setup.py (path:/tmp/pip-CAh0ms-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:32:45 INFO - Running setup.py (path:/tmp/pip-yBnQGU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:32:45 INFO - Running setup.py (path:/tmp/pip-hhaNEC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:32:45 INFO - Running setup.py (path:/tmp/pip-rXArPF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:32:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:32:45 INFO - Running setup.py (path:/tmp/pip-JLWids-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:32:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:32:46 INFO - Running setup.py install for manifestparser 18:32:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Running setup.py install for mozcrash 18:32:46 INFO - Running setup.py install for mozdebug 18:32:46 INFO - Running setup.py install for mozdevice 18:32:46 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Running setup.py install for mozfile 18:32:46 INFO - Running setup.py install for mozhttpd 18:32:46 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Running setup.py install for mozinfo 18:32:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Running setup.py install for mozInstall 18:32:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:32:46 INFO - Running setup.py install for mozleak 18:32:46 INFO - Running setup.py install for mozlog 18:32:47 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Running setup.py install for moznetwork 18:32:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Running setup.py install for mozprocess 18:32:47 INFO - Running setup.py install for mozprofile 18:32:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Running setup.py install for mozrunner 18:32:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Running setup.py install for mozscreenshot 18:32:47 INFO - Running setup.py install for moztest 18:32:47 INFO - Running setup.py install for mozversion 18:32:47 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:32:47 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:32:47 INFO - Cleaning up... 18:32:47 INFO - Return code: 0 18:32:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:32:47 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')]} 18:32:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:47 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')]} 18:32:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:47 INFO - Using env: {'DISPLAY': ':0', 18:32:47 INFO - 'HOME': '/home/cltbld', 18:32:47 INFO - 'LANG': 'en_US.UTF-8', 18:32:47 INFO - 'LANGUAGE': 'en_US:en', 18:32:47 INFO - 'LOGNAME': 'cltbld', 18:32:47 INFO - 'MAIL': '/var/mail/cltbld', 18:32:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:47 INFO - 'MOZ_NO_REMOTE': '1', 18:32:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:47 INFO - 'NO_EM_RESTART': '1', 18:32:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:47 INFO - 'PWD': '/builds/slave/test', 18:32:47 INFO - 'SHELL': '/bin/bash', 18:32:47 INFO - 'SHLVL': '1', 18:32:47 INFO - 'TERM': 'linux', 18:32:47 INFO - 'TMOUT': '86400', 18:32:47 INFO - 'USER': 'cltbld', 18:32:47 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:47 INFO - '_': '/tools/buildbot/bin/python'} 18:32:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:32:48 INFO - Running setup.py (path:/tmp/pip-IoXI9n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:32:48 INFO - Running setup.py (path:/tmp/pip-o16Yk5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:32:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:32:48 INFO - Running setup.py (path:/tmp/pip-cAEIhD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:32:48 INFO - Running setup.py (path:/tmp/pip-gB6PvQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:32:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:32:48 INFO - Running setup.py (path:/tmp/pip-VswaMh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:32:48 INFO - Running setup.py (path:/tmp/pip-Ic9l4G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:32:48 INFO - Running setup.py (path:/tmp/pip-2IMZSo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:32:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:32:48 INFO - Running setup.py (path:/tmp/pip-s9UXNJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:32:48 INFO - Running setup.py (path:/tmp/pip-IDNdik-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:32:48 INFO - Running setup.py (path:/tmp/pip-mVR94H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:32:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:32:48 INFO - Running setup.py (path:/tmp/pip-ciWbFR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:32:48 INFO - Running setup.py (path:/tmp/pip-WiHhLF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:32:48 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:32:48 INFO - Running setup.py (path:/tmp/pip-sGDkxn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:32:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 18:32:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:32:48 INFO - Running setup.py (path:/tmp/pip-Axg05w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:32:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 18:32:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:32:49 INFO - Running setup.py (path:/tmp/pip-t5jcVA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:32:49 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)) 18:32:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:32:49 INFO - Running setup.py (path:/tmp/pip-5kFw28-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:32:49 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)) 18:32:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:32:49 INFO - Running setup.py (path:/tmp/pip-MBX7eF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:32:49 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)) 18:32:49 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:32:49 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:32:49 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)) 18:32:49 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:32:49 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:32:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:32:49 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 18:32:49 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 18:32:49 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 18:32:49 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 18:32:49 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 18:32:49 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 18:32:54 INFO - Downloading blessings-1.6.tar.gz 18:32:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:32:54 INFO - Installing collected packages: blessings 18:32:54 INFO - Running setup.py install for blessings 18:32:54 INFO - Successfully installed blessings 18:32:54 INFO - Cleaning up... 18:32:54 INFO - Return code: 0 18:32:54 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:32:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:32:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:32:54 INFO - Reading from file tmpfile_stdout 18:32:54 INFO - Current package versions: 18:32:54 INFO - argparse == 1.2.1 18:32:54 INFO - blessings == 1.6 18:32:54 INFO - blobuploader == 1.2.4 18:32:54 INFO - docopt == 0.6.1 18:32:54 INFO - manifestparser == 1.1 18:32:54 INFO - mozInstall == 1.12 18:32:54 INFO - mozcrash == 0.17 18:32:54 INFO - mozdebug == 0.1 18:32:54 INFO - mozdevice == 0.48 18:32:54 INFO - mozfile == 1.2 18:32:54 INFO - mozhttpd == 0.7 18:32:54 INFO - mozinfo == 0.9 18:32:54 INFO - mozleak == 0.1 18:32:54 INFO - mozlog == 3.1 18:32:54 INFO - moznetwork == 0.27 18:32:54 INFO - mozprocess == 0.22 18:32:54 INFO - mozprofile == 0.28 18:32:54 INFO - mozrunner == 6.11 18:32:54 INFO - mozscreenshot == 0.1 18:32:54 INFO - mozsystemmonitor == 0.0 18:32:54 INFO - moztest == 0.7 18:32:54 INFO - mozversion == 1.4 18:32:54 INFO - psutil == 3.1.1 18:32:54 INFO - requests == 1.2.3 18:32:54 INFO - wsgiref == 0.1.2 18:32:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:32:54 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')]} 18:32:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:54 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')]} 18:32:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 18:32:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 18:32:54 INFO - Using env: {'DISPLAY': ':0', 18:32:54 INFO - 'HOME': '/home/cltbld', 18:32:54 INFO - 'LANG': 'en_US.UTF-8', 18:32:54 INFO - 'LANGUAGE': 'en_US:en', 18:32:54 INFO - 'LOGNAME': 'cltbld', 18:32:54 INFO - 'MAIL': '/var/mail/cltbld', 18:32:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:54 INFO - 'MOZ_NO_REMOTE': '1', 18:32:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:54 INFO - 'NO_EM_RESTART': '1', 18:32:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:54 INFO - 'PWD': '/builds/slave/test', 18:32:54 INFO - 'SHELL': '/bin/bash', 18:32:54 INFO - 'SHLVL': '1', 18:32:54 INFO - 'TERM': 'linux', 18:32:54 INFO - 'TMOUT': '86400', 18:32:54 INFO - 'USER': 'cltbld', 18:32:54 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:54 INFO - '_': '/tools/buildbot/bin/python'} 18:32:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:32:55 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 2)) 18:32:55 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 3)) 18:32:55 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 4)) 18:32:55 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 5)) 18:32:55 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 6)) 18:32:55 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 7)) 18:32:55 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 8)) 18:32:55 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 9)) 18:32:55 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 18:32:55 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 4)) 18:32:55 INFO - Cleaning up... 18:32:55 INFO - Return code: 0 18:32:55 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:32:55 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')]} 18:32:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:32:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:55 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')]} 18:32:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:32:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:32:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:32:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test/build 18:32:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema 18:32:55 INFO - Using env: {'DISPLAY': ':0', 18:32:55 INFO - 'HOME': '/home/cltbld', 18:32:55 INFO - 'LANG': 'en_US.UTF-8', 18:32:55 INFO - 'LANGUAGE': 'en_US:en', 18:32:55 INFO - 'LOGNAME': 'cltbld', 18:32:55 INFO - 'MAIL': '/var/mail/cltbld', 18:32:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:32:55 INFO - 'MOZ_NO_REMOTE': '1', 18:32:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:32:55 INFO - 'NO_EM_RESTART': '1', 18:32:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:32:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:32:55 INFO - 'PWD': '/builds/slave/test', 18:32:55 INFO - 'SHELL': '/bin/bash', 18:32:55 INFO - 'SHLVL': '1', 18:32:55 INFO - 'TERM': 'linux', 18:32:55 INFO - 'TMOUT': '86400', 18:32:55 INFO - 'USER': 'cltbld', 18:32:55 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:32:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:32:55 INFO - '_': '/tools/buildbot/bin/python'} 18:32:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:32:55 INFO - Downloading/unpacking jsonschema 18:32:55 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 18:32:55 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 18:32:55 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 18:32:55 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 18:32:55 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 18:32:55 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 18:33:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:33:01 INFO - Downloading/unpacking functools32 (from jsonschema) 18:33:01 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 18:33:01 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 18:33:01 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 18:33:01 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 18:33:01 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 18:33:01 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 18:33:01 INFO - Downloading functools32-3.2.3-2.tar.gz 18:33:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:33:02 INFO - warning: no files found matching '*.txt' 18:33:02 INFO - no previously-included directories found matching 'build' 18:33:02 INFO - no previously-included directories found matching 'dist' 18:33:02 INFO - no previously-included directories found matching '.git*' 18:33:02 INFO - Installing collected packages: jsonschema, functools32 18:33:02 INFO - Running setup.py install for functools32 18:33:02 INFO - warning: no files found matching '*.txt' 18:33:02 INFO - no previously-included directories found matching 'build' 18:33:02 INFO - no previously-included directories found matching 'dist' 18:33:02 INFO - no previously-included directories found matching '.git*' 18:33:02 INFO - Successfully installed jsonschema functools32 18:33:02 INFO - Cleaning up... 18:33:02 INFO - Return code: 0 18:33:02 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 18:33:02 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')]} 18:33:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:33:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:33:02 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')]} 18:33:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:33:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:33:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbbd95e4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21745a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', '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 18:33:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'flake8'] in /builds/slave/test/build 18:33:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 flake8 18:33:02 INFO - Using env: {'DISPLAY': ':0', 18:33:02 INFO - 'HOME': '/home/cltbld', 18:33:02 INFO - 'LANG': 'en_US.UTF-8', 18:33:02 INFO - 'LANGUAGE': 'en_US:en', 18:33:02 INFO - 'LOGNAME': 'cltbld', 18:33:02 INFO - 'MAIL': '/var/mail/cltbld', 18:33:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:33:02 INFO - 'MOZ_NO_REMOTE': '1', 18:33:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:33:02 INFO - 'NO_EM_RESTART': '1', 18:33:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:33:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:33:02 INFO - 'PWD': '/builds/slave/test', 18:33:02 INFO - 'SHELL': '/bin/bash', 18:33:02 INFO - 'SHLVL': '1', 18:33:02 INFO - 'TERM': 'linux', 18:33:02 INFO - 'TMOUT': '86400', 18:33:02 INFO - 'USER': 'cltbld', 18:33:02 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:33:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:33:02 INFO - '_': '/tools/buildbot/bin/python'} 18:33:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:33:02 INFO - Downloading/unpacking flake8 18:33:02 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 18:33:02 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 18:33:02 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 18:33:02 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 18:33:02 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 18:33:02 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 18:33:07 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 18:33:07 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 18:33:07 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:07 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 18:33:08 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 18:33:08 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 18:33:08 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 18:33:08 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 18:33:08 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 18:33:08 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 18:33:08 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 18:33:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 18:33:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:33:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:33:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:33:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:33:08 INFO - no previously-included directories found matching 'docs/_build' 18:33:08 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 18:33:08 INFO - Running setup.py install for pep8 18:33:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:33:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:33:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:33:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:33:08 INFO - no previously-included directories found matching 'docs/_build' 18:33:08 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 18:33:08 INFO - Successfully installed flake8 mccabe pyflakes pep8 18:33:08 INFO - Cleaning up... 18:33:08 INFO - Return code: 0 18:33:08 INFO - Running post-action listener: _resource_record_post_action 18:33:08 INFO - Running post-action listener: _start_resource_monitoring 18:33:08 INFO - Starting resource monitoring. 18:33:08 INFO - ##### 18:33:08 INFO - ##### Running install step. 18:33:08 INFO - ##### 18:33:08 INFO - Running pre-action listener: _resource_record_pre_action 18:33:08 INFO - Running main action method: install 18:33:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:33:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:33:08 INFO - Reading from file tmpfile_stdout 18:33:08 INFO - Detecting whether we're running mozinstall >=1.0... 18:33:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:33:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:33:08 INFO - Reading from file tmpfile_stdout 18:33:08 INFO - Output received: 18:33:08 INFO - Usage: mozinstall [options] installer 18:33:08 INFO - Options: 18:33:08 INFO - -h, --help show this help message and exit 18:33:08 INFO - -d DEST, --destination=DEST 18:33:08 INFO - Directory to install application into. [default: 18:33:08 INFO - "/builds/slave/test"] 18:33:08 INFO - --app=APP Application being installed. [default: firefox] 18:33:08 INFO - mkdir: /builds/slave/test/build/application 18:33:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:33:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 18:33:24 INFO - Reading from file tmpfile_stdout 18:33:24 INFO - Output received: 18:33:24 INFO - /builds/slave/test/build/application/firefox/firefox 18:33:24 INFO - Running post-action listener: _resource_record_post_action 18:33:24 INFO - ##### 18:33:24 INFO - ##### Running run-tests step. 18:33:24 INFO - ##### 18:33:24 INFO - Running pre-action listener: _resource_record_pre_action 18:33:24 INFO - Running main action method: run_tests 18:33:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:33:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:33:24 INFO - Python 2.7.3 18:33:24 INFO - Return code: 0 18:33:24 INFO - grabbing minidump binary from tooltool 18:33:24 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')]} 18:33:24 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 0x2203410>, '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 0x2204310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22047a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:33:24 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 18:33:24 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 18:33:24 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:33:24 INFO - Return code: 0 18:33:24 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:33:24 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:33:24 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:33:24 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:33:24 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:33:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 18:33:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 18:33:25 INFO - Return code: 0 18:33:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 18:33:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-022 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 18:33:25 INFO - Using env: {'DISPLAY': ':0', 18:33:25 INFO - 'HOME': '/home/cltbld', 18:33:25 INFO - 'LANG': 'en_US.UTF-8', 18:33:25 INFO - 'LANGUAGE': 'en_US:en', 18:33:25 INFO - 'LOGNAME': 'cltbld', 18:33:25 INFO - 'MAIL': '/var/mail/cltbld', 18:33:25 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:33:25 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:33:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:33:25 INFO - 'MOZ_NO_REMOTE': '1', 18:33:25 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:33:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:33:25 INFO - 'NO_EM_RESTART': '1', 18:33:25 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:33:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:33:25 INFO - 'PWD': '/builds/slave/test', 18:33:25 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:33:25 INFO - 'SHELL': '/bin/bash', 18:33:25 INFO - 'SHLVL': '1', 18:33:25 INFO - 'TERM': 'linux', 18:33:25 INFO - 'TMOUT': '86400', 18:33:25 INFO - 'USER': 'cltbld', 18:33:25 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497', 18:33:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:33:25 INFO - '_': '/tools/buildbot/bin/python'} 18:33:25 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 18:33:25 INFO - mozversion application_buildid: 20160322165927 18:33:25 INFO - mozversion application_changeset: f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 18:33:25 INFO - mozversion application_display_name: Nightly 18:33:25 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:33:25 INFO - mozversion application_name: Firefox 18:33:25 INFO - mozversion application_remotingname: firefox 18:33:25 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 18:33:25 INFO - mozversion application_vendor: Mozilla 18:33:25 INFO - mozversion application_version: 48.0a1 18:33:25 INFO - mozversion platform_buildid: 20160322165927 18:33:25 INFO - mozversion platform_changeset: f9e8d838c9ee9b5f71984b82e6cf4f312fa108a4 18:33:25 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 18:33:25 INFO - mozversion platform_version: 48.0a1 18:33:25 INFO - using testdate: 1458696805 18:33:25 INFO - actual date: 1458696805 18:33:25 INFO - starting webserver on 'localhost:35332' 18:33:25 INFO - SUITE-START | Running 2 tests 18:33:25 INFO - TEST-START | dromaeo_css 18:33:25 INFO - operating with platform_type : linux_ 18:33:25 INFO - Initialising browser for dromaeo_css test... 18:33:25 INFO - TEST-INFO | started process 9202 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBoOrh7/profile http://localhost:35332/getInfo.html) 18:33:30 INFO - PROCESS | 9202 | 18:33:30 INFO - PROCESS | 9202 | (process:9281): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:33:30 INFO - PROCESS | 9202 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 18:33:30 INFO - PROCESS | 9202 | __metrics Screen width/height:1600/1200 18:33:30 INFO - PROCESS | 9202 | colorDepth:24 18:33:30 INFO - PROCESS | 9202 | Browser inner width/height: 1024/697 18:33:30 INFO - PROCESS | 9202 | __metrics 18:33:31 ERROR - PROCESS | 9202 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 18:33:32 INFO - TEST-INFO | 9202: exit 0 18:33:32 INFO - Browser initialized. 18:33:32 INFO - Running cycle 1/1 for dromaeo_css test... 18:33:32 INFO - TEST-INFO | started process 9332 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBoOrh7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:33:34 INFO - PROCESS | 9332 | 18:33:34 INFO - PROCESS | 9332 | (process:9395): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:33:44 INFO - PROCESS | 9332 | RSS: Main: 167047168 18:33:44 INFO - PROCESS | 9332 | 18:34:34 INFO - PROCESS | 9332 | 1458696874026 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] 18:36:45 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35332/tests/dromaeo/cssquery-ext.html) 18:36:46 INFO - PROCESS | 9332 | RSS: Main: 170631168 18:36:46 INFO - PROCESS | 9332 | 18:39:48 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-ext.html (next: http://localhost:35332/tests/dromaeo/cssquery-jquery.html) 18:39:49 INFO - PROCESS | 9332 | RSS: Main: 168759296 18:39:49 INFO - PROCESS | 9332 | 18:42:51 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35332/tests/dromaeo/cssquery-mootools.html) 18:42:51 INFO - PROCESS | 9332 | RSS: Main: 168914944 18:42:51 INFO - PROCESS | 9332 | 18:45:53 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35332/tests/dromaeo/cssquery-prototype.html) 18:45:54 INFO - PROCESS | 9332 | RSS: Main: 166318080 18:45:54 INFO - PROCESS | 9332 | 18:48:56 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35332/tests/dromaeo/cssquery-yui.html) 18:48:57 INFO - PROCESS | 9332 | RSS: Main: 168173568 18:48:57 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | Cycle 1(1): loaded http://localhost:35332/tests/dromaeo/cssquery-yui.html (next: http://localhost:35332/tests/dromaeo/cssquery-dojo.html) 18:51:59 INFO - PROCESS | 9332 | RSS: Main: 171274240 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | __start_tp_report 18:51:59 INFO - PROCESS | 9332 | _x_x_mozilla_page_load 18:51:59 INFO - PROCESS | 9332 | _x_x_mozilla_page_load_details 18:51:59 INFO - PROCESS | 9332 | |i|pagename|runs| 18:51:59 INFO - PROCESS | 9332 | |0;dojo.html;2655.3096194989303;2709.160160350291;2739.068716636343;2744.286485513766;2751.064638023072;4727.834525791598;4737.976310118449;4794.980286087894;4800.495947925466;4827.420709514863;4701.882452938678;4778.856634300968;4815.711057336563;4867.488913664068;4872.902541949168;4404.603585677296;4431.844885429011;4482.148391805546;4502.729836209822;4519.4124763780665;638.5878989478002;4310.159518893817;4391.429114215148;4408.338749187616;4439.8446054388105;4361.80371883266;4386.232409328387;4439.1121775645;4453.732776033416;4502.977485112553;4439.045605194866;4446.799894004777;4446.799894004777;4472.798724057425;4472.910541789179;4296.162248361571;4384.671149663756;4417.536158703322;4431.158079964796;4456.6880318377725;4708.670393072486;4716.221823399135;4727.5272472752795;4743.952560474386;4767.189577771787;5166.483351664841;5169.327987361619;5171.793128274864;5174.870628234286;5183.403908550489;5087.414947281073;5221.138512145491;5257.474252574751;5290.206469029677;5329.413764485904;4782.30656554801;4809.324768419663;4809.398825146856;4810.591099756525;4850.75746212688;5273.499017593323;5294.391145018372;5299.788008479618;5308.628396012242;5309.734513274321;4926.064047830901;5026.949730502722;5117.820876269313;5141.922871156936;5158.458361872024;5115.360579927509;5168.793248270103;5186.611004174702;5190.11767999441;5197.272381866542;4950.356453661001;5123.385193776696;5127.897442051138;5134.897302053938;5140.820071297487;5078.06055879656;5111.335526381621;5150.253213284052;5159.226116082617;5182.53357197854;4372.934405983913;4394.582514661102;4398.2962725964335;4400.801963911632;4450.06548624786;3782.829772660182;3837.366834472281;3842.039490127468;3886.553046399644;3903.4535165076913;4340.544242854455;4404.1411924674385;4488.730676159441;4495.168393847149;4527.524609915978;5121.103806833789;5156.071907056766;5173.71544565045;5177.145770947826;5222.268882356473;4357.324614684729;4441.755703436277;4448.799804008828;4460.86617401472;4462.44219472566;4592.517785632527;4651.3720647712125;4652.185867473178;4656.25499920018;4686.484486706459;4792.448868380111;4814.735189564608;4836.153673107122;4842.7578621068105;4881.585065269421;5020.121478741133;5143.537081662519;5211.4527974562125;5218.843434696965;5280.313559237275;4877.097736918681;4894.290327902506;4902.460729319843;4909.042736666459;4952.034353301216;5162.922556161586;5166.044281807877;5166.715830629351;5182.24857395683;5247.527722504993;4984.476629953948;5162.380514338303;5231.764570594409;5235.267062611161;5256.710880901434;5039.697618142924;5059.291699162194;5060.240963855451;5063.215201643751;5083.313752643346;5048.823291184791;5076.263941728503;5083.110455670317;5091.770870310919;5101.20931255656;4792.041591681608;4916.360873086476;4953.009398120318;4972.453030166606;5051.166557517969;4976.651634385558;5018.222175562793;5030.798768049237;5031.798728050837;5056.266841307916;4954.108260513142;5002.549770520671;5004.974975125101;5011.473795251446;5066.518680725325 18:51:59 INFO - PROCESS | 9332 | |1;ext.html;527.9762410691519;542.2246187951229;552.588321700333;575.5769509410583;577.8988676981527;33941.32117357654;34509.48235776465;34605.480917786255;34609.48085778715;34746.305073898504;38683.61316386835;39673.404898926536;39851;39904.60095399052;39937.60062399375;7641.503302285361;7777.066751989769;7819.569923654197;7823.139454659983;7835.725749598765;7675.194104619019;7810.726624568141;7810.882836757453;7824.687012519521;7840.921590784076;7741.3419859312025;7756.18560051195;7802.843943121163;7832.80417989552;7852.097008843999;7725.49784264021;7736.9613151934445;7741.380689544823;7757.185495523002;7813.218678132198;7648.42636802242;7842.529448233067;7847.019122609674;7851.685932562691;7872.842543149105;35738;36345.63654363449;36386.45420318697;36583;36596.81701591502;2664.413828957646;3033.3023404616843;3036.878524859003;3112.766542509321;3128.765342599314;25398.87300563504;25537.872310638515;25933.870330648413;26199.607005894926;26737;3366.3267346530793;3374.578177727784;3375.476801095834;3394.083597428705;3443.896683099511;203206;203597;203709;204967;205272;41961.79019104885;43111.784441077594;51151.74424127855;51989.48010519846;52009;43658.56341436545;43982.56017439849;44028;44058.77970610191;44192;13826.861731382558;14122;14215.928920355333;14220.71558568823;14232.573022809333;11090.168237382228;11261.718457038476;11269.605563805228;11278.943605282086;11287.097032237401;14447.927760361132;14452.349644266033;14460.927695361666;14546.41814327415;14650;5735.283089613798;5777.566682498829;5802.100674395391;5822.0684690449325;5854.707264636836;905.0994260710635;914.7027216154777;967.4485543240286;979.647326962293;1028.6862506935456;26571.867140664173;26872.32819179497;27203;27673.308167295578;27692.723072769015;913.2100732866023;964.4213471916934;987.8913319534845;1035.0942924940678;1055.1084333737979;11340.533672172802;13345.66635834112;13433.126846754929;13471.595852124256;13716.588502344946;267207;272091;272351;272926;273884;47292.5270747295;47436;47804.7609761949;47862.52137478581;47911.76044119827;1135.4152611405134;1165.4289398194824;1211.5032836537155;1214.763121191377;1220.9572664956684;24804.751952480965;25321.493570128863;25477.235682929542;25586.360340991625;25611;39629;39874.800625996686;40104;40138.79930600328;40275.1944961105;257512;259005;259997;260147;260669;32229.194270143435;32461;32517.512237316932;40855.59144408518;41053.35786568504;36893.44659830158;37042;37245.25509489741;37482.81258593799;42878.78560607177;31649.8417507911;32207.51688724718;32877.67122328842;33097.83451082729;33690.157746056546;32024.67975320217;32548;33505.83247083749;34222.657773421946;34305.14237144091;31095.222619434695;34587.82706086453;34842.47736283907;37107.257854843294;37642.247155057295;32052.679473205902;34157.487637685954;34176.65823341735;34296;34514.48228276628;24162;24561;24620.261392158263;24908.37729056788;24954.750452495242 18:51:59 INFO - PROCESS | 9332 | |2;jquery.html;348.7018599097772;356.86439153121813;357.78354095772056;361.93304238715825;363.97816131032124;15722.685546289067;15784.33326689257;15878.285477153542;16188.595285117877;16208.83791162088;15419.691606167898;15607.141607211599;15787.210639468038;15804.84195158048;16130.516084517483;4905.4849240829735;4923.458419573844;5046.646734728571;5088.18589025756;5108.3359163308905;4909.263610458442;4983.601311895058;5008.724520151391;5020.472850350716;5024.397072351323;4942.085714142895;4944.35723355965;4947.8268260610885;4948.703077815325;4994.875128121808;4751.121042607128;4984.127777638935;4986.152354099811;4989.850304490853;4995.625328100389;4416.403785488982;4419.801108950072;4426.756528390937;4431.135928493945;4442.444694413199;18903.716444253347;19087.331943382054;19569;19605;19793.604127917504;1898.3545594497937;1941.4952112450865;2011.4367976966473;2022.4438279473263;2511.982647027957;12742.554010609585;12872.549460768922;12906.419211135522;13193.076484646079;13216.339183040809;1752.3691471070404;1802.6755184066863;1809.746635471035;1852.0461962089535;1854.1563588567305;47590;52893;53498;58003.70998145024;60753;9573.425594464354;9694.127528522467;9950.701478955643;9957.55191016406;10021.39871607706;12559;12624.242545447303;12648.051396145325;12765.106442548933;12793.360331983364;7576.052993375828;7630.542167469969;7685.538867667958;7744.186860379579;7759;7291.125064992235;7317.524360916524;7339.376153027052;7441.181470038291;7451.068616422947;5885.588008839426;5939.940600594025;5965.13505541694;5998.970005149947;6067.120267561268;1701.8978861268363;1769.8938063716218;1795.9640807183782;1799.7300404939365;1801.5225965119255;835.1606635331453;845.5504274947901;879.5118709116501;886.5877367024365;923.5105394141116;14815.481458148914;15082.793376529851;15543.844561554466;16184;16360.836391636169;848.7284069097952;849.2144766091341;872.241150199318;913.0595486648763;920.4569304110607;9496.997559112917;9561.90438095624;9599.808003839884;9713.514324283757;9775.315727898978;260492;266946;421675;425618;429069;72542.63728681428;73294;73299.63350183216;73536.264637354;74851;931.6366617019368;965.3049804141148;979.8138353712772;980.9117179453741;981.1316984468797;14636.926815365856;14814;15140.545783626509;15179.544613661608;15311.770323444935;34756.82621586876;34829.65170348366;35261.82369088241;35604.465933010506;35748;45970.77014614906;49478.257826133355;49514.75242623764;49637;49929.75035124801;6961.860762784817;6972.198197207386;7084.2915708428745;7109.715611375694;7127.893081603884;10505.68482945513;11084.279521831055;11230.719232019264;11282.210245282751;11321.886781132083;9601;9674.806503869742;9796.118349348593;9846;9885.752856178653;9355.298352623444;9614.230861530921;9836.311458198144;9885.456299903575;10052.597896084075;9737.659181928599;9813.754656133653;10029.247806414402;10171.436554504498;10186.541605627617;7104.751333703295;7111.075560177351;7189.281071892978;7269.781906542812;7327.487075904849;9342.252619790537;9984.151347135576;10105.090541851268;10172.593096276067;10386.272960892666 18:51:59 INFO - PROCESS | 9332 | |3;mootools.html;1343.8454577723562;1386.4038463460713;1506.7212565675352;1724.1293146960784;1755.8858674186185;6448.097266382711;7230.2046774854725;7414.6292685365715;7637.1980942001055;7673.040869891263;7232.20445750967;7242.891356629655;7341.963290183555;7355.77932662021;7358.963205183966;2177.564487102582;2211.524522227721;2217.135317226283;2222.3110835641005;2223.722034745657;2185.125949620157;2214.2139540463145;2216.036024329414;2217.246136313653;2217.9778202218013;2203.0416768705586;2204.34971683353;2209.2046863129262;2218.73375194976;2249.134083377903;2164.3182397544724;2199.230269405711;2208.8564243324213;2216.74507431645;2219.367480268132;2179.466030822459;2194.7914948079906;2210.668399740036;2214.247155966979;2214.9114035438565;7454.664540095709;7456.291652293077;7474.887876681854;7489.850202995964;7525.4355923305975;4461.977690111528;4544.295634176708;4573.565511276423;4581.61056310214;4597.310403439477;2900.3474218300926;3054.144839444959;3075.8308293043874;3077.1076387847497;3089.3666798306294;917.8806755121858;947.1759569174793;957.2150836314225;966.9516524173763;977.0522593084696;9817.754556136153;9825.213982881352;9853.408795472295;9858.162056225157;9893.802123957481;4081.7346872453195;4149.730267532601;4187.685923555746;4200.663946884242;4242.809073591696;8398;8458.49249045047;8465.449745766506;8516.190961858614;8526.914730852612;4593.012502312019;4601.44782626087;4609.700369476041;4616.630669546428;4623.514530974267;3595.1012246938267;4055.371417430303;4122.2786012447705;4208.642265407475;4211.852585159505;3597.244578638515;3609.9639003609627;3651.2697460508007;3662.853485860589;3696.3531382008578;1180.6222008957222;1197.6407077876777;1198.5864876617727;1201.1771936223715;1206.2219868185148;1190.345310079453;1198.9460474278503;1219.8048312269993;1234.4136535145913;1245.1346314311647;7154.570725756471;7194.676239569232;7211.206767255598;7295.70817167318;7458.70165193397;1053.0417320238546;1059.2320567588438;1063.3354153653966;1074.2856000759564;1082.8050950828926;5733.569982251348;5736.397678243808;5791.536677065825;5800.738966746507;5827.3007239131575;8938.776530586787;9366;9500.619975201053;9531.571079301448;9583.712488625353;9290.628374865066;9329.533523323807;9329.860052099224;9389.436633801994;9436.764080897896;7066.50534462593;7257.201707812136;7288.380487658608;7301.9047142928985;7314.670839812221;6890.93109068923;6909.067275917888;6969.9303006969285;6982.825429364307;6986.790396288119;8224;8231.135730748425;8479.576021198793;8497.235248827636;8596.871046934177;8393.524654861829;8513.446625969293;8550.401471896908;8622.568871556523;8690.652373904974;5672.347680016851;6047.274327080779;6189.319174890848;6302.369763023661;6455.354464553507;7059.152901651834;7076.044733960849;7091.43268538526;7095.574265544084;7130.251323611154;6429.38920802523;6434.163558737521;6502.252240992347;6524.67376631176;6541.149650545399;6363.1091647168505;6415.390537898892;6472;6569.178852643419;6582.243042050225;6630.403263706289;6648.601083934979;6694.096296999843;6701.530892837454;6702.899456508058;6164.291106522807;6222.906656400067;6268.686565671607;6331.746730130927;6346.238451385863;6354.555181137276;6381.617102973836;6393;6402.167718196604;6429.839254018687 18:51:59 INFO - PROCESS | 9332 | |4;prototype.html;301.5642396736716;310.89429593938064;313.0389703609917;320.60565504429536;322.29095988824594;5637.323521177459;5734.971325143374;5738.856528586787;5745.253117094782;5749.885002299951;5625.915611265824;5639.041362968295;5640.520555752756;5644.971775141129;5655.321361436633;4116.855910043149;4193.769342686166;4321.265384884561;4325.675574331922;4333.285007973681;4321.373400856874;4333.848315308965;4335.154644844257;4337.501187363462;4341.761203133827;4286.935695964563;4289.635380992604;4290.699651024414;4290.884370063774;4294.248506511348;4285.250081235787;4287.549807270223;4305.504866940295;4310.913781724379;4315.13697260546;3747.0819649186124;3750.006248344191;3755.5681096673957;3758.5677647070665;3759.4924685167425;5389.649672771257;5425.647332923387;5433.130699088127;5462.754176062087;5466.480684334982;4868.464468908417;4979.327790748239;4980.87547811304;4984.127777638935;4988.530677314752;5930.466258036754;5933.495652869511;5937.732802023919;5940;5942.316633587149;4046.352583586612;4075.572064933169;4096.897577560555;4102.979485102585;4108.979455102705;6269.435750782406;6272.623642581414;6278.654673992928;6279.183706118221;6284.528660350446;4192.979035104866;4205.663546916239;4206.20082184384;4209.94751312172;4210.347396153601;4124.4019617155345;4234.745915245096;4275.315949448073;4277.3797799319545;4281.807318670667;4939.851804445801;4944.678595891256;4952.702837829742;4960.379952505937;4961.3798275215595;5908.202392676933;5953.880922381615;5984.73068711909;5986.73059712314;5987.13186587951;1499.2503748125937;1548.41934274647;1549.2486144220045;1550.4108438793187;1553.2622004547975;1027.8715160604925;1041.0474415909357;1048.2505008918508;1059.613241166984;1064.2550214849637;5167.767450464738;5184.455632158644;5187.221916712448;5189.065968125698;5190.24741412493;6124.173236613;6182.28903676074;6186.10301506288;6193.907091393633;6204.038374052029;5002.874928126753;5058.54473097423;5168.198929165986;5183.403908550489;5196.272521846944;3346.548215990859;3371.7302615790677;3381.205416727067;3381.3575420669995;3384.983075084609;5722.055860782924;5747.08046712524;5762.2509073820975;5766.625169363978;5770.855728606818;6402.327755585689;6409.647469389229;6414.518911081687;6427.485801135991;6427.517936154807;5776.855578610568;5777.566682498829;5777.971110144338;5780.335261444903;5785.855353616109;6131.478824299985;6280.9685951569945;6292.811215663537;6293.842653933688;6298.779542715983;6078.3617720138745;6096.0855871619615;6098.329183789869;6102.267727872683;6115.602485838406;5748.080307150836;5776.797812076557;5783.768649253982;5784.016717158009;5792.681402522733;4290.935635965526;4295.806688698954;4310.31035034393;4311.396404503309;4320.287152619908;6193.163922870355;6234.407731265523;6235.314115447388;6237.812865614039;6254.405831446005;5862.530997520103;6010.2186715726675;6040.456358927718;6070.605410648293;6072.210612620508;5971.253593300838;6001.90997135052;6003.159557661844;6012.518998480198;6023.48800351975;5863.2670916135485;5885.323187833454;5900.7049647518315;5905.852353691021;5919.674417906885;6012.819615411545;6016.368281330572;6041.395860413923;6042.969785151046;6050.9394906050375;5717.971410142923;5869.4717475427415;5872.55955803325;5875.911861321998;5919.319278283053 18:51:59 INFO - PROCESS | 9332 | |5;yui.html;675.517005341181;677.3598948993204;687.8796210663135;747.0698979770187;772.7063715787999;12144.39278036098;12535.435905384256;12645.683857903558;12715.618531444048;12749.617511474671;12155.939220303908;12222.449989750461;12224.14430989831;12267.447964841582;12302.138850280484;638.0588631768128;777.149021821105;786.0999155966415;786.8426314737047;790.9841803163933;781.8045488627843;800.3437181511163;804.0833449867127;804.4610111225493;804.7022601637402;831.733845169546;842.2083241752733;842.2377748137915;842.2503971465401;842.7893026743315;826.6569373709904;833.72487079264;836.506461187902;840.1304649687575;840.9159084091604;594.8096609085095;597.8296185587087;606.3178923710825;611.8837420890061;614.3457218062749;12127;12145.696357591043;12148.87851121495;12155.392230388445;12193.085518586053;11840.644780656594;12134.332611706353;12328;13099.607011789662;13246.271455069967;9777.41335519871;9887.505624718808;9990.35062720928;10095.091441770275;10141.492925353776;3315.419801534722;3335.5997280326274;3346.4143774839304;3373.173572474735;3404.455287154068;43847.56152438467;44000.11999759987;44006.55993440057;44069.33895991563;44405.3339199909;9754.658586949423;9894.455804930798;10040.146587539995;10114.089731924161;10133.138683211862;16969.660606788042;17163.485095446908;17172.22724977379;17217.655646887244;17486.650266994588;6909.930900691029;6942.028116063755;6952.582845029213;7023.719051237996;7079.079719636517;3621.3843646580144;3636.563612366533;3652.4703917932284;3727.2918145552258;3733.5085126183917;2897.1163795042294;2946;2956.512175491063;2979.06159559738;2986.074316961749;571.3172758553571;582.8630271886103;589.1516216648099;591.9289685237799;591.9585629005928;498.9351384320015;557.3506864502809;579.5537436174122;602.3584882100549;603.3453702732496;7531.73638922646;7599.354054905395;7667.156612772591;7725.961370193226;7757.689692412353;483.54546726078075;561.8735784448548;570.8401647538695;571.1147721032384;573.489594261108;3255.4302996975434;3404.2170300830453;3416.24842534642;3494.8602055917477;3540.150363912642;49151;52552;52606;52699.209511857356;52735;41808.37287440691;42299.57700423018;42361.78819105885;42693.146137077085;42754.78622606929;43610.7819460907;43881;44028.55971440308;44549.55450445519;46003.76998115055;8591.871121933302;8594.957025214833;8638.611262493077;8758.82482350362;8951.41815781998;32085.197870053435;32956.34087318192;33143.834280829404;33640.1589960253;34379;39561.406578901915;41455.585444145174;41997;42052;42536.361954570086;10593.841092383465;10684.786304273715;10777;10898.073663738354;11292.15308851823;11553.537858485566;11696.415179240834;11795;11830;11839.92162037859;10939.343639381663;11030.338179709242;11162.330260184415;11302.43487825622;11541.192116551762;11279.210455268052;11487.54049837997;11582.768344632892;11601.071914247008;11622.535098595961;10782.299150555189;10887.129029677766;10927.235093543375;11044.779104418027;11243.044341231087;9087.863682044643;9252.722418327461;9346.299027572823;9359.204467620057;9361.531923403938;9057.864132037894;9588.856167157637;9622.470764107762;9782.608695652094;9853.162481188892 18:51:59 INFO - PROCESS | 9332 | __end_tp_report 18:51:59 INFO - PROCESS | 9332 | __start_cc_report 18:51:59 INFO - PROCESS | 9332 | _x_x_mozilla_cycle_collect,347 18:51:59 INFO - PROCESS | 9332 | __end_cc_report 18:51:59 INFO - PROCESS | 9332 | __startTimestamp1458697919921__endTimestamp 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | ------- Summary: start ------- 18:51:59 INFO - PROCESS | 9332 | Number of tests: 6 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#0] dojo.html Cycles:165 Average:4750.41 Median:4902.46 stddev:595.34 (12.1%) stddev-sans-first:574.03 18:51:59 INFO - PROCESS | 9332 | Values: 2655.3 2709.2 2739.1 2744.3 2751.1 4727.8 4738.0 4795.0 4800.5 4827.4 4701.9 4778.9 4815.7 4867.5 4872.9 4404.6 4431.8 4482.1 4502.7 4519.4 638.6 4310.2 4391.4 4408.3 4439.8 4361.8 4386.2 4439.1 4453.7 4503.0 4439.0 4446.8 4446.8 4472.8 4472.9 4296.2 4384.7 4417.5 4431.2 4456.7 4708.7 4716.2 4727.5 4744.0 4767.2 5166.5 5169.3 5171.8 5174.9 5183.4 5087.4 5221.1 5257.5 5290.2 5329.4 4782.3 4809.3 4809.4 4810.6 4850.8 5273.5 5294.4 5299.8 5308.6 5309.7 4926.1 5026.9 5117.8 5141.9 5158.5 5115.4 5168.8 5186.6 5190.1 5197.3 4950.4 5123.4 5127.9 5134.9 5140.8 5078.1 5111.3 5150.3 5159.2 5182.5 4372.9 4394.6 4398.3 4400.8 4450.1 3782.8 3837.4 3842.0 3886.6 3903.5 4340.5 4404.1 4488.7 4495.2 4527.5 5121.1 5156.1 5173.7 5177.1 5222.3 4357.3 4441.8 4448.8 4460.9 4462.4 4592.5 4651.4 4652.2 4656.3 4686.5 4792.4 4814.7 4836.2 4842.8 4881.6 5020.1 5143.5 5211.5 5218.8 5280.3 4877.1 4894.3 4902.5 4909.0 4952.0 5162.9 5166.0 5166.7 5182.2 5247.5 4984.5 5162.4 5231.8 5235.3 5256.7 5039.7 5059.3 5060.2 5063.2 5083.3 5048.8 5076.3 5083.1 5091.8 5101.2 4792.0 4916.4 4953.0 4972.5 5051.2 4976.7 5018.2 5030.8 5031.8 5056.3 4954.1 5002.5 5005.0 5011.5 5066.5 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#1] ext.html Cycles:180 Average:40149.80 Median:18874.52 stddev:64312.83 (340.7%) stddev-sans-first:64424.44 18:51:59 INFO - PROCESS | 9332 | Values: 528.0 542.2 552.6 575.6 577.9 33941.3 34509.5 34605.5 34609.5 34746.3 38683.6 39673.4 39851.0 39904.6 39937.6 7641.5 7777.1 7819.6 7823.1 7835.7 7675.2 7810.7 7810.9 7824.7 7840.9 7741.3 7756.2 7802.8 7832.8 7852.1 7725.5 7737.0 7741.4 7757.2 7813.2 7648.4 7842.5 7847.0 7851.7 7872.8 35738.0 36345.6 36386.5 36583.0 36596.8 2664.4 3033.3 3036.9 3112.8 3128.8 25398.9 25537.9 25933.9 26199.6 26737.0 3366.3 3374.6 3375.5 3394.1 3443.9 203206.0 203597.0 203709.0 204967.0 205272.0 41961.8 43111.8 51151.7 51989.5 52009.0 43658.6 43982.6 44028.0 44058.8 44192.0 13826.9 14122.0 14215.9 14220.7 14232.6 11090.2 11261.7 11269.6 11278.9 11287.1 14447.9 14452.3 14460.9 14546.4 14650.0 5735.3 5777.6 5802.1 5822.1 5854.7 905.1 914.7 967.4 979.6 1028.7 26571.9 26872.3 27203.0 27673.3 27692.7 913.2 964.4 987.9 1035.1 1055.1 11340.5 13345.7 13433.1 13471.6 13716.6 267207.0 272091.0 272351.0 272926.0 273884.0 47292.5 47436.0 47804.8 47862.5 47911.8 1135.4 1165.4 1211.5 1214.8 1221.0 24804.8 25321.5 25477.2 25586.4 25611.0 39629.0 39874.8 40104.0 40138.8 40275.2 257512.0 259005.0 259997.0 260147.0 260669.0 32229.2 32461.0 32517.5 40855.6 41053.4 36893.4 37042.0 37245.3 37482.8 42878.8 31649.8 32207.5 32877.7 33097.8 33690.2 32024.7 32548.0 33505.8 34222.7 34305.1 31095.2 34587.8 34842.5 37107.3 37642.2 32052.7 34157.5 34176.7 34296.0 34514.5 24162.0 24561.0 24620.3 24908.4 24954.8 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#2] jquery.html Cycles:180 Average:22742.43 Median:4946.09 stddev:60862.95 (1230.5%) stddev-sans-first:61010.46 18:51:59 INFO - PROCESS | 9332 | Values: 348.7 356.9 357.8 361.9 364.0 15722.7 15784.3 15878.3 16188.6 16208.8 15419.7 15607.1 15787.2 15804.8 16130.5 4905.5 4923.5 5046.6 5088.2 5108.3 4909.3 4983.6 5008.7 5020.5 5024.4 4942.1 4944.4 4947.8 4948.7 4994.9 4751.1 4984.1 4986.2 4989.9 4995.6 4416.4 4419.8 4426.8 4431.1 4442.4 18903.7 19087.3 19569.0 19605.0 19793.6 1898.4 1941.5 2011.4 2022.4 2512.0 12742.6 12872.5 12906.4 13193.1 13216.3 1752.4 1802.7 1809.7 1852.0 1854.2 47590.0 52893.0 53498.0 58003.7 60753.0 9573.4 9694.1 9950.7 9957.6 10021.4 12559.0 12624.2 12648.1 12765.1 12793.4 7576.1 7630.5 7685.5 7744.2 7759.0 7291.1 7317.5 7339.4 7441.2 7451.1 5885.6 5939.9 5965.1 5999.0 6067.1 1701.9 1769.9 1796.0 1799.7 1801.5 835.2 845.6 879.5 886.6 923.5 14815.5 15082.8 15543.8 16184.0 16360.8 848.7 849.2 872.2 913.1 920.5 9497.0 9561.9 9599.8 9713.5 9775.3 260492.0 266946.0 421675.0 425618.0 429069.0 72542.6 73294.0 73299.6 73536.3 74851.0 931.6 965.3 979.8 980.9 981.1 14636.9 14814.0 15140.5 15179.5 15311.8 34756.8 34829.7 35261.8 35604.5 35748.0 45970.8 49478.3 49514.8 49637.0 49929.8 6961.9 6972.2 7084.3 7109.7 7127.9 10505.7 11084.3 11230.7 11282.2 11321.9 9601.0 9674.8 9796.1 9846.0 9885.8 9355.3 9614.2 9836.3 9885.5 10052.6 9737.7 9813.8 10029.2 10171.4 10186.5 7104.8 7111.1 7189.3 7269.8 7327.5 9342.3 9984.2 10105.1 10172.6 10386.3 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#3] mootools.html Cycles:180 Average:5275.64 Median:6372.36 stddev:2708.29 (42.5%) stddev-sans-first:2699.76 18:51:59 INFO - PROCESS | 9332 | Values: 1343.8 1386.4 1506.7 1724.1 1755.9 6448.1 7230.2 7414.6 7637.2 7673.0 7232.2 7242.9 7342.0 7355.8 7359.0 2177.6 2211.5 2217.1 2222.3 2223.7 2185.1 2214.2 2216.0 2217.2 2218.0 2203.0 2204.3 2209.2 2218.7 2249.1 2164.3 2199.2 2208.9 2216.7 2219.4 2179.5 2194.8 2210.7 2214.2 2214.9 7454.7 7456.3 7474.9 7489.9 7525.4 4462.0 4544.3 4573.6 4581.6 4597.3 2900.3 3054.1 3075.8 3077.1 3089.4 917.9 947.2 957.2 967.0 977.1 9817.8 9825.2 9853.4 9858.2 9893.8 4081.7 4149.7 4187.7 4200.7 4242.8 8398.0 8458.5 8465.4 8516.2 8526.9 4593.0 4601.4 4609.7 4616.6 4623.5 3595.1 4055.4 4122.3 4208.6 4211.9 3597.2 3610.0 3651.3 3662.9 3696.4 1180.6 1197.6 1198.6 1201.2 1206.2 1190.3 1198.9 1219.8 1234.4 1245.1 7154.6 7194.7 7211.2 7295.7 7458.7 1053.0 1059.2 1063.3 1074.3 1082.8 5733.6 5736.4 5791.5 5800.7 5827.3 8938.8 9366.0 9500.6 9531.6 9583.7 9290.6 9329.5 9329.9 9389.4 9436.8 7066.5 7257.2 7288.4 7301.9 7314.7 6890.9 6909.1 6969.9 6982.8 6986.8 8224.0 8231.1 8479.6 8497.2 8596.9 8393.5 8513.4 8550.4 8622.6 8690.7 5672.3 6047.3 6189.3 6302.4 6455.4 7059.2 7076.0 7091.4 7095.6 7130.3 6429.4 6434.2 6502.3 6524.7 6541.1 6363.1 6415.4 6472.0 6569.2 6582.2 6630.4 6648.6 6694.1 6701.5 6702.9 6164.3 6222.9 6268.7 6331.7 6346.2 6354.6 6381.6 6393.0 6402.2 6429.8 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#4] prototype.html Cycles:180 Average:4931.34 Median:5631.62 stddev:1465.12 (26.0%) stddev-sans-first:1427.43 18:51:59 INFO - PROCESS | 9332 | Values: 301.6 310.9 313.0 320.6 322.3 5637.3 5735.0 5738.9 5745.3 5749.9 5625.9 5639.0 5640.5 5645.0 5655.3 4116.9 4193.8 4321.3 4325.7 4333.3 4321.4 4333.8 4335.2 4337.5 4341.8 4286.9 4289.6 4290.7 4290.9 4294.2 4285.3 4287.5 4305.5 4310.9 4315.1 3747.1 3750.0 3755.6 3758.6 3759.5 5389.6 5425.6 5433.1 5462.8 5466.5 4868.5 4979.3 4980.9 4984.1 4988.5 5930.5 5933.5 5937.7 5940.0 5942.3 4046.4 4075.6 4096.9 4103.0 4109.0 6269.4 6272.6 6278.7 6279.2 6284.5 4193.0 4205.7 4206.2 4209.9 4210.3 4124.4 4234.7 4275.3 4277.4 4281.8 4939.9 4944.7 4952.7 4960.4 4961.4 5908.2 5953.9 5984.7 5986.7 5987.1 1499.3 1548.4 1549.2 1550.4 1553.3 1027.9 1041.0 1048.3 1059.6 1064.3 5167.8 5184.5 5187.2 5189.1 5190.2 6124.2 6182.3 6186.1 6193.9 6204.0 5002.9 5058.5 5168.2 5183.4 5196.3 3346.5 3371.7 3381.2 3381.4 3385.0 5722.1 5747.1 5762.3 5766.6 5770.9 6402.3 6409.6 6414.5 6427.5 6427.5 5776.9 5777.6 5778.0 5780.3 5785.9 6131.5 6281.0 6292.8 6293.8 6298.8 6078.4 6096.1 6098.3 6102.3 6115.6 5748.1 5776.8 5783.8 5784.0 5792.7 4290.9 4295.8 4310.3 4311.4 4320.3 6193.2 6234.4 6235.3 6237.8 6254.4 5862.5 6010.2 6040.5 6070.6 6072.2 5971.3 6001.9 6003.2 6012.5 6023.5 5863.3 5885.3 5900.7 5905.9 5919.7 6012.8 6016.4 6041.4 6043.0 6050.9 5718.0 5869.5 5872.6 5875.9 5919.3 18:51:59 INFO - PROCESS | 9332 | 18:51:59 INFO - PROCESS | 9332 | [#5] yui.html Cycles:180 Average:12843.40 Median:43729.17 stddev:14432.84 (33.0%) stddev-sans-first:14444.40 18:51:59 INFO - PROCESS | 9332 | Values: 675.5 677.4 687.9 747.1 772.7 12144.4 12535.4 12645.7 12715.6 12749.6 12155.9 12222.4 12224.1 12267.4 12302.1 638.1 777.1 786.1 786.8 791.0 781.8 800.3 804.1 804.5 804.7 831.7 842.2 842.2 842.3 842.8 826.7 833.7 836.5 840.1 840.9 594.8 597.8 606.3 611.9 614.3 12127.0 12145.7 12148.9 12155.4 12193.1 11840.6 12134.3 12328.0 13099.6 13246.3 9777.4 9887.5 9990.4 10095.1 10141.5 3315.4 3335.6 3346.4 3373.2 3404.5 43847.6 44000.1 44006.6 44069.3 44405.3 9754.7 9894.5 10040.1 10114.1 10133.1 16969.7 17163.5 17172.2 17217.7 17486.7 6909.9 6942.0 6952.6 7023.7 7079.1 3621.4 3636.6 3652.5 3727.3 3733.5 2897.1 2946.0 2956.5 2979.1 2986.1 571.3 582.9 589.2 591.9 592.0 498.9 557.4 579.6 602.4 603.3 7531.7 7599.4 7667.2 7726.0 7757.7 483.5 561.9 570.8 571.1 573.5 3255.4 3404.2 3416.2 3494.9 3540.2 49151.0 52552.0 52606.0 52699.2 52735.0 41808.4 42299.6 42361.8 42693.1 42754.8 43610.8 43881.0 44028.6 44549.6 46003.8 8591.9 8595.0 8638.6 8758.8 8951.4 32085.2 32956.3 33143.8 33640.2 34379.0 39561.4 41455.6 41997.0 42052.0 42536.4 10593.8 10684.8 10777.0 10898.1 11292.2 11553.5 11696.4 11795.0 11830.0 11839.9 10939.3 11030.3 11162.3 11302.4 11541.2 11279.2 11487.5 11582.8 11601.1 11622.5 10782.3 10887.1 10927.2 11044.8 11243.0 9087.9 9252.7 9346.3 9359.2 9361.5 9057.9 9588.9 9622.5 9782.6 9853.2 18:51:59 INFO - PROCESS | 9332 | -------- Summary: end -------- 18:51:59 INFO - PROCESS | 9332 | 18:52:00 INFO - TEST-INFO | 9332: exit 0 18:52:00 INFO - TEST-OK | dromaeo_css | took 1114786ms 18:52:00 INFO - TEST-START | kraken 18:52:00 INFO - operating with platform_type : linux_ 18:52:00 INFO - Initialising browser for kraken test... 18:52:00 INFO - TEST-INFO | started process 9570 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMMFN9T/profile http://localhost:35332/getInfo.html) 18:52:04 INFO - PROCESS | 9570 | 18:52:04 INFO - PROCESS | 9570 | (process:9642): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:52:04 INFO - PROCESS | 9570 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 18:52:05 INFO - PROCESS | 9570 | __metrics Screen width/height:1600/1200 18:52:05 INFO - PROCESS | 9570 | colorDepth:24 18:52:05 INFO - PROCESS | 9570 | Browser inner width/height: 1024/697 18:52:05 INFO - PROCESS | 9570 | __metrics 18:52:06 ERROR - PROCESS | 9570 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 18:52:06 INFO - TEST-INFO | 9570: exit 0 18:52:06 INFO - Browser initialized. 18:52:06 INFO - Running cycle 1/1 for kraken test... 18:52:06 INFO - TEST-INFO | started process 9693 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMMFN9T/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:52:08 INFO - PROCESS | 9693 | 18:52:08 INFO - PROCESS | 9693 | (process:9752): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:52:18 INFO - PROCESS | 9693 | RSS: Main: 167809024 18:52:18 INFO - PROCESS | 9693 | 18:52:21 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35332/tests/kraken/driver.html?testName=audio-beat-detection) 18:52:22 INFO - PROCESS | 9693 | RSS: Main: 171896832 18:52:22 INFO - PROCESS | 9693 | 18:52:24 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35332/tests/kraken/driver.html?testName=audio-dft) 18:52:25 INFO - PROCESS | 9693 | RSS: Main: 176021504 18:52:25 INFO - PROCESS | 9693 | 18:52:28 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35332/tests/kraken/driver.html?testName=audio-fft) 18:52:29 INFO - PROCESS | 9693 | RSS: Main: 167841792 18:52:29 INFO - PROCESS | 9693 | 18:52:31 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35332/tests/kraken/driver.html?testName=audio-oscillator) 18:52:31 INFO - PROCESS | 9693 | RSS: Main: 168902656 18:52:31 INFO - PROCESS | 9693 | 18:52:33 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35332/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:52:34 INFO - PROCESS | 9693 | RSS: Main: 169054208 18:52:34 INFO - PROCESS | 9693 | 18:52:37 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35332/tests/kraken/driver.html?testName=imaging-darkroom) 18:52:38 INFO - PROCESS | 9693 | RSS: Main: 167161856 18:52:38 INFO - PROCESS | 9693 | 18:52:41 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35332/tests/kraken/driver.html?testName=imaging-desaturate) 18:52:42 INFO - PROCESS | 9693 | RSS: Main: 166932480 18:52:42 INFO - PROCESS | 9693 | 18:52:45 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35332/tests/kraken/driver.html?testName=json-parse-financial) 18:52:45 INFO - PROCESS | 9693 | RSS: Main: 165548032 18:52:45 INFO - PROCESS | 9693 | 18:52:47 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35332/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:52:48 INFO - PROCESS | 9693 | RSS: Main: 168247296 18:52:48 INFO - PROCESS | 9693 | 18:52:50 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:52:50 INFO - PROCESS | 9693 | RSS: Main: 168288256 18:52:50 INFO - PROCESS | 9693 | 18:52:52 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:52:53 INFO - PROCESS | 9693 | RSS: Main: 168321024 18:52:53 INFO - PROCESS | 9693 | 18:52:56 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:52:56 INFO - PROCESS | 9693 | RSS: Main: 166641664 18:52:56 INFO - PROCESS | 9693 | 18:52:59 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:52:59 INFO - PROCESS | 9693 | RSS: Main: 166531072 18:52:59 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | Cycle 1(1): loaded http://localhost:35332/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35332/tests/kraken/driver.html?testName=ai-astar) 18:53:01 INFO - PROCESS | 9693 | RSS: Main: 168714240 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | __start_tp_report 18:53:01 INFO - PROCESS | 9693 | _x_x_mozilla_page_load 18:53:01 INFO - PROCESS | 9693 | _x_x_mozilla_page_load_details 18:53:01 INFO - PROCESS | 9693 | |i|pagename|runs| 18:53:01 INFO - PROCESS | 9693 | |0;ai-astar;113;107;114;114;114;123;111;111;114;113 18:53:01 INFO - PROCESS | 9693 | |1;audio-beat-detection;153;128;155;172;132;156;153;131;170;133 18:53:01 INFO - PROCESS | 9693 | |2;audio-dft;162;162;162;161;162;164;168;164;168;163 18:53:01 INFO - PROCESS | 9693 | |3;audio-fft;73;77;73;75;73;74;76;74;144;74 18:53:01 INFO - PROCESS | 9693 | |4;audio-oscillator;94;94;139;94;93;95;142;93;94;141 18:53:01 INFO - PROCESS | 9693 | |5;imaging-gaussian-blur;117;118;118;117;119;118;117;117;118;117 18:53:01 INFO - PROCESS | 9693 | |6;imaging-darkroom;147;147;149;148;147;147;149;148;148;147 18:53:01 INFO - PROCESS | 9693 | |7;imaging-desaturate;97;96;96;97;97;96;95;96;97;96 18:53:01 INFO - PROCESS | 9693 | |8;json-parse-financial;68;67;66;66;67;66;68;67;66;65 18:53:01 INFO - PROCESS | 9693 | |9;json-stringify-tinderbox;65;65;65;66;65;65;64;64;65;64 18:53:01 INFO - PROCESS | 9693 | |10;stanford-crypto-aes;81;81;82;81;82;81;83;81;82;83 18:53:01 INFO - PROCESS | 9693 | |11;stanford-crypto-ccm;124;123;125;120;124;131;118;125;122;129 18:53:01 INFO - PROCESS | 9693 | |12;stanford-crypto-pbkdf2;133;144;148;141;142;134;149;145;141;134 18:53:01 INFO - PROCESS | 9693 | |13;stanford-crypto-sha256-iterative;67;66;68;67;68;67;66;66;68;66 18:53:01 INFO - PROCESS | 9693 | __end_tp_report 18:53:01 INFO - PROCESS | 9693 | __start_cc_report 18:53:01 INFO - PROCESS | 9693 | _x_x_mozilla_cycle_collect,872 18:53:01 INFO - PROCESS | 9693 | __end_cc_report 18:53:01 INFO - PROCESS | 9693 | __startTimestamp1458697981806__endTimestamp 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | ------- Summary: start ------- 18:53:01 INFO - PROCESS | 9693 | Number of tests: 14 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#0] ai-astar Cycles:10 Average:113.40 Median:114.00 stddev:4.03 (3.5%) stddev-sans-first:4.28 18:53:01 INFO - PROCESS | 9693 | Values: 113.0 107.0 114.0 114.0 114.0 123.0 111.0 111.0 114.0 113.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#1] audio-beat-detection Cycles:10 Average:148.30 Median:154.00 stddev:16.30 (10.6%) stddev-sans-first:17.20 18:53:01 INFO - PROCESS | 9693 | Values: 153.0 128.0 155.0 172.0 132.0 156.0 153.0 131.0 170.0 133.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#2] audio-dft Cycles:10 Average:163.60 Median:163.50 stddev:2.50 (1.5%) stddev-sans-first:2.59 18:53:01 INFO - PROCESS | 9693 | Values: 162.0 162.0 162.0 161.0 162.0 164.0 168.0 164.0 168.0 163.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#3] audio-fft Cycles:10 Average:81.30 Median:74.00 stddev:22.07 (29.8%) stddev-sans-first:23.20 18:53:01 INFO - PROCESS | 9693 | Values: 73.0 77.0 73.0 75.0 73.0 74.0 76.0 74.0 144.0 74.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#4] audio-oscillator Cycles:10 Average:107.90 Median:94.00 stddev:22.63 (24.1%) stddev-sans-first:23.44 18:53:01 INFO - PROCESS | 9693 | Values: 94.0 94.0 139.0 94.0 93.0 95.0 142.0 93.0 94.0 141.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.70 (0.6%) stddev-sans-first:0.71 18:53:01 INFO - PROCESS | 9693 | Values: 117.0 118.0 118.0 117.0 119.0 118.0 117.0 117.0 118.0 117.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#6] imaging-darkroom Cycles:10 Average:147.70 Median:148.00 stddev:0.82 (0.6%) stddev-sans-first:0.83 18:53:01 INFO - PROCESS | 9693 | Values: 147.0 147.0 149.0 148.0 147.0 147.0 149.0 148.0 148.0 147.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.50 stddev:0.67 (0.7%) stddev-sans-first:0.67 18:53:01 INFO - PROCESS | 9693 | Values: 97.0 96.0 96.0 97.0 97.0 96.0 95.0 96.0 97.0 96.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#8] json-parse-financial Cycles:10 Average:66.60 Median:67.00 stddev:0.97 (1.4%) stddev-sans-first:0.88 18:53:01 INFO - PROCESS | 9693 | Values: 68.0 67.0 66.0 66.0 67.0 66.0 68.0 67.0 66.0 65.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#9] json-stringify-tinderbox Cycles:10 Average:64.80 Median:65.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 18:53:01 INFO - PROCESS | 9693 | Values: 65.0 65.0 65.0 66.0 65.0 65.0 64.0 64.0 65.0 64.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#10] stanford-crypto-aes Cycles:10 Average:81.70 Median:82.00 stddev:0.82 (1.0%) stddev-sans-first:0.83 18:53:01 INFO - PROCESS | 9693 | Values: 81.0 81.0 82.0 81.0 82.0 81.0 83.0 81.0 82.0 83.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#11] stanford-crypto-ccm Cycles:10 Average:124.10 Median:124.50 stddev:3.84 (3.1%) stddev-sans-first:4.08 18:53:01 INFO - PROCESS | 9693 | Values: 124.0 123.0 125.0 120.0 124.0 131.0 118.0 125.0 122.0 129.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:141.10 Median:143.00 stddev:5.78 (4.0%) stddev-sans-first:5.34 18:53:01 INFO - PROCESS | 9693 | Values: 133.0 144.0 148.0 141.0 142.0 134.0 149.0 145.0 141.0 134.0 18:53:01 INFO - PROCESS | 9693 | 18:53:01 INFO - PROCESS | 9693 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.90 Median:67.00 stddev:0.88 (1.3%) stddev-sans-first:0.93 18:53:01 INFO - PROCESS | 9693 | Values: 67.0 66.0 68.0 67.0 68.0 67.0 66.0 66.0 68.0 66.0 18:53:01 INFO - PROCESS | 9693 | -------- Summary: end -------- 18:53:01 INFO - PROCESS | 9693 | 18:53:02 INFO - TEST-INFO | 9693: exit 0 18:53:02 INFO - TEST-OK | kraken | took 62153ms 18:53:02 INFO - SUITE-END | took 1176s 18:53:02 INFO - Completed test suite (00:19:37) 18:53:02 INFO - javascript benchmark 18:53:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2655.3096194989303, 2709.160160350291, 2739.068716636343, 2744.286485513766, 2751.064638023072, 4727.834525791598, 4737.976310118449, 4794.980286087894, 4800.495947925466, 4827.420709514863, 4701.882452938678, 4778.856634300968, 4815.711057336563, 4867.488913664068, 4872.902541949168, 4404.603585677296, 4431.844885429011, 4482.148391805546, 4502.729836209822, 4519.4124763780665, 638.5878989478002, 4310.159518893817, 4391.429114215148, 4408.338749187616, 4439.8446054388105, 4361.80371883266, 4386.232409328387, 4439.1121775645, 4453.732776033416, 4502.977485112553, 4439.045605194866, 4446.799894004777, 4446.799894004777, 4472.798724057425, 4472.910541789179, 4296.162248361571, 4384.671149663756, 4417.536158703322, 4431.158079964796, 4456.6880318377725, 4708.670393072486, 4716.221823399135, 4727.5272472752795, 4743.952560474386, 4767.189577771787, 5166.483351664841, 5169.327987361619, 5171.793128274864, 5174.870628234286, 5183.403908550489, 5087.414947281073, 5221.138512145491, 5257.474252574751, 5290.206469029677, 5329.413764485904, 4782.30656554801, 4809.324768419663, 4809.398825146856, 4810.591099756525, 4850.75746212688, 5273.499017593323, 5294.391145018372, 5299.788008479618, 5308.628396012242, 5309.734513274321, 4926.064047830901, 5026.949730502722, 5117.820876269313, 5141.922871156936, 5158.458361872024, 5115.360579927509, 5168.793248270103, 5186.611004174702, 5190.11767999441, 5197.272381866542, 4950.356453661001, 5123.385193776696, 5127.897442051138, 5134.897302053938, 5140.820071297487, 5078.06055879656, 5111.335526381621, 5150.253213284052, 5159.226116082617, 5182.53357197854, 4372.934405983913, 4394.582514661102, 4398.2962725964335, 4400.801963911632, 4450.06548624786, 3782.829772660182, 3837.366834472281, 3842.039490127468, 3886.553046399644, 3903.4535165076913, 4340.544242854455, 4404.1411924674385, 4488.730676159441, 4495.168393847149, 4527.524609915978, 5121.103806833789, 5156.071907056766, 5173.71544565045, 5177.145770947826, 5222.268882356473, 4357.324614684729, 4441.755703436277, 4448.799804008828, 4460.86617401472, 4462.44219472566, 4592.517785632527, 4651.3720647712125, 4652.185867473178, 4656.25499920018, 4686.484486706459, 4792.448868380111, 4814.735189564608, 4836.153673107122, 4842.7578621068105, 4881.585065269421, 5020.121478741133, 5143.537081662519, 5211.4527974562125, 5218.843434696965, 5280.313559237275, 4877.097736918681, 4894.290327902506, 4902.460729319843, 4909.042736666459, 4952.034353301216, 5162.922556161586, 5166.044281807877, 5166.715830629351, 5182.24857395683, 5247.527722504993, 4984.476629953948, 5162.380514338303, 5231.764570594409, 5235.267062611161, 5256.710880901434, 5039.697618142924, 5059.291699162194, 5060.240963855451, 5063.215201643751, 5083.313752643346, 5048.823291184791, 5076.263941728503, 5083.110455670317, 5091.770870310919, 5101.20931255656, 4792.041591681608, 4916.360873086476, 4953.009398120318, 4972.453030166606, 5051.166557517969, 4976.651634385558, 5018.222175562793, 5030.798768049237, 5031.798728050837, 5056.266841307916, 4954.108260513142, 5002.549770520671, 5004.974975125101, 5011.473795251446, 5066.518680725325], "unit": "score", "name": "dojo.html", "value": 4714.48365154904}, {"lowerIsBetter": false, "replicates": [527.9762410691519, 542.2246187951229, 552.588321700333, 575.5769509410583, 577.8988676981527, 33941.32117357654, 34509.48235776465, 34605.480917786255, 34609.48085778715, 34746.305073898504, 38683.61316386835, 39673.404898926536, 39851.0, 39904.60095399052, 39937.60062399375, 7641.503302285361, 7777.066751989769, 7819.569923654197, 7823.139454659983, 7835.725749598765, 7675.194104619019, 7810.726624568141, 7810.882836757453, 7824.687012519521, 7840.921590784076, 7741.3419859312025, 7756.18560051195, 7802.843943121163, 7832.80417989552, 7852.097008843999, 7725.49784264021, 7736.9613151934445, 7741.380689544823, 7757.185495523002, 7813.218678132198, 7648.42636802242, 7842.529448233067, 7847.019122609674, 7851.685932562691, 7872.842543149105, 35738.0, 36345.63654363449, 36386.45420318697, 36583.0, 36596.81701591502, 2664.413828957646, 3033.3023404616843, 3036.878524859003, 3112.766542509321, 3128.765342599314, 25398.87300563504, 25537.872310638515, 25933.870330648413, 26199.607005894926, 26737.0, 3366.3267346530793, 3374.578177727784, 3375.476801095834, 3394.083597428705, 3443.896683099511, 203206.0, 203597.0, 203709.0, 204967.0, 205272.0, 41961.79019104885, 43111.784441077594, 51151.74424127855, 51989.48010519846, 52009.0, 43658.56341436545, 43982.56017439849, 44028.0, 44058.77970610191, 44192.0, 13826.861731382558, 14122.0, 14215.928920355333, 14220.71558568823, 14232.573022809333, 11090.168237382228, 11261.718457038476, 11269.605563805228, 11278.943605282086, 11287.097032237401, 14447.927760361132, 14452.349644266033, 14460.927695361666, 14546.41814327415, 14650.0, 5735.283089613798, 5777.566682498829, 5802.100674395391, 5822.0684690449325, 5854.707264636836, 905.0994260710635, 914.7027216154777, 967.4485543240286, 979.647326962293, 1028.6862506935456, 26571.867140664173, 26872.32819179497, 27203.0, 27673.308167295578, 27692.723072769015, 913.2100732866023, 964.4213471916934, 987.8913319534845, 1035.0942924940678, 1055.1084333737979, 11340.533672172802, 13345.66635834112, 13433.126846754929, 13471.595852124256, 13716.588502344946, 267207.0, 272091.0, 272351.0, 272926.0, 273884.0, 47292.5270747295, 47436.0, 47804.7609761949, 47862.52137478581, 47911.76044119827, 1135.4152611405134, 1165.4289398194824, 1211.5032836537155, 1214.763121191377, 1220.9572664956684, 24804.751952480965, 25321.493570128863, 25477.235682929542, 25586.360340991625, 25611.0, 39629.0, 39874.800625996686, 40104.0, 40138.79930600328, 40275.1944961105, 257512.0, 259005.0, 259997.0, 260147.0, 260669.0, 32229.194270143435, 32461.0, 32517.512237316932, 40855.59144408518, 41053.35786568504, 36893.44659830158, 37042.0, 37245.25509489741, 37482.81258593799, 42878.78560607177, 31649.8417507911, 32207.51688724718, 32877.67122328842, 33097.83451082729, 33690.157746056546, 32024.67975320217, 32548.0, 33505.83247083749, 34222.657773421946, 34305.14237144091, 31095.222619434695, 34587.82706086453, 34842.47736283907, 37107.257854843294, 37642.247155057295, 32052.679473205902, 34157.487637685954, 34176.65823341735, 34296.0, 34514.48228276628, 24162.0, 24561.0, 24620.261392158263, 24908.37729056788, 24954.750452495242], "unit": "score", "name": "ext.html", "value": 16530.15758222346}, {"lowerIsBetter": false, "replicates": [348.7018599097772, 356.86439153121813, 357.78354095772056, 361.93304238715825, 363.97816131032124, 15722.685546289067, 15784.33326689257, 15878.285477153542, 16188.595285117877, 16208.83791162088, 15419.691606167898, 15607.141607211599, 15787.210639468038, 15804.84195158048, 16130.516084517483, 4905.4849240829735, 4923.458419573844, 5046.646734728571, 5088.18589025756, 5108.3359163308905, 4909.263610458442, 4983.601311895058, 5008.724520151391, 5020.472850350716, 5024.397072351323, 4942.085714142895, 4944.35723355965, 4947.8268260610885, 4948.703077815325, 4994.875128121808, 4751.121042607128, 4984.127777638935, 4986.152354099811, 4989.850304490853, 4995.625328100389, 4416.403785488982, 4419.801108950072, 4426.756528390937, 4431.135928493945, 4442.444694413199, 18903.716444253347, 19087.331943382054, 19569.0, 19605.0, 19793.604127917504, 1898.3545594497937, 1941.4952112450865, 2011.4367976966473, 2022.4438279473263, 2511.982647027957, 12742.554010609585, 12872.549460768922, 12906.419211135522, 13193.076484646079, 13216.339183040809, 1752.3691471070404, 1802.6755184066863, 1809.746635471035, 1852.0461962089535, 1854.1563588567305, 47590.0, 52893.0, 53498.0, 58003.70998145024, 60753.0, 9573.425594464354, 9694.127528522467, 9950.701478955643, 9957.55191016406, 10021.39871607706, 12559.0, 12624.242545447303, 12648.051396145325, 12765.106442548933, 12793.360331983364, 7576.052993375828, 7630.542167469969, 7685.538867667958, 7744.186860379579, 7759.0, 7291.125064992235, 7317.524360916524, 7339.376153027052, 7441.181470038291, 7451.068616422947, 5885.588008839426, 5939.940600594025, 5965.13505541694, 5998.970005149947, 6067.120267561268, 1701.8978861268363, 1769.8938063716218, 1795.9640807183782, 1799.7300404939365, 1801.5225965119255, 835.1606635331453, 845.5504274947901, 879.5118709116501, 886.5877367024365, 923.5105394141116, 14815.481458148914, 15082.793376529851, 15543.844561554466, 16184.0, 16360.836391636169, 848.7284069097952, 849.2144766091341, 872.241150199318, 913.0595486648763, 920.4569304110607, 9496.997559112917, 9561.90438095624, 9599.808003839884, 9713.514324283757, 9775.315727898978, 260492.0, 266946.0, 421675.0, 425618.0, 429069.0, 72542.63728681428, 73294.0, 73299.63350183216, 73536.264637354, 74851.0, 931.6366617019368, 965.3049804141148, 979.8138353712772, 980.9117179453741, 981.1316984468797, 14636.926815365856, 14814.0, 15140.545783626509, 15179.544613661608, 15311.770323444935, 34756.82621586876, 34829.65170348366, 35261.82369088241, 35604.465933010506, 35748.0, 45970.77014614906, 49478.257826133355, 49514.75242623764, 49637.0, 49929.75035124801, 6961.860762784817, 6972.198197207386, 7084.2915708428745, 7109.715611375694, 7127.893081603884, 10505.68482945513, 11084.279521831055, 11230.719232019264, 11282.210245282751, 11321.886781132083, 9601.0, 9674.806503869742, 9796.118349348593, 9846.0, 9885.752856178653, 9355.298352623444, 9614.230861530921, 9836.311458198144, 9885.456299903575, 10052.597896084075, 9737.659181928599, 9813.754656133653, 10029.247806414402, 10171.436554504498, 10186.541605627617, 7104.751333703295, 7111.075560177351, 7189.281071892978, 7269.781906542812, 7327.487075904849, 9342.252619790537, 9984.151347135576, 10105.090541851268, 10172.593096276067, 10386.272960892666], "unit": "score", "name": "jquery.html", "value": 8040.986093784894}, {"lowerIsBetter": false, "replicates": [1343.8454577723562, 1386.4038463460713, 1506.7212565675352, 1724.1293146960784, 1755.8858674186185, 6448.097266382711, 7230.2046774854725, 7414.6292685365715, 7637.1980942001055, 7673.040869891263, 7232.20445750967, 7242.891356629655, 7341.963290183555, 7355.77932662021, 7358.963205183966, 2177.564487102582, 2211.524522227721, 2217.135317226283, 2222.3110835641005, 2223.722034745657, 2185.125949620157, 2214.2139540463145, 2216.036024329414, 2217.246136313653, 2217.9778202218013, 2203.0416768705586, 2204.34971683353, 2209.2046863129262, 2218.73375194976, 2249.134083377903, 2164.3182397544724, 2199.230269405711, 2208.8564243324213, 2216.74507431645, 2219.367480268132, 2179.466030822459, 2194.7914948079906, 2210.668399740036, 2214.247155966979, 2214.9114035438565, 7454.664540095709, 7456.291652293077, 7474.887876681854, 7489.850202995964, 7525.4355923305975, 4461.977690111528, 4544.295634176708, 4573.565511276423, 4581.61056310214, 4597.310403439477, 2900.3474218300926, 3054.144839444959, 3075.8308293043874, 3077.1076387847497, 3089.3666798306294, 917.8806755121858, 947.1759569174793, 957.2150836314225, 966.9516524173763, 977.0522593084696, 9817.754556136153, 9825.213982881352, 9853.408795472295, 9858.162056225157, 9893.802123957481, 4081.7346872453195, 4149.730267532601, 4187.685923555746, 4200.663946884242, 4242.809073591696, 8398.0, 8458.49249045047, 8465.449745766506, 8516.190961858614, 8526.914730852612, 4593.012502312019, 4601.44782626087, 4609.700369476041, 4616.630669546428, 4623.514530974267, 3595.1012246938267, 4055.371417430303, 4122.2786012447705, 4208.642265407475, 4211.852585159505, 3597.244578638515, 3609.9639003609627, 3651.2697460508007, 3662.853485860589, 3696.3531382008578, 1180.6222008957222, 1197.6407077876777, 1198.5864876617727, 1201.1771936223715, 1206.2219868185148, 1190.345310079453, 1198.9460474278503, 1219.8048312269993, 1234.4136535145913, 1245.1346314311647, 7154.570725756471, 7194.676239569232, 7211.206767255598, 7295.70817167318, 7458.70165193397, 1053.0417320238546, 1059.2320567588438, 1063.3354153653966, 1074.2856000759564, 1082.8050950828926, 5733.569982251348, 5736.397678243808, 5791.536677065825, 5800.738966746507, 5827.3007239131575, 8938.776530586787, 9366.0, 9500.619975201053, 9531.571079301448, 9583.712488625353, 9290.628374865066, 9329.533523323807, 9329.860052099224, 9389.436633801994, 9436.764080897896, 7066.50534462593, 7257.201707812136, 7288.380487658608, 7301.9047142928985, 7314.670839812221, 6890.93109068923, 6909.067275917888, 6969.9303006969285, 6982.825429364307, 6986.790396288119, 8224.0, 8231.135730748425, 8479.576021198793, 8497.235248827636, 8596.871046934177, 8393.524654861829, 8513.446625969293, 8550.401471896908, 8622.568871556523, 8690.652373904974, 5672.347680016851, 6047.274327080779, 6189.319174890848, 6302.369763023661, 6455.354464553507, 7059.152901651834, 7076.044733960849, 7091.43268538526, 7095.574265544084, 7130.251323611154, 6429.38920802523, 6434.163558737521, 6502.252240992347, 6524.67376631176, 6541.149650545399, 6363.1091647168505, 6415.390537898892, 6472.0, 6569.178852643419, 6582.243042050225, 6630.403263706289, 6648.601083934979, 6694.096296999843, 6701.530892837454, 6702.899456508058, 6164.291106522807, 6222.906656400067, 6268.686565671607, 6331.746730130927, 6346.238451385863, 6354.555181137276, 6381.617102973836, 6393.0, 6402.167718196604, 6429.839254018687], "unit": "score", "name": "mootools.html", "value": 4356.478497697818}, {"lowerIsBetter": false, "replicates": [301.5642396736716, 310.89429593938064, 313.0389703609917, 320.60565504429536, 322.29095988824594, 5637.323521177459, 5734.971325143374, 5738.856528586787, 5745.253117094782, 5749.885002299951, 5625.915611265824, 5639.041362968295, 5640.520555752756, 5644.971775141129, 5655.321361436633, 4116.855910043149, 4193.769342686166, 4321.265384884561, 4325.675574331922, 4333.285007973681, 4321.373400856874, 4333.848315308965, 4335.154644844257, 4337.501187363462, 4341.761203133827, 4286.935695964563, 4289.635380992604, 4290.699651024414, 4290.884370063774, 4294.248506511348, 4285.250081235787, 4287.549807270223, 4305.504866940295, 4310.913781724379, 4315.13697260546, 3747.0819649186124, 3750.006248344191, 3755.5681096673957, 3758.5677647070665, 3759.4924685167425, 5389.649672771257, 5425.647332923387, 5433.130699088127, 5462.754176062087, 5466.480684334982, 4868.464468908417, 4979.327790748239, 4980.87547811304, 4984.127777638935, 4988.530677314752, 5930.466258036754, 5933.495652869511, 5937.732802023919, 5940.0, 5942.316633587149, 4046.352583586612, 4075.572064933169, 4096.897577560555, 4102.979485102585, 4108.979455102705, 6269.435750782406, 6272.623642581414, 6278.654673992928, 6279.183706118221, 6284.528660350446, 4192.979035104866, 4205.663546916239, 4206.20082184384, 4209.94751312172, 4210.347396153601, 4124.4019617155345, 4234.745915245096, 4275.315949448073, 4277.3797799319545, 4281.807318670667, 4939.851804445801, 4944.678595891256, 4952.702837829742, 4960.379952505937, 4961.3798275215595, 5908.202392676933, 5953.880922381615, 5984.73068711909, 5986.73059712314, 5987.13186587951, 1499.2503748125937, 1548.41934274647, 1549.2486144220045, 1550.4108438793187, 1553.2622004547975, 1027.8715160604925, 1041.0474415909357, 1048.2505008918508, 1059.613241166984, 1064.2550214849637, 5167.767450464738, 5184.455632158644, 5187.221916712448, 5189.065968125698, 5190.24741412493, 6124.173236613, 6182.28903676074, 6186.10301506288, 6193.907091393633, 6204.038374052029, 5002.874928126753, 5058.54473097423, 5168.198929165986, 5183.403908550489, 5196.272521846944, 3346.548215990859, 3371.7302615790677, 3381.205416727067, 3381.3575420669995, 3384.983075084609, 5722.055860782924, 5747.08046712524, 5762.2509073820975, 5766.625169363978, 5770.855728606818, 6402.327755585689, 6409.647469389229, 6414.518911081687, 6427.485801135991, 6427.517936154807, 5776.855578610568, 5777.566682498829, 5777.971110144338, 5780.335261444903, 5785.855353616109, 6131.478824299985, 6280.9685951569945, 6292.811215663537, 6293.842653933688, 6298.779542715983, 6078.3617720138745, 6096.0855871619615, 6098.329183789869, 6102.267727872683, 6115.602485838406, 5748.080307150836, 5776.797812076557, 5783.768649253982, 5784.016717158009, 5792.681402522733, 4290.935635965526, 4295.806688698954, 4310.31035034393, 4311.396404503309, 4320.287152619908, 6193.163922870355, 6234.407731265523, 6235.314115447388, 6237.812865614039, 6254.405831446005, 5862.530997520103, 6010.2186715726675, 6040.456358927718, 6070.605410648293, 6072.210612620508, 5971.253593300838, 6001.90997135052, 6003.159557661844, 6012.518998480198, 6023.48800351975, 5863.2670916135485, 5885.323187833454, 5900.7049647518315, 5905.852353691021, 5919.674417906885, 6012.819615411545, 6016.368281330572, 6041.395860413923, 6042.969785151046, 6050.9394906050375, 5717.971410142923, 5869.4717475427415, 5872.55955803325, 5875.911861321998, 5919.319278283053], "unit": "score", "name": "prototype.html", "value": 4459.915872972768}, {"lowerIsBetter": false, "replicates": [675.517005341181, 677.3598948993204, 687.8796210663135, 747.0698979770187, 772.7063715787999, 12144.39278036098, 12535.435905384256, 12645.683857903558, 12715.618531444048, 12749.617511474671, 12155.939220303908, 12222.449989750461, 12224.14430989831, 12267.447964841582, 12302.138850280484, 638.0588631768128, 777.149021821105, 786.0999155966415, 786.8426314737047, 790.9841803163933, 781.8045488627843, 800.3437181511163, 804.0833449867127, 804.4610111225493, 804.7022601637402, 831.733845169546, 842.2083241752733, 842.2377748137915, 842.2503971465401, 842.7893026743315, 826.6569373709904, 833.72487079264, 836.506461187902, 840.1304649687575, 840.9159084091604, 594.8096609085095, 597.8296185587087, 606.3178923710825, 611.8837420890061, 614.3457218062749, 12127.0, 12145.696357591043, 12148.87851121495, 12155.392230388445, 12193.085518586053, 11840.644780656594, 12134.332611706353, 12328.0, 13099.607011789662, 13246.271455069967, 9777.41335519871, 9887.505624718808, 9990.35062720928, 10095.091441770275, 10141.492925353776, 3315.419801534722, 3335.5997280326274, 3346.4143774839304, 3373.173572474735, 3404.455287154068, 43847.56152438467, 44000.11999759987, 44006.55993440057, 44069.33895991563, 44405.3339199909, 9754.658586949423, 9894.455804930798, 10040.146587539995, 10114.089731924161, 10133.138683211862, 16969.660606788042, 17163.485095446908, 17172.22724977379, 17217.655646887244, 17486.650266994588, 6909.930900691029, 6942.028116063755, 6952.582845029213, 7023.719051237996, 7079.079719636517, 3621.3843646580144, 3636.563612366533, 3652.4703917932284, 3727.2918145552258, 3733.5085126183917, 2897.1163795042294, 2946.0, 2956.512175491063, 2979.06159559738, 2986.074316961749, 571.3172758553571, 582.8630271886103, 589.1516216648099, 591.9289685237799, 591.9585629005928, 498.9351384320015, 557.3506864502809, 579.5537436174122, 602.3584882100549, 603.3453702732496, 7531.73638922646, 7599.354054905395, 7667.156612772591, 7725.961370193226, 7757.689692412353, 483.54546726078075, 561.8735784448548, 570.8401647538695, 571.1147721032384, 573.489594261108, 3255.4302996975434, 3404.2170300830453, 3416.24842534642, 3494.8602055917477, 3540.150363912642, 49151.0, 52552.0, 52606.0, 52699.209511857356, 52735.0, 41808.37287440691, 42299.57700423018, 42361.78819105885, 42693.146137077085, 42754.78622606929, 43610.7819460907, 43881.0, 44028.55971440308, 44549.55450445519, 46003.76998115055, 8591.871121933302, 8594.957025214833, 8638.611262493077, 8758.82482350362, 8951.41815781998, 32085.197870053435, 32956.34087318192, 33143.834280829404, 33640.1589960253, 34379.0, 39561.406578901915, 41455.585444145174, 41997.0, 42052.0, 42536.361954570086, 10593.841092383465, 10684.786304273715, 10777.0, 10898.073663738354, 11292.15308851823, 11553.537858485566, 11696.415179240834, 11795.0, 11830.0, 11839.92162037859, 10939.343639381663, 11030.338179709242, 11162.330260184415, 11302.43487825622, 11541.192116551762, 11279.210455268052, 11487.54049837997, 11582.768344632892, 11601.071914247008, 11622.535098595961, 10782.299150555189, 10887.129029677766, 10927.235093543375, 11044.779104418027, 11243.044341231087, 9087.863682044643, 9252.722418327461, 9346.299027572823, 9359.204467620057, 9361.531923403938, 9057.864132037894, 9588.856167157637, 9622.470764107762, 9782.608695652094, 9853.162481188892], "unit": "score", "name": "yui.html", "value": 5947.5360030626}], "name": "dromaeo_css", "value": 6456.192017741091}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 107.0, 114.0, 114.0, 114.0, 123.0, 111.0, 111.0, 114.0, 113.0], "unit": "score", "name": "ai-astar", "value": 113.4}, {"lowerIsBetter": true, "replicates": [153.0, 128.0, 155.0, 172.0, 132.0, 156.0, 153.0, 131.0, 170.0, 133.0], "unit": "score", "name": "audio-beat-detection", "value": 148.3}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 162.0, 161.0, 162.0, 164.0, 168.0, 164.0, 168.0, 163.0], "unit": "score", "name": "audio-dft", "value": 163.6}, {"lowerIsBetter": true, "replicates": [73.0, 77.0, 73.0, 75.0, 73.0, 74.0, 76.0, 74.0, 144.0, 74.0], "unit": "score", "name": "audio-fft", "value": 81.3}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 139.0, 94.0, 93.0, 95.0, 142.0, 93.0, 94.0, 141.0], "unit": "score", "name": "audio-oscillator", "value": 107.9}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 118.0, 117.0, 119.0, 118.0, 117.0, 117.0, 118.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.6}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 149.0, 148.0, 147.0, 147.0, 149.0, 148.0, 148.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.7}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 96.0, 97.0, 97.0, 96.0, 95.0, 96.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.3}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 66.0, 66.0, 67.0, 66.0, 68.0, 67.0, 66.0, 65.0], "unit": "score", "name": "json-parse-financial", "value": 66.6}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 65.0, 66.0, 65.0, 65.0, 64.0, 64.0, 65.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.8}, {"lowerIsBetter": true, "replicates": [81.0, 81.0, 82.0, 81.0, 82.0, 81.0, 83.0, 81.0, 82.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.7}, {"lowerIsBetter": true, "replicates": [124.0, 123.0, 125.0, 120.0, 124.0, 131.0, 118.0, 125.0, 122.0, 129.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.1}, {"lowerIsBetter": true, "replicates": [133.0, 144.0, 148.0, 141.0, 142.0, 134.0, 149.0, 145.0, 141.0, 134.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 141.1}, {"lowerIsBetter": true, "replicates": [67.0, 66.0, 68.0, 67.0, 68.0, 67.0, 66.0, 66.0, 68.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.9}], "name": "kraken", "value": 1521.3}]} 18:53:03 INFO - Return code: 0 18:53:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 18:53:03 ERROR - # TBPL SUCCESS # 18:53:03 INFO - Running post-action listener: _resource_record_post_action 18:53:03 INFO - Running post-run listener: _resource_record_post_run 18:53:04 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 339968; Write bytes: 282783744; Read time: 76; Write time: 202776 18:53:04 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 6815744; Read time: 0; Write time: 924 18:53:04 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 339968; Write bytes: 275968000; Read time: 76; Write time: 201852 18:53:04 INFO - Running post-run listener: _upload_blobber_files 18:53:04 INFO - Blob upload gear active. 18:53:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:53:04 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 18:53:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:53:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:53:04 INFO - (blobuploader) - INFO - Open directory for files ... 18:53:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:53:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:53:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:53:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:53:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:53:06 INFO - (blobuploader) - INFO - Done attempting. 18:53:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:53:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:53:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:53:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:53:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:53:06 INFO - (blobuploader) - INFO - Done attempting. 18:53:06 INFO - (blobuploader) - INFO - Iteration through files over. 18:53:07 INFO - Return code: 0 18:53:07 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:53:07 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:53:07 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f34367410b9103bd95d1962194588a3346e9ca109ad2b23f4efa6d847f50c1d5e078caeee13eb129b72b7c618d7490869d0992fd46a02ef8a518b44e8eaa0a5c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dfa26506dafdd8e43c821f9d5d4e9d4a44c1687f5d6e0bd69de614d837501a8f7dbe7ad704af5958e722c5afbaec95874800ff4e0ff641a4c7cf01602477e417"} 18:53:07 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:53:07 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:53:07 INFO - Contents: 18:53:07 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f34367410b9103bd95d1962194588a3346e9ca109ad2b23f4efa6d847f50c1d5e078caeee13eb129b72b7c618d7490869d0992fd46a02ef8a518b44e8eaa0a5c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dfa26506dafdd8e43c821f9d5d4e9d4a44c1687f5d6e0bd69de614d837501a8f7dbe7ad704af5958e722c5afbaec95874800ff4e0ff641a4c7cf01602477e417"} 18:53:07 INFO - Running post-run listener: copy_logs_to_upload_dir 18:53:07 INFO - Copying logs to upload dir... 18:53:07 INFO - mkdir: /builds/slave/test/build/upload/logs 18:53:07 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1300.453212 ========= master_lag: 0.12 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 40 secs) (at 2016-03-22 18:53:07.115486) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-22 18:53:07.118559) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f34367410b9103bd95d1962194588a3346e9ca109ad2b23f4efa6d847f50c1d5e078caeee13eb129b72b7c618d7490869d0992fd46a02ef8a518b44e8eaa0a5c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dfa26506dafdd8e43c821f9d5d4e9d4a44c1687f5d6e0bd69de614d837501a8f7dbe7ad704af5958e722c5afbaec95874800ff4e0ff641a4c7cf01602477e417"} build_url:https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011352 build_url: 'https://queue.taskcluster.net/v1/task/XTfE97PtS1Sy3hed6_BL8A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f34367410b9103bd95d1962194588a3346e9ca109ad2b23f4efa6d847f50c1d5e078caeee13eb129b72b7c618d7490869d0992fd46a02ef8a518b44e8eaa0a5c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/dfa26506dafdd8e43c821f9d5d4e9d4a44c1687f5d6e0bd69de614d837501a8f7dbe7ad704af5958e722c5afbaec95874800ff4e0ff641a4c7cf01602477e417"}' ========= master_lag: 0.07 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-22 18:53:07.201055) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:53:07.201364) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1458696542.332971-430125497 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004693 ========= master_lag: 0.15 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-22 18:53:07.359774) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-22 18:53:07.360089) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-22 18:53:07.360394) ========= ========= Total master_lag: 3.69 =========