builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-034 starttime: 1470172848.57 results: success (0) buildid: 20160802113011 builduid: 9db83c31d97247e0980df5608e5a2375 revision: 1460b360645d017f987e48b4f16f6c455f1e9e38 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.572179) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.572694) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.572989) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.602179) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.602520) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-02 14:20:49-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 109M=0s 2016-08-02 14:20:49 (109 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.081129 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.698059) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.698387) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020907 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.749174) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:48.749536) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1460b360645d017f987e48b4f16f6c455f1e9e38 --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 1460b360645d017f987e48b4f16f6c455f1e9e38 --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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-02 14:20:49,863 truncating revision to first 12 chars 2016-08-02 14:20:49,863 Setting DEBUG logging. 2016-08-02 14:20:49,863 attempt 1/10 2016-08-02 14:20:49,863 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1460b360645d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-02 14:20:50,470 unpacking tar archive at: fx-team-1460b360645d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.928387 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:49.692336) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:49.692703) ========= script_repo_revision: 1460b360645d017f987e48b4f16f6c455f1e9e38 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:49.693178) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:49.693466) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-02 14:20:49.704440) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-08-02 14:20:49.704787) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:20:50 INFO - MultiFileLogger online at 20160802 14:20:50 in /builds/slave/test 14:20:50 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 14:20:50 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:20:50 INFO - {'append_to_log': False, 14:20:50 INFO - 'base_work_dir': '/builds/slave/test', 14:20:50 INFO - 'blob_upload_branch': 'Fx-Team', 14:20:50 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:20:50 INFO - 'branch': 'Fx-Team', 14:20:50 INFO - 'buildbot_json_path': 'buildprops.json', 14:20:50 INFO - 'config_files': ('talos/linux_config.py',), 14:20:50 INFO - 'default_actions': ('clobber', 14:20:50 INFO - 'read-buildbot-config', 14:20:50 INFO - 'download-and-extract', 14:20:50 INFO - 'populate-webroot', 14:20:50 INFO - 'create-virtualenv', 14:20:50 INFO - 'install', 14:20:50 INFO - 'run-tests'), 14:20:50 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:20:50 INFO - 'download_minidump_stackwalk': True, 14:20:50 INFO - 'download_symbols': 'ondemand', 14:20:50 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:20:50 INFO - 'tooltool.py': '/tools/tooltool.py', 14:20:50 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:20:50 INFO - '/tools/misc-python/virtualenv.py')}, 14:20:50 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:20:50 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:20:50 INFO - 'installer_path': 'installer.exe', 14:20:50 INFO - 'log_level': 'info', 14:20:50 INFO - 'log_name': 'talos', 14:20:50 INFO - 'log_to_console': True, 14:20:50 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:20:50 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:20:50 INFO - 'opt_config_files': (), 14:20:50 INFO - 'pip_index': False, 14:20:50 INFO - 'sps_profile': False, 14:20:50 INFO - 'sps_profile_interval': 0, 14:20:50 INFO - 'suite': 'dromaeojs', 14:20:50 INFO - 'system_bits': '32', 14:20:50 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:20:50 INFO - 'title': 'talos-linux64-ix-034', 14:20:50 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:20:50 INFO - 'use_talos_json': True, 14:20:50 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:20:50 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:20:50 INFO - 'work_dir': 'build'} 14:20:50 INFO - [mozharness: 2016-08-02 21:20:50.902918Z] Running clobber step. 14:20:50 INFO - Running pre-action listener: _resource_record_pre_action 14:20:50 INFO - Running main action method: clobber 14:20:50 INFO - rmtree: /builds/slave/test/build 14:20:50 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:20:51 INFO - Running post-action listener: _resource_record_post_action 14:20:51 INFO - [mozharness: 2016-08-02 21:20:51.887982Z] Finished clobber step (success) 14:20:51 INFO - [mozharness: 2016-08-02 21:20:51.888083Z] Running read-buildbot-config step. 14:20:51 INFO - Running pre-action listener: _resource_record_pre_action 14:20:51 INFO - Running main action method: read_buildbot_config 14:20:51 INFO - Using buildbot properties: 14:20:51 INFO - { 14:20:51 INFO - "project": "", 14:20:51 INFO - "product": "firefox", 14:20:51 INFO - "script_repo_revision": "production", 14:20:51 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 14:20:51 INFO - "repository": "", 14:20:51 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 14:20:51 INFO - "buildid": "20160802113011", 14:20:51 INFO - "pgo_build": "True", 14:20:51 INFO - "basedir": "/builds/slave/test", 14:20:51 INFO - "buildnumber": 945, 14:20:51 INFO - "slavename": "talos-linux64-ix-034", 14:20:51 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 14:20:51 INFO - "platform": "ubuntu64_hw", 14:20:51 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 14:20:51 INFO - "branch": "fx-team", 14:20:51 INFO - "repo_path": "integration/fx-team", 14:20:51 INFO - "revision": "1460b360645d017f987e48b4f16f6c455f1e9e38", 14:20:51 INFO - "stage_platform": "linux64-pgo", 14:20:51 INFO - "builduid": "9db83c31d97247e0980df5608e5a2375", 14:20:51 INFO - "slavebuilddir": "test" 14:20:51 INFO - } 14:20:51 INFO - Found installer url https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 14:20:51 INFO - Running post-action listener: _resource_record_post_action 14:20:51 INFO - [mozharness: 2016-08-02 21:20:51.890559Z] Finished read-buildbot-config step (success) 14:20:51 INFO - [mozharness: 2016-08-02 21:20:51.890648Z] Running download-and-extract step. 14:20:51 INFO - Running pre-action listener: _resource_record_pre_action 14:20:51 INFO - Running main action method: download_and_extract 14:20:51 INFO - mkdir: /builds/slave/test/build/tests 14:20: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')]} 14:20:51 INFO - https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 14:20:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 14:20:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 14:20:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 14:20:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 14:20:52 INFO - Downloaded 1361 bytes. 14:20:52 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 14:20:52 INFO - Using the following test package requirements: 14:20:52 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 14:20:52 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 14:20:52 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 14:20:52 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'jsshell-linux-x86_64.zip'], 14:20:52 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 14:20:52 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 14:20:52 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 14:20:52 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 14:20:52 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 14:20:52 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 14:20:52 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 14:20:52 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 14:20:52 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')]} 14:20:52 INFO - https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:20:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:20:53 INFO - Downloaded 21811115 bytes. 14:20:53 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:20:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:20:54 INFO - Return code: 0 14:20:54 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 14:20: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')]} 14:20:54 INFO - https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:20:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 14:20:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:20:55 INFO - Downloaded 21811115 bytes. 14:20:55 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:20:55 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:20:57 INFO - Return code: 0 14:20:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:20:57 INFO - https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 14:20:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 14:20:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 14:20:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 14:20:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 14:20:58 INFO - Downloaded 14413723 bytes. 14:20:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:20:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 14:20:58 INFO - Return code: 0 14:20:58 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')]} 14:20:58 INFO - https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 14:20:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 14:20:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 14:20:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 14:20:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 14:20:59 INFO - Downloaded 59381576 bytes. 14:20:59 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 14:20:59 INFO - mkdir: /builds/slave/test/properties 14:20:59 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:20:59 INFO - Writing to file /builds/slave/test/properties/build_url 14:20:59 INFO - Contents: 14:20:59 INFO - build_url:https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 14:21:00 INFO - Running post-action listener: _resource_record_post_action 14:21:00 INFO - Running post-action listener: set_extra_try_arguments 14:21:00 INFO - [mozharness: 2016-08-02 21:21:00.233803Z] Finished download-and-extract step (success) 14:21:00 INFO - [mozharness: 2016-08-02 21:21:00.234037Z] Running populate-webroot step. 14:21:00 INFO - Running pre-action listener: _resource_record_pre_action 14:21:00 INFO - Running main action method: populate_webroot 14:21:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:21:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:21:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:21:00 INFO - '--tppagecycles', 14:21:00 INFO - '7'], 14:21:00 INFO - 'tests': ['tsvgm']}}, 14:21:00 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:21:00 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:21:00 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:21:00 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:21:00 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:21:00 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:21:00 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['damp', 'tps']}, 14:21:00 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'tests': ['damp', 'tps']}, 14:21:00 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['dromaeo_dom']}, 14:21:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:21:00 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['basic_compositor_video']}, 14:21:00 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 14:21:00 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'other-e10s': {'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['a11yr', 14:21:00 INFO - 'ts_paint', 14:21:00 INFO - 'tpaint', 14:21:00 INFO - 'sessionrestore', 14:21:00 INFO - 'sessionrestore_no_auto_restore', 14:21:00 INFO - 'tabpaint']}, 14:21:00 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['tsvgx', 14:21:00 INFO - 'tsvgr_opacity', 14:21:00 INFO - 'tart', 14:21:00 INFO - 'tscrollx', 14:21:00 INFO - 'cart']}, 14:21:00 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:21:00 INFO - 'tsvgr_opacity', 14:21:00 INFO - 'tart', 14:21:00 INFO - 'tscrollx', 14:21:00 INFO - 'cart']}, 14:21:00 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'talos_options': ['--disable-e10s'], 14:21:00 INFO - 'tests': ['tp5o']}, 14:21:00 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'tests': ['tp5o']}, 14:21:00 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'talos_options': ['--disable-e10s', 14:21:00 INFO - '--xperf_path', 14:21:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:21:00 INFO - 'tests': ['tp5n']}, 14:21:00 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:21:00 INFO - 'talos_options': ['--xperf_path', 14:21:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:21:00 INFO - 'tests': ['tp5n']}}, 14:21:00 INFO - 'talos.zip': {'path': '', 14:21:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:21:00 INFO - Running post-action listener: _resource_record_post_action 14:21:00 INFO - [mozharness: 2016-08-02 21:21:00.249323Z] Finished populate-webroot step (success) 14:21:00 INFO - [mozharness: 2016-08-02 21:21:00.249412Z] Running create-virtualenv step. 14:21:00 INFO - Running pre-action listener: _resource_record_pre_action 14:21:00 INFO - Running main action method: create_virtualenv 14:21:00 INFO - Creating virtualenv /builds/slave/test/build/venv 14:21:00 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 14:21:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:21:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:21:00 INFO - Using real prefix '/usr' 14:21:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:21:00 INFO - Installing distribute.............................................................................................................................................................................................done. 14:21:02 INFO - Installing pip.................done. 14:21:02 INFO - Return code: 0 14:21:02 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:21: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')]} 14:21:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21: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')]} 14:21:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21: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', 'pip>=1.5'] in /builds/slave/test/build 14:21: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 pip>=1.5 14:21:02 INFO - Using env: {'DISPLAY': ':0', 14:21:02 INFO - 'HOME': '/home/cltbld', 14:21:02 INFO - 'LANG': 'en_US.UTF-8', 14:21:02 INFO - 'LANGUAGE': 'en_US:en', 14:21:02 INFO - 'LOGNAME': 'cltbld', 14:21:02 INFO - 'MAIL': '/var/mail/cltbld', 14:21:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:02 INFO - 'MOZ_NO_REMOTE': '1', 14:21:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:02 INFO - 'NO_EM_RESTART': '1', 14:21:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:02 INFO - 'PWD': '/builds/slave/test', 14:21:02 INFO - 'SHELL': '/bin/bash', 14:21:02 INFO - 'SHLVL': '1', 14:21:02 INFO - 'TERM': 'linux', 14:21:02 INFO - 'TMOUT': '86400', 14:21:02 INFO - 'USER': 'cltbld', 14:21:02 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:02 INFO - '_': '/tools/buildbot/bin/python'} 14:21:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:03 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 14:21:03 INFO - Cleaning up... 14:21:03 INFO - Return code: 0 14:21:03 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:21:03 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')]} 14:21:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:03 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')]} 14:21:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:03 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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:03 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>=3.1.1'] in /builds/slave/test/build 14:21:03 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>=3.1.1 14:21:03 INFO - Using env: {'DISPLAY': ':0', 14:21:03 INFO - 'HOME': '/home/cltbld', 14:21:03 INFO - 'LANG': 'en_US.UTF-8', 14:21:03 INFO - 'LANGUAGE': 'en_US:en', 14:21:03 INFO - 'LOGNAME': 'cltbld', 14:21:03 INFO - 'MAIL': '/var/mail/cltbld', 14:21:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:03 INFO - 'MOZ_NO_REMOTE': '1', 14:21:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:03 INFO - 'NO_EM_RESTART': '1', 14:21:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:03 INFO - 'PWD': '/builds/slave/test', 14:21:03 INFO - 'SHELL': '/bin/bash', 14:21:03 INFO - 'SHLVL': '1', 14:21:03 INFO - 'TERM': 'linux', 14:21:03 INFO - 'TMOUT': '86400', 14:21:03 INFO - 'USER': 'cltbld', 14:21:03 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:03 INFO - '_': '/tools/buildbot/bin/python'} 14:21:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:03 INFO - Downloading/unpacking psutil>=3.1.1 14:21:03 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 14:21:03 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 14:21:03 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 14:21:03 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 14:21:03 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 14:21:03 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 14:21:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:21:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:21:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:21:05 INFO - Installing collected packages: psutil 14:21:05 INFO - Running setup.py install for psutil 14:21:05 INFO - building 'psutil._psutil_linux' extension 14:21:05 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 14:21:05 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 14:21:05 INFO - building 'psutil._psutil_posix' extension 14:21:05 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 14:21:05 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 14:21:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:21:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:21:05 INFO - Successfully installed psutil 14:21:05 INFO - Cleaning up... 14:21:05 INFO - Return code: 0 14:21:05 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:21:05 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')]} 14:21:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:05 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')]} 14:21:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:05 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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:05 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.3'] in /builds/slave/test/build 14:21:05 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.3 14:21:05 INFO - Using env: {'DISPLAY': ':0', 14:21:05 INFO - 'HOME': '/home/cltbld', 14:21:05 INFO - 'LANG': 'en_US.UTF-8', 14:21:05 INFO - 'LANGUAGE': 'en_US:en', 14:21:05 INFO - 'LOGNAME': 'cltbld', 14:21:05 INFO - 'MAIL': '/var/mail/cltbld', 14:21:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:05 INFO - 'MOZ_NO_REMOTE': '1', 14:21:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:05 INFO - 'NO_EM_RESTART': '1', 14:21:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:05 INFO - 'PWD': '/builds/slave/test', 14:21:05 INFO - 'SHELL': '/bin/bash', 14:21:05 INFO - 'SHLVL': '1', 14:21:05 INFO - 'TERM': 'linux', 14:21:05 INFO - 'TMOUT': '86400', 14:21:05 INFO - 'USER': 'cltbld', 14:21:05 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:05 INFO - '_': '/tools/buildbot/bin/python'} 14:21:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:06 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:21:06 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 14:21:06 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 14:21:06 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 14:21:06 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 14:21:06 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 14:21:06 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 14:21:07 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:21:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:21:07 INFO - Installing collected packages: mozsystemmonitor 14:21:07 INFO - Running setup.py install for mozsystemmonitor 14:21:08 INFO - Successfully installed mozsystemmonitor 14:21:08 INFO - Cleaning up... 14:21:08 INFO - Return code: 0 14:21:08 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:21:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:21:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:08 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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:08 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==2.5.1'] in /builds/slave/test/build 14:21:08 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==2.5.1 14:21:08 INFO - Using env: {'DISPLAY': ':0', 14:21:08 INFO - 'HOME': '/home/cltbld', 14:21:08 INFO - 'LANG': 'en_US.UTF-8', 14:21:08 INFO - 'LANGUAGE': 'en_US:en', 14:21:08 INFO - 'LOGNAME': 'cltbld', 14:21:08 INFO - 'MAIL': '/var/mail/cltbld', 14:21:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:08 INFO - 'MOZ_NO_REMOTE': '1', 14:21:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:08 INFO - 'NO_EM_RESTART': '1', 14:21:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:08 INFO - 'PWD': '/builds/slave/test', 14:21:08 INFO - 'SHELL': '/bin/bash', 14:21:08 INFO - 'SHLVL': '1', 14:21:08 INFO - 'TERM': 'linux', 14:21:08 INFO - 'TMOUT': '86400', 14:21:08 INFO - 'USER': 'cltbld', 14:21:08 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:08 INFO - '_': '/tools/buildbot/bin/python'} 14:21:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:08 INFO - Downloading/unpacking jsonschema==2.5.1 14:21: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 14:21: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 14:21: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 14:21: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 14:21: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 14:21: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 14:21:11 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:21:11 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:21:11 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 14:21:11 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 14:21:11 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 14:21:11 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 14:21:11 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 14:21:11 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 14:21:11 INFO - Downloading functools32-3.2.3-2.tar.gz 14:21:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:21:11 INFO - warning: no files found matching '*.txt' 14:21:11 INFO - no previously-included directories found matching 'build' 14:21:11 INFO - no previously-included directories found matching 'dist' 14:21:11 INFO - no previously-included directories found matching '.git*' 14:21:11 INFO - Installing collected packages: jsonschema, functools32 14:21:11 INFO - Running setup.py install for functools32 14:21:11 INFO - warning: no files found matching '*.txt' 14:21:11 INFO - no previously-included directories found matching 'build' 14:21:11 INFO - no previously-included directories found matching 'dist' 14:21:11 INFO - no previously-included directories found matching '.git*' 14:21:11 INFO - Successfully installed jsonschema functools32 14:21:11 INFO - Cleaning up... 14:21:11 INFO - Return code: 0 14:21:11 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 14:21:11 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')]} 14:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:11 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')]} 14:21:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:11 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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:11 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', 'functools32==3.2.3-2'] in /builds/slave/test/build 14:21:11 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 functools32==3.2.3-2 14:21:11 INFO - Using env: {'DISPLAY': ':0', 14:21:11 INFO - 'HOME': '/home/cltbld', 14:21:11 INFO - 'LANG': 'en_US.UTF-8', 14:21:11 INFO - 'LANGUAGE': 'en_US:en', 14:21:11 INFO - 'LOGNAME': 'cltbld', 14:21:11 INFO - 'MAIL': '/var/mail/cltbld', 14:21:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:11 INFO - 'MOZ_NO_REMOTE': '1', 14:21:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:11 INFO - 'NO_EM_RESTART': '1', 14:21:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:11 INFO - 'PWD': '/builds/slave/test', 14:21:11 INFO - 'SHELL': '/bin/bash', 14:21:11 INFO - 'SHLVL': '1', 14:21:11 INFO - 'TERM': 'linux', 14:21:11 INFO - 'TMOUT': '86400', 14:21:11 INFO - 'USER': 'cltbld', 14:21:11 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:11 INFO - '_': '/tools/buildbot/bin/python'} 14:21:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:11 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 14:21:11 INFO - Cleaning up... 14:21:11 INFO - Return code: 0 14:21:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:21:11 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')]} 14:21:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:11 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')]} 14:21:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:11 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 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:11 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 14:21:11 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 14:21:11 INFO - Using env: {'DISPLAY': ':0', 14:21:11 INFO - 'HOME': '/home/cltbld', 14:21:11 INFO - 'LANG': 'en_US.UTF-8', 14:21:11 INFO - 'LANGUAGE': 'en_US:en', 14:21:11 INFO - 'LOGNAME': 'cltbld', 14:21:11 INFO - 'MAIL': '/var/mail/cltbld', 14:21:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:11 INFO - 'MOZ_NO_REMOTE': '1', 14:21:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:11 INFO - 'NO_EM_RESTART': '1', 14:21:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:11 INFO - 'PWD': '/builds/slave/test', 14:21:11 INFO - 'SHELL': '/bin/bash', 14:21:11 INFO - 'SHLVL': '1', 14:21:11 INFO - 'TERM': 'linux', 14:21:11 INFO - 'TMOUT': '86400', 14:21:11 INFO - 'USER': 'cltbld', 14:21:11 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:11 INFO - '_': '/tools/buildbot/bin/python'} 14:21:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:12 INFO - Downloading/unpacking blobuploader==1.2.4 14:21:12 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 14:21:12 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 14:21:12 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 14:21:12 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 14:21:12 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 14:21:12 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 14:21:13 INFO - Downloading blobuploader-1.2.4.tar.gz 14:21:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:21:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:21:14 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 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 14:21:14 INFO - Downloading docopt-0.6.1.tar.gz 14:21:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:21:14 INFO - Installing collected packages: blobuploader, requests, docopt 14:21:14 INFO - Running setup.py install for blobuploader 14:21:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:21:14 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:21:14 INFO - Running setup.py install for requests 14:21:15 INFO - Running setup.py install for docopt 14:21:15 INFO - Successfully installed blobuploader requests docopt 14:21:15 INFO - Cleaning up... 14:21:15 INFO - Return code: 0 14:21:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:21:15 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')]} 14:21:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:15 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')]} 14:21:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:15 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 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:15 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 14:21:15 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 14:21:15 INFO - Using env: {'DISPLAY': ':0', 14:21:15 INFO - 'HOME': '/home/cltbld', 14:21:15 INFO - 'LANG': 'en_US.UTF-8', 14:21:15 INFO - 'LANGUAGE': 'en_US:en', 14:21:15 INFO - 'LOGNAME': 'cltbld', 14:21:15 INFO - 'MAIL': '/var/mail/cltbld', 14:21:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:15 INFO - 'MOZ_NO_REMOTE': '1', 14:21:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:15 INFO - 'NO_EM_RESTART': '1', 14:21:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:15 INFO - 'PWD': '/builds/slave/test', 14:21:15 INFO - 'SHELL': '/bin/bash', 14:21:15 INFO - 'SHLVL': '1', 14:21:15 INFO - 'TERM': 'linux', 14:21:15 INFO - 'TMOUT': '86400', 14:21:15 INFO - 'USER': 'cltbld', 14:21:15 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:15 INFO - '_': '/tools/buildbot/bin/python'} 14:21:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:21:15 INFO - Running setup.py (path:/tmp/pip-uPb1GR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:21:15 INFO - Running setup.py (path:/tmp/pip-Tr3bv8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:21:15 INFO - Running setup.py (path:/tmp/pip-aYPv9C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:21:15 INFO - Running setup.py (path:/tmp/pip-1UrKRG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:21:15 INFO - Running setup.py (path:/tmp/pip-5TM9hl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:21:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:21:15 INFO - Running setup.py (path:/tmp/pip-xS6oMs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:21:16 INFO - Running setup.py (path:/tmp/pip-q11qUj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:21:16 INFO - Running setup.py (path:/tmp/pip-ilurcZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:21:16 INFO - Running setup.py (path:/tmp/pip-UPqE3V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:21:16 INFO - Running setup.py (path:/tmp/pip-MLOtId-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:21:16 INFO - Running setup.py (path:/tmp/pip-ye48Uw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:21:16 INFO - Running setup.py (path:/tmp/pip-avI0Jb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:21:16 INFO - Running setup.py (path:/tmp/pip-D0llNQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:21:16 INFO - Running setup.py (path:/tmp/pip-X96nRC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:21:16 INFO - Running setup.py (path:/tmp/pip-xvmamN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:21:16 INFO - Running setup.py (path:/tmp/pip-FBCZE7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:21:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:21:16 INFO - Running setup.py (path:/tmp/pip-ZSCSz5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:21:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:21:16 INFO - Running setup.py install for manifestparser 14:21:16 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:21:16 INFO - Running setup.py install for mozcrash 14:21:16 INFO - Running setup.py install for mozdebug 14:21:17 INFO - Running setup.py install for mozdevice 14:21:17 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for mozfile 14:21:17 INFO - Running setup.py install for mozhttpd 14:21:17 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for mozinfo 14:21:17 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for mozInstall 14:21:17 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for mozleak 14:21:17 INFO - Running setup.py install for mozlog 14:21:17 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for moznetwork 14:21:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:21:17 INFO - Running setup.py install for mozprocess 14:21:18 INFO - Running setup.py install for mozprofile 14:21:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:21:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:21:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:21:18 INFO - Running setup.py install for mozrunner 14:21:18 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:21:18 INFO - Running setup.py install for mozscreenshot 14:21:18 INFO - Running setup.py install for moztest 14:21:18 INFO - Running setup.py install for mozversion 14:21:18 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:21:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:21:18 INFO - Cleaning up... 14:21:18 INFO - Return code: 0 14:21:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:21:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:21:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:18 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 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:18 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 14:21:18 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 14:21:18 INFO - Using env: {'DISPLAY': ':0', 14:21:18 INFO - 'HOME': '/home/cltbld', 14:21:18 INFO - 'LANG': 'en_US.UTF-8', 14:21:18 INFO - 'LANGUAGE': 'en_US:en', 14:21:18 INFO - 'LOGNAME': 'cltbld', 14:21:18 INFO - 'MAIL': '/var/mail/cltbld', 14:21:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:18 INFO - 'MOZ_NO_REMOTE': '1', 14:21:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:18 INFO - 'NO_EM_RESTART': '1', 14:21:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:18 INFO - 'PWD': '/builds/slave/test', 14:21:18 INFO - 'SHELL': '/bin/bash', 14:21:18 INFO - 'SHLVL': '1', 14:21:18 INFO - 'TERM': 'linux', 14:21:18 INFO - 'TMOUT': '86400', 14:21:18 INFO - 'USER': 'cltbld', 14:21:18 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:18 INFO - '_': '/tools/buildbot/bin/python'} 14:21:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:21:18 INFO - Running setup.py (path:/tmp/pip-cjdDvP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:21:18 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)) 14:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:21:18 INFO - Running setup.py (path:/tmp/pip-EGzDan-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:21:18 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)) 14:21:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:21:18 INFO - Running setup.py (path:/tmp/pip-ZxPpw9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:21:19 INFO - Running setup.py (path:/tmp/pip-diynEx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:21:19 INFO - Running setup.py (path:/tmp/pip-REuTyX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:21:19 INFO - Running setup.py (path:/tmp/pip-Ft1gwK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:21:19 INFO - Running setup.py (path:/tmp/pip-kYPhp2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:21:19 INFO - Running setup.py (path:/tmp/pip-Dc7xTA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:21:19 INFO - Running setup.py (path:/tmp/pip-Soge2r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:21:19 INFO - Running setup.py (path:/tmp/pip-jggxft-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:21:19 INFO - Running setup.py (path:/tmp/pip-ME3hEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:21:19 INFO - Running setup.py (path:/tmp/pip-4QLX6k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:21:19 INFO - Running setup.py (path:/tmp/pip-5zDezE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:21:19 INFO - Running setup.py (path:/tmp/pip-6N6WRa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:21:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:21:19 INFO - Running setup.py (path:/tmp/pip-ZbE0zj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:21:19 INFO - Running setup.py (path:/tmp/pip-TAHmi9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:21:19 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)) 14:21:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:21:19 INFO - Running setup.py (path:/tmp/pip-G_hbW5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:21:20 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)) 14:21:20 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)) 14:21:20 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)) 14:21:20 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)) 14:21:20 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)) 14:21:20 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)) 14:21:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:21:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:21:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:21:21 INFO - Downloading blessings-1.6.tar.gz 14:21:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:21:22 INFO - Installing collected packages: blessings 14:21:22 INFO - Running setup.py install for blessings 14:21:22 INFO - Successfully installed blessings 14:21:22 INFO - Cleaning up... 14:21:22 INFO - Return code: 0 14:21:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:21:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:21:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:21:22 INFO - Reading from file tmpfile_stdout 14:21:22 INFO - Current package versions: 14:21:22 INFO - argparse == 1.2.1 14:21:22 INFO - blessings == 1.6 14:21:22 INFO - blobuploader == 1.2.4 14:21:22 INFO - docopt == 0.6.1 14:21:22 INFO - functools32 == 3.2.3-2 14:21:22 INFO - jsonschema == 2.5.1 14:21:22 INFO - manifestparser == 1.1 14:21:22 INFO - mozInstall == 1.12 14:21:22 INFO - mozcrash == 0.17 14:21:22 INFO - mozdebug == 0.1 14:21:22 INFO - mozdevice == 0.48 14:21:22 INFO - mozfile == 1.2 14:21:22 INFO - mozhttpd == 0.7 14:21:22 INFO - mozinfo == 0.9 14:21:22 INFO - mozleak == 0.1 14:21:22 INFO - mozlog == 3.3 14:21:22 INFO - moznetwork == 0.27 14:21:22 INFO - mozprocess == 0.23 14:21:22 INFO - mozprofile == 0.28 14:21:22 INFO - mozrunner == 6.12 14:21:22 INFO - mozscreenshot == 0.1 14:21:22 INFO - mozsystemmonitor == 0.3 14:21:22 INFO - moztest == 0.7 14:21:22 INFO - mozversion == 1.4 14:21:22 INFO - psutil == 3.1.1 14:21:22 INFO - requests == 1.2.3 14:21:22 INFO - wsgiref == 0.1.2 14:21:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:21: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')]} 14:21:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21: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')]} 14:21:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21:22 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 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21:22 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 14:21:22 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 14:21:22 INFO - Using env: {'DISPLAY': ':0', 14:21:22 INFO - 'HOME': '/home/cltbld', 14:21:22 INFO - 'LANG': 'en_US.UTF-8', 14:21:22 INFO - 'LANGUAGE': 'en_US:en', 14:21:22 INFO - 'LOGNAME': 'cltbld', 14:21:22 INFO - 'MAIL': '/var/mail/cltbld', 14:21:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:22 INFO - 'MOZ_NO_REMOTE': '1', 14:21:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:22 INFO - 'NO_EM_RESTART': '1', 14:21:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:22 INFO - 'PWD': '/builds/slave/test', 14:21:22 INFO - 'SHELL': '/bin/bash', 14:21:22 INFO - 'SHLVL': '1', 14:21:22 INFO - 'TERM': 'linux', 14:21:22 INFO - 'TMOUT': '86400', 14:21:22 INFO - 'USER': 'cltbld', 14:21:22 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:22 INFO - '_': '/tools/buildbot/bin/python'} 14:21:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 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)) 14:21:22 INFO - Cleaning up... 14:21:22 INFO - Return code: 0 14:21:22 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:21: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')]} 14:21:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:21:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21: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')]} 14:21:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:21:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:21: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x228f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2550180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', '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 14:21: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', 'jsonschema'] in /builds/slave/test/build 14:21: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 jsonschema 14:21:22 INFO - Using env: {'DISPLAY': ':0', 14:21:22 INFO - 'HOME': '/home/cltbld', 14:21:22 INFO - 'LANG': 'en_US.UTF-8', 14:21:22 INFO - 'LANGUAGE': 'en_US:en', 14:21:22 INFO - 'LOGNAME': 'cltbld', 14:21:22 INFO - 'MAIL': '/var/mail/cltbld', 14:21:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:22 INFO - 'MOZ_NO_REMOTE': '1', 14:21:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:22 INFO - 'NO_EM_RESTART': '1', 14:21:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:22 INFO - 'PWD': '/builds/slave/test', 14:21:22 INFO - 'SHELL': '/bin/bash', 14:21:22 INFO - 'SHLVL': '1', 14:21:22 INFO - 'TERM': 'linux', 14:21:22 INFO - 'TMOUT': '86400', 14:21:22 INFO - 'USER': 'cltbld', 14:21:22 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:22 INFO - '_': '/tools/buildbot/bin/python'} 14:21:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:21:22 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:21:22 INFO - Cleaning up... 14:21:22 INFO - Return code: 0 14:21:22 INFO - Running post-action listener: _resource_record_post_action 14:21:22 INFO - Running post-action listener: _start_resource_monitoring 14:21:22 INFO - Starting resource monitoring. 14:21:22 INFO - [mozharness: 2016-08-02 21:21:22.862320Z] Finished create-virtualenv step (success) 14:21:22 INFO - [mozharness: 2016-08-02 21:21:22.878519Z] Running install step. 14:21:22 INFO - Running pre-action listener: _resource_record_pre_action 14:21:22 INFO - Running main action method: install 14:21:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:21:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:21:23 INFO - Reading from file tmpfile_stdout 14:21:23 INFO - Detecting whether we're running mozinstall >=1.0... 14:21:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:21:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:21:23 INFO - Reading from file tmpfile_stdout 14:21:23 INFO - Output received: 14:21:23 INFO - Usage: mozinstall [options] installer 14:21:23 INFO - Options: 14:21:23 INFO - -h, --help show this help message and exit 14:21:23 INFO - -d DEST, --destination=DEST 14:21:23 INFO - Directory to install application into. [default: 14:21:23 INFO - "/builds/slave/test"] 14:21:23 INFO - --app=APP Application being installed. [default: firefox] 14:21:23 INFO - mkdir: /builds/slave/test/build/application 14:21:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 14:21:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 14:21:40 INFO - Reading from file tmpfile_stdout 14:21:40 INFO - Output received: 14:21:40 INFO - /builds/slave/test/build/application/firefox/firefox 14:21:40 INFO - Running post-action listener: _resource_record_post_action 14:21:40 INFO - [mozharness: 2016-08-02 21:21:40.068232Z] Finished install step (success) 14:21:40 INFO - [mozharness: 2016-08-02 21:21:40.068513Z] Running run-tests step. 14:21:40 INFO - Running pre-action listener: _resource_record_pre_action 14:21:40 INFO - Running main action method: run_tests 14:21:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:21:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:21:40 INFO - Python 2.7.3 14:21:40 INFO - Return code: 0 14:21:40 INFO - grabbing minidump binary from tooltool 14:21:40 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')]} 14:21:40 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x254e3b0>, '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 0x254f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x254f740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:21:40 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 14:21:40 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 14:21:40 INFO - Calling ['/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'] with output_timeout 600 14:21:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:21:40 INFO - Return code: 0 14:21:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:21:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:21:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:21:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:21:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:21:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 14:21:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-034 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 14:21:40 INFO - Using env: {'DISPLAY': ':0', 14:21:40 INFO - 'HOME': '/home/cltbld', 14:21:40 INFO - 'LANG': 'en_US.UTF-8', 14:21:40 INFO - 'LANGUAGE': 'en_US:en', 14:21:40 INFO - 'LOGNAME': 'cltbld', 14:21:40 INFO - 'MAIL': '/var/mail/cltbld', 14:21:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:21:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:21:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:21:40 INFO - 'MOZ_NO_REMOTE': '1', 14:21:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:21:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:21:40 INFO - 'NO_EM_RESTART': '1', 14:21:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:21:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:21:40 INFO - 'PWD': '/builds/slave/test', 14:21:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:21:40 INFO - 'SHELL': '/bin/bash', 14:21:40 INFO - 'SHLVL': '1', 14:21:40 INFO - 'TERM': 'linux', 14:21:40 INFO - 'TMOUT': '86400', 14:21:40 INFO - 'USER': 'cltbld', 14:21:40 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967', 14:21:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:21:40 INFO - '_': '/tools/buildbot/bin/python'} 14:21:40 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 14:21:40 INFO - mozversion application_buildid: 20160802113011 14:21:40 INFO - mozversion application_changeset: 1460b360645d017f987e48b4f16f6c455f1e9e38 14:21:40 INFO - mozversion application_display_name: Nightly 14:21:40 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:21:40 INFO - mozversion application_name: Firefox 14:21:40 INFO - mozversion application_remotingname: firefox 14:21:40 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 14:21:40 INFO - mozversion application_vendor: Mozilla 14:21:40 INFO - mozversion application_version: 51.0a1 14:21:40 INFO - mozversion platform_buildid: 20160802113011 14:21:40 INFO - mozversion platform_changeset: 1460b360645d017f987e48b4f16f6c455f1e9e38 14:21:40 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 14:21:40 INFO - mozversion platform_version: 51.0a1 14:21:40 INFO - using testdate: 1470172900 14:21:40 INFO - actual date: 1470172900 14:21:40 INFO - starting webserver on 'localhost:52468' 14:21:40 INFO - SUITE-START | Running 2 tests 14:21:40 INFO - TEST-START | dromaeo_css 14:21:40 INFO - operating with platform_type : linux_ 14:21:40 INFO - Initialising browser for dromaeo_css test... 14:21:40 INFO - TEST-INFO | started process 11292 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdzKxVA/profile http://localhost:52468/getInfo.html) 14:21:44 INFO - PROCESS | 11292 | __metrics Screen width/height:1600/1200 14:21:44 INFO - PROCESS | 11292 | colorDepth:24 14:21:44 INFO - PROCESS | 11292 | Browser inner width/height: 1024/697 14:21:44 INFO - PROCESS | 11292 | __metrics 14:21:45 INFO - PROCESS | 11292 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 14:21:45 INFO - PROCESS | 11292 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:21:46 INFO - TEST-INFO | 11292: exit 0 14:21:46 INFO - Browser initialized. 14:21:46 INFO - Running cycle 1/1 for dromaeo_css test... 14:21:46 INFO - TEST-INFO | started process 11370 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdzKxVA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:21:58 INFO - PROCESS | 11370 | RSS: Main: 156553216 14:21:58 INFO - PROCESS | 11370 | 14:22:48 INFO - PROCESS | 11370 | 1470172968704 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] 14:24:57 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52468/tests/dromaeo/cssquery-ext.html) 14:24:58 INFO - PROCESS | 11370 | RSS: Main: 273440768 14:24:58 INFO - PROCESS | 11370 | 14:28:01 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-ext.html (next: http://localhost:52468/tests/dromaeo/cssquery-jquery.html) 14:28:01 INFO - PROCESS | 11370 | RSS: Main: 245276672 14:28:01 INFO - PROCESS | 11370 | 14:31:03 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52468/tests/dromaeo/cssquery-mootools.html) 14:31:04 INFO - PROCESS | 11370 | RSS: Main: 226054144 14:31:04 INFO - PROCESS | 11370 | 14:34:06 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52468/tests/dromaeo/cssquery-prototype.html) 14:34:07 INFO - PROCESS | 11370 | RSS: Main: 235479040 14:34:07 INFO - PROCESS | 11370 | 14:37:09 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52468/tests/dromaeo/cssquery-yui.html) 14:37:10 INFO - PROCESS | 11370 | RSS: Main: 185974784 14:37:10 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | Cycle 1(1): loaded http://localhost:52468/tests/dromaeo/cssquery-yui.html (next: http://localhost:52468/tests/dromaeo/cssquery-dojo.html) 14:40:13 INFO - PROCESS | 11370 | RSS: Main: 279941120 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | __start_tp_report 14:40:13 INFO - PROCESS | 11370 | _x_x_mozilla_page_load 14:40:13 INFO - PROCESS | 11370 | _x_x_mozilla_page_load_details 14:40:13 INFO - PROCESS | 11370 | |i|pagename|runs| 14:40:13 INFO - PROCESS | 11370 | |0;dojo.html;3020.5318175682764;3020.7583393328537;3031.939361212774;3054.1906394805364;3064.678208788077;5221.347331583552;5273.736313184345;5299.788008479661;5382.89234215316;5430.864228394292;5291.126964050927;5303.257543943851;5332.813351532697;5335.626506144571;5365.570754339653;4771.403574553189;4830.806767729287;4859.198232291686;4863.221884498481;5029.446760856303;4950.133726597849;4969.850904472872;4999.725015124167;5010.524000219992;5017.52333528316;4717.740524271164;4765.380500534909;4791.616670666356;4817.205161148407;4918.532739389752;4816.951830481686;4818.783154758009;4832.782524786393;4888.755562221911;4927.6550641455115;4860.586850117745;4870.220764677634;4878.829240976549;4881.243407271879;4886.731229782361;5155.845324640267;5272.077386457355;5328.600354973392;5348.893022139536;5376.247325374451;5671.06427439472;5743.655380677173;5754.539636829086;5766.423357664242;5776.566757493163;5767.682777447239;5790.594658373915;5800.680962547058;5806.854828629276;5812.738426770806;5134.204198349262;5189.558887494568;5230.8692282692855;5253.264542964026;5349.786008559614;5794.652320860761;5841.328247251536;5857.912131318034;5861.3552509223955;5862.208601838783;5584;5607.747651355618;5631.605787594829;5636.2391077204875;5637.46444087811;5552.139418390156;5626.718664066862;5688.857778555486;5698.943010569841;5776.913346299809;5669.064604340238;5671.149327600893;5679.517241034476;5694.231278777312;5696.914546281809;5669.688167150846;5705.572082093777;5709.857253568694;5711.828645140569;5716.1997320375185;4258.403823464718;4338.132373525307;4357.281048626941;4372.103718737651;4426.734395936254;3891.20230352777;3893.8637147699696;3900.7464514806447;3925.21495700861;3931.5282166140246;5413.485718856702;5417.729113544307;5421.159720243369;5425.403205647375;5426.67439953604;5574.080276754371;5637.746301416446;5676.148577713376;5686.317641883001;5771.538276937835;5365.919511207335;5396.055690254189;5397.055515284809;5397.298351214317;5402.135658294733;4880.804767809248;4883.633727470454;4890.070886531547;4900.97079613278;4940.110780059624;5710.029295019856;5800.361960184377;5850.414958504116;5858.443447872445;5950.107483877453;5670.773169073191;5677.829665110054;5680.460356266148;5682.403347648437;5685.516731077904;5899.410058994238;5903.350631430625;5906.379830117948;5908.468237858441;5909.438603332676;5373.650712703662;5672.7163641816915;5720.456556627114;5754.136879467946;5762.798302059407;5752.482276595127;5789;5801.274840644919;5804.6807425592;5805.622634528742;5649.519790817826;5656.095024796013;5657.4908258256955;5659.179418984307;5660.349059858169;5358.919616205838;5515.806946757005;5555.555555555465;5573.052581061148;5654.40628733977;5582.637128586629;5585.748641311232;5586.16207568868;5589.329280486368;5592.804251851166;5625.887482250414;5629.240052593012;5683.5453163747625;5690;5693.402192769865;5350.545203657733;5355.464453554613;5422.8373148805595;5472.452754724496;5515.669059856422 14:40:13 INFO - PROCESS | 11370 | |1;ext.html;593.3769541980919;597.2593983460505;608.3490664988462;608.6834845880139;630.136712703596;33547.16132096696;34131.65868341316;36598.26803463929;36705.81647091764;49331.75334123324;48836.51163488364;49102.99999999991;49258.50741492584;49292.26061609079;49298.75350623251;8971.506567138806;9112.271018318519;9133.908660913372;9141.497217653026;9145.542722863864;8985.101489850995;9072.954635226815;9077.818443631124;9078.546072696372;9087.045860184684;9046.638134474613;9114.635414583441;9118.452892826419;9121.17909388155;9121.680741174061;9010.59452324647;9044.502552359618;9056.366054376196;9065.95467022664;9066.274698024143;8936.821263574757;8979.68571100015;9001;9008.279337652972;9008.819823603491;44666.55333446657;45194;45209.54790452086;45213;45213.32180017302;3487.186593682888;3650.9634903651154;3739.0652336915773;4004.599540046001;4335.458067741532;33677.15807104817;34421.655783442344;35031.29937401238;35038.29923401543;35192.648073519194;4450.910981780378;4452.287633978548;4473.709208901443;4486.080353527519;4625.398698169251;352052;354791;357608;358278;358947.9999999974;58600;59489.40510594839;59765.103523447186;59819.504512386666;59830.10254846181;64595.832333413215;64865;64879;65077.67461162664;65318;15107.244637768068;15174.772378414333;15189.392424302903;15198.696026079637;15203.467878624417;13117.475300987853;13167.868321316855;13194.604161875159;13223.801642975362;13237.867621323856;16711.331546738238;18065.367712130013;18080.197569376767;18121.54696132581;18164.456021238344;6740.258571557125;6753.2909044549615;6790.8302292442095;6826.385625293748;6847.349501797321;981.4945303168873;1055.9788804224027;1056.1761825775907;1143.731223162556;1181.8227265910182;33454.83272583621;33703.662963370545;33925.49111763325;33961;33999.4900076499;971.2569884038716;1108.2076315434504;1131.4908291268962;1147.9540818367173;1229.3975951783561;16436.75344869804;17195.57011074708;17295.74056389155;17392.3043078278;17395.217215225344;577431;581854;581982;584849;585350;62311;62448.687756560925;62480.375196247456;62575.37424625787;62692;1238.486028298264;1343.603636927109;1371.2184055088703;1371.615947534692;1412.5197432872872;33544.1613959653;34899;35058;35127;35502.8224858874;52697;53429.46570534245;53515.73242133764;53560.46439535555;53631.731841340545;413064;414004;415789;416323;416817;28510.57234141448;29609.555856661736;29698.703012970458;30986.53520197154;31194.22014449657;50384.496155039444;51029;51217;51271.48728512667;53176.46823531715;42479.362809557264;43630.34554481749;43722;43877.78061109674;45414.772926135156;42909;43621.781891090344;43990.580518071816;44543.33185002163;44619.776901115285;43075;43499.13001740011;44097;44575;44644;34689;37615;38059.42910856395;38180.80909595434;39223;28441.43117137687;29124.563131553467;29677.851610741807;29704.554431683973;29895.402091957603 14:40:13 INFO - PROCESS | 11370 | |2;jquery.html;377.10625816814155;392.7663040490907;395.2332474998503;406.577159753856;422.1493690214219;16338.591535211626;19643.5089122772;19839.702404463926;20078.598428031466;20486.692699609517;12591.748165036694;12686.61940141795;12761.553345632905;12810.29543375114;12845.550405735801;5304.045271851075;5484.177373393983;5493.972530137344;5495.450454954513;5499.065158922973;5401.054815407308;5405.918911216335;5646.858828529279;5888.381719919411;5932.970335148319;5984.491318237955;5991.490723288525;5993.4006599340155;5994.100884867261;5999.040153575429;5801.564882633798;5825.825225243249;5835.212246346752;5886.499647529965;5887.499562537189;5513.8345849624575;5744.425557444264;5748.7987920423;5753.280839895013;5753.971230143864;13843.930780346034;14017.509387171502;22354.888225558767;22589.774102259096;23492.647610285858;2440.487497625501;2468.666729991446;2503.9499210015697;2767.5433553463654;3051;10380.740481487948;10517.376600410615;10860.6198783043;10878.891211087946;11030.613928512463;1829.9817001830077;1865.1886429403116;1927.267638297438;2081.08432289792;2083.3854013066184;80993.59503202446;83812.58093709493;85931.57034214851;86065.56967215124;86237.56881215617;11220.495077721358;11226.316052592176;11467.483963221675;11484.081273498101;11545.191836571528;15938;15953.202339882959;15957.44148954781;15974.840251597569;15985.760213596805;8159.020917489939;8381.790455238668;8410.495370277802;8492.278156356655;8530.445521041112;7885.369170466349;7993.160718124629;8057.59712014397;8208.343332533503;8238.50568965864;4852.17513022787;4869.415670119608;4898.387701537308;4920.384951881015;5051.646384753032;1936.1190658250462;2039.2862498125835;2044.2606906745034;2050.8359331253764;2066.7519897612383;895.9417637853519;987.2792861211356;1001.8046480936293;1002.5688953749958;1041.6406339812752;19396.321128760424;19932.402027939184;19948.800511994694;20013.199472021246;20073.29743459001;998.3909815012836;1004.6634377483479;1006.5671761142779;1010.6008126790024;1052.2476429353048;10436.37381757097;10939.617113400993;11041.503132359063;11157.776844463066;11177.776444471065;452795;455937;456565;474634;475631;67056;82817.58591207005;84524;91042;92986;1014.7970405918845;1015.3653966271081;1045.7699306152633;1076.332673742285;1087.9619213327653;16088.356465741239;16899.831001690316;17355.2190151446;17634.5591360217;17971.820281797016;42581.57418425776;42957.355639664805;42983.78508107439;43717.344239835795;44537.33194002158;60771.392286076574;61217.69391153016;61361.693191533755;61883.690581546805;61936;8565.871511927202;8678.566071696516;8863.290936724918;8879.200871921557;8944.552772361487;11371.943140284246;13025.153365031243;13101.606951791462;13234.801477978031;13347.265900375183;11422.714432139262;11473.885261147616;11939.283642981449;12210.633680989584;12223.327716975651;11408.54365825391;11502.654920352068;11686.065114790626;11790.41047947582;11895.82156267674;11321.207515474167;11806.409679515818;11868.525258989888;11948.880511195124;11998.340091295062;8217.630206640835;8254.669813207405;8309.293710034715;8362.372822038249;8601.6989405373;9253.814923701622;10676.199285053808;10767.515461804394;11193.552257909592;11541.82687259675 14:40:13 INFO - PROCESS | 11370 | |3;mootools.html;1300.2718477652509;1453.2443129572623;1519.3998370643596;1633.6242664187237;1798.3256278895415;8397.496150230983;8659.740207793768;8750.387472876893;8753.343499237551;8973.461592304466;8503.829923401529;8685.044645089036;8895.066018068106;8906.153915378045;8909.777255568613;2375.275540960011;2428.611422172453;2428.854268743872;2429;2429.720582133051;2315.455867871049;2354.96467552986;2384.332386931662;2387.319613910036;2388.176079252655;2348.156696992861;2364.0189321431585;2370.5140446208484;2420.044082587377;2426.2721183644926;2329.219711396684;2332.4285550040263;2341.321016905087;2342.8594284342907;2372.430616652008;2288.828337874666;2310.849794763335;2316.745158032615;2322.454223257533;2353.4822339085545;8852.247558957431;8855.424397414148;8974.50640214788;8976.371653984224;8976.41653292534;5264.52619264268;5490.286262785852;5497.312835895513;5499.395066542677;5499.890002199933;3326.3513614845115;3364.4785058315756;3409.4827801628285;3428.0572842468273;3438.1060924159647;1213.2417239225483;1217.2696382170716;1219.780439520886;1241.540629966909;2211.259228158569;12115.39423028845;12655.493780248778;12659.493620255178;12660.17708848922;12664.050196235226;4807.326974223612;4895.510448955076;4898.559129678346;4948.38145231846;4961.4294356148785;10813.243072984815;10813.405262710627;10826;10836.783264334668;10841.295315804447;5433.429489903582;5453.400125986138;5460.017196904516;5462.863428414322;5501.339839219239;4316.417283666728;4452.532484089189;4917.975410122926;4964.478729733398;4995.200767877195;4155.231282212801;4177.391492649672;4227.746335219835;4251.723637963584;4270.914581708348;1292.9935350323187;1323.371398585664;1335.2656039178607;1335.9759963654876;1337.7057047449546;918.6876462002817;945.3004776465366;1020.6070662794729;1037.6316407675317;1042.3641578637025;5958.910616340759;5966.552508561876;6155.815325540241;6331.68341582919;6334.809955701337;460.3876843797741;463.25647336025867;467.4437419470819;490.36008009547885;491.5109466081272;4074.348104303297;4177.624013838769;4256.893577660583;4269.082147338275;4397.032652816375;11174.720631984103;11318.207725459139;11359.034482068952;11454.828177577343;11461;11312.208145429906;11321.094312454983;11343.43282835855;11346.262492937933;11350.31898086101;7993.960030199928;8300.418970672115;8384.077751447336;8462.449940753831;8479.19447652472;6030.48740857032;6094.177286066324;6098.969505152446;6136.478399335928;6155;10382.532786024798;10485.52815123306;10515.369077855354;10539.26225164231;10642.467876605984;9469.526523673927;9509.096635819586;10328.690139295833;10629.9468502657;10761.246712730346;7608.391328693802;7914.169012253861;7947.205279472007;7949.364050876032;7958.403119765925;8649.827003460021;8671.479711217347;8701.95649021776;8717.302615790595;8737.650493980169;7550.924490755022;7711.267429594404;7761.534307941542;7776.261255180749;7964;7035.210778526335;7039.648017598997;7549.09410870677;7579.469437139347;7621.961890190513;7049.330313620198;7054.329838665319;7120.145582530129;7135.571865688075;7142.071530700976;5271.1039123348355;5312.28284181646;5383.892322153613;5395.838124856261;5533.418991006048;5337.492938170868;5344.839654810362;5402.189671549299;5456.48163424474;5610.5231055360755 14:40:13 INFO - PROCESS | 11370 | |4;prototype.html;321.31500788985664;339.6196260188589;346.25727813839313;346.57717584546845;347.0456245325354;5164.147915593927;5204.791808327667;5219.1649336106275;5224.21636754487;5243.554297884675;5097.770600322985;5117.437081920985;5136.2038883972955;5138.563222126115;5146.408163061249;4105.794710264489;4111.321631930728;4134.917301653965;4151.315033019563;4161.292580261363;3777.6411240932066;3940.6650434713083;4112.38314252863;4112.745612588159;4123.876283711494;4031.1131551058866;4055.2092341993325;4079.8572049978256;4085.162541678949;4094.5905409459115;4106.733062350938;4109.260333140033;4110.630043296088;4143.81352839123;4147.834086636531;3521.260535287567;3526.7002304804123;3539.507852108322;3623.166671665532;3624.6375362463805;4998;5025.7235852028125;5030.270610761456;5036.143855544529;5052;4687.578068010337;4696.976515117437;4697.637685071325;4705.1530724469585;4739.691920025221;5280.392754833205;5336.43967383423;5346.732663366816;5354;5360.383555891083;3979.1047014421815;3987.6211759882763;3992.121733218687;3993.520777506718;4019.678425725935;5283.63014588979;5522.502974732253;5604.943950560483;5663;5675.659460432346;3992.500937382827;4002.779847108379;4058.817353219112;4106;4141.565135660772;4164;4205.600467955539;4210.410542524049;4213.641840443535;4216.47294088239;4704.341392205094;4708.176069187947;4722.315264286659;4728.148933191989;4731.195696731564;5179.249008893689;5383.7308134593895;5385.676859388449;5469.206964990054;5491.725413729378;1426.7717165253716;1439.3522914688433;1443.1124858212333;1443.8411774704985;1444.4222311075655;895.8880139982502;933.2767105493161;933.537898740128;953.3993584042009;961.4327546747453;4613.746243956614;4613.95386046142;4647.604953578916;4679.298105284234;4697.6711630185555;4911.484294149134;4917.508249175054;4922.876928076755;4956.3804524434445;4975.527324904128;4693.929591056137;4695.309688512133;4717.764111794397;4721.504242054603;4912.557869791736;2937.6621688506098;2970.8366039868015;2972.5689774982507;2976.925576860596;2987.716166964135;5801.274840644919;5806.709664516758;5811.738471768696;5816.0338227503435;5823.388544202798;5556.555475561945;5644.379118296984;5672.52514346273;5686.886262274814;5699.145128230799;5511.448855114537;5592.3009623797025;5657.490825825777;5726.370099289158;5789.015867302569;5498.45015498447;5513.283273174462;5513.972430137824;5523.447655234444;5527.668339899619;5225.320708307896;5430.212619170277;5452.6183167177915;5478.698671572943;5488.451154884479;5730.656160630376;5761.8559536011935;5805.738741756547;5808.157817116579;5809.257222833217;4032.153247817991;4047.959520404758;4053.533843608023;4054.533728621246;4090.6931980101017;5372.570194384518;5572.219889215432;5671.773129074791;5672.007398705127;5685.260916080883;5435.537979271648;5438;5467.535259502987;5471.2613797138465;5478.260434841245;5327.520523152934;5400.648957817729;5464.235007099089;5465.59008074388;5478.150886612581;5237.847673511974;5359.196120581944;5400.351957765093;5425.267588875451;5446.121088224556;5380.166074258496;5441.483059109379;5455.181722741462;5463.399026107205;5465.672059676433;5165.502004418677;5308.893822123458;5350.30446042012;5378.838634840961;5381.48875856793 14:40:13 INFO - PROCESS | 11370 | |5;yui.html;757.0801476206408;779.294738261873;783.4594130050265;803.6022169026332;833.0836080311658;15693.21533923305;16058.5985350366;16735.497935061936;16746.916265418688;16766.077865717394;15149.394024239018;15345.30946107425;15386.769058475324;15398.69202615947;15441.922790386061;678.1252184681755;809.6235250608465;813.4834380168606;830.0869044051525;830.9875351869697;832.81261716114;838.2958315015386;840.861257892447;841.4572600672593;842.6250318608222;877.1973644115658;879.2174964281794;879.2614204068581;880.366136381804;881.0968757024069;699.7096205074888;839.2446797881894;873.3449912565576;874.1215078845751;874.3049275825733;632.6520413772407;633.0283015571076;634.8984162534018;637.9075034120073;638.0301941049624;15269.160196189205;15296.158711270875;15360.615984600363;15363.078215307005;15405;14508.419663213564;14560;14806.185659788815;14807.333669984877;15085.47200847965;13671.794923076162;13876.791848122286;13942.651433714136;14114.717705645933;14497.56507304772;4267.274563324242;4293.855805271283;4295.656347492193;4298.634616057639;4417.801198946023;85109;85907.14092859054;86106.56946715227;88987;90621;11553.826692599618;11571.884281157081;11649.301041937511;11763.470643821049;11961.40192990347;21185.576288474145;21198.47003824886;21237.256696015564;21265.36203913885;21266.149354025667;8808.955955220183;8930.642774288955;8957.417767845069;9123.589438475152;9305.860412093823;4935.21036634144;4963.611496570784;4975.402951645753;5041.218611115283;5041.319421878073;3485.3029394121277;3547.3260080584605;3596.8201589920923;3598.6581274778855;3606.765560238576;592.2460558403372;595.2648479128273;600.0279547133672;600.051917969607;607.1378642327905;629.6851574212893;669.6250099944046;674.4199988010307;704.2077662629541;706.4666177036305;9434.528273586293;9612.903870961201;9678.70963871085;9702.126808587262;9777.168940640126;592.5496622566881;688.0985908459934;691.1153723234269;715.0954043135438;718.2099690340583;4634.0036892068365;4967.205247160509;4982.227754698028;5020.121478741279;5038.798448062036;125681;126337.36831315784;127511.36244318905;129201;131764;62341.376586234466;88221;105838;108703;109219;94575.52712236394;95419.52290238504;96975;97144.51427742816;98631.50684246677;8875.822483550422;9120.315976301672;9145.3598248122;9210.728501112833;9236.769080773034;54199.45800541944;54896.725516372164;55494;56293.71853140708;56800.715996419756;47430.76284618693;47587.52412475831;69012;80721;80778.19221807942;10479.738006549896;10482.056614904695;10628;11069.833952490559;12980.480780768663;14074;14838.480653177086;14887.776683349975;15026.398944042116;15382.923085384502;13931.58205253844;14005.1596904182;14299.928500357431;14652;15226.467073652811;14207.573772786833;14287.357068932131;14689.41242350294;15072;15669;14203.218822964836;14284.285785710881;14677.633059173178;14685.632859178606;14716.484923027643;10417.389064466002;11045.171612128961;11228.66314010581;11290.379029153475;11803.055755539708;10616.991385818335;11072.667819965414;11768.35274059935;11960.222585531912;11963.521459141537 14:40:13 INFO - PROCESS | 11370 | __end_tp_report 14:40:13 INFO - PROCESS | 11370 | __start_cc_report 14:40:13 INFO - PROCESS | 11370 | _x_x_mozilla_cycle_collect,1034 14:40:13 INFO - PROCESS | 11370 | __end_cc_report 14:40:13 INFO - PROCESS | 11370 | __startTimestamp1470174013320__endTimestamp 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | ------- Summary: start ------- 14:40:13 INFO - PROCESS | 11370 | Number of tests: 6 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#0] dojo.html Cycles:165 Average:5304.01 Median:5515.81 stddev:608.18 (11.0%) stddev-sans-first:583.07 14:40:13 INFO - PROCESS | 11370 | Values: 3020.5 3020.8 3031.9 3054.2 3064.7 5221.3 5273.7 5299.8 5382.9 5430.9 5291.1 5303.3 5332.8 5335.6 5365.6 4771.4 4830.8 4859.2 4863.2 5029.4 4950.1 4969.9 4999.7 5010.5 5017.5 4717.7 4765.4 4791.6 4817.2 4918.5 4817.0 4818.8 4832.8 4888.8 4927.7 4860.6 4870.2 4878.8 4881.2 4886.7 5155.8 5272.1 5328.6 5348.9 5376.2 5671.1 5743.7 5754.5 5766.4 5776.6 5767.7 5790.6 5800.7 5806.9 5812.7 5134.2 5189.6 5230.9 5253.3 5349.8 5794.7 5841.3 5857.9 5861.4 5862.2 5584.0 5607.7 5631.6 5636.2 5637.5 5552.1 5626.7 5688.9 5698.9 5776.9 5669.1 5671.1 5679.5 5694.2 5696.9 5669.7 5705.6 5709.9 5711.8 5716.2 4258.4 4338.1 4357.3 4372.1 4426.7 3891.2 3893.9 3900.7 3925.2 3931.5 5413.5 5417.7 5421.2 5425.4 5426.7 5574.1 5637.7 5676.1 5686.3 5771.5 5365.9 5396.1 5397.1 5397.3 5402.1 4880.8 4883.6 4890.1 4901.0 4940.1 5710.0 5800.4 5850.4 5858.4 5950.1 5670.8 5677.8 5680.5 5682.4 5685.5 5899.4 5903.4 5906.4 5908.5 5909.4 5373.7 5672.7 5720.5 5754.1 5762.8 5752.5 5789.0 5801.3 5804.7 5805.6 5649.5 5656.1 5657.5 5659.2 5660.3 5358.9 5515.8 5555.6 5573.1 5654.4 5582.6 5585.7 5586.2 5589.3 5592.8 5625.9 5629.2 5683.5 5690.0 5693.4 5350.5 5355.5 5422.8 5472.5 5515.7 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#1] ext.html Cycles:180 Average:62160.41 Median:44043.79 stddev:122414.22 (277.9%) stddev-sans-first:122670.35 14:40:13 INFO - PROCESS | 11370 | Values: 593.4 597.3 608.3 608.7 630.1 33547.2 34131.7 36598.3 36705.8 49331.8 48836.5 49103.0 49258.5 49292.3 49298.8 8971.5 9112.3 9133.9 9141.5 9145.5 8985.1 9073.0 9077.8 9078.5 9087.0 9046.6 9114.6 9118.5 9121.2 9121.7 9010.6 9044.5 9056.4 9066.0 9066.3 8936.8 8979.7 9001.0 9008.3 9008.8 44666.6 45194.0 45209.5 45213.0 45213.3 3487.2 3651.0 3739.1 4004.6 4335.5 33677.2 34421.7 35031.3 35038.3 35192.6 4450.9 4452.3 4473.7 4486.1 4625.4 352052.0 354791.0 357608.0 358278.0 358948.0 58600.0 59489.4 59765.1 59819.5 59830.1 64595.8 64865.0 64879.0 65077.7 65318.0 15107.2 15174.8 15189.4 15198.7 15203.5 13117.5 13167.9 13194.6 13223.8 13237.9 16711.3 18065.4 18080.2 18121.5 18164.5 6740.3 6753.3 6790.8 6826.4 6847.3 981.5 1056.0 1056.2 1143.7 1181.8 33454.8 33703.7 33925.5 33961.0 33999.5 971.3 1108.2 1131.5 1148.0 1229.4 16436.8 17195.6 17295.7 17392.3 17395.2 577431.0 581854.0 581982.0 584849.0 585350.0 62311.0 62448.7 62480.4 62575.4 62692.0 1238.5 1343.6 1371.2 1371.6 1412.5 33544.2 34899.0 35058.0 35127.0 35502.8 52697.0 53429.5 53515.7 53560.5 53631.7 413064.0 414004.0 415789.0 416323.0 416817.0 28510.6 29609.6 29698.7 30986.5 31194.2 50384.5 51029.0 51217.0 51271.5 53176.5 42479.4 43630.3 43722.0 43877.8 45414.8 42909.0 43621.8 43990.6 44543.3 44619.8 43075.0 43499.1 44097.0 44575.0 44644.0 34689.0 37615.0 38059.4 38180.8 39223.0 28441.4 29124.6 29677.9 29704.6 29895.4 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#2] jquery.html Cycles:180 Average:28045.22 Median:12966.57 stddev:76512.96 (590.1%) stddev-sans-first:76699.40 14:40:13 INFO - PROCESS | 11370 | Values: 377.1 392.8 395.2 406.6 422.1 16338.6 19643.5 19839.7 20078.6 20486.7 12591.7 12686.6 12761.6 12810.3 12845.6 5304.0 5484.2 5494.0 5495.5 5499.1 5401.1 5405.9 5646.9 5888.4 5933.0 5984.5 5991.5 5993.4 5994.1 5999.0 5801.6 5825.8 5835.2 5886.5 5887.5 5513.8 5744.4 5748.8 5753.3 5754.0 13843.9 14017.5 22354.9 22589.8 23492.6 2440.5 2468.7 2503.9 2767.5 3051.0 10380.7 10517.4 10860.6 10878.9 11030.6 1830.0 1865.2 1927.3 2081.1 2083.4 80993.6 83812.6 85931.6 86065.6 86237.6 11220.5 11226.3 11467.5 11484.1 11545.2 15938.0 15953.2 15957.4 15974.8 15985.8 8159.0 8381.8 8410.5 8492.3 8530.4 7885.4 7993.2 8057.6 8208.3 8238.5 4852.2 4869.4 4898.4 4920.4 5051.6 1936.1 2039.3 2044.3 2050.8 2066.8 895.9 987.3 1001.8 1002.6 1041.6 19396.3 19932.4 19948.8 20013.2 20073.3 998.4 1004.7 1006.6 1010.6 1052.2 10436.4 10939.6 11041.5 11157.8 11177.8 452795.0 455937.0 456565.0 474634.0 475631.0 67056.0 82817.6 84524.0 91042.0 92986.0 1014.8 1015.4 1045.8 1076.3 1088.0 16088.4 16899.8 17355.2 17634.6 17971.8 42581.6 42957.4 42983.8 43717.3 44537.3 60771.4 61217.7 61361.7 61883.7 61936.0 8565.9 8678.6 8863.3 8879.2 8944.6 11371.9 13025.2 13101.6 13234.8 13347.3 11422.7 11473.9 11939.3 12210.6 12223.3 11408.5 11502.7 11686.1 11790.4 11895.8 11321.2 11806.4 11868.5 11948.9 11998.3 8217.6 8254.7 8309.3 8362.4 8601.7 9253.8 10676.2 10767.5 11193.6 11541.8 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#3] mootools.html Cycles:180 Average:5924.52 Median:2637.39 stddev:3380.33 (128.2%) stddev-sans-first:3371.95 14:40:13 INFO - PROCESS | 11370 | Values: 1300.3 1453.2 1519.4 1633.6 1798.3 8397.5 8659.7 8750.4 8753.3 8973.5 8503.8 8685.0 8895.1 8906.2 8909.8 2375.3 2428.6 2428.9 2429.0 2429.7 2315.5 2355.0 2384.3 2387.3 2388.2 2348.2 2364.0 2370.5 2420.0 2426.3 2329.2 2332.4 2341.3 2342.9 2372.4 2288.8 2310.8 2316.7 2322.5 2353.5 8852.2 8855.4 8974.5 8976.4 8976.4 5264.5 5490.3 5497.3 5499.4 5499.9 3326.4 3364.5 3409.5 3428.1 3438.1 1213.2 1217.3 1219.8 1241.5 2211.3 12115.4 12655.5 12659.5 12660.2 12664.1 4807.3 4895.5 4898.6 4948.4 4961.4 10813.2 10813.4 10826.0 10836.8 10841.3 5433.4 5453.4 5460.0 5462.9 5501.3 4316.4 4452.5 4918.0 4964.5 4995.2 4155.2 4177.4 4227.7 4251.7 4270.9 1293.0 1323.4 1335.3 1336.0 1337.7 918.7 945.3 1020.6 1037.6 1042.4 5958.9 5966.6 6155.8 6331.7 6334.8 460.4 463.3 467.4 490.4 491.5 4074.3 4177.6 4256.9 4269.1 4397.0 11174.7 11318.2 11359.0 11454.8 11461.0 11312.2 11321.1 11343.4 11346.3 11350.3 7994.0 8300.4 8384.1 8462.4 8479.2 6030.5 6094.2 6099.0 6136.5 6155.0 10382.5 10485.5 10515.4 10539.3 10642.5 9469.5 9509.1 10328.7 10629.9 10761.2 7608.4 7914.2 7947.2 7949.4 7958.4 8649.8 8671.5 8702.0 8717.3 8737.7 7550.9 7711.3 7761.5 7776.3 7964.0 7035.2 7039.6 7549.1 7579.5 7622.0 7049.3 7054.3 7120.1 7135.6 7142.1 5271.1 5312.3 5383.9 5395.8 5533.4 5337.5 5344.8 5402.2 5456.5 5610.5 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#4] prototype.html Cycles:180 Average:4548.38 Median:5107.60 stddev:1309.36 (25.6%) stddev-sans-first:1274.02 14:40:13 INFO - PROCESS | 11370 | Values: 321.3 339.6 346.3 346.6 347.0 5164.1 5204.8 5219.2 5224.2 5243.6 5097.8 5117.4 5136.2 5138.6 5146.4 4105.8 4111.3 4134.9 4151.3 4161.3 3777.6 3940.7 4112.4 4112.7 4123.9 4031.1 4055.2 4079.9 4085.2 4094.6 4106.7 4109.3 4110.6 4143.8 4147.8 3521.3 3526.7 3539.5 3623.2 3624.6 4998.0 5025.7 5030.3 5036.1 5052.0 4687.6 4697.0 4697.6 4705.2 4739.7 5280.4 5336.4 5346.7 5354.0 5360.4 3979.1 3987.6 3992.1 3993.5 4019.7 5283.6 5522.5 5604.9 5663.0 5675.7 3992.5 4002.8 4058.8 4106.0 4141.6 4164.0 4205.6 4210.4 4213.6 4216.5 4704.3 4708.2 4722.3 4728.1 4731.2 5179.2 5383.7 5385.7 5469.2 5491.7 1426.8 1439.4 1443.1 1443.8 1444.4 895.9 933.3 933.5 953.4 961.4 4613.7 4614.0 4647.6 4679.3 4697.7 4911.5 4917.5 4922.9 4956.4 4975.5 4693.9 4695.3 4717.8 4721.5 4912.6 2937.7 2970.8 2972.6 2976.9 2987.7 5801.3 5806.7 5811.7 5816.0 5823.4 5556.6 5644.4 5672.5 5686.9 5699.1 5511.4 5592.3 5657.5 5726.4 5789.0 5498.5 5513.3 5514.0 5523.4 5527.7 5225.3 5430.2 5452.6 5478.7 5488.5 5730.7 5761.9 5805.7 5808.2 5809.3 4032.2 4048.0 4053.5 4054.5 4090.7 5372.6 5572.2 5671.8 5672.0 5685.3 5435.5 5438.0 5467.5 5471.3 5478.3 5327.5 5400.6 5464.2 5465.6 5478.2 5237.8 5359.2 5400.4 5425.3 5446.1 5380.2 5441.5 5455.2 5463.4 5465.7 5165.5 5308.9 5350.3 5378.8 5381.5 14:40:13 INFO - PROCESS | 11370 | 14:40:13 INFO - PROCESS | 11370 | [#5] yui.html Cycles:180 Average:21692.41 Median:26261.37 stddev:31986.56 (121.8%) stddev-sans-first:32037.67 14:40:13 INFO - PROCESS | 11370 | Values: 757.1 779.3 783.5 803.6 833.1 15693.2 16058.6 16735.5 16746.9 16766.1 15149.4 15345.3 15386.8 15398.7 15441.9 678.1 809.6 813.5 830.1 831.0 832.8 838.3 840.9 841.5 842.6 877.2 879.2 879.3 880.4 881.1 699.7 839.2 873.3 874.1 874.3 632.7 633.0 634.9 637.9 638.0 15269.2 15296.2 15360.6 15363.1 15405.0 14508.4 14560.0 14806.2 14807.3 15085.5 13671.8 13876.8 13942.7 14114.7 14497.6 4267.3 4293.9 4295.7 4298.6 4417.8 85109.0 85907.1 86106.6 88987.0 90621.0 11553.8 11571.9 11649.3 11763.5 11961.4 21185.6 21198.5 21237.3 21265.4 21266.1 8809.0 8930.6 8957.4 9123.6 9305.9 4935.2 4963.6 4975.4 5041.2 5041.3 3485.3 3547.3 3596.8 3598.7 3606.8 592.2 595.3 600.0 600.1 607.1 629.7 669.6 674.4 704.2 706.5 9434.5 9612.9 9678.7 9702.1 9777.2 592.5 688.1 691.1 715.1 718.2 4634.0 4967.2 4982.2 5020.1 5038.8 125681.0 126337.4 127511.4 129201.0 131764.0 62341.4 88221.0 105838.0 108703.0 109219.0 94575.5 95419.5 96975.0 97144.5 98631.5 8875.8 9120.3 9145.4 9210.7 9236.8 54199.5 54896.7 55494.0 56293.7 56800.7 47430.8 47587.5 69012.0 80721.0 80778.2 10479.7 10482.1 10628.0 11069.8 12980.5 14074.0 14838.5 14887.8 15026.4 15382.9 13931.6 14005.2 14299.9 14652.0 15226.5 14207.6 14287.4 14689.4 15072.0 15669.0 14203.2 14284.3 14677.6 14685.6 14716.5 10417.4 11045.2 11228.7 11290.4 11803.1 10617.0 11072.7 11768.4 11960.2 11963.5 14:40:13 INFO - PROCESS | 11370 | -------- Summary: end -------- 14:40:13 INFO - PROCESS | 11370 | 14:40:14 INFO - TEST-INFO | 11370: exit 0 14:40:14 INFO - TEST-OK | dromaeo_css | took 1113824ms 14:40:14 INFO - TEST-START | kraken 14:40:14 INFO - operating with platform_type : linux_ 14:40:14 INFO - Initialising browser for kraken test... 14:40:14 INFO - TEST-INFO | started process 11556 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsZUCDX/profile http://localhost:52468/getInfo.html) 14:40:18 INFO - PROCESS | 11556 | __metrics Screen width/height:1600/1200 14:40:18 INFO - PROCESS | 11556 | colorDepth:24 14:40:18 INFO - PROCESS | 11556 | Browser inner width/height: 1024/697 14:40:18 INFO - PROCESS | 11556 | __metrics 14:40:18 INFO - PROCESS | 11556 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 14:40:18 INFO - PROCESS | 11556 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:40:19 INFO - TEST-INFO | 11556: exit 0 14:40:19 INFO - Browser initialized. 14:40:19 INFO - Running cycle 1/1 for kraken test... 14:40:19 INFO - TEST-INFO | started process 11639 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsZUCDX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:40:31 INFO - PROCESS | 11639 | RSS: Main: 156352512 14:40:31 INFO - PROCESS | 11639 | 14:40:34 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52468/tests/kraken/driver.html?testName=audio-beat-detection) 14:40:35 INFO - PROCESS | 11639 | RSS: Main: 212897792 14:40:35 INFO - PROCESS | 11639 | 14:40:37 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52468/tests/kraken/driver.html?testName=audio-dft) 14:40:38 INFO - PROCESS | 11639 | RSS: Main: 186384384 14:40:38 INFO - PROCESS | 11639 | 14:40:41 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52468/tests/kraken/driver.html?testName=audio-fft) 14:40:42 INFO - PROCESS | 11639 | RSS: Main: 268988416 14:40:42 INFO - PROCESS | 11639 | 14:40:44 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52468/tests/kraken/driver.html?testName=audio-oscillator) 14:40:44 INFO - PROCESS | 11639 | RSS: Main: 179134464 14:40:44 INFO - PROCESS | 11639 | 14:40:47 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52468/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:40:47 INFO - PROCESS | 11639 | RSS: Main: 183832576 14:40:47 INFO - PROCESS | 11639 | 14:40:50 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52468/tests/kraken/driver.html?testName=imaging-darkroom) 14:40:51 INFO - PROCESS | 11639 | RSS: Main: 218853376 14:40:51 INFO - PROCESS | 11639 | 14:40:54 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52468/tests/kraken/driver.html?testName=imaging-desaturate) 14:40:55 INFO - PROCESS | 11639 | RSS: Main: 219074560 14:40:55 INFO - PROCESS | 11639 | 14:40:58 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52468/tests/kraken/driver.html?testName=json-parse-financial) 14:40:58 INFO - PROCESS | 11639 | RSS: Main: 219115520 14:40:58 INFO - PROCESS | 11639 | 14:41:00 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52468/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:41:00 INFO - PROCESS | 11639 | RSS: Main: 183681024 14:41:00 INFO - PROCESS | 11639 | 14:41:02 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:41:03 INFO - PROCESS | 11639 | RSS: Main: 189071360 14:41:03 INFO - PROCESS | 11639 | 14:41:05 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:41:05 INFO - PROCESS | 11639 | RSS: Main: 194441216 14:41:05 INFO - PROCESS | 11639 | 14:41:08 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:41:09 INFO - PROCESS | 11639 | RSS: Main: 188182528 14:41:09 INFO - PROCESS | 11639 | 14:41:11 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:41:12 INFO - PROCESS | 11639 | RSS: Main: 192606208 14:41:12 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | Cycle 1(1): loaded http://localhost:52468/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52468/tests/kraken/driver.html?testName=ai-astar) 14:41:14 INFO - PROCESS | 11639 | RSS: Main: 243494912 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | __start_tp_report 14:41:14 INFO - PROCESS | 11639 | _x_x_mozilla_page_load 14:41:14 INFO - PROCESS | 11639 | _x_x_mozilla_page_load_details 14:41:14 INFO - PROCESS | 11639 | |i|pagename|runs| 14:41:14 INFO - PROCESS | 11639 | |0;ai-astar;104;113;112;111;115;112;110;112;112;110 14:41:14 INFO - PROCESS | 11639 | |1;audio-beat-detection;146;119;131;185;122;124;139;119;159;119 14:41:14 INFO - PROCESS | 11639 | |2;audio-dft;161;160;162;162;161;161;162;162;161;162 14:41:14 INFO - PROCESS | 11639 | |3;audio-fft;75;75;76;105;78;76;75;75;99;74 14:41:14 INFO - PROCESS | 11639 | |4;audio-oscillator;85;85;119;86;85;86;122;84;85;132 14:41:14 INFO - PROCESS | 11639 | |5;imaging-gaussian-blur;117;117;116;117;117;116;117;117;117;117 14:41:14 INFO - PROCESS | 11639 | |6;imaging-darkroom;145;146;145;145;146;146;146;146;145;145 14:41:14 INFO - PROCESS | 11639 | |7;imaging-desaturate;95;95;95;96;95;94;95;95;95;95 14:41:14 INFO - PROCESS | 11639 | |8;json-parse-financial;50;50;50;50;49;51;51;51;50;49 14:41:14 INFO - PROCESS | 11639 | |9;json-stringify-tinderbox;60;61;61;60;62;61;60;61;61;61 14:41:14 INFO - PROCESS | 11639 | |10;stanford-crypto-aes;76;77;76;88;81;85;75;76;76;85 14:41:14 INFO - PROCESS | 11639 | |11;stanford-crypto-ccm;132;119;120;121;122;118;122;122;158;122 14:41:14 INFO - PROCESS | 11639 | |12;stanford-crypto-pbkdf2;169;164;162;164;162;161;160;158;161;159 14:41:14 INFO - PROCESS | 11639 | |13;stanford-crypto-sha256-iterative;62;62;62;63;62;62;63;63;62;61 14:41:14 INFO - PROCESS | 11639 | __end_tp_report 14:41:14 INFO - PROCESS | 11639 | __start_cc_report 14:41:14 INFO - PROCESS | 11639 | _x_x_mozilla_cycle_collect,1649 14:41:14 INFO - PROCESS | 11639 | __end_cc_report 14:41:14 INFO - PROCESS | 11639 | __startTimestamp1470174074257__endTimestamp 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | ------- Summary: start ------- 14:41:14 INFO - PROCESS | 11639 | Number of tests: 14 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#0] ai-astar Cycles:10 Average:111.10 Median:112.00 stddev:2.88 (2.6%) stddev-sans-first:1.54 14:41:14 INFO - PROCESS | 11639 | Values: 104.0 113.0 112.0 111.0 115.0 112.0 110.0 112.0 112.0 110.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#1] audio-beat-detection Cycles:10 Average:136.30 Median:135.00 stddev:21.78 (16.1%) stddev-sans-first:22.82 14:41:14 INFO - PROCESS | 11639 | Values: 146.0 119.0 131.0 185.0 122.0 124.0 139.0 119.0 159.0 119.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#2] audio-dft Cycles:10 Average:161.40 Median:162.00 stddev:0.70 (0.4%) stddev-sans-first:0.73 14:41:14 INFO - PROCESS | 11639 | Values: 161.0 160.0 162.0 162.0 161.0 161.0 162.0 162.0 161.0 162.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#3] audio-fft Cycles:10 Average:80.80 Median:75.50 stddev:11.31 (15.0%) stddev-sans-first:11.80 14:41:14 INFO - PROCESS | 11639 | Values: 75.0 75.0 76.0 105.0 78.0 76.0 75.0 75.0 99.0 74.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#4] audio-oscillator Cycles:10 Average:96.90 Median:85.00 stddev:19.21 (22.6%) stddev-sans-first:19.89 14:41:14 INFO - PROCESS | 11639 | Values: 85.0 85.0 119.0 86.0 85.0 86.0 122.0 84.0 85.0 132.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 14:41:14 INFO - PROCESS | 11639 | Values: 117.0 117.0 116.0 117.0 117.0 116.0 117.0 117.0 117.0 117.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#6] imaging-darkroom Cycles:10 Average:145.50 Median:146.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 14:41:14 INFO - PROCESS | 11639 | Values: 145.0 146.0 145.0 145.0 146.0 146.0 146.0 146.0 145.0 145.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.47 (0.5%) stddev-sans-first:0.50 14:41:14 INFO - PROCESS | 11639 | Values: 95.0 95.0 95.0 96.0 95.0 94.0 95.0 95.0 95.0 95.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#8] json-parse-financial Cycles:10 Average:50.10 Median:50.00 stddev:0.74 (1.5%) stddev-sans-first:0.78 14:41:14 INFO - PROCESS | 11639 | Values: 50.0 50.0 50.0 50.0 49.0 51.0 51.0 51.0 50.0 49.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#9] json-stringify-tinderbox Cycles:10 Average:60.80 Median:61.00 stddev:0.63 (1.0%) stddev-sans-first:0.60 14:41:14 INFO - PROCESS | 11639 | Values: 60.0 61.0 61.0 60.0 62.0 61.0 60.0 61.0 61.0 61.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#10] stanford-crypto-aes Cycles:10 Average:79.50 Median:79.00 stddev:4.84 (6.1%) stddev-sans-first:4.96 14:41:14 INFO - PROCESS | 11639 | Values: 76.0 77.0 76.0 88.0 81.0 85.0 75.0 76.0 76.0 85.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#11] stanford-crypto-ccm Cycles:10 Average:125.60 Median:122.00 stddev:12.00 (9.8%) stddev-sans-first:12.50 14:41:14 INFO - PROCESS | 11639 | Values: 132.0 119.0 120.0 121.0 122.0 118.0 122.0 122.0 158.0 122.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.00 Median:162.00 stddev:3.13 (1.9%) stddev-sans-first:2.05 14:41:14 INFO - PROCESS | 11639 | Values: 169.0 164.0 162.0 164.0 162.0 161.0 160.0 158.0 161.0 159.0 14:41:14 INFO - PROCESS | 11639 | 14:41:14 INFO - PROCESS | 11639 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.20 Median:62.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 14:41:14 INFO - PROCESS | 11639 | Values: 62.0 62.0 62.0 63.0 62.0 62.0 63.0 63.0 62.0 61.0 14:41:14 INFO - PROCESS | 11639 | -------- Summary: end -------- 14:41:14 INFO - PROCESS | 11639 | 14:41:15 INFO - TEST-INFO | 11639: exit 0 14:41:15 INFO - TEST-OK | kraken | took 61141ms 14:41:15 INFO - SUITE-END | took 1174s 14:41:15 INFO - Completed test suite (00:19:35) 14:41:15 INFO - javascript benchmark 14:41:15 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3020.5318175682764, 3020.7583393328537, 3031.939361212774, 3054.1906394805364, 3064.678208788077, 5221.347331583552, 5273.736313184345, 5299.788008479661, 5382.89234215316, 5430.864228394292, 5291.126964050927, 5303.257543943851, 5332.813351532697, 5335.626506144571, 5365.570754339653, 4771.403574553189, 4830.806767729287, 4859.198232291686, 4863.221884498481, 5029.446760856303, 4950.133726597849, 4969.850904472872, 4999.725015124167, 5010.524000219992, 5017.52333528316, 4717.740524271164, 4765.380500534909, 4791.616670666356, 4817.205161148407, 4918.532739389752, 4816.951830481686, 4818.783154758009, 4832.782524786393, 4888.755562221911, 4927.6550641455115, 4860.586850117745, 4870.220764677634, 4878.829240976549, 4881.243407271879, 4886.731229782361, 5155.845324640267, 5272.077386457355, 5328.600354973392, 5348.893022139536, 5376.247325374451, 5671.06427439472, 5743.655380677173, 5754.539636829086, 5766.423357664242, 5776.566757493163, 5767.682777447239, 5790.594658373915, 5800.680962547058, 5806.854828629276, 5812.738426770806, 5134.204198349262, 5189.558887494568, 5230.8692282692855, 5253.264542964026, 5349.786008559614, 5794.652320860761, 5841.328247251536, 5857.912131318034, 5861.3552509223955, 5862.208601838783, 5584.0, 5607.747651355618, 5631.605787594829, 5636.2391077204875, 5637.46444087811, 5552.139418390156, 5626.718664066862, 5688.857778555486, 5698.943010569841, 5776.913346299809, 5669.064604340238, 5671.149327600893, 5679.517241034476, 5694.231278777312, 5696.914546281809, 5669.688167150846, 5705.572082093777, 5709.857253568694, 5711.828645140569, 5716.1997320375185, 4258.403823464718, 4338.132373525307, 4357.281048626941, 4372.103718737651, 4426.734395936254, 3891.20230352777, 3893.8637147699696, 3900.7464514806447, 3925.21495700861, 3931.5282166140246, 5413.485718856702, 5417.729113544307, 5421.159720243369, 5425.403205647375, 5426.67439953604, 5574.080276754371, 5637.746301416446, 5676.148577713376, 5686.317641883001, 5771.538276937835, 5365.919511207335, 5396.055690254189, 5397.055515284809, 5397.298351214317, 5402.135658294733, 4880.804767809248, 4883.633727470454, 4890.070886531547, 4900.97079613278, 4940.110780059624, 5710.029295019856, 5800.361960184377, 5850.414958504116, 5858.443447872445, 5950.107483877453, 5670.773169073191, 5677.829665110054, 5680.460356266148, 5682.403347648437, 5685.516731077904, 5899.410058994238, 5903.350631430625, 5906.379830117948, 5908.468237858441, 5909.438603332676, 5373.650712703662, 5672.7163641816915, 5720.456556627114, 5754.136879467946, 5762.798302059407, 5752.482276595127, 5789.0, 5801.274840644919, 5804.6807425592, 5805.622634528742, 5649.519790817826, 5656.095024796013, 5657.4908258256955, 5659.179418984307, 5660.349059858169, 5358.919616205838, 5515.806946757005, 5555.555555555465, 5573.052581061148, 5654.40628733977, 5582.637128586629, 5585.748641311232, 5586.16207568868, 5589.329280486368, 5592.804251851166, 5625.887482250414, 5629.240052593012, 5683.5453163747625, 5690.0, 5693.402192769865, 5350.545203657733, 5355.464453554613, 5422.8373148805595, 5472.452754724496, 5515.669059856422], "value": 5262.244886576458, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [593.3769541980919, 597.2593983460505, 608.3490664988462, 608.6834845880139, 630.136712703596, 33547.16132096696, 34131.65868341316, 36598.26803463929, 36705.81647091764, 49331.75334123324, 48836.51163488364, 49102.99999999991, 49258.50741492584, 49292.26061609079, 49298.75350623251, 8971.506567138806, 9112.271018318519, 9133.908660913372, 9141.497217653026, 9145.542722863864, 8985.101489850995, 9072.954635226815, 9077.818443631124, 9078.546072696372, 9087.045860184684, 9046.638134474613, 9114.635414583441, 9118.452892826419, 9121.17909388155, 9121.680741174061, 9010.59452324647, 9044.502552359618, 9056.366054376196, 9065.95467022664, 9066.274698024143, 8936.821263574757, 8979.68571100015, 9001.0, 9008.279337652972, 9008.819823603491, 44666.55333446657, 45194.0, 45209.54790452086, 45213.0, 45213.32180017302, 3487.186593682888, 3650.9634903651154, 3739.0652336915773, 4004.599540046001, 4335.458067741532, 33677.15807104817, 34421.655783442344, 35031.29937401238, 35038.29923401543, 35192.648073519194, 4450.910981780378, 4452.287633978548, 4473.709208901443, 4486.080353527519, 4625.398698169251, 352052.0, 354791.0, 357608.0, 358278.0, 358947.9999999974, 58600.0, 59489.40510594839, 59765.103523447186, 59819.504512386666, 59830.10254846181, 64595.832333413215, 64865.0, 64879.0, 65077.67461162664, 65318.0, 15107.244637768068, 15174.772378414333, 15189.392424302903, 15198.696026079637, 15203.467878624417, 13117.475300987853, 13167.868321316855, 13194.604161875159, 13223.801642975362, 13237.867621323856, 16711.331546738238, 18065.367712130013, 18080.197569376767, 18121.54696132581, 18164.456021238344, 6740.258571557125, 6753.2909044549615, 6790.8302292442095, 6826.385625293748, 6847.349501797321, 981.4945303168873, 1055.9788804224027, 1056.1761825775907, 1143.731223162556, 1181.8227265910182, 33454.83272583621, 33703.662963370545, 33925.49111763325, 33961.0, 33999.4900076499, 971.2569884038716, 1108.2076315434504, 1131.4908291268962, 1147.9540818367173, 1229.3975951783561, 16436.75344869804, 17195.57011074708, 17295.74056389155, 17392.3043078278, 17395.217215225344, 577431.0, 581854.0, 581982.0, 584849.0, 585350.0, 62311.0, 62448.687756560925, 62480.375196247456, 62575.37424625787, 62692.0, 1238.486028298264, 1343.603636927109, 1371.2184055088703, 1371.615947534692, 1412.5197432872872, 33544.1613959653, 34899.0, 35058.0, 35127.0, 35502.8224858874, 52697.0, 53429.46570534245, 53515.73242133764, 53560.46439535555, 53631.731841340545, 413064.0, 414004.0, 415789.0, 416323.0, 416817.0, 28510.57234141448, 29609.555856661736, 29698.703012970458, 30986.53520197154, 31194.22014449657, 50384.496155039444, 51029.0, 51217.0, 51271.48728512667, 53176.46823531715, 42479.362809557264, 43630.34554481749, 43722.0, 43877.78061109674, 45414.772926135156, 42909.0, 43621.781891090344, 43990.580518071816, 44543.33185002163, 44619.776901115285, 43075.0, 43499.13001740011, 44097.0, 44575.0, 44644.0, 34689.0, 37615.0, 38059.42910856395, 38180.80909595434, 39223.0, 28441.43117137687, 29124.563131553467, 29677.851610741807, 29704.554431683973, 29895.402091957603], "value": 20708.52665039881, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [377.10625816814155, 392.7663040490907, 395.2332474998503, 406.577159753856, 422.1493690214219, 16338.591535211626, 19643.5089122772, 19839.702404463926, 20078.598428031466, 20486.692699609517, 12591.748165036694, 12686.61940141795, 12761.553345632905, 12810.29543375114, 12845.550405735801, 5304.045271851075, 5484.177373393983, 5493.972530137344, 5495.450454954513, 5499.065158922973, 5401.054815407308, 5405.918911216335, 5646.858828529279, 5888.381719919411, 5932.970335148319, 5984.491318237955, 5991.490723288525, 5993.4006599340155, 5994.100884867261, 5999.040153575429, 5801.564882633798, 5825.825225243249, 5835.212246346752, 5886.499647529965, 5887.499562537189, 5513.8345849624575, 5744.425557444264, 5748.7987920423, 5753.280839895013, 5753.971230143864, 13843.930780346034, 14017.509387171502, 22354.888225558767, 22589.774102259096, 23492.647610285858, 2440.487497625501, 2468.666729991446, 2503.9499210015697, 2767.5433553463654, 3051.0, 10380.740481487948, 10517.376600410615, 10860.6198783043, 10878.891211087946, 11030.613928512463, 1829.9817001830077, 1865.1886429403116, 1927.267638297438, 2081.08432289792, 2083.3854013066184, 80993.59503202446, 83812.58093709493, 85931.57034214851, 86065.56967215124, 86237.56881215617, 11220.495077721358, 11226.316052592176, 11467.483963221675, 11484.081273498101, 11545.191836571528, 15938.0, 15953.202339882959, 15957.44148954781, 15974.840251597569, 15985.760213596805, 8159.020917489939, 8381.790455238668, 8410.495370277802, 8492.278156356655, 8530.445521041112, 7885.369170466349, 7993.160718124629, 8057.59712014397, 8208.343332533503, 8238.50568965864, 4852.17513022787, 4869.415670119608, 4898.387701537308, 4920.384951881015, 5051.646384753032, 1936.1190658250462, 2039.2862498125835, 2044.2606906745034, 2050.8359331253764, 2066.7519897612383, 895.9417637853519, 987.2792861211356, 1001.8046480936293, 1002.5688953749958, 1041.6406339812752, 19396.321128760424, 19932.402027939184, 19948.800511994694, 20013.199472021246, 20073.29743459001, 998.3909815012836, 1004.6634377483479, 1006.5671761142779, 1010.6008126790024, 1052.2476429353048, 10436.37381757097, 10939.617113400993, 11041.503132359063, 11157.776844463066, 11177.776444471065, 452795.0, 455937.0, 456565.0, 474634.0, 475631.0, 67056.0, 82817.58591207005, 84524.0, 91042.0, 92986.0, 1014.7970405918845, 1015.3653966271081, 1045.7699306152633, 1076.332673742285, 1087.9619213327653, 16088.356465741239, 16899.831001690316, 17355.2190151446, 17634.5591360217, 17971.820281797016, 42581.57418425776, 42957.355639664805, 42983.78508107439, 43717.344239835795, 44537.33194002158, 60771.392286076574, 61217.69391153016, 61361.693191533755, 61883.690581546805, 61936.0, 8565.871511927202, 8678.566071696516, 8863.290936724918, 8879.200871921557, 8944.552772361487, 11371.943140284246, 13025.153365031243, 13101.606951791462, 13234.801477978031, 13347.265900375183, 11422.714432139262, 11473.885261147616, 11939.283642981449, 12210.633680989584, 12223.327716975651, 11408.54365825391, 11502.654920352068, 11686.065114790626, 11790.41047947582, 11895.82156267674, 11321.207515474167, 11806.409679515818, 11868.525258989888, 11948.880511195124, 11998.340091295062, 8217.630206640835, 8254.669813207405, 8309.293710034715, 8362.372822038249, 8601.6989405373, 9253.814923701622, 10676.199285053808, 10767.515461804394, 11193.552257909592, 11541.82687259675], "value": 9173.403483348722, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1300.2718477652509, 1453.2443129572623, 1519.3998370643596, 1633.6242664187237, 1798.3256278895415, 8397.496150230983, 8659.740207793768, 8750.387472876893, 8753.343499237551, 8973.461592304466, 8503.829923401529, 8685.044645089036, 8895.066018068106, 8906.153915378045, 8909.777255568613, 2375.275540960011, 2428.611422172453, 2428.854268743872, 2429.0, 2429.720582133051, 2315.455867871049, 2354.96467552986, 2384.332386931662, 2387.319613910036, 2388.176079252655, 2348.156696992861, 2364.0189321431585, 2370.5140446208484, 2420.044082587377, 2426.2721183644926, 2329.219711396684, 2332.4285550040263, 2341.321016905087, 2342.8594284342907, 2372.430616652008, 2288.828337874666, 2310.849794763335, 2316.745158032615, 2322.454223257533, 2353.4822339085545, 8852.247558957431, 8855.424397414148, 8974.50640214788, 8976.371653984224, 8976.41653292534, 5264.52619264268, 5490.286262785852, 5497.312835895513, 5499.395066542677, 5499.890002199933, 3326.3513614845115, 3364.4785058315756, 3409.4827801628285, 3428.0572842468273, 3438.1060924159647, 1213.2417239225483, 1217.2696382170716, 1219.780439520886, 1241.540629966909, 2211.259228158569, 12115.39423028845, 12655.493780248778, 12659.493620255178, 12660.17708848922, 12664.050196235226, 4807.326974223612, 4895.510448955076, 4898.559129678346, 4948.38145231846, 4961.4294356148785, 10813.243072984815, 10813.405262710627, 10826.0, 10836.783264334668, 10841.295315804447, 5433.429489903582, 5453.400125986138, 5460.017196904516, 5462.863428414322, 5501.339839219239, 4316.417283666728, 4452.532484089189, 4917.975410122926, 4964.478729733398, 4995.200767877195, 4155.231282212801, 4177.391492649672, 4227.746335219835, 4251.723637963584, 4270.914581708348, 1292.9935350323187, 1323.371398585664, 1335.2656039178607, 1335.9759963654876, 1337.7057047449546, 918.6876462002817, 945.3004776465366, 1020.6070662794729, 1037.6316407675317, 1042.3641578637025, 5958.910616340759, 5966.552508561876, 6155.815325540241, 6331.68341582919, 6334.809955701337, 460.3876843797741, 463.25647336025867, 467.4437419470819, 490.36008009547885, 491.5109466081272, 4074.348104303297, 4177.624013838769, 4256.893577660583, 4269.082147338275, 4397.032652816375, 11174.720631984103, 11318.207725459139, 11359.034482068952, 11454.828177577343, 11461.0, 11312.208145429906, 11321.094312454983, 11343.43282835855, 11346.262492937933, 11350.31898086101, 7993.960030199928, 8300.418970672115, 8384.077751447336, 8462.449940753831, 8479.19447652472, 6030.48740857032, 6094.177286066324, 6098.969505152446, 6136.478399335928, 6155.0, 10382.532786024798, 10485.52815123306, 10515.369077855354, 10539.26225164231, 10642.467876605984, 9469.526523673927, 9509.096635819586, 10328.690139295833, 10629.9468502657, 10761.246712730346, 7608.391328693802, 7914.169012253861, 7947.205279472007, 7949.364050876032, 7958.403119765925, 8649.827003460021, 8671.479711217347, 8701.95649021776, 8717.302615790595, 8737.650493980169, 7550.924490755022, 7711.267429594404, 7761.534307941542, 7776.261255180749, 7964.0, 7035.210778526335, 7039.648017598997, 7549.09410870677, 7579.469437139347, 7621.961890190513, 7049.330313620198, 7054.329838665319, 7120.145582530129, 7135.571865688075, 7142.071530700976, 5271.1039123348355, 5312.28284181646, 5383.892322153613, 5395.838124856261, 5533.418991006048, 5337.492938170868, 5344.839654810362, 5402.189671549299, 5456.48163424474, 5610.5231055360755], "value": 4682.508596681643, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [321.31500788985664, 339.6196260188589, 346.25727813839313, 346.57717584546845, 347.0456245325354, 5164.147915593927, 5204.791808327667, 5219.1649336106275, 5224.21636754487, 5243.554297884675, 5097.770600322985, 5117.437081920985, 5136.2038883972955, 5138.563222126115, 5146.408163061249, 4105.794710264489, 4111.321631930728, 4134.917301653965, 4151.315033019563, 4161.292580261363, 3777.6411240932066, 3940.6650434713083, 4112.38314252863, 4112.745612588159, 4123.876283711494, 4031.1131551058866, 4055.2092341993325, 4079.8572049978256, 4085.162541678949, 4094.5905409459115, 4106.733062350938, 4109.260333140033, 4110.630043296088, 4143.81352839123, 4147.834086636531, 3521.260535287567, 3526.7002304804123, 3539.507852108322, 3623.166671665532, 3624.6375362463805, 4998.0, 5025.7235852028125, 5030.270610761456, 5036.143855544529, 5052.0, 4687.578068010337, 4696.976515117437, 4697.637685071325, 4705.1530724469585, 4739.691920025221, 5280.392754833205, 5336.43967383423, 5346.732663366816, 5354.0, 5360.383555891083, 3979.1047014421815, 3987.6211759882763, 3992.121733218687, 3993.520777506718, 4019.678425725935, 5283.63014588979, 5522.502974732253, 5604.943950560483, 5663.0, 5675.659460432346, 3992.500937382827, 4002.779847108379, 4058.817353219112, 4106.0, 4141.565135660772, 4164.0, 4205.600467955539, 4210.410542524049, 4213.641840443535, 4216.47294088239, 4704.341392205094, 4708.176069187947, 4722.315264286659, 4728.148933191989, 4731.195696731564, 5179.249008893689, 5383.7308134593895, 5385.676859388449, 5469.206964990054, 5491.725413729378, 1426.7717165253716, 1439.3522914688433, 1443.1124858212333, 1443.8411774704985, 1444.4222311075655, 895.8880139982502, 933.2767105493161, 933.537898740128, 953.3993584042009, 961.4327546747453, 4613.746243956614, 4613.95386046142, 4647.604953578916, 4679.298105284234, 4697.6711630185555, 4911.484294149134, 4917.508249175054, 4922.876928076755, 4956.3804524434445, 4975.527324904128, 4693.929591056137, 4695.309688512133, 4717.764111794397, 4721.504242054603, 4912.557869791736, 2937.6621688506098, 2970.8366039868015, 2972.5689774982507, 2976.925576860596, 2987.716166964135, 5801.274840644919, 5806.709664516758, 5811.738471768696, 5816.0338227503435, 5823.388544202798, 5556.555475561945, 5644.379118296984, 5672.52514346273, 5686.886262274814, 5699.145128230799, 5511.448855114537, 5592.3009623797025, 5657.490825825777, 5726.370099289158, 5789.015867302569, 5498.45015498447, 5513.283273174462, 5513.972430137824, 5523.447655234444, 5527.668339899619, 5225.320708307896, 5430.212619170277, 5452.6183167177915, 5478.698671572943, 5488.451154884479, 5730.656160630376, 5761.8559536011935, 5805.738741756547, 5808.157817116579, 5809.257222833217, 4032.153247817991, 4047.959520404758, 4053.533843608023, 4054.533728621246, 4090.6931980101017, 5372.570194384518, 5572.219889215432, 5671.773129074791, 5672.007398705127, 5685.260916080883, 5435.537979271648, 5438.0, 5467.535259502987, 5471.2613797138465, 5478.260434841245, 5327.520523152934, 5400.648957817729, 5464.235007099089, 5465.59008074388, 5478.150886612581, 5237.847673511974, 5359.196120581944, 5400.351957765093, 5425.267588875451, 5446.121088224556, 5380.166074258496, 5441.483059109379, 5455.181722741462, 5463.399026107205, 5465.672059676433, 5165.502004418677, 5308.893822123458, 5350.30446042012, 5378.838634840961, 5381.48875856793], "value": 4138.192491426923, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [757.0801476206408, 779.294738261873, 783.4594130050265, 803.6022169026332, 833.0836080311658, 15693.21533923305, 16058.5985350366, 16735.497935061936, 16746.916265418688, 16766.077865717394, 15149.394024239018, 15345.30946107425, 15386.769058475324, 15398.69202615947, 15441.922790386061, 678.1252184681755, 809.6235250608465, 813.4834380168606, 830.0869044051525, 830.9875351869697, 832.81261716114, 838.2958315015386, 840.861257892447, 841.4572600672593, 842.6250318608222, 877.1973644115658, 879.2174964281794, 879.2614204068581, 880.366136381804, 881.0968757024069, 699.7096205074888, 839.2446797881894, 873.3449912565576, 874.1215078845751, 874.3049275825733, 632.6520413772407, 633.0283015571076, 634.8984162534018, 637.9075034120073, 638.0301941049624, 15269.160196189205, 15296.158711270875, 15360.615984600363, 15363.078215307005, 15405.0, 14508.419663213564, 14560.0, 14806.185659788815, 14807.333669984877, 15085.47200847965, 13671.794923076162, 13876.791848122286, 13942.651433714136, 14114.717705645933, 14497.56507304772, 4267.274563324242, 4293.855805271283, 4295.656347492193, 4298.634616057639, 4417.801198946023, 85109.0, 85907.14092859054, 86106.56946715227, 88987.0, 90621.0, 11553.826692599618, 11571.884281157081, 11649.301041937511, 11763.470643821049, 11961.40192990347, 21185.576288474145, 21198.47003824886, 21237.256696015564, 21265.36203913885, 21266.149354025667, 8808.955955220183, 8930.642774288955, 8957.417767845069, 9123.589438475152, 9305.860412093823, 4935.21036634144, 4963.611496570784, 4975.402951645753, 5041.218611115283, 5041.319421878073, 3485.3029394121277, 3547.3260080584605, 3596.8201589920923, 3598.6581274778855, 3606.765560238576, 592.2460558403372, 595.2648479128273, 600.0279547133672, 600.051917969607, 607.1378642327905, 629.6851574212893, 669.6250099944046, 674.4199988010307, 704.2077662629541, 706.4666177036305, 9434.528273586293, 9612.903870961201, 9678.70963871085, 9702.126808587262, 9777.168940640126, 592.5496622566881, 688.0985908459934, 691.1153723234269, 715.0954043135438, 718.2099690340583, 4634.0036892068365, 4967.205247160509, 4982.227754698028, 5020.121478741279, 5038.798448062036, 125681.0, 126337.36831315784, 127511.36244318905, 129201.0, 131764.0, 62341.376586234466, 88221.0, 105838.0, 108703.0, 109219.0, 94575.52712236394, 95419.52290238504, 96975.0, 97144.51427742816, 98631.50684246677, 8875.822483550422, 9120.315976301672, 9145.3598248122, 9210.728501112833, 9236.769080773034, 54199.45800541944, 54896.725516372164, 55494.0, 56293.71853140708, 56800.715996419756, 47430.76284618693, 47587.52412475831, 69012.0, 80721.0, 80778.19221807942, 10479.738006549896, 10482.056614904695, 10628.0, 11069.833952490559, 12980.480780768663, 14074.0, 14838.480653177086, 14887.776683349975, 15026.398944042116, 15382.923085384502, 13931.58205253844, 14005.1596904182, 14299.928500357431, 14652.0, 15226.467073652811, 14207.573772786833, 14287.357068932131, 14689.41242350294, 15072.0, 15669.0, 14203.218822964836, 14284.285785710881, 14677.633059173178, 14685.632859178606, 14716.484923027643, 10417.389064466002, 11045.171612128961, 11228.66314010581, 11290.379029153475, 11803.055755539708, 10616.991385818335, 11072.667819965414, 11768.35274059935, 11960.222585531912, 11963.521459141537], "value": 7739.532630892062, "unit": "score"}], "name": "dromaeo_css", "value": 7288.704035257403, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 113.0, 112.0, 111.0, 115.0, 112.0, 110.0, 112.0, 112.0, 110.0], "value": 111.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 119.0, 131.0, 185.0, 122.0, 124.0, 139.0, 119.0, 159.0, 119.0], "value": 136.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 160.0, 162.0, 162.0, 161.0, 161.0, 162.0, 162.0, 161.0, 162.0], "value": 161.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 105.0, 78.0, 76.0, 75.0, 75.0, 99.0, 74.0], "value": 80.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 119.0, 86.0, 85.0, 86.0, 122.0, 84.0, 85.0, 132.0], "value": 96.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 146.0, 145.0, 145.0, 146.0, 146.0, 146.0, 146.0, 145.0, 145.0], "value": 145.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 96.0, 95.0, 94.0, 95.0, 95.0, 95.0, 95.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [50.0, 50.0, 50.0, 50.0, 49.0, 51.0, 51.0, 51.0, 50.0, 49.0], "value": 50.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 61.0, 60.0, 62.0, 61.0, 60.0, 61.0, 61.0, 61.0], "value": 60.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 76.0, 88.0, 81.0, 85.0, 75.0, 76.0, 76.0, 85.0], "value": 79.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 119.0, 120.0, 121.0, 122.0, 118.0, 122.0, 122.0, 158.0, 122.0], "value": 125.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 164.0, 162.0, 164.0, 162.0, 161.0, 160.0, 158.0, 161.0, 159.0], "value": 162.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 63.0, 62.0, 62.0, 63.0, 63.0, 62.0, 61.0], "value": 62.2, "unit": "score"}], "name": "kraken", "value": 1484.0, "alertThreshold": 2.0}]} 14:41:15 INFO - Return code: 0 14:41:15 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:41:15 INFO - # TBPL SUCCESS # 14:41:15 INFO - Running post-action listener: _resource_record_post_action 14:41:15 INFO - [mozharness: 2016-08-02 21:41:15.553618Z] Finished run-tests step (success) 14:41:15 INFO - Running post-run listener: _resource_record_post_run 14:41:15 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 542756864; Read time: 16; Write time: 518688 14:41:15 INFO - TinderboxPrint: CPU usage
13.0% 14:41:15 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 14:41:15 INFO - TinderboxPrint: I/O write bytes / time
542,756,864 / 518,688 14:41:15 INFO - TinderboxPrint: CPU idle
8,273.1 (87.0%) 14:41:15 INFO - TinderboxPrint: CPU user
1,194.5 (12.6%) 14:41:15 INFO - TinderboxPrint: Swap in / out
0 / 0 14:41:15 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 247947264; Read time: 0; Write time: 308460 14:41:15 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 291147776; Read time: 0; Write time: 209504 14:41:16 INFO - Running post-run listener: _upload_blobber_files 14:41:16 INFO - Blob upload gear active. 14:41:16 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:41:16 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 14:41:16 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', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 14:41:16 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 -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 14:41:16 INFO - (blobuploader) - INFO - Open directory for files ... 14:41:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 14:41:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:41:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:41:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 14:41:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:41:17 INFO - (blobuploader) - INFO - Done attempting. 14:41:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 14:41:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:41:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:41:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 14:41:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:41:18 INFO - (blobuploader) - INFO - Done attempting. 14:41:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:41:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:41:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:41:22 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:41:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:41:22 INFO - (blobuploader) - INFO - Done attempting. 14:41:22 INFO - (blobuploader) - INFO - Iteration through files over. 14:41:22 INFO - Return code: 0 14:41:22 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:41:22 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:41:22 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1b7eab5f733e83db00e98954da4685587ad9826118e4fb2417ad3652eec72c290cc9e8c5b47a55bdc49d6a69b8360e6aaf3b1fe47bcf51e9ec64fae449c5a91d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7444d960404915d2644903a509e1fba3c6d96dad2b5d6ea336f79d8d75304e409063fddd4b296a91d697d4ce5a9ebd5cd65ea132da3cb7eecee8865e3fe92d98", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03fa1ecee624193fca77ffbf5be930616a73d138c3ef49574a6a61cc5b1e2273d505ccccbbb4c698244aaa5d3cc85c17ec8763629e9aa8c2e31b0395e9f3eb65"} 14:41:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:41:22 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:41:22 INFO - Contents: 14:41:22 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1b7eab5f733e83db00e98954da4685587ad9826118e4fb2417ad3652eec72c290cc9e8c5b47a55bdc49d6a69b8360e6aaf3b1fe47bcf51e9ec64fae449c5a91d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7444d960404915d2644903a509e1fba3c6d96dad2b5d6ea336f79d8d75304e409063fddd4b296a91d697d4ce5a9ebd5cd65ea132da3cb7eecee8865e3fe92d98", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03fa1ecee624193fca77ffbf5be930616a73d138c3ef49574a6a61cc5b1e2273d505ccccbbb4c698244aaa5d3cc85c17ec8763629e9aa8c2e31b0395e9f3eb65"} 14:41:22 INFO - Running post-run listener: copy_logs_to_upload_dir 14:41:22 INFO - Copying logs to upload dir... 14:41:22 INFO - mkdir: /builds/slave/test/build/upload/logs 14:41:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1231.966974 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-08-02 14:41:21.681228) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-02 14:41:21.684396) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1b7eab5f733e83db00e98954da4685587ad9826118e4fb2417ad3652eec72c290cc9e8c5b47a55bdc49d6a69b8360e6aaf3b1fe47bcf51e9ec64fae449c5a91d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7444d960404915d2644903a509e1fba3c6d96dad2b5d6ea336f79d8d75304e409063fddd4b296a91d697d4ce5a9ebd5cd65ea132da3cb7eecee8865e3fe92d98", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03fa1ecee624193fca77ffbf5be930616a73d138c3ef49574a6a61cc5b1e2273d505ccccbbb4c698244aaa5d3cc85c17ec8763629e9aa8c2e31b0395e9f3eb65"} build_url:https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011314 build_url: 'https://queue.taskcluster.net/v1/task/UkaJC15-QiSM3oxjJrsVNQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1b7eab5f733e83db00e98954da4685587ad9826118e4fb2417ad3652eec72c290cc9e8c5b47a55bdc49d6a69b8360e6aaf3b1fe47bcf51e9ec64fae449c5a91d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7444d960404915d2644903a509e1fba3c6d96dad2b5d6ea336f79d8d75304e409063fddd4b296a91d697d4ce5a9ebd5cd65ea132da3cb7eecee8865e3fe92d98", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03fa1ecee624193fca77ffbf5be930616a73d138c3ef49574a6a61cc5b1e2273d505ccccbbb4c698244aaa5d3cc85c17ec8763629e9aa8c2e31b0395e9f3eb65"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-02 14:41:21.709616) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:41:21.709955) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1470172848.676855-91322967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004513 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-02 14:41:21.793057) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-02 14:41:21.793362) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-02 14:41:21.793654) ========= ========= Total master_lag: 0.16 =========