builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-043 starttime: 1466518613.92 results: success (0) buildid: 20160621064400 builduid: 774b8571136f4237973290f4f2baba9a revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:53.922947) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:53.923410) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:53.923705) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:53.969568) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:53.969875) ========= 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=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-21 07:16:55-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.0M=0s 2016-06-21 07:16:55 (46.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.077100 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.061047) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.061391) ========= 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=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017194 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.110918) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.111285) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ecd3562339dcd51a604e82efbcb347de8b823aee --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 ecd3562339dcd51a604e82efbcb347de8b823aee --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=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-21 07:16:55,231 truncating revision to first 12 chars 2016-06-21 07:16:55,231 Setting DEBUG logging. 2016-06-21 07:16:55,231 attempt 1/10 2016-06-21 07:16:55,231 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ecd3562339dc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-21 07:16:55,555 unpacking tar archive at: fx-team-ecd3562339dc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.661926 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.786578) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.786922) ========= script_repo_revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.787349) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.787629) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 07:16:54.797713) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-06-21 07:16:54.797990) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:16:55 INFO - MultiFileLogger online at 20160621 07:16:55 in /builds/slave/test 07:16:55 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 07:16:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:16:56 INFO - {'append_to_log': False, 07:16:56 INFO - 'base_work_dir': '/builds/slave/test', 07:16:56 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 07:16:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:16:56 INFO - 'branch': 'Fx-Team-Non-PGO', 07:16:56 INFO - 'buildbot_json_path': 'buildprops.json', 07:16:56 INFO - 'config_files': ('talos/linux_config.py',), 07:16:56 INFO - 'default_actions': ('clobber', 07:16:56 INFO - 'read-buildbot-config', 07:16:56 INFO - 'download-and-extract', 07:16:56 INFO - 'populate-webroot', 07:16:56 INFO - 'create-virtualenv', 07:16:56 INFO - 'install', 07:16:56 INFO - 'run-tests'), 07:16:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:16:56 INFO - 'download_minidump_stackwalk': True, 07:16:56 INFO - 'download_symbols': 'ondemand', 07:16:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:16:56 INFO - 'tooltool.py': '/tools/tooltool.py', 07:16:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:16:56 INFO - '/tools/misc-python/virtualenv.py')}, 07:16:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:16:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:16:56 INFO - 'installer_path': 'installer.exe', 07:16:56 INFO - 'log_level': 'info', 07:16:56 INFO - 'log_name': 'talos', 07:16:56 INFO - 'log_to_console': True, 07:16:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:16:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:16:56 INFO - 'opt_config_files': (), 07:16:56 INFO - 'pip_index': False, 07:16:56 INFO - 'sps_profile': False, 07:16:56 INFO - 'sps_profile_interval': 0, 07:16:56 INFO - 'suite': 'dromaeojs-e10s', 07:16:56 INFO - 'system_bits': '32', 07:16:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:16:56 INFO - 'title': 'talos-linux64-ix-043', 07:16:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:16:56 INFO - 'use_talos_json': True, 07:16:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:16:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:16:56 INFO - 'work_dir': 'build'} 07:16:56 INFO - ##### 07:16:56 INFO - ##### Running clobber step. 07:16:56 INFO - ##### 07:16:56 INFO - Running pre-action listener: _resource_record_pre_action 07:16:56 INFO - Running main action method: clobber 07:16:56 INFO - rmtree: /builds/slave/test/build 07:16:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:16:56 INFO - Running post-action listener: _resource_record_post_action 07:16:56 INFO - ##### 07:16:56 INFO - ##### Finished clobber step (success) 07:16:56 INFO - ##### 07:16:56 INFO - ##### 07:16:56 INFO - ##### Running read-buildbot-config step. 07:16:56 INFO - ##### 07:16:56 INFO - Running pre-action listener: _resource_record_pre_action 07:16:56 INFO - Running main action method: read_buildbot_config 07:16:56 INFO - Using buildbot properties: 07:16:56 INFO - { 07:16:56 INFO - "project": "", 07:16:56 INFO - "product": "firefox", 07:16:56 INFO - "script_repo_revision": "production", 07:16:56 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 07:16:56 INFO - "repository": "", 07:16:56 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 07:16:56 INFO - "buildid": "20160621064400", 07:16:56 INFO - "pgo_build": "False", 07:16:56 INFO - "basedir": "/builds/slave/test", 07:16:56 INFO - "buildnumber": 1418, 07:16:56 INFO - "slavename": "talos-linux64-ix-043", 07:16:56 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 07:16:56 INFO - "platform": "ubuntu64_hw", 07:16:56 INFO - "scheduler": "tests-fx-team-linux64-talos", 07:16:56 INFO - "branch": "fx-team", 07:16:56 INFO - "repo_path": "integration/fx-team", 07:16:56 INFO - "revision": "ecd3562339dcd51a604e82efbcb347de8b823aee", 07:16:56 INFO - "stage_platform": "linux64", 07:16:56 INFO - "builduid": "774b8571136f4237973290f4f2baba9a", 07:16:56 INFO - "slavebuilddir": "test" 07:16:56 INFO - } 07:16:56 INFO - Found installer url https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 07:16:56 INFO - Running post-action listener: _resource_record_post_action 07:16:56 INFO - ##### 07:16:56 INFO - ##### Finished read-buildbot-config step (success) 07:16:56 INFO - ##### 07:16:56 INFO - ##### 07:16:56 INFO - ##### Running download-and-extract step. 07:16:56 INFO - ##### 07:16:56 INFO - Running pre-action listener: _resource_record_pre_action 07:16:56 INFO - Running main action method: download_and_extract 07:16:56 INFO - mkdir: /builds/slave/test/build/tests 07:16:56 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')]} 07:16:56 INFO - https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:16:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:16:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:16:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:16:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:16:57 INFO - Downloaded 1361 bytes. 07:16:57 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:16:57 INFO - Using the following test package requirements: 07:16:57 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:16:57 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:16:57 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:16:57 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'jsshell-linux-x86_64.zip'], 07:16:57 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:16:57 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:16:57 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:16:57 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:16:57 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:16:57 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:16:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:16:57 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:16: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')]} 07:16:57 INFO - https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:16:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:16:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:16:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:16:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:16:58 INFO - Downloaded 22658730 bytes. 07:16:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:16:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:17:00 INFO - Return code: 0 07:17:00 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:17:00 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')]} 07:17:00 INFO - https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:17:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:17:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:17:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:17:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:17:01 INFO - Downloaded 22658730 bytes. 07:17:01 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:17:01 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:17:02 INFO - Return code: 0 07:17: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')]} 07:17:02 INFO - https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:17:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:17:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:17:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:17:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:17:03 INFO - Downloaded 14405384 bytes. 07:17:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:17:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 07:17:03 INFO - Return code: 0 07:17: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')]} 07:17:03 INFO - https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:17:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:17:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:17:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:17:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:17:05 INFO - Downloaded 56237188 bytes. 07:17:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:17:05 INFO - mkdir: /builds/slave/test/properties 07:17:05 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:17:05 INFO - Writing to file /builds/slave/test/properties/build_url 07:17:05 INFO - Contents: 07:17:05 INFO - build_url:https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:17:06 INFO - Running post-action listener: _resource_record_post_action 07:17:06 INFO - Running post-action listener: set_extra_try_arguments 07:17:06 INFO - ##### 07:17:06 INFO - ##### Finished download-and-extract step (success) 07:17:06 INFO - ##### 07:17:06 INFO - ##### 07:17:06 INFO - ##### Running populate-webroot step. 07:17:06 INFO - ##### 07:17:06 INFO - Running pre-action listener: _resource_record_pre_action 07:17:06 INFO - Running main action method: populate_webroot 07:17:06 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:17:06 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:17:06 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:17:06 INFO - '--tppagecycles', 07:17:06 INFO - '7'], 07:17:06 INFO - 'tests': ['tsvgm']}}, 07:17:06 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:17:06 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:17:06 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:17:06 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:17:06 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:17:06 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:17:06 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['damp', 'tps']}, 07:17:06 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'tests': ['damp', 'tps']}, 07:17:06 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['dromaeo_dom']}, 07:17:06 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:17:06 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['basic_compositor_video']}, 07:17:06 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:17:06 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'other-e10s': {'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['a11yr', 07:17:06 INFO - 'ts_paint', 07:17:06 INFO - 'tpaint', 07:17:06 INFO - 'sessionrestore', 07:17:06 INFO - 'sessionrestore_no_auto_restore', 07:17:06 INFO - 'tabpaint']}, 07:17:06 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['tsvgx', 07:17:06 INFO - 'tsvgr_opacity', 07:17:06 INFO - 'tart', 07:17:06 INFO - 'tscrollx', 07:17:06 INFO - 'cart']}, 07:17:06 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:17:06 INFO - 'tsvgr_opacity', 07:17:06 INFO - 'tart', 07:17:06 INFO - 'tscrollx', 07:17:06 INFO - 'cart']}, 07:17:06 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'talos_options': ['--disable-e10s'], 07:17:06 INFO - 'tests': ['tp5o']}, 07:17:06 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'tests': ['tp5o']}, 07:17:06 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'talos_options': ['--disable-e10s', 07:17:06 INFO - '--xperf_path', 07:17:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:17:06 INFO - 'tests': ['tp5n']}, 07:17:06 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:17:06 INFO - 'talos_options': ['--xperf_path', 07:17:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:17:06 INFO - 'tests': ['tp5n']}}, 07:17:06 INFO - 'talos.zip': {'path': '', 07:17:06 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:17:06 INFO - Running post-action listener: _resource_record_post_action 07:17:06 INFO - ##### 07:17:06 INFO - ##### Finished populate-webroot step (success) 07:17:06 INFO - ##### 07:17:06 INFO - ##### 07:17:06 INFO - ##### Running create-virtualenv step. 07:17:06 INFO - ##### 07:17:06 INFO - Running pre-action listener: _resource_record_pre_action 07:17:06 INFO - Running main action method: create_virtualenv 07:17:06 INFO - Creating virtualenv /builds/slave/test/build/venv 07:17:06 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 07:17:06 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:17:06 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:17:06 INFO - Using real prefix '/usr' 07:17:06 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:17:07 INFO - Installing distribute.............................................................................................................................................................................................done. 07:17:09 INFO - Installing pip.................done. 07:17:09 INFO - Return code: 0 07:17:09 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:17:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:09 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:09 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 07:17:09 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 07:17:09 INFO - Using env: {'DISPLAY': ':0', 07:17:09 INFO - 'HOME': '/home/cltbld', 07:17:09 INFO - 'LANG': 'en_US.UTF-8', 07:17:09 INFO - 'LANGUAGE': 'en_US:en', 07:17:09 INFO - 'LOGNAME': 'cltbld', 07:17:09 INFO - 'MAIL': '/var/mail/cltbld', 07:17:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:09 INFO - 'MOZ_NO_REMOTE': '1', 07:17:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:09 INFO - 'NO_EM_RESTART': '1', 07:17:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:09 INFO - 'PWD': '/builds/slave/test', 07:17:09 INFO - 'SHELL': '/bin/bash', 07:17:09 INFO - 'SHLVL': '1', 07:17:09 INFO - 'TERM': 'linux', 07:17:09 INFO - 'TMOUT': '86400', 07:17:09 INFO - 'USER': 'cltbld', 07:17:09 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:09 INFO - '_': '/tools/buildbot/bin/python'} 07:17:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:09 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 07:17:09 INFO - Cleaning up... 07:17:09 INFO - Return code: 0 07:17:09 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:17:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:09 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:09 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 07:17:09 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 07:17:09 INFO - Using env: {'DISPLAY': ':0', 07:17:09 INFO - 'HOME': '/home/cltbld', 07:17:09 INFO - 'LANG': 'en_US.UTF-8', 07:17:09 INFO - 'LANGUAGE': 'en_US:en', 07:17:09 INFO - 'LOGNAME': 'cltbld', 07:17:09 INFO - 'MAIL': '/var/mail/cltbld', 07:17:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:09 INFO - 'MOZ_NO_REMOTE': '1', 07:17:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:09 INFO - 'NO_EM_RESTART': '1', 07:17:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:09 INFO - 'PWD': '/builds/slave/test', 07:17:09 INFO - 'SHELL': '/bin/bash', 07:17:09 INFO - 'SHLVL': '1', 07:17:09 INFO - 'TERM': 'linux', 07:17:09 INFO - 'TMOUT': '86400', 07:17:09 INFO - 'USER': 'cltbld', 07:17:09 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:09 INFO - '_': '/tools/buildbot/bin/python'} 07:17:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:09 INFO - Downloading/unpacking psutil>=3.1.1 07:17:09 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 07:17:09 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 07:17:09 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 07:17:09 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 07:17:09 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 07:17:09 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 07:17:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:17:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:17:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:17:11 INFO - Installing collected packages: psutil 07:17:11 INFO - Running setup.py install for psutil 07:17:11 INFO - building 'psutil._psutil_linux' extension 07:17:11 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 07:17:12 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 07:17:12 INFO - building 'psutil._psutil_posix' extension 07:17:12 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 07:17:12 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 07:17:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:17:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:17:12 INFO - Successfully installed psutil 07:17:12 INFO - Cleaning up... 07:17:12 INFO - Return code: 0 07:17:12 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:17:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:12 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:12 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 07:17:12 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 07:17:12 INFO - Using env: {'DISPLAY': ':0', 07:17:12 INFO - 'HOME': '/home/cltbld', 07:17:12 INFO - 'LANG': 'en_US.UTF-8', 07:17:12 INFO - 'LANGUAGE': 'en_US:en', 07:17:12 INFO - 'LOGNAME': 'cltbld', 07:17:12 INFO - 'MAIL': '/var/mail/cltbld', 07:17:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:12 INFO - 'MOZ_NO_REMOTE': '1', 07:17:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:12 INFO - 'NO_EM_RESTART': '1', 07:17:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:12 INFO - 'PWD': '/builds/slave/test', 07:17:12 INFO - 'SHELL': '/bin/bash', 07:17:12 INFO - 'SHLVL': '1', 07:17:12 INFO - 'TERM': 'linux', 07:17:12 INFO - 'TMOUT': '86400', 07:17:12 INFO - 'USER': 'cltbld', 07:17:12 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:12 INFO - '_': '/tools/buildbot/bin/python'} 07:17:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:12 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:17: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 07:17: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 07:17: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 07:17: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 07:17: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 07:17: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 07:17:14 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:17:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:17:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:17:14 INFO - Installing collected packages: mozsystemmonitor 07:17:14 INFO - Running setup.py install for mozsystemmonitor 07:17:14 INFO - Successfully installed mozsystemmonitor 07:17:14 INFO - Cleaning up... 07:17:14 INFO - Return code: 0 07:17:14 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:17:14 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')]} 07:17:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:14 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')]} 07:17:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:14 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:14 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 07:17:14 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 07:17:14 INFO - Using env: {'DISPLAY': ':0', 07:17:14 INFO - 'HOME': '/home/cltbld', 07:17:14 INFO - 'LANG': 'en_US.UTF-8', 07:17:14 INFO - 'LANGUAGE': 'en_US:en', 07:17:14 INFO - 'LOGNAME': 'cltbld', 07:17:14 INFO - 'MAIL': '/var/mail/cltbld', 07:17:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:14 INFO - 'MOZ_NO_REMOTE': '1', 07:17:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:14 INFO - 'NO_EM_RESTART': '1', 07:17:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:14 INFO - 'PWD': '/builds/slave/test', 07:17:14 INFO - 'SHELL': '/bin/bash', 07:17:14 INFO - 'SHLVL': '1', 07:17:14 INFO - 'TERM': 'linux', 07:17:14 INFO - 'TMOUT': '86400', 07:17:14 INFO - 'USER': 'cltbld', 07:17:14 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:14 INFO - '_': '/tools/buildbot/bin/python'} 07:17:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:14 INFO - Downloading/unpacking jsonschema==2.5.1 07:17: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 07:17: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 07:17: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 07:17: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 07:17: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 07:17: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 07:17:16 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:17:16 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:17:16 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 07:17:16 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 07:17:16 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 07:17:16 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 07:17:16 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 07:17:16 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 07:17:16 INFO - Downloading functools32-3.2.3-2.tar.gz 07:17:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:17:17 INFO - warning: no files found matching '*.txt' 07:17:17 INFO - no previously-included directories found matching 'build' 07:17:17 INFO - no previously-included directories found matching 'dist' 07:17:17 INFO - no previously-included directories found matching '.git*' 07:17:17 INFO - Installing collected packages: jsonschema, functools32 07:17:17 INFO - Running setup.py install for functools32 07:17:17 INFO - warning: no files found matching '*.txt' 07:17:17 INFO - no previously-included directories found matching 'build' 07:17:17 INFO - no previously-included directories found matching 'dist' 07:17:17 INFO - no previously-included directories found matching '.git*' 07:17:17 INFO - Successfully installed jsonschema functools32 07:17:17 INFO - Cleaning up... 07:17:17 INFO - Return code: 0 07:17:17 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:17:17 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')]} 07:17:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:17 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')]} 07:17:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:17 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:17 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 07:17:17 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 07:17:17 INFO - Using env: {'DISPLAY': ':0', 07:17:17 INFO - 'HOME': '/home/cltbld', 07:17:17 INFO - 'LANG': 'en_US.UTF-8', 07:17:17 INFO - 'LANGUAGE': 'en_US:en', 07:17:17 INFO - 'LOGNAME': 'cltbld', 07:17:17 INFO - 'MAIL': '/var/mail/cltbld', 07:17:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:17 INFO - 'MOZ_NO_REMOTE': '1', 07:17:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:17 INFO - 'NO_EM_RESTART': '1', 07:17:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:17 INFO - 'PWD': '/builds/slave/test', 07:17:17 INFO - 'SHELL': '/bin/bash', 07:17:17 INFO - 'SHLVL': '1', 07:17:17 INFO - 'TERM': 'linux', 07:17:17 INFO - 'TMOUT': '86400', 07:17:17 INFO - 'USER': 'cltbld', 07:17:17 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:17 INFO - '_': '/tools/buildbot/bin/python'} 07:17:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:17 INFO - Downloading/unpacking blobuploader==1.2.4 07:17:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:19 INFO - Downloading blobuploader-1.2.4.tar.gz 07:17:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:17:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:17:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:17:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:17:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:17:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:17:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:17:19 INFO - Downloading docopt-0.6.1.tar.gz 07:17:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:17:20 INFO - Installing collected packages: blobuploader, requests, docopt 07:17:20 INFO - Running setup.py install for blobuploader 07:17:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:17:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:17:20 INFO - Running setup.py install for requests 07:17:20 INFO - Running setup.py install for docopt 07:17:20 INFO - Successfully installed blobuploader requests docopt 07:17:20 INFO - Cleaning up... 07:17:20 INFO - Return code: 0 07:17:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:17:20 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')]} 07:17:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:20 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')]} 07:17:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:20 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:20 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 07:17:20 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 07:17:20 INFO - Using env: {'DISPLAY': ':0', 07:17:20 INFO - 'HOME': '/home/cltbld', 07:17:20 INFO - 'LANG': 'en_US.UTF-8', 07:17:20 INFO - 'LANGUAGE': 'en_US:en', 07:17:20 INFO - 'LOGNAME': 'cltbld', 07:17:20 INFO - 'MAIL': '/var/mail/cltbld', 07:17:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:20 INFO - 'MOZ_NO_REMOTE': '1', 07:17:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:20 INFO - 'NO_EM_RESTART': '1', 07:17:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:20 INFO - 'PWD': '/builds/slave/test', 07:17:20 INFO - 'SHELL': '/bin/bash', 07:17:20 INFO - 'SHLVL': '1', 07:17:20 INFO - 'TERM': 'linux', 07:17:20 INFO - 'TMOUT': '86400', 07:17:20 INFO - 'USER': 'cltbld', 07:17:20 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:20 INFO - '_': '/tools/buildbot/bin/python'} 07:17:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:17:20 INFO - Running setup.py (path:/tmp/pip-x32_iP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:17:20 INFO - Running setup.py (path:/tmp/pip-MfaU2U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:17:21 INFO - Running setup.py (path:/tmp/pip-aULojV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:17:21 INFO - Running setup.py (path:/tmp/pip-9ssWxK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:17:21 INFO - Running setup.py (path:/tmp/pip-DyMbF4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:17:21 INFO - Running setup.py (path:/tmp/pip-0pIg1t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:17:21 INFO - Running setup.py (path:/tmp/pip-3wRdfq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:17:21 INFO - Running setup.py (path:/tmp/pip-ziIZ5b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:17:21 INFO - Running setup.py (path:/tmp/pip-J6XVE9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:17:21 INFO - Running setup.py (path:/tmp/pip-Zb2Mgy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:17:21 INFO - Running setup.py (path:/tmp/pip-8lt0EP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:17:21 INFO - Running setup.py (path:/tmp/pip-WOWhFV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:17:21 INFO - Running setup.py (path:/tmp/pip-2bicGo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:17:21 INFO - Running setup.py (path:/tmp/pip-U9YeaU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:17:21 INFO - Running setup.py (path:/tmp/pip-ycqMD9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:17:21 INFO - Running setup.py (path:/tmp/pip-QYgkDH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:17:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:17:22 INFO - Running setup.py (path:/tmp/pip-TKoHrO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:17:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:17:22 INFO - Running setup.py install for manifestparser 07:17:22 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Running setup.py install for mozcrash 07:17:22 INFO - Running setup.py install for mozdebug 07:17:22 INFO - Running setup.py install for mozdevice 07:17:22 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Running setup.py install for mozfile 07:17:22 INFO - Running setup.py install for mozhttpd 07:17:22 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Running setup.py install for mozinfo 07:17:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Running setup.py install for mozInstall 07:17:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:17:22 INFO - Running setup.py install for mozleak 07:17:23 INFO - Running setup.py install for mozlog 07:17:23 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Running setup.py install for moznetwork 07:17:23 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Running setup.py install for mozprocess 07:17:23 INFO - Running setup.py install for mozprofile 07:17:23 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Running setup.py install for mozrunner 07:17:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Running setup.py install for mozscreenshot 07:17:23 INFO - Running setup.py install for moztest 07:17:23 INFO - Running setup.py install for mozversion 07:17:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:17:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:17:23 INFO - Cleaning up... 07:17:23 INFO - Return code: 0 07:17:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:17:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:23 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:23 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 07:17:23 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 07:17:23 INFO - Using env: {'DISPLAY': ':0', 07:17:23 INFO - 'HOME': '/home/cltbld', 07:17:23 INFO - 'LANG': 'en_US.UTF-8', 07:17:23 INFO - 'LANGUAGE': 'en_US:en', 07:17:23 INFO - 'LOGNAME': 'cltbld', 07:17:23 INFO - 'MAIL': '/var/mail/cltbld', 07:17:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:23 INFO - 'MOZ_NO_REMOTE': '1', 07:17:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:23 INFO - 'NO_EM_RESTART': '1', 07:17:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:23 INFO - 'PWD': '/builds/slave/test', 07:17:23 INFO - 'SHELL': '/bin/bash', 07:17:23 INFO - 'SHLVL': '1', 07:17:23 INFO - 'TERM': 'linux', 07:17:23 INFO - 'TMOUT': '86400', 07:17:23 INFO - 'USER': 'cltbld', 07:17:23 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:23 INFO - '_': '/tools/buildbot/bin/python'} 07:17:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:17:24 INFO - Running setup.py (path:/tmp/pip-a4Qinp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:17:24 INFO - Running setup.py (path:/tmp/pip-7EvjRE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:17:24 INFO - Running setup.py (path:/tmp/pip-MbQ33N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:17:24 INFO - Running setup.py (path:/tmp/pip-_sVRJH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:17:24 INFO - Running setup.py (path:/tmp/pip-BpoJa0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:17:24 INFO - Running setup.py (path:/tmp/pip-vNrDD4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:17:24 INFO - Running setup.py (path:/tmp/pip-ik66LO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:17:24 INFO - Running setup.py (path:/tmp/pip-AAN38M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:17:24 INFO - Running setup.py (path:/tmp/pip-U7yV_l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:17:24 INFO - Running setup.py (path:/tmp/pip-rC4Vpw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:17:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:17:24 INFO - Running setup.py (path:/tmp/pip-DRubna-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:17:24 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)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:17:24 INFO - Running setup.py (path:/tmp/pip-5oABpt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:17:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 07:17:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:17:24 INFO - Running setup.py (path:/tmp/pip-KhRY6X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:17:25 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)) 07:17:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:17:25 INFO - Running setup.py (path:/tmp/pip-eaL7L8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:17:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 07:17:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:17:25 INFO - Running setup.py (path:/tmp/pip-AnyzZ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:17:25 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)) 07:17:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:17:25 INFO - Running setup.py (path:/tmp/pip-remzcL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:17:25 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)) 07:17:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:17:25 INFO - Running setup.py (path:/tmp/pip-dQu3D1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:17:25 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)) 07:17:25 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)) 07:17:25 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)) 07:17:25 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)) 07:17:25 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)) 07:17:25 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)) 07:17:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:17:25 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 07:17:25 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 07:17:25 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 07:17:25 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 07:17:25 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 07:17:25 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 07:17:27 INFO - Downloading blessings-1.6.tar.gz 07:17:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:17:27 INFO - Installing collected packages: blessings 07:17:27 INFO - Running setup.py install for blessings 07:17:27 INFO - Successfully installed blessings 07:17:27 INFO - Cleaning up... 07:17:27 INFO - Return code: 0 07:17:27 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:17:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:17:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:17:27 INFO - Reading from file tmpfile_stdout 07:17:27 INFO - Current package versions: 07:17:27 INFO - argparse == 1.2.1 07:17:27 INFO - blessings == 1.6 07:17:27 INFO - blobuploader == 1.2.4 07:17:27 INFO - docopt == 0.6.1 07:17:27 INFO - functools32 == 3.2.3-2 07:17:27 INFO - jsonschema == 2.5.1 07:17:27 INFO - manifestparser == 1.1 07:17:27 INFO - mozInstall == 1.12 07:17:27 INFO - mozcrash == 0.17 07:17:27 INFO - mozdebug == 0.1 07:17:27 INFO - mozdevice == 0.48 07:17:27 INFO - mozfile == 1.2 07:17:27 INFO - mozhttpd == 0.7 07:17:27 INFO - mozinfo == 0.9 07:17:27 INFO - mozleak == 0.1 07:17:27 INFO - mozlog == 3.2 07:17:27 INFO - moznetwork == 0.27 07:17:27 INFO - mozprocess == 0.22 07:17:27 INFO - mozprofile == 0.28 07:17:27 INFO - mozrunner == 6.11 07:17:27 INFO - mozscreenshot == 0.1 07:17:27 INFO - mozsystemmonitor == 0.3 07:17:27 INFO - moztest == 0.7 07:17:27 INFO - mozversion == 1.4 07:17:27 INFO - psutil == 3.1.1 07:17:27 INFO - requests == 1.2.3 07:17:27 INFO - wsgiref == 0.1.2 07:17:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:27 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:27 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 07:17:27 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 07:17:27 INFO - Using env: {'DISPLAY': ':0', 07:17:27 INFO - 'HOME': '/home/cltbld', 07:17:27 INFO - 'LANG': 'en_US.UTF-8', 07:17:27 INFO - 'LANGUAGE': 'en_US:en', 07:17:27 INFO - 'LOGNAME': 'cltbld', 07:17:27 INFO - 'MAIL': '/var/mail/cltbld', 07:17:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:27 INFO - 'MOZ_NO_REMOTE': '1', 07:17:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:27 INFO - 'NO_EM_RESTART': '1', 07:17:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:27 INFO - 'PWD': '/builds/slave/test', 07:17:27 INFO - 'SHELL': '/bin/bash', 07:17:27 INFO - 'SHLVL': '1', 07:17:27 INFO - 'TERM': 'linux', 07:17:27 INFO - 'TMOUT': '86400', 07:17:27 INFO - 'USER': 'cltbld', 07:17:27 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:27 INFO - '_': '/tools/buildbot/bin/python'} 07:17:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 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)) 07:17:27 INFO - Cleaning up... 07:17:27 INFO - Return code: 0 07:17:27 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:27 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 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:27 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 07:17:27 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 07:17:27 INFO - Using env: {'DISPLAY': ':0', 07:17:27 INFO - 'HOME': '/home/cltbld', 07:17:27 INFO - 'LANG': 'en_US.UTF-8', 07:17:27 INFO - 'LANGUAGE': 'en_US:en', 07:17:27 INFO - 'LOGNAME': 'cltbld', 07:17:27 INFO - 'MAIL': '/var/mail/cltbld', 07:17:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:27 INFO - 'MOZ_NO_REMOTE': '1', 07:17:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:27 INFO - 'NO_EM_RESTART': '1', 07:17:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:27 INFO - 'PWD': '/builds/slave/test', 07:17:27 INFO - 'SHELL': '/bin/bash', 07:17:27 INFO - 'SHLVL': '1', 07:17:27 INFO - 'TERM': 'linux', 07:17:27 INFO - 'TMOUT': '86400', 07:17:27 INFO - 'USER': 'cltbld', 07:17:27 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:27 INFO - '_': '/tools/buildbot/bin/python'} 07:17:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:28 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:17:28 INFO - Cleaning up... 07:17:28 INFO - Return code: 0 07:17:28 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 07:17:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:17:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:17:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:17:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2f60980f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19008a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19cb350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, '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': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', '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 07:17:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 07:17:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 07:17:28 INFO - Using env: {'DISPLAY': ':0', 07:17:28 INFO - 'HOME': '/home/cltbld', 07:17:28 INFO - 'LANG': 'en_US.UTF-8', 07:17:28 INFO - 'LANGUAGE': 'en_US:en', 07:17:28 INFO - 'LOGNAME': 'cltbld', 07:17:28 INFO - 'MAIL': '/var/mail/cltbld', 07:17:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:28 INFO - 'MOZ_NO_REMOTE': '1', 07:17:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:28 INFO - 'NO_EM_RESTART': '1', 07:17:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:28 INFO - 'PWD': '/builds/slave/test', 07:17:28 INFO - 'SHELL': '/bin/bash', 07:17:28 INFO - 'SHLVL': '1', 07:17:28 INFO - 'TERM': 'linux', 07:17:28 INFO - 'TMOUT': '86400', 07:17:28 INFO - 'USER': 'cltbld', 07:17:28 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:28 INFO - '_': '/tools/buildbot/bin/python'} 07:17:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:17:28 INFO - Downloading/unpacking flake8 07:17:28 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 07:17:28 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 07:17:28 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 07:17:28 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 07:17:28 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 07:17:28 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 07:17:30 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:17:30 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:17:30 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 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 07:17:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 07:17:31 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:17:31 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:17:31 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:17:31 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:17:31 INFO - no previously-included directories found matching 'docs/_build' 07:17:31 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:17:31 INFO - Running setup.py install for pep8 07:17:31 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:17:31 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:17:31 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:17:31 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:17:31 INFO - no previously-included directories found matching 'docs/_build' 07:17:31 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 07:17:31 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:17:31 INFO - Cleaning up... 07:17:31 INFO - Return code: 0 07:17:31 INFO - Running post-action listener: _resource_record_post_action 07:17:31 INFO - Running post-action listener: _start_resource_monitoring 07:17:31 INFO - Starting resource monitoring. 07:17:31 INFO - ##### 07:17:31 INFO - ##### Finished create-virtualenv step (success) 07:17:31 INFO - ##### 07:17:31 INFO - ##### 07:17:31 INFO - ##### Running install step. 07:17:31 INFO - ##### 07:17:31 INFO - Running pre-action listener: _resource_record_pre_action 07:17:31 INFO - Running main action method: install 07:17:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:17:31 INFO - Reading from file tmpfile_stdout 07:17:31 INFO - Detecting whether we're running mozinstall >=1.0... 07:17:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:17:31 INFO - Reading from file tmpfile_stdout 07:17:31 INFO - Output received: 07:17:31 INFO - Usage: mozinstall [options] installer 07:17:31 INFO - Options: 07:17:31 INFO - -h, --help show this help message and exit 07:17:31 INFO - -d DEST, --destination=DEST 07:17:31 INFO - Directory to install application into. [default: 07:17:31 INFO - "/builds/slave/test"] 07:17:31 INFO - --app=APP Application being installed. [default: firefox] 07:17:31 INFO - mkdir: /builds/slave/test/build/application 07:17:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 07:17:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 07:17:47 INFO - Reading from file tmpfile_stdout 07:17:47 INFO - Output received: 07:17:47 INFO - /builds/slave/test/build/application/firefox/firefox 07:17:47 INFO - Running post-action listener: _resource_record_post_action 07:17:47 INFO - ##### 07:17:47 INFO - ##### Finished install step (success) 07:17:47 INFO - ##### 07:17:47 INFO - ##### 07:17:47 INFO - ##### Running run-tests step. 07:17:47 INFO - ##### 07:17:47 INFO - Running pre-action listener: _resource_record_pre_action 07:17:47 INFO - Running main action method: run_tests 07:17:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:17:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:17:47 INFO - Python 2.7.3 07:17:47 INFO - Return code: 0 07:17:47 INFO - grabbing minidump binary from tooltool 07:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:17:47 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 0x1a5a1c0>, '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 0x1a5b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a5b550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:17:47 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 07:17:47 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 07:17:47 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 07:17:47 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:17:47 INFO - Return code: 0 07:17:47 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:17:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:17:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:17:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:17:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:17:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 07:17:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 07:17:48 INFO - Return code: 0 07:17:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 07:17:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-043 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 07:17:48 INFO - Using env: {'DISPLAY': ':0', 07:17:48 INFO - 'HOME': '/home/cltbld', 07:17:48 INFO - 'LANG': 'en_US.UTF-8', 07:17:48 INFO - 'LANGUAGE': 'en_US:en', 07:17:48 INFO - 'LOGNAME': 'cltbld', 07:17:48 INFO - 'MAIL': '/var/mail/cltbld', 07:17:48 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:17:48 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:17:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:17:48 INFO - 'MOZ_NO_REMOTE': '1', 07:17:48 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:17:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:17:48 INFO - 'NO_EM_RESTART': '1', 07:17:48 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:17:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:17:48 INFO - 'PWD': '/builds/slave/test', 07:17:48 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:17:48 INFO - 'SHELL': '/bin/bash', 07:17:48 INFO - 'SHLVL': '1', 07:17:48 INFO - 'TERM': 'linux', 07:17:48 INFO - 'TMOUT': '86400', 07:17:48 INFO - 'USER': 'cltbld', 07:17:48 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1466518614.297966-574441065', 07:17:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:17:48 INFO - '_': '/tools/buildbot/bin/python'} 07:17:48 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 07:17:49 INFO - mozversion application_buildid: 20160621064400 07:17:49 INFO - mozversion application_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 07:17:49 INFO - mozversion application_display_name: Nightly 07:17:49 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:17:49 INFO - mozversion application_name: Firefox 07:17:49 INFO - mozversion application_remotingname: firefox 07:17:49 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 07:17:49 INFO - mozversion application_vendor: Mozilla 07:17:49 INFO - mozversion application_version: 50.0a1 07:17:49 INFO - mozversion platform_buildid: 20160621064400 07:17:49 INFO - mozversion platform_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 07:17:49 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 07:17:49 INFO - mozversion platform_version: 50.0a1 07:17:49 INFO - using testdate: 1466518669 07:17:49 INFO - actual date: 1466518669 07:17:49 INFO - starting webserver on 'localhost:55040' 07:17:49 INFO - SUITE-START | Running 2 tests 07:17:49 INFO - TEST-START | dromaeo_css 07:17:49 INFO - operating with platform_type : linux_ 07:17:49 INFO - Initialising browser for dromaeo_css test... 07:17:49 INFO - TEST-INFO | started process 4794 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkz50ii/profile http://localhost:55040/getInfo.html) 07:17:54 INFO - PROCESS | 4794 | __metrics Screen width/height:1600/1200 07:17:54 INFO - PROCESS | 4794 | colorDepth:24 07:17:54 INFO - PROCESS | 4794 | Browser inner width/height: 1024/697 07:17:54 INFO - PROCESS | 4794 | __metrics 07:17:55 ERROR - PROCESS | 4794 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 07:17:55 INFO - TEST-INFO | 4794: exit 0 07:17:55 INFO - Browser initialized. 07:17:55 INFO - Running cycle 1/1 for dromaeo_css test... 07:17:55 INFO - TEST-INFO | started process 4912 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkz50ii/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:18:08 INFO - PROCESS | 4912 | RSS: Main: 185802752 07:18:08 INFO - PROCESS | 4912 | 07:18:57 INFO - PROCESS | 4912 | 1466518737834 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] 07:21:10 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55040/tests/dromaeo/cssquery-ext.html) 07:21:11 INFO - PROCESS | 4912 | RSS: Main: 188915712 07:21:11 INFO - PROCESS | 4912 | 07:24:13 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-ext.html (next: http://localhost:55040/tests/dromaeo/cssquery-jquery.html) 07:24:14 INFO - PROCESS | 4912 | RSS: Main: 187981824 07:24:14 INFO - PROCESS | 4912 | 07:27:16 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55040/tests/dromaeo/cssquery-mootools.html) 07:27:16 INFO - PROCESS | 4912 | RSS: Main: 188923904 07:27:16 INFO - PROCESS | 4912 | 07:30:18 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55040/tests/dromaeo/cssquery-prototype.html) 07:30:19 INFO - PROCESS | 4912 | RSS: Main: 186687488 07:30:19 INFO - PROCESS | 4912 | 07:33:21 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55040/tests/dromaeo/cssquery-yui.html) 07:33:22 INFO - PROCESS | 4912 | RSS: Main: 188772352 07:33:22 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | Cycle 1(1): loaded http://localhost:55040/tests/dromaeo/cssquery-yui.html (next: http://localhost:55040/tests/dromaeo/cssquery-dojo.html) 07:36:25 INFO - PROCESS | 4912 | RSS: Main: 189599744 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | __start_tp_report 07:36:25 INFO - PROCESS | 4912 | _x_x_mozilla_page_load 07:36:25 INFO - PROCESS | 4912 | _x_x_mozilla_page_load_details 07:36:25 INFO - PROCESS | 4912 | |i|pagename|runs| 07:36:25 INFO - PROCESS | 4912 | |0;dojo.html;2607.4915391498653;2648.695400028996;2655.2565281721118;2662.9201123966263;2692.663417072865;4837.80648774049;4905.607551395884;4921.630877684179;4932.235503496955;4972.428170760364;4698.31874378215;4800.063987522434;4831.903361932759;4881.4630390657;4906.509349065092;4439.489458712257;4471.776411179428;4586;4592.839250626229;4606.60843828275;510.5898900556225;4373.365861950016;4387.978060109695;4456.487503937056;4490.169318676056;4492.236319825637;4495.685302028843;4505.504394516601;4511.639068874515;4536.523665015192;4470.977645111753;4501.324801279834;4513.368128462018;4516.23224051912;4552.635789136861;4341.630961368288;4399.494058183318;4438.467383913919;4474.798634061475;4475.977620111878;4875.195592727196;4879.1461494238365;4882.218844984821;4902.852914412573;4974.60203183748;5148.9485105149215;5215.791368345262;5218.311511333625;5233.528982391603;5265.921011184835;5141.5886729061585;5166.095933211711;5176.197689358156;5220.321358223445;5299.099153143936;4882.3408839806525;4889.559939605452;4892.63305252104;4900.656954013256;4939.975300123477;5230.843074707765;5287.735613219324;5341.4925582069645;5343.385510666245;5350.464953504618;5112.309838171799;5115;5118.59051275897;5122.282880396748;5155.819546315861;5157.690538567698;5199.688018718889;5200.505951934636;5212.270282160501;5218.191180367049;5034.0938631046765;5058.570021548209;5089.898202035939;5106.948930510722;5143.819966301162;5078.873028174326;5083.313752643419;5087.287779710843;5096.821611243588;5146.485351464824;4306.181825453154;4323.956760432418;4324.9135017300105;4332.978335108367;4362.541933097043;3737.0657335666083;3737.2338670573013;3786.4320351947426;3802.7528210666774;3845.2117315950163;4369.300911854088;4372.934405983913;4391.209582275157;4417.911641767211;4485.192665320274;5163.586913046947;5167.095758242368;5191.065608190562;5192.506711862443;5195.168772996302;4366.716163449366;4406.669499787528;4455.086707225011;4463.754493502824;4466.642668586505;4623.722576645412;4646.86059418218;4651;4656.045510670305;4674;4744.478107408251;4819.108464933998;4823.397075365579;4862.562369386772;4909.3126962225315;5154.14956532183;5182.844514664566;5205.45342739007;5211.426743058185;5215.061288968022;4821.54195351441;4862.781174847069;4863.7324947128245;4876.561109500162;4954.1825598775795;5056.82301119459;5102.974485127551;5148.794048238028;5150.072986862401;5185.870353241199;5175.120229560908;5191.325127733521;5193.350831146106;5197.506236907488;5239.135542635422;5042.4705405931845;5046.545810877039;5055.898882022412;5056;5118.641695081308;5013.473585273494;5016.623753218596;5021.347224860745;5040.319556859924;5076.974615127048;4966.130927087817;4971.577415919687;4975.975120124521;4997.725125118008;5053.2420136979745;5076.847694569169;5089.414717307409;5095.77069031887;5105.897882042264;5117.8720531987;4871.2206047032305;4985.626078044089;4997.775100120576;5022.17134172872;5039.697618142924 07:36:25 INFO - PROCESS | 4912 | |1;ext.html;537.9486667712148;581.5202457972173;587.838344455275;597.2832600878944;617.3795335687633;36670.44994325084;38870.61129388705;40096.398554021674;40157.79921100398;40458.59541404585;40649;41313.38029929546;41379;41464.378034329435;41614.375784363256;7945.006874140747;7964;8015.158408367125;8061.153578874222;8107.229813167769;7924;7970.601469926481;7980;7988.68045278191;8015.398845086613;7983.361331093528;7989.480683755537;8003.399745019117;8014.158513356101;8045.235702608243;7958.283754462097;7990.960045199766;8000.239977202185;8016;8025.558594277312;7843.960780196119;7919.287264146197;7926.524408535506;7938.483998540134;7940.364770818321;30546.69453305483;39263;39605;39918;39941.20117597661;2968.5992391027153;3037.6202974628172;3040.559118927765;3070.431970085519;3107.254258977852;27792;28144.718552814415;28531;29455.11634650964;29643.258918526994;3519.1554027033585;3528.2061536154415;3546.343926373603;3560.839762210681;3572.1962558424407;264514;267316;268184;270144;271642;56000.719996399755;56269.155962660596;56296;56701.46388288927;57024;33312.83343583315;34065.659343406245;34282.82858585741;59396.1090583633;59475.40524594699;13756.587302380945;13903.513377031957;13917.608239176001;13925.930370348286;13928.442862285598;10216.744581385376;10266.076053155102;10316.329438586468;10349.120324772479;10370.896291036994;18828.24687012504;18835.81164188368;18925.716114258295;18956;18976.620467590572;6801.65991700413;6820.590764554143;6961.129858767654;7022.6488675566015;7103;777.1296148313925;897.3001059173724;930.7068273493828;937.4609599480326;1019.8521214424015;28233.71766282352;28675.28311792222;28788.49979506758;28875.566866497018;28936.710632893824;946.4510583861344;964.5563041001218;1003.603576587244;1005.3110773899772;1041.031840388431;15319.61700957485;15333.233338333039;15339;15460;15547.378104875905;403887;406024;406252;407319;408401;50954;51554.48445515572;51619.48380516222;51640.74179629078;51675.22487162695;1075.4031512510633;1083.4528563075596;1145.9828102578467;1176.4882276209876;1183.4378670131791;26742.19773406801;27928.30179245535;28200.43599128047;28739.425211496073;28960.42079158363;38911.61088389193;38984.220315594095;39019.2196156081;39061.41407878827;39172;320386;320424;320529;321432;321842;25522;26058.86970565211;26237.868810655826;26245.34386640349;26516.734832651426;42833.357499636906;42847.14305713806;43281.56718432775;43799.56200437955;44236.11527769362;36974;37233.62766372302;37337.81331093327;37681.81159094187;37894;36507.452388214726;37058.54856835897;37313.44029839609;37497.25005499929;37637.24725505529;36071.45892811557;36108.63891361053;36874.631253688196;36906.44640330451;37175.81412092922;32269;33266;33329.00012999614;33406;33542.49686254757;24273.757262427855;24576.631350530115;24788.876055620327;25032.874835625706;25262.368440789127 07:36:25 INFO - PROCESS | 4912 | |2;jquery.html;359.9892003239902;369.5159341262945;369.9001269657191;377.1739889641685;394.4773175542407;16382;16919.74620380694;17550.561235969108;17633.55916102098;17686.292548298054;15371.538853834403;16449.424270150546;16781.077040762753;16809;16988;5010.549050585438;5180.404253510838;5218.817341393052;5220.791168353261;5223.059849227137;3772;5145.665531740444;5665.461781130786;6026.54800889935;6027.60820546663;6067.24159480065;6083.48290395317;6094.786682466114;6100.96949515254;6120.326764055951;5105.157648987913;5428.131498960167;5432.158015507603;5495.752691128909;5507.531859791922;5282.709450980195;5295.338082739658;5315.123004704219;5351.277577527062;5361.035013697533;12564.560240391635;12927.870721292855;13022.218666879922;19944.900275498676;20056.814494186303;1905.1712505060343;1917.2235244725769;1976.8418526517987;2086.457521044539;2312.90748370065;9541.809163816753;9596.95201523988;9638.132568068837;11986;13030.609081727564;1706.7269236922034;1739.6868563658536;1781.8930864148192;1802.3241284518306;1831.679456095178;66978.74721475621;69203.30796692018;69642.30357696358;69700.3029969704;69923.3007669927;9840.753981150528;9910;9949.701508954742;9976.45129517869;10817.459127043616;13237.602871913858;13286.402111904987;13337;13411.530596429078;13434.193948363129;6914.757983470555;6963.9303606964295;6976.790696279119;7039.084918960605;7133.5719856808755;6558.639274839834;6609.5373323867825;6614.636195009224;6675.933240667531;6788.422984046411;4201.768902710381;4214.620684138442;4231.978840105841;4260.659147268211;4492.056668099735;1666;1666.2918259739563;1731.5497970527754;1806.5573934385898;1867.7011678131435;807.463037080335;843.4264700004056;894.6823877523516;916.8551867095792;924.4176169013479;16317.102559359111;16431.014139151688;16813.41153059637;16815.41146059882;16918.238679259463;810.8621534339177;838.9906174711654;858.0904241504026;859.441363113981;871.333429926107;9423;9499.335046546676;9518.095780900803;9527.809443811086;9644.18024467928;373922;384532;384858;385365;386649;47645;50355;59680;75307.62346188344;78585.21414785893;861.7587075618836;888.0941439731438;899.7885496908222;902.9683961061331;907.4736652741394;15761.290741916411;15888.761668574749;15936.024569117946;16137.838621613633;16500.42248521296;37389.626103738614;37496.81251593724;37803.243935121696;38319.23361532809;39004.219915602094;46000.76999614981;47757.76121119372;47794.28308575444;48990.26514602355;50155.49844501654;7452.888206676796;7538.849223015399;7747;8067.798305042421;8116.350691944512;11978;11982.460789264678;12074.637760867188;12266.877331226573;12377.752444951231;10383.94808025955;10557.155427565624;10692.946535267274;10733.570657173626;10861.945690271497;10631.255812093079;10830.837537437103;10915.781684366428;10972.067374272958;11140.832887506533;10635.308704934465;10859.728506787393;10926.399048052433;11006.724831879266;11101.777964440827;6564.704588293634;7239.4932354734665;7306.744263950736;7443.55338679681;8184.345252379914;9185.77035574116;9921.503924803586;9966.103050725469;10200.591976320864;10767 07:36:25 INFO - PROCESS | 4912 | |3;mootools.html;1330.4744625872784;1358.98076442668;1432.7134573085386;1605.3899518183089;1665.2007036622422;6939.791806245808;7716.344110750593;7727.381809455244;8286.627101780427;8293.087760346358;7816.570088645122;8041.678332866678;8109;8115.0667673217595;8126.918730812705;2178;2223.9888800556055;2226.64373700208;2230.7546169921297;2232.2633530934754;2186.890655467228;2203.801657850793;2233.2853486884205;2234.486068204306;2237.015713086245;2199.824014078878;2209.834262430316;2212.413710366754;2228.565429741201;2240.395093324801;2136.134865379516;2148.5165837686473;2148.6884401761813;2150.3333966470445;2155.805977462036;2132.4668832791804;2181.9236326728487;2183.3231698173618;2187.628103222456;2194.462356722613;7986.480878742863;8130.59347032646;8137.145599712004;8144.796380090486;8153.470024448451;4519.593236608721;4626.791794369262;4629.537046295377;4638.814447422099;4644.024754801496;2948.7198716121934;2970.376220993594;3173;3180.984095079533;3186.187522181852;921.4517362169498;970.854371844222;971.218169373654;973.990260097397;991.2317953585956;10830.241883068189;10901.1279097672;10930.890691093067;10944.124470042458;10946.616868409646;4159.584041595876;4317.740935543815;4357.803898824561;4399.38408622793;4412.205802955435;9301.069893010645;9312.022237664947;9315.534223288809;9360.4383736976;9374.62501499946;4716.221823399101;4793.592544633675;4794.184988551954;4805.255185446262;4831.227003679394;3656.213914008501;4250.851220207278;4267.743935363888;4358.106588149485;4408.382826404306;3693.353663108945;3751;3783.7729736215915;3827.1962887793875;3843.7117216208894;1194.665493661776;1232.0697873105748;1235.4131787401093;1239.0892693869998;1249.3066348176849;787.1027029186731;872.450356275555;878.6792820620556;894.3918135667808;917.3165991336497;5447.727613619303;5504.110342070445;5622.690752008679;5699.857503562361;5858.004139296245;794.9721759738497;874.5190145419994;918.1919910478736;936.203165021932;956.9617215311449;3565.5186549815444;3668.761530500509;3709.870154544578;3710.5547334319513;3738.7569807962395;9678.419294842332;9980.600775969026;9983.201343892471;10054.145397641136;10084.647037353658;9962.950185249027;9974.40153590787;9979.900200998043;9986.800263994679;9990.600375985025;7254.165770936304;7422.96288518554;7508.962455187799;7585.886211706828;7619.466637335444;5352.812651557177;5364.168553874156;5419.566434685137;5638.097904335286;5669.177969194526;9072;9158.084191580789;9234.861477077984;9264.72205833826;9291.303152263472;9181.54092295396;9381.108794664497;9476.336656433983;9542.33203675736;9561.235101192027;6103.145559621746;6686.665666716547;6917.481188910751;6993.125859267591;7130;7689;7699;7721.459497835098;7724.227577242231;7735.265149810759;6681.465482761465;6919.37725604698;6924.930750692429;6940.271271516418;7084;6880.931190688029;6894.172699275919;6931.480138989495;7021.543599666005;7056.470764692566;6482.286948435574;6495.317991611002;6522.15212022453;6540.607563546202;6612.23959244693;4524.5701658342405;4546.499885012712;4595.310703394518;4662.277347011219;4666.440027196622;4402.955970440383;4474.836542499039;4595.1958407277925;4618.861434156981;4702 07:36:25 INFO - PROCESS | 4912 | |4;prototype.html;297.79154591785755;310.7436364998876;311.26386096880884;312.5483676088054;314.8079671400445;4859.489753575876;4939.357883475143;5019.849404517866;5111.923321150181;5159.50984656458;4945.233488809231;4976.925346119802;5006.54941055305;5006.799728010875;5036.697798132105;3975.6681511693473;3988.7606743595334;3993.9800300998454;4002.1395399988996;4025.7584544927254;3868.7485313454677;3899.8245078971513;3960.940585891214;3994.0813612869056;4006.2588421142036;3913.706472014596;3922.293987082324;3942.901427464322;3943.2649634160875;3944.008275820721;3953.604639536052;3955.248502784462;3959.030037640782;3986.362182050858;4001.8599349022643;3541.8583256669704;3550.4851796489625;3560.1633616100194;3563.6436356364156;3580.0870777951454;4855.465898751135;4940.135476291671;4958.768554150611;4964.422140663635;5088.389393272794;4529.4791099023705;4533.954660453386;4552.408186935711;4554.544545545452;4582.473015603182;5293.206019097166;5319.787208511693;5323.1749078892835;5345.3585569731495;5360.973195134038;3738.196676383376;3864.5555761087553;3867.6325749053794;3880.1269714314335;3913.099987002977;5566.832995010156;5585.497305242548;5587.580931430119;5603.411641777596;5616.438356164392;3928.842846286174;3943.921121577552;3959.6238357356006;3978.6419222269556;3986.123052928351;3676.17286110623;4029.6776257899883;4048.1701251243426;4058.9594104059174;4063.963689259279;4416.293393057095;4427.490838553543;4439.378487011821;4447.644188464979;4448.397687352935;5292.7353632319;5293.041574617416;5306.442823503554;5352.812651557177;5359.598030147755;1268.1503392726895;1324.9470021199236;1343.8387393512842;1354.146887460913;1361.8161548191065;856.4047986649343;861.1259571534897;866.6533386645266;873.1355957601928;881.5894568690172;4099.549049604541;4102.405151253111;4113.465249517543;4131.376575874341;4153.792310384469;4778.665493415428;4834.492378300228;4856.538628830255;4859.857933385722;4867.415910090812;4132.979335103305;4167.395727619478;4173.330667732931;4210.431591735138;4222.345536441856;2517.6727025486935;2532.430203204301;2596.415806443535;2614.0328078610655;2614.045873256248;4521.796519156645;4528.592426681615;4535.365048893158;4546.477155127137;4570.611498022706;4917.975410122926;4931.432885218174;4937;4941;4977.950220497749;4543.45478542577;4666.2767271073035;5135.486451354909;5148.150555158357;5171.3535808024;5495.422980587141;5519.944800551943;5535;5556.861078473071;5560.441317556848;5201.479852014768;5389.75746091419;5407.405185429521;5419.05166595852;5464.759448626044;5160.845174644766;5166.32094569259;5169.224616307584;5178.352705911761;5180.7409629517615;3819.656230939229;3882.4758657580865;3896.8636097736444;3907.8632247871187;3917.451556781996;4923.975380123076;5570.108782594765;5570.749316280696;5571.4428557143965;5597.860053498695;5269.4730526947;5301.734913254399;5302.337207849019;5311.49540793624;5311.867203319948;5306.8938621228135;5357.8392648220615;5373.4357892422295;5383.67697938125;5410.75651595687;5079.6698214615935;5153.584289340577;5220.608454366014;5240.737963101754;5258.684478931276;5331.413544510178;5337.919931200958;5342.8512869733195;5351.678899266057;5395.70323632204;5230.424653288212;5232.738363081907;5242.895142097213;5264.736763161904;5272.156454967187 07:36:25 INFO - PROCESS | 4912 | |5;yui.html;609.2475792396392;629.4429429954491;665.2615596687674;680.2347359220877;703.7149954268519;13340.533081342155;13824.894008479323;14119.294035298233;14147.434102635907;14175.503857364994;11998.340091294996;12921.741565168692;13309.134906231087;13312.267825269606;13319.26744029078;617.0559044661675;779.2013186483842;794.3803833010261;796.6216047377478;801.7234054251275;771.5100910921577;805.0420000199744;807.6163822184474;807.7899746066006;808.8220591469867;841.4404421059987;844.7043534762814;847.0259201917783;847.7075408983891;847.7499137754346;831.9334453243756;835.4360806455649;842.2588122452264;843.2789964580287;844.4890841041143;616.1681729664916;616.8797084568511;618.774147436187;619.662284055191;619.8326451857973;13356.131851429724;13375.197488150645;13434.462621495226;13444.86555134446;13478;13389.86610133896;13621.591352259447;13800.861991380158;13878.791818122736;14178.361973711208;10384.844227336596;10424.478776061167;10451.947740261327;10540.104091152261;10618.203634727426;3379.1214284286016;3396.7792093513845;3402.166469215058;3410.215650400397;3489.180042689966;53800.461995379934;55619.44380556224;55934.72032639811;60479.09281360783;60590.69704651493;10343.84484232722;10424.426656533811;10518.263721539572;10533.631322903662;10747.623833165802;18425.170867311004;18578.349757758413;18615.255389784255;18625.975571343708;18822.905885470485;6943.132108486439;6967.79096627102;7002.929970700227;7126.786196414116;7191.173015103225;3621.203335266237;3665.2119794244363;3749.409336218238;3771.4342848572933;3846.786617011436;2958.8668509917106;3101.4727496325677;3105.8663587790293;3107.564940908275;3113.6886311369135;513.0610981903109;513.9434662187157;515.2734644151803;534.882325888304;535.0903464111027;400.3814107204376;439.22257604041306;445.71251542754743;462.36424915740855;505.79515296305055;7562.958634963645;7568.697252109854;7613.428992825449;7717.459777815611;7965.4822436541435;568.3464016381195;593.474774824275;609.7500024989733;611.5871786544064;616.7902913009598;3492.2666240089866;3694.5751238607904;3778.3387907116144;3816.427535869642;3851.8651847185215;90423.54788226017;91227;91858.54070729738;93875.53062234781;94588;83374;83979.5801020991;84372.73440898392;84580.57709711535;84606.57696711477;72982.63508682423;74804.2519574819;75169.62415187998;75701.56536694443;76868;7014.403775679124;7131.465140114408;7142.428605711634;7345.045144131443;7373.29953654402;38053.42919856149;38198.61801382062;43759.78120109379;44112.77943610262;45609.087818242784;39418.802905985285;39896.80051599723;41775.373369398876;52439.47560524346;62102.68948655228;10669.306495077795;10795.784084318428;10868.67393978182;10908.127349812155;11131.332120072822;12346.876531234931;12364.505419783109;12410.069244806495;12428.502859885502;12629.431675574437;11394.316341019565;11851.407429628656;11986.340751258764;12003.519859205884;12013.038956883604;12114.878851211728;12167.94946231754;12602.621921342374;12675.746485070431;12694.746105077662;10906.400147991619;11348;11449.59926402572;11535.942320288344;11712.765744685228;10070.295079344669;10245.743856403351;10490.685279441628;10571.68284951422;10707.411092389993;9740.366876153028;9925.205983521157;9957.551910164206;9989.800203996025;10018.849717254101 07:36:25 INFO - PROCESS | 4912 | __end_tp_report 07:36:25 INFO - PROCESS | 4912 | __start_cc_report 07:36:25 INFO - PROCESS | 4912 | _x_x_mozilla_cycle_collect,394 07:36:25 INFO - PROCESS | 4912 | __end_cc_report 07:36:25 INFO - PROCESS | 4912 | __startTimestamp1466519785643__endTimestamp 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | ------- Summary: start ------- 07:36:25 INFO - PROCESS | 4912 | Number of tests: 6 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#0] dojo.html Cycles:165 Average:4764.93 Median:4954.18 stddev:611.79 (12.3%) stddev-sans-first:589.79 07:36:25 INFO - PROCESS | 4912 | Values: 2607.5 2648.7 2655.3 2662.9 2692.7 4837.8 4905.6 4921.6 4932.2 4972.4 4698.3 4800.1 4831.9 4881.5 4906.5 4439.5 4471.8 4586.0 4592.8 4606.6 510.6 4373.4 4388.0 4456.5 4490.2 4492.2 4495.7 4505.5 4511.6 4536.5 4471.0 4501.3 4513.4 4516.2 4552.6 4341.6 4399.5 4438.5 4474.8 4476.0 4875.2 4879.1 4882.2 4902.9 4974.6 5148.9 5215.8 5218.3 5233.5 5265.9 5141.6 5166.1 5176.2 5220.3 5299.1 4882.3 4889.6 4892.6 4900.7 4940.0 5230.8 5287.7 5341.5 5343.4 5350.5 5112.3 5115.0 5118.6 5122.3 5155.8 5157.7 5199.7 5200.5 5212.3 5218.2 5034.1 5058.6 5089.9 5106.9 5143.8 5078.9 5083.3 5087.3 5096.8 5146.5 4306.2 4324.0 4324.9 4333.0 4362.5 3737.1 3737.2 3786.4 3802.8 3845.2 4369.3 4372.9 4391.2 4417.9 4485.2 5163.6 5167.1 5191.1 5192.5 5195.2 4366.7 4406.7 4455.1 4463.8 4466.6 4623.7 4646.9 4651.0 4656.0 4674.0 4744.5 4819.1 4823.4 4862.6 4909.3 5154.1 5182.8 5205.5 5211.4 5215.1 4821.5 4862.8 4863.7 4876.6 4954.2 5056.8 5103.0 5148.8 5150.1 5185.9 5175.1 5191.3 5193.4 5197.5 5239.1 5042.5 5046.5 5055.9 5056.0 5118.6 5013.5 5016.6 5021.3 5040.3 5077.0 4966.1 4971.6 4976.0 4997.7 5053.2 5076.8 5089.4 5095.8 5105.9 5117.9 4871.2 4985.6 4997.8 5022.2 5039.7 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#1] ext.html Cycles:180 Average:48470.64 Median:37117.18 stddev:88732.68 (239.1%) stddev-sans-first:88908.61 07:36:25 INFO - PROCESS | 4912 | Values: 537.9 581.5 587.8 597.3 617.4 36670.4 38870.6 40096.4 40157.8 40458.6 40649.0 41313.4 41379.0 41464.4 41614.4 7945.0 7964.0 8015.2 8061.2 8107.2 7924.0 7970.6 7980.0 7988.7 8015.4 7983.4 7989.5 8003.4 8014.2 8045.2 7958.3 7991.0 8000.2 8016.0 8025.6 7844.0 7919.3 7926.5 7938.5 7940.4 30546.7 39263.0 39605.0 39918.0 39941.2 2968.6 3037.6 3040.6 3070.4 3107.3 27792.0 28144.7 28531.0 29455.1 29643.3 3519.2 3528.2 3546.3 3560.8 3572.2 264514.0 267316.0 268184.0 270144.0 271642.0 56000.7 56269.2 56296.0 56701.5 57024.0 33312.8 34065.7 34282.8 59396.1 59475.4 13756.6 13903.5 13917.6 13925.9 13928.4 10216.7 10266.1 10316.3 10349.1 10370.9 18828.2 18835.8 18925.7 18956.0 18976.6 6801.7 6820.6 6961.1 7022.6 7103.0 777.1 897.3 930.7 937.5 1019.9 28233.7 28675.3 28788.5 28875.6 28936.7 946.5 964.6 1003.6 1005.3 1041.0 15319.6 15333.2 15339.0 15460.0 15547.4 403887.0 406024.0 406252.0 407319.0 408401.0 50954.0 51554.5 51619.5 51640.7 51675.2 1075.4 1083.5 1146.0 1176.5 1183.4 26742.2 27928.3 28200.4 28739.4 28960.4 38911.6 38984.2 39019.2 39061.4 39172.0 320386.0 320424.0 320529.0 321432.0 321842.0 25522.0 26058.9 26237.9 26245.3 26516.7 42833.4 42847.1 43281.6 43799.6 44236.1 36974.0 37233.6 37337.8 37681.8 37894.0 36507.5 37058.5 37313.4 37497.3 37637.2 36071.5 36108.6 36874.6 36906.4 37175.8 32269.0 33266.0 33329.0 33406.0 33542.5 24273.8 24576.6 24788.9 25032.9 25262.4 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#2] jquery.html Cycles:180 Average:23610.39 Median:25246.41 stddev:63005.28 (249.6%) stddev-sans-first:63157.84 07:36:25 INFO - PROCESS | 4912 | Values: 360.0 369.5 369.9 377.2 394.5 16382.0 16919.7 17550.6 17633.6 17686.3 15371.5 16449.4 16781.1 16809.0 16988.0 5010.5 5180.4 5218.8 5220.8 5223.1 3772.0 5145.7 5665.5 6026.5 6027.6 6067.2 6083.5 6094.8 6101.0 6120.3 5105.2 5428.1 5432.2 5495.8 5507.5 5282.7 5295.3 5315.1 5351.3 5361.0 12564.6 12927.9 13022.2 19944.9 20056.8 1905.2 1917.2 1976.8 2086.5 2312.9 9541.8 9597.0 9638.1 11986.0 13030.6 1706.7 1739.7 1781.9 1802.3 1831.7 66978.7 69203.3 69642.3 69700.3 69923.3 9840.8 9910.0 9949.7 9976.5 10817.5 13237.6 13286.4 13337.0 13411.5 13434.2 6914.8 6963.9 6976.8 7039.1 7133.6 6558.6 6609.5 6614.6 6675.9 6788.4 4201.8 4214.6 4232.0 4260.7 4492.1 1666.0 1666.3 1731.5 1806.6 1867.7 807.5 843.4 894.7 916.9 924.4 16317.1 16431.0 16813.4 16815.4 16918.2 810.9 839.0 858.1 859.4 871.3 9423.0 9499.3 9518.1 9527.8 9644.2 373922.0 384532.0 384858.0 385365.0 386649.0 47645.0 50355.0 59680.0 75307.6 78585.2 861.8 888.1 899.8 903.0 907.5 15761.3 15888.8 15936.0 16137.8 16500.4 37389.6 37496.8 37803.2 38319.2 39004.2 46000.8 47757.8 47794.3 48990.3 50155.5 7452.9 7538.8 7747.0 8067.8 8116.4 11978.0 11982.5 12074.6 12266.9 12377.8 10383.9 10557.2 10692.9 10733.6 10861.9 10631.3 10830.8 10915.8 10972.1 11140.8 10635.3 10859.7 10926.4 11006.7 11101.8 6564.7 7239.5 7306.7 7443.6 8184.3 9185.8 9921.5 9966.1 10200.6 10767.0 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#3] mootools.html Cycles:180 Average:5285.35 Median:5475.92 stddev:2973.49 (54.3%) stddev-sans-first:2966.98 07:36:25 INFO - PROCESS | 4912 | Values: 1330.5 1359.0 1432.7 1605.4 1665.2 6939.8 7716.3 7727.4 8286.6 8293.1 7816.6 8041.7 8109.0 8115.1 8126.9 2178.0 2224.0 2226.6 2230.8 2232.3 2186.9 2203.8 2233.3 2234.5 2237.0 2199.8 2209.8 2212.4 2228.6 2240.4 2136.1 2148.5 2148.7 2150.3 2155.8 2132.5 2181.9 2183.3 2187.6 2194.5 7986.5 8130.6 8137.1 8144.8 8153.5 4519.6 4626.8 4629.5 4638.8 4644.0 2948.7 2970.4 3173.0 3181.0 3186.2 921.5 970.9 971.2 974.0 991.2 10830.2 10901.1 10930.9 10944.1 10946.6 4159.6 4317.7 4357.8 4399.4 4412.2 9301.1 9312.0 9315.5 9360.4 9374.6 4716.2 4793.6 4794.2 4805.3 4831.2 3656.2 4250.9 4267.7 4358.1 4408.4 3693.4 3751.0 3783.8 3827.2 3843.7 1194.7 1232.1 1235.4 1239.1 1249.3 787.1 872.5 878.7 894.4 917.3 5447.7 5504.1 5622.7 5699.9 5858.0 795.0 874.5 918.2 936.2 957.0 3565.5 3668.8 3709.9 3710.6 3738.8 9678.4 9980.6 9983.2 10054.1 10084.6 9963.0 9974.4 9979.9 9986.8 9990.6 7254.2 7423.0 7509.0 7585.9 7619.5 5352.8 5364.2 5419.6 5638.1 5669.2 9072.0 9158.1 9234.9 9264.7 9291.3 9181.5 9381.1 9476.3 9542.3 9561.2 6103.1 6686.7 6917.5 6993.1 7130.0 7689.0 7699.0 7721.5 7724.2 7735.3 6681.5 6919.4 6924.9 6940.3 7084.0 6880.9 6894.2 6931.5 7021.5 7056.5 6482.3 6495.3 6522.2 6540.6 6612.2 4524.6 4546.5 4595.3 4662.3 4666.4 4403.0 4474.8 4595.2 4618.9 4702.0 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#4] prototype.html Cycles:180 Average:4330.67 Median:4858.01 stddev:1266.95 (26.1%) stddev-sans-first:1233.82 07:36:25 INFO - PROCESS | 4912 | Values: 297.8 310.7 311.3 312.5 314.8 4859.5 4939.4 5019.8 5111.9 5159.5 4945.2 4976.9 5006.5 5006.8 5036.7 3975.7 3988.8 3994.0 4002.1 4025.8 3868.7 3899.8 3960.9 3994.1 4006.3 3913.7 3922.3 3942.9 3943.3 3944.0 3953.6 3955.2 3959.0 3986.4 4001.9 3541.9 3550.5 3560.2 3563.6 3580.1 4855.5 4940.1 4958.8 4964.4 5088.4 4529.5 4534.0 4552.4 4554.5 4582.5 5293.2 5319.8 5323.2 5345.4 5361.0 3738.2 3864.6 3867.6 3880.1 3913.1 5566.8 5585.5 5587.6 5603.4 5616.4 3928.8 3943.9 3959.6 3978.6 3986.1 3676.2 4029.7 4048.2 4059.0 4064.0 4416.3 4427.5 4439.4 4447.6 4448.4 5292.7 5293.0 5306.4 5352.8 5359.6 1268.2 1324.9 1343.8 1354.1 1361.8 856.4 861.1 866.7 873.1 881.6 4099.5 4102.4 4113.5 4131.4 4153.8 4778.7 4834.5 4856.5 4859.9 4867.4 4133.0 4167.4 4173.3 4210.4 4222.3 2517.7 2532.4 2596.4 2614.0 2614.0 4521.8 4528.6 4535.4 4546.5 4570.6 4918.0 4931.4 4937.0 4941.0 4978.0 4543.5 4666.3 5135.5 5148.2 5171.4 5495.4 5519.9 5535.0 5556.9 5560.4 5201.5 5389.8 5407.4 5419.1 5464.8 5160.8 5166.3 5169.2 5178.4 5180.7 3819.7 3882.5 3896.9 3907.9 3917.5 4924.0 5570.1 5570.7 5571.4 5597.9 5269.5 5301.7 5302.3 5311.5 5311.9 5306.9 5357.8 5373.4 5383.7 5410.8 5079.7 5153.6 5220.6 5240.7 5258.7 5331.4 5337.9 5342.9 5351.7 5395.7 5230.4 5232.7 5242.9 5264.7 5272.2 07:36:25 INFO - PROCESS | 4912 | 07:36:25 INFO - PROCESS | 4912 | [#5] yui.html Cycles:180 Average:17029.40 Median:21087.88 stddev:23991.04 (113.8%) stddev-sans-first:24026.66 07:36:25 INFO - PROCESS | 4912 | Values: 609.2 629.4 665.3 680.2 703.7 13340.5 13824.9 14119.3 14147.4 14175.5 11998.3 12921.7 13309.1 13312.3 13319.3 617.1 779.2 794.4 796.6 801.7 771.5 805.0 807.6 807.8 808.8 841.4 844.7 847.0 847.7 847.7 831.9 835.4 842.3 843.3 844.5 616.2 616.9 618.8 619.7 619.8 13356.1 13375.2 13434.5 13444.9 13478.0 13389.9 13621.6 13800.9 13878.8 14178.4 10384.8 10424.5 10451.9 10540.1 10618.2 3379.1 3396.8 3402.2 3410.2 3489.2 53800.5 55619.4 55934.7 60479.1 60590.7 10343.8 10424.4 10518.3 10533.6 10747.6 18425.2 18578.3 18615.3 18626.0 18822.9 6943.1 6967.8 7002.9 7126.8 7191.2 3621.2 3665.2 3749.4 3771.4 3846.8 2958.9 3101.5 3105.9 3107.6 3113.7 513.1 513.9 515.3 534.9 535.1 400.4 439.2 445.7 462.4 505.8 7563.0 7568.7 7613.4 7717.5 7965.5 568.3 593.5 609.8 611.6 616.8 3492.3 3694.6 3778.3 3816.4 3851.9 90423.5 91227.0 91858.5 93875.5 94588.0 83374.0 83979.6 84372.7 84580.6 84606.6 72982.6 74804.3 75169.6 75701.6 76868.0 7014.4 7131.5 7142.4 7345.0 7373.3 38053.4 38198.6 43759.8 44112.8 45609.1 39418.8 39896.8 41775.4 52439.5 62102.7 10669.3 10795.8 10868.7 10908.1 11131.3 12346.9 12364.5 12410.1 12428.5 12629.4 11394.3 11851.4 11986.3 12003.5 12013.0 12114.9 12167.9 12602.6 12675.7 12694.7 10906.4 11348.0 11449.6 11535.9 11712.8 10070.3 10245.7 10490.7 10571.7 10707.4 9740.4 9925.2 9957.6 9989.8 10018.8 07:36:25 INFO - PROCESS | 4912 | -------- Summary: end -------- 07:36:25 INFO - PROCESS | 4912 | 07:36:26 INFO - TEST-INFO | 4912: exit 0 07:36:26 INFO - TEST-OK | dromaeo_css | took 1117449ms 07:36:26 INFO - TEST-START | kraken 07:36:26 INFO - operating with platform_type : linux_ 07:36:26 INFO - Initialising browser for kraken test... 07:36:26 INFO - TEST-INFO | started process 5186 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAT0msB/profile http://localhost:55040/getInfo.html) 07:36:31 INFO - PROCESS | 5186 | __metrics Screen width/height:1600/1200 07:36:31 INFO - PROCESS | 5186 | colorDepth:24 07:36:31 INFO - PROCESS | 5186 | Browser inner width/height: 1024/697 07:36:31 INFO - PROCESS | 5186 | __metrics 07:36:32 ERROR - PROCESS | 5186 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 07:36:33 INFO - TEST-INFO | 5186: exit 0 07:36:33 INFO - Browser initialized. 07:36:33 INFO - Running cycle 1/1 for kraken test... 07:36:33 INFO - TEST-INFO | started process 5305 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAT0msB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:36:45 INFO - PROCESS | 5305 | RSS: Main: 186294272 07:36:45 INFO - PROCESS | 5305 | 07:36:48 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55040/tests/kraken/driver.html?testName=audio-beat-detection) 07:36:49 INFO - PROCESS | 5305 | RSS: Main: 191025152 07:36:49 INFO - PROCESS | 5305 | 07:36:52 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55040/tests/kraken/driver.html?testName=audio-dft) 07:36:52 INFO - PROCESS | 5305 | RSS: Main: 190406656 07:36:52 INFO - PROCESS | 5305 | 07:36:55 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55040/tests/kraken/driver.html?testName=audio-fft) 07:36:56 INFO - PROCESS | 5305 | RSS: Main: 186216448 07:36:56 INFO - PROCESS | 5305 | 07:36:58 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55040/tests/kraken/driver.html?testName=audio-oscillator) 07:36:59 INFO - PROCESS | 5305 | RSS: Main: 186822656 07:36:59 INFO - PROCESS | 5305 | 07:37:01 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55040/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:37:01 INFO - PROCESS | 5305 | RSS: Main: 187330560 07:37:01 INFO - PROCESS | 5305 | 07:37:05 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55040/tests/kraken/driver.html?testName=imaging-darkroom) 07:37:05 INFO - PROCESS | 5305 | RSS: Main: 188313600 07:37:05 INFO - PROCESS | 5305 | 07:37:09 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55040/tests/kraken/driver.html?testName=imaging-desaturate) 07:37:09 INFO - PROCESS | 5305 | RSS: Main: 184451072 07:37:09 INFO - PROCESS | 5305 | 07:37:12 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55040/tests/kraken/driver.html?testName=json-parse-financial) 07:37:13 INFO - PROCESS | 5305 | RSS: Main: 185843712 07:37:13 INFO - PROCESS | 5305 | 07:37:15 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55040/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:37:15 INFO - PROCESS | 5305 | RSS: Main: 187076608 07:37:15 INFO - PROCESS | 5305 | 07:37:17 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:37:18 INFO - PROCESS | 5305 | RSS: Main: 187064320 07:37:18 INFO - PROCESS | 5305 | 07:37:20 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:37:21 INFO - PROCESS | 5305 | RSS: Main: 187269120 07:37:21 INFO - PROCESS | 5305 | 07:37:24 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:37:24 INFO - PROCESS | 5305 | RSS: Main: 187592704 07:37:24 INFO - PROCESS | 5305 | 07:37:27 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:37:28 INFO - PROCESS | 5305 | RSS: Main: 187432960 07:37:28 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | Cycle 1(1): loaded http://localhost:55040/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55040/tests/kraken/driver.html?testName=ai-astar) 07:37:30 INFO - PROCESS | 5305 | RSS: Main: 188178432 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | __start_tp_report 07:37:30 INFO - PROCESS | 5305 | _x_x_mozilla_page_load 07:37:30 INFO - PROCESS | 5305 | _x_x_mozilla_page_load_details 07:37:30 INFO - PROCESS | 5305 | |i|pagename|runs| 07:37:30 INFO - PROCESS | 5305 | |0;ai-astar;115;110;114;118;114;113;115;113;113;115 07:37:30 INFO - PROCESS | 5305 | |1;audio-beat-detection;162;132;159;175;133;162;160;144;197;133 07:37:30 INFO - PROCESS | 5305 | |2;audio-dft;162;164;175;165;163;163;163;164;163;165 07:37:30 INFO - PROCESS | 5305 | |3;audio-fft;77;77;77;173;76;76;76;77;165;78 07:37:30 INFO - PROCESS | 5305 | |4;audio-oscillator;87;88;151;86;86;88;131;89;87;156 07:37:30 INFO - PROCESS | 5305 | |5;imaging-gaussian-blur;118;119;118;118;119;118;119;119;118;119 07:37:30 INFO - PROCESS | 5305 | |6;imaging-darkroom;147;150;149;148;147;149;148;147;147;148 07:37:30 INFO - PROCESS | 5305 | |7;imaging-desaturate;95;96;95;96;96;96;96;96;95;95 07:37:30 INFO - PROCESS | 5305 | |8;json-parse-financial;65;64;65;66;67;65;66;65;66;66 07:37:30 INFO - PROCESS | 5305 | |9;json-stringify-tinderbox;65;66;65;67;66;65;67;65;65;66 07:37:30 INFO - PROCESS | 5305 | |10;stanford-crypto-aes;84;83;85;86;85;90;90;89;112;85 07:37:30 INFO - PROCESS | 5305 | |11;stanford-crypto-ccm;134;149;135;133;141;134;136;143;138;149 07:37:30 INFO - PROCESS | 5305 | |12;stanford-crypto-pbkdf2;172;175;172;168;172;167;170;173;172;172 07:37:30 INFO - PROCESS | 5305 | |13;stanford-crypto-sha256-iterative;69;69;69;69;68;69;71;68;69;67 07:37:30 INFO - PROCESS | 5305 | __end_tp_report 07:37:30 INFO - PROCESS | 5305 | __start_cc_report 07:37:30 INFO - PROCESS | 5305 | _x_x_mozilla_cycle_collect,1016 07:37:30 INFO - PROCESS | 5305 | __end_cc_report 07:37:30 INFO - PROCESS | 5305 | __startTimestamp1466519850485__endTimestamp 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | ------- Summary: start ------- 07:37:30 INFO - PROCESS | 5305 | Number of tests: 14 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#0] ai-astar Cycles:10 Average:114.00 Median:114.50 stddev:2.05 (1.8%) stddev-sans-first:2.15 07:37:30 INFO - PROCESS | 5305 | Values: 115.0 110.0 114.0 118.0 114.0 113.0 115.0 113.0 113.0 115.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#1] audio-beat-detection Cycles:10 Average:155.70 Median:161.00 stddev:20.86 (13.0%) stddev-sans-first:22.00 07:37:30 INFO - PROCESS | 5305 | Values: 162.0 132.0 159.0 175.0 133.0 162.0 160.0 144.0 197.0 133.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.00 stddev:3.74 (2.3%) stddev-sans-first:3.84 07:37:30 INFO - PROCESS | 5305 | Values: 162.0 164.0 175.0 165.0 163.0 163.0 163.0 164.0 163.0 165.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#3] audio-fft Cycles:10 Average:95.20 Median:77.00 stddev:38.95 (50.6%) stddev-sans-first:40.75 07:37:30 INFO - PROCESS | 5305 | Values: 77.0 77.0 77.0 173.0 76.0 76.0 76.0 77.0 165.0 78.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#4] audio-oscillator Cycles:10 Average:104.90 Median:87.00 stddev:29.05 (33.4%) stddev-sans-first:30.09 07:37:30 INFO - PROCESS | 5305 | Values: 87.0 88.0 151.0 86.0 86.0 88.0 131.0 89.0 87.0 156.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#5] imaging-gaussian-blur Cycles:10 Average:118.50 Median:119.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 07:37:30 INFO - PROCESS | 5305 | Values: 118.0 119.0 118.0 118.0 119.0 118.0 119.0 119.0 118.0 119.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:1.05 (0.7%) stddev-sans-first:1.05 07:37:30 INFO - PROCESS | 5305 | Values: 147.0 150.0 149.0 148.0 147.0 149.0 148.0 147.0 147.0 148.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 07:37:30 INFO - PROCESS | 5305 | Values: 95.0 96.0 95.0 96.0 96.0 96.0 96.0 96.0 95.0 95.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#8] json-parse-financial Cycles:10 Average:65.50 Median:66.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 07:37:30 INFO - PROCESS | 5305 | Values: 65.0 64.0 65.0 66.0 67.0 65.0 66.0 65.0 66.0 66.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#9] json-stringify-tinderbox Cycles:10 Average:65.70 Median:66.00 stddev:0.82 (1.2%) stddev-sans-first:0.83 07:37:30 INFO - PROCESS | 5305 | Values: 65.0 66.0 65.0 67.0 66.0 65.0 67.0 65.0 65.0 66.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#10] stanford-crypto-aes Cycles:10 Average:88.90 Median:85.50 stddev:8.49 (9.9%) stddev-sans-first:8.82 07:37:30 INFO - PROCESS | 5305 | Values: 84.0 83.0 85.0 86.0 85.0 90.0 90.0 89.0 112.0 85.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#11] stanford-crypto-ccm Cycles:10 Average:139.20 Median:139.50 stddev:6.07 (4.4%) stddev-sans-first:6.14 07:37:30 INFO - PROCESS | 5305 | Values: 134.0 149.0 135.0 133.0 141.0 134.0 136.0 143.0 138.0 149.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.30 Median:172.00 stddev:2.36 (1.4%) stddev-sans-first:2.49 07:37:30 INFO - PROCESS | 5305 | Values: 172.0 175.0 172.0 168.0 172.0 167.0 170.0 173.0 172.0 172.0 07:37:30 INFO - PROCESS | 5305 | 07:37:30 INFO - PROCESS | 5305 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.80 Median:69.00 stddev:1.03 (1.5%) stddev-sans-first:1.09 07:37:30 INFO - PROCESS | 5305 | Values: 69.0 69.0 69.0 69.0 68.0 69.0 71.0 68.0 69.0 67.0 07:37:30 INFO - PROCESS | 5305 | -------- Summary: end -------- 07:37:30 INFO - PROCESS | 5305 | 07:37:31 INFO - TEST-INFO | 5305: exit 0 07:37:31 INFO - TEST-OK | kraken | took 65127ms 07:37:31 INFO - SUITE-END | took 1182s 07:37:31 INFO - Completed test suite (00:19:42) 07:37:31 INFO - javascript benchmark 07:37:31 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6470.444788908957, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2607.4915391498653, 2648.695400028996, 2655.2565281721118, 2662.9201123966263, 2692.663417072865, 4837.80648774049, 4905.607551395884, 4921.630877684179, 4932.235503496955, 4972.428170760364, 4698.31874378215, 4800.063987522434, 4831.903361932759, 4881.4630390657, 4906.509349065092, 4439.489458712257, 4471.776411179428, 4586.0, 4592.839250626229, 4606.60843828275, 510.5898900556225, 4373.365861950016, 4387.978060109695, 4456.487503937056, 4490.169318676056, 4492.236319825637, 4495.685302028843, 4505.504394516601, 4511.639068874515, 4536.523665015192, 4470.977645111753, 4501.324801279834, 4513.368128462018, 4516.23224051912, 4552.635789136861, 4341.630961368288, 4399.494058183318, 4438.467383913919, 4474.798634061475, 4475.977620111878, 4875.195592727196, 4879.1461494238365, 4882.218844984821, 4902.852914412573, 4974.60203183748, 5148.9485105149215, 5215.791368345262, 5218.311511333625, 5233.528982391603, 5265.921011184835, 5141.5886729061585, 5166.095933211711, 5176.197689358156, 5220.321358223445, 5299.099153143936, 4882.3408839806525, 4889.559939605452, 4892.63305252104, 4900.656954013256, 4939.975300123477, 5230.843074707765, 5287.735613219324, 5341.4925582069645, 5343.385510666245, 5350.464953504618, 5112.309838171799, 5115.0, 5118.59051275897, 5122.282880396748, 5155.819546315861, 5157.690538567698, 5199.688018718889, 5200.505951934636, 5212.270282160501, 5218.191180367049, 5034.0938631046765, 5058.570021548209, 5089.898202035939, 5106.948930510722, 5143.819966301162, 5078.873028174326, 5083.313752643419, 5087.287779710843, 5096.821611243588, 5146.485351464824, 4306.181825453154, 4323.956760432418, 4324.9135017300105, 4332.978335108367, 4362.541933097043, 3737.0657335666083, 3737.2338670573013, 3786.4320351947426, 3802.7528210666774, 3845.2117315950163, 4369.300911854088, 4372.934405983913, 4391.209582275157, 4417.911641767211, 4485.192665320274, 5163.586913046947, 5167.095758242368, 5191.065608190562, 5192.506711862443, 5195.168772996302, 4366.716163449366, 4406.669499787528, 4455.086707225011, 4463.754493502824, 4466.642668586505, 4623.722576645412, 4646.86059418218, 4651.0, 4656.045510670305, 4674.0, 4744.478107408251, 4819.108464933998, 4823.397075365579, 4862.562369386772, 4909.3126962225315, 5154.14956532183, 5182.844514664566, 5205.45342739007, 5211.426743058185, 5215.061288968022, 4821.54195351441, 4862.781174847069, 4863.7324947128245, 4876.561109500162, 4954.1825598775795, 5056.82301119459, 5102.974485127551, 5148.794048238028, 5150.072986862401, 5185.870353241199, 5175.120229560908, 5191.325127733521, 5193.350831146106, 5197.506236907488, 5239.135542635422, 5042.4705405931845, 5046.545810877039, 5055.898882022412, 5056.0, 5118.641695081308, 5013.473585273494, 5016.623753218596, 5021.347224860745, 5040.319556859924, 5076.974615127048, 4966.130927087817, 4971.577415919687, 4975.975120124521, 4997.725125118008, 5053.2420136979745, 5076.847694569169, 5089.414717307409, 5095.77069031887, 5105.897882042264, 5117.8720531987, 4871.2206047032305, 4985.626078044089, 4997.775100120576, 5022.17134172872, 5039.697618142924], "value": 4726.649827189878, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [537.9486667712148, 581.5202457972173, 587.838344455275, 597.2832600878944, 617.3795335687633, 36670.44994325084, 38870.61129388705, 40096.398554021674, 40157.79921100398, 40458.59541404585, 40649.0, 41313.38029929546, 41379.0, 41464.378034329435, 41614.375784363256, 7945.006874140747, 7964.0, 8015.158408367125, 8061.153578874222, 8107.229813167769, 7924.0, 7970.601469926481, 7980.0, 7988.68045278191, 8015.398845086613, 7983.361331093528, 7989.480683755537, 8003.399745019117, 8014.158513356101, 8045.235702608243, 7958.283754462097, 7990.960045199766, 8000.239977202185, 8016.0, 8025.558594277312, 7843.960780196119, 7919.287264146197, 7926.524408535506, 7938.483998540134, 7940.364770818321, 30546.69453305483, 39263.0, 39605.0, 39918.0, 39941.20117597661, 2968.5992391027153, 3037.6202974628172, 3040.559118927765, 3070.431970085519, 3107.254258977852, 27792.0, 28144.718552814415, 28531.0, 29455.11634650964, 29643.258918526994, 3519.1554027033585, 3528.2061536154415, 3546.343926373603, 3560.839762210681, 3572.1962558424407, 264514.0, 267316.0, 268184.0, 270144.0, 271642.0, 56000.719996399755, 56269.155962660596, 56296.0, 56701.46388288927, 57024.0, 33312.83343583315, 34065.659343406245, 34282.82858585741, 59396.1090583633, 59475.40524594699, 13756.587302380945, 13903.513377031957, 13917.608239176001, 13925.930370348286, 13928.442862285598, 10216.744581385376, 10266.076053155102, 10316.329438586468, 10349.120324772479, 10370.896291036994, 18828.24687012504, 18835.81164188368, 18925.716114258295, 18956.0, 18976.620467590572, 6801.65991700413, 6820.590764554143, 6961.129858767654, 7022.6488675566015, 7103.0, 777.1296148313925, 897.3001059173724, 930.7068273493828, 937.4609599480326, 1019.8521214424015, 28233.71766282352, 28675.28311792222, 28788.49979506758, 28875.566866497018, 28936.710632893824, 946.4510583861344, 964.5563041001218, 1003.603576587244, 1005.3110773899772, 1041.031840388431, 15319.61700957485, 15333.233338333039, 15339.0, 15460.0, 15547.378104875905, 403887.0, 406024.0, 406252.0, 407319.0, 408401.0, 50954.0, 51554.48445515572, 51619.48380516222, 51640.74179629078, 51675.22487162695, 1075.4031512510633, 1083.4528563075596, 1145.9828102578467, 1176.4882276209876, 1183.4378670131791, 26742.19773406801, 27928.30179245535, 28200.43599128047, 28739.425211496073, 28960.42079158363, 38911.61088389193, 38984.220315594095, 39019.2196156081, 39061.41407878827, 39172.0, 320386.0, 320424.0, 320529.0, 321432.0, 321842.0, 25522.0, 26058.86970565211, 26237.868810655826, 26245.34386640349, 26516.734832651426, 42833.357499636906, 42847.14305713806, 43281.56718432775, 43799.56200437955, 44236.11527769362, 36974.0, 37233.62766372302, 37337.81331093327, 37681.81159094187, 37894.0, 36507.452388214726, 37058.54856835897, 37313.44029839609, 37497.25005499929, 37637.24725505529, 36071.45892811557, 36108.63891361053, 36874.631253688196, 36906.44640330451, 37175.81412092922, 32269.0, 33266.0, 33329.00012999614, 33406.0, 33542.49686254757, 24273.757262427855, 24576.631350530115, 24788.876055620327, 25032.874835625706, 25262.368440789127], "value": 17621.75633793889, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [359.9892003239902, 369.5159341262945, 369.9001269657191, 377.1739889641685, 394.4773175542407, 16382.0, 16919.74620380694, 17550.561235969108, 17633.55916102098, 17686.292548298054, 15371.538853834403, 16449.424270150546, 16781.077040762753, 16809.0, 16988.0, 5010.549050585438, 5180.404253510838, 5218.817341393052, 5220.791168353261, 5223.059849227137, 3772.0, 5145.665531740444, 5665.461781130786, 6026.54800889935, 6027.60820546663, 6067.24159480065, 6083.48290395317, 6094.786682466114, 6100.96949515254, 6120.326764055951, 5105.157648987913, 5428.131498960167, 5432.158015507603, 5495.752691128909, 5507.531859791922, 5282.709450980195, 5295.338082739658, 5315.123004704219, 5351.277577527062, 5361.035013697533, 12564.560240391635, 12927.870721292855, 13022.218666879922, 19944.900275498676, 20056.814494186303, 1905.1712505060343, 1917.2235244725769, 1976.8418526517987, 2086.457521044539, 2312.90748370065, 9541.809163816753, 9596.95201523988, 9638.132568068837, 11986.0, 13030.609081727564, 1706.7269236922034, 1739.6868563658536, 1781.8930864148192, 1802.3241284518306, 1831.679456095178, 66978.74721475621, 69203.30796692018, 69642.30357696358, 69700.3029969704, 69923.3007669927, 9840.753981150528, 9910.0, 9949.701508954742, 9976.45129517869, 10817.459127043616, 13237.602871913858, 13286.402111904987, 13337.0, 13411.530596429078, 13434.193948363129, 6914.757983470555, 6963.9303606964295, 6976.790696279119, 7039.084918960605, 7133.5719856808755, 6558.639274839834, 6609.5373323867825, 6614.636195009224, 6675.933240667531, 6788.422984046411, 4201.768902710381, 4214.620684138442, 4231.978840105841, 4260.659147268211, 4492.056668099735, 1666.0, 1666.2918259739563, 1731.5497970527754, 1806.5573934385898, 1867.7011678131435, 807.463037080335, 843.4264700004056, 894.6823877523516, 916.8551867095792, 924.4176169013479, 16317.102559359111, 16431.014139151688, 16813.41153059637, 16815.41146059882, 16918.238679259463, 810.8621534339177, 838.9906174711654, 858.0904241504026, 859.441363113981, 871.333429926107, 9423.0, 9499.335046546676, 9518.095780900803, 9527.809443811086, 9644.18024467928, 373922.0, 384532.0, 384858.0, 385365.0, 386649.0, 47645.0, 50355.0, 59680.0, 75307.62346188344, 78585.21414785893, 861.7587075618836, 888.0941439731438, 899.7885496908222, 902.9683961061331, 907.4736652741394, 15761.290741916411, 15888.761668574749, 15936.024569117946, 16137.838621613633, 16500.42248521296, 37389.626103738614, 37496.81251593724, 37803.243935121696, 38319.23361532809, 39004.219915602094, 46000.76999614981, 47757.76121119372, 47794.28308575444, 48990.26514602355, 50155.49844501654, 7452.888206676796, 7538.849223015399, 7747.0, 8067.798305042421, 8116.350691944512, 11978.0, 11982.460789264678, 12074.637760867188, 12266.877331226573, 12377.752444951231, 10383.94808025955, 10557.155427565624, 10692.946535267274, 10733.570657173626, 10861.945690271497, 10631.255812093079, 10830.837537437103, 10915.781684366428, 10972.067374272958, 11140.832887506533, 10635.308704934465, 10859.728506787393, 10926.399048052433, 11006.724831879266, 11101.777964440827, 6564.704588293634, 7239.4932354734665, 7306.744263950736, 7443.55338679681, 8184.345252379914, 9185.77035574116, 9921.503924803586, 9966.103050725469, 10200.591976320864, 10767.0], "value": 8159.9150162885935, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1330.4744625872784, 1358.98076442668, 1432.7134573085386, 1605.3899518183089, 1665.2007036622422, 6939.791806245808, 7716.344110750593, 7727.381809455244, 8286.627101780427, 8293.087760346358, 7816.570088645122, 8041.678332866678, 8109.0, 8115.0667673217595, 8126.918730812705, 2178.0, 2223.9888800556055, 2226.64373700208, 2230.7546169921297, 2232.2633530934754, 2186.890655467228, 2203.801657850793, 2233.2853486884205, 2234.486068204306, 2237.015713086245, 2199.824014078878, 2209.834262430316, 2212.413710366754, 2228.565429741201, 2240.395093324801, 2136.134865379516, 2148.5165837686473, 2148.6884401761813, 2150.3333966470445, 2155.805977462036, 2132.4668832791804, 2181.9236326728487, 2183.3231698173618, 2187.628103222456, 2194.462356722613, 7986.480878742863, 8130.59347032646, 8137.145599712004, 8144.796380090486, 8153.470024448451, 4519.593236608721, 4626.791794369262, 4629.537046295377, 4638.814447422099, 4644.024754801496, 2948.7198716121934, 2970.376220993594, 3173.0, 3180.984095079533, 3186.187522181852, 921.4517362169498, 970.854371844222, 971.218169373654, 973.990260097397, 991.2317953585956, 10830.241883068189, 10901.1279097672, 10930.890691093067, 10944.124470042458, 10946.616868409646, 4159.584041595876, 4317.740935543815, 4357.803898824561, 4399.38408622793, 4412.205802955435, 9301.069893010645, 9312.022237664947, 9315.534223288809, 9360.4383736976, 9374.62501499946, 4716.221823399101, 4793.592544633675, 4794.184988551954, 4805.255185446262, 4831.227003679394, 3656.213914008501, 4250.851220207278, 4267.743935363888, 4358.106588149485, 4408.382826404306, 3693.353663108945, 3751.0, 3783.7729736215915, 3827.1962887793875, 3843.7117216208894, 1194.665493661776, 1232.0697873105748, 1235.4131787401093, 1239.0892693869998, 1249.3066348176849, 787.1027029186731, 872.450356275555, 878.6792820620556, 894.3918135667808, 917.3165991336497, 5447.727613619303, 5504.110342070445, 5622.690752008679, 5699.857503562361, 5858.004139296245, 794.9721759738497, 874.5190145419994, 918.1919910478736, 936.203165021932, 956.9617215311449, 3565.5186549815444, 3668.761530500509, 3709.870154544578, 3710.5547334319513, 3738.7569807962395, 9678.419294842332, 9980.600775969026, 9983.201343892471, 10054.145397641136, 10084.647037353658, 9962.950185249027, 9974.40153590787, 9979.900200998043, 9986.800263994679, 9990.600375985025, 7254.165770936304, 7422.96288518554, 7508.962455187799, 7585.886211706828, 7619.466637335444, 5352.812651557177, 5364.168553874156, 5419.566434685137, 5638.097904335286, 5669.177969194526, 9072.0, 9158.084191580789, 9234.861477077984, 9264.72205833826, 9291.303152263472, 9181.54092295396, 9381.108794664497, 9476.336656433983, 9542.33203675736, 9561.235101192027, 6103.145559621746, 6686.665666716547, 6917.481188910751, 6993.125859267591, 7130.0, 7689.0, 7699.0, 7721.459497835098, 7724.227577242231, 7735.265149810759, 6681.465482761465, 6919.37725604698, 6924.930750692429, 6940.271271516418, 7084.0, 6880.931190688029, 6894.172699275919, 6931.480138989495, 7021.543599666005, 7056.470764692566, 6482.286948435574, 6495.317991611002, 6522.15212022453, 6540.607563546202, 6612.23959244693, 4524.5701658342405, 4546.499885012712, 4595.310703394518, 4662.277347011219, 4666.440027196622, 4402.955970440383, 4474.836542499039, 4595.1958407277925, 4618.861434156981, 4702.0], "value": 4252.340993164833, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [297.79154591785755, 310.7436364998876, 311.26386096880884, 312.5483676088054, 314.8079671400445, 4859.489753575876, 4939.357883475143, 5019.849404517866, 5111.923321150181, 5159.50984656458, 4945.233488809231, 4976.925346119802, 5006.54941055305, 5006.799728010875, 5036.697798132105, 3975.6681511693473, 3988.7606743595334, 3993.9800300998454, 4002.1395399988996, 4025.7584544927254, 3868.7485313454677, 3899.8245078971513, 3960.940585891214, 3994.0813612869056, 4006.2588421142036, 3913.706472014596, 3922.293987082324, 3942.901427464322, 3943.2649634160875, 3944.008275820721, 3953.604639536052, 3955.248502784462, 3959.030037640782, 3986.362182050858, 4001.8599349022643, 3541.8583256669704, 3550.4851796489625, 3560.1633616100194, 3563.6436356364156, 3580.0870777951454, 4855.465898751135, 4940.135476291671, 4958.768554150611, 4964.422140663635, 5088.389393272794, 4529.4791099023705, 4533.954660453386, 4552.408186935711, 4554.544545545452, 4582.473015603182, 5293.206019097166, 5319.787208511693, 5323.1749078892835, 5345.3585569731495, 5360.973195134038, 3738.196676383376, 3864.5555761087553, 3867.6325749053794, 3880.1269714314335, 3913.099987002977, 5566.832995010156, 5585.497305242548, 5587.580931430119, 5603.411641777596, 5616.438356164392, 3928.842846286174, 3943.921121577552, 3959.6238357356006, 3978.6419222269556, 3986.123052928351, 3676.17286110623, 4029.6776257899883, 4048.1701251243426, 4058.9594104059174, 4063.963689259279, 4416.293393057095, 4427.490838553543, 4439.378487011821, 4447.644188464979, 4448.397687352935, 5292.7353632319, 5293.041574617416, 5306.442823503554, 5352.812651557177, 5359.598030147755, 1268.1503392726895, 1324.9470021199236, 1343.8387393512842, 1354.146887460913, 1361.8161548191065, 856.4047986649343, 861.1259571534897, 866.6533386645266, 873.1355957601928, 881.5894568690172, 4099.549049604541, 4102.405151253111, 4113.465249517543, 4131.376575874341, 4153.792310384469, 4778.665493415428, 4834.492378300228, 4856.538628830255, 4859.857933385722, 4867.415910090812, 4132.979335103305, 4167.395727619478, 4173.330667732931, 4210.431591735138, 4222.345536441856, 2517.6727025486935, 2532.430203204301, 2596.415806443535, 2614.0328078610655, 2614.045873256248, 4521.796519156645, 4528.592426681615, 4535.365048893158, 4546.477155127137, 4570.611498022706, 4917.975410122926, 4931.432885218174, 4937.0, 4941.0, 4977.950220497749, 4543.45478542577, 4666.2767271073035, 5135.486451354909, 5148.150555158357, 5171.3535808024, 5495.422980587141, 5519.944800551943, 5535.0, 5556.861078473071, 5560.441317556848, 5201.479852014768, 5389.75746091419, 5407.405185429521, 5419.05166595852, 5464.759448626044, 5160.845174644766, 5166.32094569259, 5169.224616307584, 5178.352705911761, 5180.7409629517615, 3819.656230939229, 3882.4758657580865, 3896.8636097736444, 3907.8632247871187, 3917.451556781996, 4923.975380123076, 5570.108782594765, 5570.749316280696, 5571.4428557143965, 5597.860053498695, 5269.4730526947, 5301.734913254399, 5302.337207849019, 5311.49540793624, 5311.867203319948, 5306.8938621228135, 5357.8392648220615, 5373.4357892422295, 5383.67697938125, 5410.75651595687, 5079.6698214615935, 5153.584289340577, 5220.608454366014, 5240.737963101754, 5258.684478931276, 5331.413544510178, 5337.919931200958, 5342.8512869733195, 5351.678899266057, 5395.70323632204, 5230.424653288212, 5232.738363081907, 5242.895142097213, 5264.736763161904, 5272.156454967187], "value": 3926.975635270258, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [609.2475792396392, 629.4429429954491, 665.2615596687674, 680.2347359220877, 703.7149954268519, 13340.533081342155, 13824.894008479323, 14119.294035298233, 14147.434102635907, 14175.503857364994, 11998.340091294996, 12921.741565168692, 13309.134906231087, 13312.267825269606, 13319.26744029078, 617.0559044661675, 779.2013186483842, 794.3803833010261, 796.6216047377478, 801.7234054251275, 771.5100910921577, 805.0420000199744, 807.6163822184474, 807.7899746066006, 808.8220591469867, 841.4404421059987, 844.7043534762814, 847.0259201917783, 847.7075408983891, 847.7499137754346, 831.9334453243756, 835.4360806455649, 842.2588122452264, 843.2789964580287, 844.4890841041143, 616.1681729664916, 616.8797084568511, 618.774147436187, 619.662284055191, 619.8326451857973, 13356.131851429724, 13375.197488150645, 13434.462621495226, 13444.86555134446, 13478.0, 13389.86610133896, 13621.591352259447, 13800.861991380158, 13878.791818122736, 14178.361973711208, 10384.844227336596, 10424.478776061167, 10451.947740261327, 10540.104091152261, 10618.203634727426, 3379.1214284286016, 3396.7792093513845, 3402.166469215058, 3410.215650400397, 3489.180042689966, 53800.461995379934, 55619.44380556224, 55934.72032639811, 60479.09281360783, 60590.69704651493, 10343.84484232722, 10424.426656533811, 10518.263721539572, 10533.631322903662, 10747.623833165802, 18425.170867311004, 18578.349757758413, 18615.255389784255, 18625.975571343708, 18822.905885470485, 6943.132108486439, 6967.79096627102, 7002.929970700227, 7126.786196414116, 7191.173015103225, 3621.203335266237, 3665.2119794244363, 3749.409336218238, 3771.4342848572933, 3846.786617011436, 2958.8668509917106, 3101.4727496325677, 3105.8663587790293, 3107.564940908275, 3113.6886311369135, 513.0610981903109, 513.9434662187157, 515.2734644151803, 534.882325888304, 535.0903464111027, 400.3814107204376, 439.22257604041306, 445.71251542754743, 462.36424915740855, 505.79515296305055, 7562.958634963645, 7568.697252109854, 7613.428992825449, 7717.459777815611, 7965.4822436541435, 568.3464016381195, 593.474774824275, 609.7500024989733, 611.5871786544064, 616.7902913009598, 3492.2666240089866, 3694.5751238607904, 3778.3387907116144, 3816.427535869642, 3851.8651847185215, 90423.54788226017, 91227.0, 91858.54070729738, 93875.53062234781, 94588.0, 83374.0, 83979.5801020991, 84372.73440898392, 84580.57709711535, 84606.57696711477, 72982.63508682423, 74804.2519574819, 75169.62415187998, 75701.56536694443, 76868.0, 7014.403775679124, 7131.465140114408, 7142.428605711634, 7345.045144131443, 7373.29953654402, 38053.42919856149, 38198.61801382062, 43759.78120109379, 44112.77943610262, 45609.087818242784, 39418.802905985285, 39896.80051599723, 41775.373369398876, 52439.47560524346, 62102.68948655228, 10669.306495077795, 10795.784084318428, 10868.67393978182, 10908.127349812155, 11131.332120072822, 12346.876531234931, 12364.505419783109, 12410.069244806495, 12428.502859885502, 12629.431675574437, 11394.316341019565, 11851.407429628656, 11986.340751258764, 12003.519859205884, 12013.038956883604, 12114.878851211728, 12167.94946231754, 12602.621921342374, 12675.746485070431, 12694.746105077662, 10906.400147991619, 11348.0, 11449.59926402572, 11535.942320288344, 11712.765744685228, 10070.295079344669, 10245.743856403351, 10490.685279441628, 10571.68284951422, 10707.411092389993, 9740.366876153028, 9925.205983521157, 9957.551910164206, 9989.800203996025, 10018.849717254101], "value": 6465.220676519102, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1596.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 110.0, 114.0, 118.0, 114.0, 113.0, 115.0, 113.0, 113.0, 115.0], "value": 114.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 132.0, 159.0, 175.0, 133.0, 162.0, 160.0, 144.0, 197.0, 133.0], "value": 155.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 164.0, 175.0, 165.0, 163.0, 163.0, 163.0, 164.0, 163.0, 165.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 77.0, 173.0, 76.0, 76.0, 76.0, 77.0, 165.0, 78.0], "value": 95.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 88.0, 151.0, 86.0, 86.0, 88.0, 131.0, 89.0, 87.0, 156.0], "value": 104.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 119.0, 118.0, 118.0, 119.0, 118.0, 119.0, 119.0, 118.0, 119.0], "value": 118.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 150.0, 149.0, 148.0, 147.0, 149.0, 148.0, 147.0, 147.0, 148.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 65.0, 66.0, 67.0, 65.0, 66.0, 65.0, 66.0, 66.0], "value": 65.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 66.0, 65.0, 67.0, 66.0, 65.0, 67.0, 65.0, 65.0, 66.0], "value": 65.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 85.0, 86.0, 85.0, 90.0, 90.0, 89.0, 112.0, 85.0], "value": 88.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [134.0, 149.0, 135.0, 133.0, 141.0, 134.0, 136.0, 143.0, 138.0, 149.0], "value": 139.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 175.0, 172.0, 168.0, 172.0, 167.0, 170.0, 173.0, 172.0, 172.0], "value": 171.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 69.0, 69.0, 68.0, 69.0, 71.0, 68.0, 69.0, 67.0], "value": 68.8, "unit": "score"}]}]} 07:37:31 INFO - Return code: 0 07:37:31 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:37:31 ERROR - # TBPL SUCCESS # 07:37:31 INFO - Running post-action listener: _resource_record_post_action 07:37:31 INFO - ##### 07:37:31 INFO - ##### Finished run-tests step (success) 07:37:31 INFO - ##### 07:37:31 INFO - Running post-run listener: _resource_record_post_run 07:37:31 INFO - Total resource usage - Wall time: 1200s; CPU: 14.0%; Read bytes: 2158592; Write bytes: 552288256; Read time: 1264; Write time: 623280 07:37:31 INFO - TinderboxPrint: CPU usage
13.5% 07:37:31 INFO - TinderboxPrint: I/O read bytes / time
2,158,592 / 1,264 07:37:31 INFO - TinderboxPrint: I/O write bytes / time
552,288,256 / 623,280 07:37:31 INFO - TinderboxPrint: CPU idle
8,276.4 (86.5%) 07:37:31 INFO - TinderboxPrint: CPU user
1,235.1 (12.9%) 07:37:31 INFO - TinderboxPrint: Swap in / out
0 / 0 07:37:31 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 253550592; Read time: 0; Write time: 370184 07:37:31 INFO - run-tests - Wall time: 1184s; CPU: 14.0%; Read bytes: 2158592; Write bytes: 298151936; Read time: 1264; Write time: 253088 07:37:32 INFO - Running post-run listener: _upload_blobber_files 07:37:32 INFO - Blob upload gear active. 07:37:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:37:32 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 07:37:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:37:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:37:32 INFO - (blobuploader) - INFO - Open directory for files ... 07:37:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:37:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:37:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:37:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:37:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:37:33 INFO - (blobuploader) - INFO - Done attempting. 07:37:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:37:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:37:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:37:37 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:37:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:37:37 INFO - (blobuploader) - INFO - Done attempting. 07:37:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:37:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:37:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:37:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:37:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:37:38 INFO - (blobuploader) - INFO - Done attempting. 07:37:38 INFO - (blobuploader) - INFO - Iteration through files over. 07:37:38 INFO - Return code: 0 07:37:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:37:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:37:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/aa888559c2ccbe09248c9b4262e705fa486242134697cc50d2b8141d50acfe2c15a32b5fd5fc9c9526d7d80dbbd6d3b8886c72f5498851589e484072e7268404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f6c43f1703a25805e2265fe0470d1f1b44f3eca90a7f9e6de93167e77e6ee846d83b66f551a75503c89cae1fdf6453568351ace45638158f17d20f4ab7da67ff", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4aea6e73a9657c200775df8ee9170cb717fc0cdf23107bf73f9561901a57ce9613ca684a27693c8113a22ca8657a1828b64103aa9abef117e248dfa702b61151"} 07:37:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:37:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:37:38 INFO - Contents: 07:37:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/aa888559c2ccbe09248c9b4262e705fa486242134697cc50d2b8141d50acfe2c15a32b5fd5fc9c9526d7d80dbbd6d3b8886c72f5498851589e484072e7268404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f6c43f1703a25805e2265fe0470d1f1b44f3eca90a7f9e6de93167e77e6ee846d83b66f551a75503c89cae1fdf6453568351ace45638158f17d20f4ab7da67ff", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4aea6e73a9657c200775df8ee9170cb717fc0cdf23107bf73f9561901a57ce9613ca684a27693c8113a22ca8657a1828b64103aa9abef117e248dfa702b61151"} 07:37:38 INFO - Running post-run listener: copy_logs_to_upload_dir 07:37:38 INFO - Copying logs to upload dir... 07:37:38 INFO - mkdir: /builds/slave/test/build/upload/logs 07:37:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1242.675882 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-06-21 07:37:37.488140) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 07:37:37.491656) ========= 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=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/aa888559c2ccbe09248c9b4262e705fa486242134697cc50d2b8141d50acfe2c15a32b5fd5fc9c9526d7d80dbbd6d3b8886c72f5498851589e484072e7268404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f6c43f1703a25805e2265fe0470d1f1b44f3eca90a7f9e6de93167e77e6ee846d83b66f551a75503c89cae1fdf6453568351ace45638158f17d20f4ab7da67ff", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4aea6e73a9657c200775df8ee9170cb717fc0cdf23107bf73f9561901a57ce9613ca684a27693c8113a22ca8657a1828b64103aa9abef117e248dfa702b61151"} build_url:https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011221 build_url: 'https://queue.taskcluster.net/v1/task/PmiCwNN6SeSzutIzcI6EWw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/aa888559c2ccbe09248c9b4262e705fa486242134697cc50d2b8141d50acfe2c15a32b5fd5fc9c9526d7d80dbbd6d3b8886c72f5498851589e484072e7268404", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f6c43f1703a25805e2265fe0470d1f1b44f3eca90a7f9e6de93167e77e6ee846d83b66f551a75503c89cae1fdf6453568351ace45638158f17d20f4ab7da67ff", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4aea6e73a9657c200775df8ee9170cb717fc0cdf23107bf73f9561901a57ce9613ca684a27693c8113a22ca8657a1828b64103aa9abef117e248dfa702b61151"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 07:37:37.516670) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:37:37.516971) ========= 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=d2a8c569965ab8367867b893000001a1-1466518614.297966-574441065 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004454 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 07:37:37.602012) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 07:37:37.602432) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 07:37:37.602705) ========= ========= Total master_lag: 0.17 =========