builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-034 starttime: 1465366023.34 results: success (0) buildid: 20160607203013 builduid: cbad0c3de0f74bd9a62abdbc5329ba3e revision: a7b31be0a19ae5413db3e10ad4e5251cac84b08d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.342533) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.343965) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.344258) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.367594) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.367885) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-07 23:07:03-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.3M=0s 2016-06-07 23:07:03 (46.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.118812 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.542323) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.542639) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022105 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:03.577319) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-07 23:07:03.577652) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev a7b31be0a19ae5413db3e10ad4e5251cac84b08d --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 a7b31be0a19ae5413db3e10ad4e5251cac84b08d --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-07 23:07:03,942 truncating revision to first 12 chars 2016-06-07 23:07:03,942 Setting DEBUG logging. 2016-06-07 23:07:03,942 attempt 1/10 2016-06-07 23:07:03,942 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/a7b31be0a19a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-07 23:07:05,199 unpacking tar archive at: fx-team-a7b31be0a19a/testing/mozharness/ program finished with exit code 0 elapsedTime=1.619621 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-07 23:07:05.210830) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:05.211161) ========= script_repo_revision: a7b31be0a19ae5413db3e10ad4e5251cac84b08d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:05.211593) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:05.211862) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-07 23:07:05.221764) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-06-07 23:07:05.222111) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:07:05 INFO - MultiFileLogger online at 20160607 23:07:05 in /builds/slave/test 23:07:05 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 23:07:05 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:07:05 INFO - {'append_to_log': False, 23:07:05 INFO - 'base_work_dir': '/builds/slave/test', 23:07:05 INFO - 'blob_upload_branch': 'Fx-Team', 23:07:05 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:07:05 INFO - 'branch': 'Fx-Team', 23:07:05 INFO - 'buildbot_json_path': 'buildprops.json', 23:07:05 INFO - 'config_files': ('talos/linux_config.py',), 23:07:05 INFO - 'default_actions': ('clobber', 23:07:05 INFO - 'read-buildbot-config', 23:07:05 INFO - 'download-and-extract', 23:07:05 INFO - 'populate-webroot', 23:07:05 INFO - 'create-virtualenv', 23:07:05 INFO - 'install', 23:07:05 INFO - 'run-tests'), 23:07:05 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:07:05 INFO - 'download_minidump_stackwalk': True, 23:07:05 INFO - 'download_symbols': 'ondemand', 23:07:05 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:07:05 INFO - 'tooltool.py': '/tools/tooltool.py', 23:07:05 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:07:05 INFO - '/tools/misc-python/virtualenv.py')}, 23:07:05 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:07:05 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:07:05 INFO - 'installer_path': 'installer.exe', 23:07:05 INFO - 'log_level': 'info', 23:07:05 INFO - 'log_name': 'talos', 23:07:05 INFO - 'log_to_console': True, 23:07:05 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:07:05 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:07:05 INFO - 'opt_config_files': (), 23:07:05 INFO - 'pip_index': False, 23:07:05 INFO - 'sps_profile': False, 23:07:05 INFO - 'sps_profile_interval': 0, 23:07:05 INFO - 'suite': 'dromaeojs-e10s', 23:07:05 INFO - 'system_bits': '32', 23:07:05 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:07:05 INFO - 'title': 'talos-linux64-ix-034', 23:07:05 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:07:05 INFO - 'use_talos_json': True, 23:07:05 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:07:05 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:07:05 INFO - 'work_dir': 'build'} 23:07:05 INFO - ##### 23:07:05 INFO - ##### Running clobber step. 23:07:05 INFO - ##### 23:07:05 INFO - Running pre-action listener: _resource_record_pre_action 23:07:05 INFO - Running main action method: clobber 23:07:05 INFO - rmtree: /builds/slave/test/build 23:07:05 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:07:06 INFO - Running post-action listener: _resource_record_post_action 23:07:06 INFO - ##### 23:07:06 INFO - ##### Finished clobber step (success) 23:07:06 INFO - ##### 23:07:06 INFO - ##### 23:07:06 INFO - ##### Running read-buildbot-config step. 23:07:06 INFO - ##### 23:07:06 INFO - Running pre-action listener: _resource_record_pre_action 23:07:06 INFO - Running main action method: read_buildbot_config 23:07:06 INFO - Using buildbot properties: 23:07:06 INFO - { 23:07:06 INFO - "project": "", 23:07:06 INFO - "product": "firefox", 23:07:06 INFO - "script_repo_revision": "production", 23:07:06 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 23:07:06 INFO - "repository": "", 23:07:06 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 23:07:06 INFO - "buildid": "20160607203013", 23:07:06 INFO - "pgo_build": "True", 23:07:06 INFO - "basedir": "/builds/slave/test", 23:07:06 INFO - "buildnumber": 541, 23:07:06 INFO - "slavename": "talos-linux64-ix-034", 23:07:06 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 23:07:06 INFO - "platform": "ubuntu64_hw", 23:07:06 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 23:07:06 INFO - "branch": "fx-team", 23:07:06 INFO - "repo_path": "integration/fx-team", 23:07:06 INFO - "revision": "a7b31be0a19ae5413db3e10ad4e5251cac84b08d", 23:07:06 INFO - "stage_platform": "linux64-pgo", 23:07:06 INFO - "builduid": "cbad0c3de0f74bd9a62abdbc5329ba3e", 23:07:06 INFO - "slavebuilddir": "test" 23:07:06 INFO - } 23:07:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 23:07:06 INFO - Running post-action listener: _resource_record_post_action 23:07:06 INFO - ##### 23:07:06 INFO - ##### Finished read-buildbot-config step (success) 23:07:06 INFO - ##### 23:07:06 INFO - ##### 23:07:06 INFO - ##### Running download-and-extract step. 23:07:06 INFO - ##### 23:07:06 INFO - Running pre-action listener: _resource_record_pre_action 23:07:06 INFO - Running main action method: download_and_extract 23:07:06 INFO - mkdir: /builds/slave/test/build/tests 23:07:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:06 INFO - https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 23:07:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:07:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:07:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:08 INFO - Downloaded 1361 bytes. 23:07:08 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 23:07:08 INFO - Using the following test package requirements: 23:07:08 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 23:07:08 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:07:08 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:07:08 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'jsshell-linux-x86_64.zip'], 23:07:08 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:07:08 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 23:07:08 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:07:08 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:07:08 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:07:08 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:08 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:07:08 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:07:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:08 INFO - https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:07:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:07:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:07:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:10 INFO - Downloaded 24447005 bytes. 23:07:10 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'] 23:07:10 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 23:07:11 INFO - Return code: 0 23:07:11 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 23:07:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:11 INFO - https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:07:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:07:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 23:07:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:14 INFO - Downloaded 24447005 bytes. 23:07:14 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'] 23:07:14 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 23:07:15 INFO - Return code: 0 23:07:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:15 INFO - https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:07:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 23:07:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 23:07:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:16 INFO - Downloaded 10833369 bytes. 23:07:16 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'] 23:07:16 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 23:07:16 INFO - Return code: 0 23:07:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:16 INFO - https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:07:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:07:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:07:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FEi06RDARjWL9aVedZ5jtQ/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 23:07:18 INFO - Downloaded 59190267 bytes. 23:07:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:07:18 INFO - mkdir: /builds/slave/test/properties 23:07:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:07:18 INFO - Writing to file /builds/slave/test/properties/build_url 23:07:18 INFO - Contents: 23:07:18 INFO - build_url:https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 23:07:20 INFO - Running post-action listener: _resource_record_post_action 23:07:20 INFO - Running post-action listener: set_extra_try_arguments 23:07:20 INFO - ##### 23:07:20 INFO - ##### Finished download-and-extract step (success) 23:07:20 INFO - ##### 23:07:20 INFO - ##### 23:07:20 INFO - ##### Running populate-webroot step. 23:07:20 INFO - ##### 23:07:20 INFO - Running pre-action listener: _resource_record_pre_action 23:07:20 INFO - Running main action method: populate_webroot 23:07:20 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:07:20 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:07:20 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:07:20 INFO - '--tppagecycles', 23:07:20 INFO - '7'], 23:07:20 INFO - 'tests': ['tsvgm']}}, 23:07:20 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:07:20 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:07:20 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:07:20 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:07:20 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:07:20 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:07:20 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['damp', 'tps']}, 23:07:20 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'tests': ['damp', 'tps']}, 23:07:20 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['dromaeo_dom']}, 23:07:20 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:07:20 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'other-e10s': {'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['a11yr', 23:07:20 INFO - 'ts_paint', 23:07:20 INFO - 'tpaint', 23:07:20 INFO - 'sessionrestore', 23:07:20 INFO - 'sessionrestore_no_auto_restore', 23:07:20 INFO - 'tabpaint']}, 23:07:20 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['tsvgx', 23:07:20 INFO - 'tsvgr_opacity', 23:07:20 INFO - 'tart', 23:07:20 INFO - 'tscrollx', 23:07:20 INFO - 'cart']}, 23:07:20 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:07:20 INFO - 'tsvgr_opacity', 23:07:20 INFO - 'tart', 23:07:20 INFO - 'tscrollx', 23:07:20 INFO - 'cart']}, 23:07:20 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'talos_options': ['--disable-e10s'], 23:07:20 INFO - 'tests': ['tp5o']}, 23:07:20 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'tests': ['tp5o']}, 23:07:20 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'talos_options': ['--disable-e10s', 23:07:20 INFO - '--xperf_path', 23:07:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:07:20 INFO - 'tests': ['tp5n']}, 23:07:20 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:07:20 INFO - 'talos_options': ['--xperf_path', 23:07:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:07:20 INFO - 'tests': ['tp5n']}}, 23:07:20 INFO - 'talos.zip': {'path': '', 23:07:20 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:07:20 INFO - Running post-action listener: _resource_record_post_action 23:07:20 INFO - ##### 23:07:20 INFO - ##### Finished populate-webroot step (success) 23:07:20 INFO - ##### 23:07:20 INFO - ##### 23:07:20 INFO - ##### Running create-virtualenv step. 23:07:20 INFO - ##### 23:07:20 INFO - Running pre-action listener: _resource_record_pre_action 23:07:20 INFO - Running main action method: create_virtualenv 23:07:20 INFO - Creating virtualenv /builds/slave/test/build/venv 23:07:20 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 23:07:20 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:07:20 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:07:20 INFO - Using real prefix '/usr' 23:07:20 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:07:20 INFO - Installing distribute.............................................................................................................................................................................................done. 23:07:22 INFO - Installing pip.................done. 23:07:22 INFO - Return code: 0 23:07:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 23:07:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 23:07:22 INFO - Using env: {'DISPLAY': ':0', 23:07:22 INFO - 'HOME': '/home/cltbld', 23:07:22 INFO - 'LANG': 'en_US.UTF-8', 23:07:22 INFO - 'LANGUAGE': 'en_US:en', 23:07:22 INFO - 'LOGNAME': 'cltbld', 23:07:22 INFO - 'MAIL': '/var/mail/cltbld', 23:07:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:22 INFO - 'MOZ_NO_REMOTE': '1', 23:07:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:22 INFO - 'NO_EM_RESTART': '1', 23:07:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:22 INFO - 'PWD': '/builds/slave/test', 23:07:22 INFO - 'SHELL': '/bin/bash', 23:07:22 INFO - 'SHLVL': '1', 23:07:22 INFO - 'TERM': 'linux', 23:07:22 INFO - 'TMOUT': '86400', 23:07:22 INFO - 'USER': 'cltbld', 23:07:22 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:22 INFO - '_': '/tools/buildbot/bin/python'} 23:07:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:22 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 23:07:22 INFO - Cleaning up... 23:07:22 INFO - Return code: 0 23:07:22 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 23:07:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 23:07:22 INFO - Using env: {'DISPLAY': ':0', 23:07:22 INFO - 'HOME': '/home/cltbld', 23:07:22 INFO - 'LANG': 'en_US.UTF-8', 23:07:22 INFO - 'LANGUAGE': 'en_US:en', 23:07:22 INFO - 'LOGNAME': 'cltbld', 23:07:22 INFO - 'MAIL': '/var/mail/cltbld', 23:07:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:22 INFO - 'MOZ_NO_REMOTE': '1', 23:07:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:22 INFO - 'NO_EM_RESTART': '1', 23:07:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:22 INFO - 'PWD': '/builds/slave/test', 23:07:22 INFO - 'SHELL': '/bin/bash', 23:07:22 INFO - 'SHLVL': '1', 23:07:22 INFO - 'TERM': 'linux', 23:07:22 INFO - 'TMOUT': '86400', 23:07:22 INFO - 'USER': 'cltbld', 23:07:22 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:22 INFO - '_': '/tools/buildbot/bin/python'} 23:07:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:23 INFO - Downloading/unpacking psutil>=3.1.1 23:07:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:07:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:07:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:07:25 INFO - Installing collected packages: psutil 23:07:25 INFO - Running setup.py install for psutil 23:07:25 INFO - building 'psutil._psutil_linux' extension 23:07:25 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 23:07:25 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 23:07:25 INFO - building 'psutil._psutil_posix' extension 23:07:25 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 23:07:25 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 23:07:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:07:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:07:25 INFO - Successfully installed psutil 23:07:25 INFO - Cleaning up... 23:07:25 INFO - Return code: 0 23:07:25 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:07:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:25 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:25 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 23:07:25 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 23:07:25 INFO - Using env: {'DISPLAY': ':0', 23:07:25 INFO - 'HOME': '/home/cltbld', 23:07:25 INFO - 'LANG': 'en_US.UTF-8', 23:07:25 INFO - 'LANGUAGE': 'en_US:en', 23:07:25 INFO - 'LOGNAME': 'cltbld', 23:07:25 INFO - 'MAIL': '/var/mail/cltbld', 23:07:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:25 INFO - 'MOZ_NO_REMOTE': '1', 23:07:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:25 INFO - 'NO_EM_RESTART': '1', 23:07:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:25 INFO - 'PWD': '/builds/slave/test', 23:07:25 INFO - 'SHELL': '/bin/bash', 23:07:25 INFO - 'SHLVL': '1', 23:07:25 INFO - 'TERM': 'linux', 23:07:25 INFO - 'TMOUT': '86400', 23:07:25 INFO - 'USER': 'cltbld', 23:07:25 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:25 INFO - '_': '/tools/buildbot/bin/python'} 23:07:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07:27 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:07:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:07:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:07:27 INFO - Installing collected packages: mozsystemmonitor 23:07:27 INFO - Running setup.py install for mozsystemmonitor 23:07:27 INFO - Successfully installed mozsystemmonitor 23:07:27 INFO - Cleaning up... 23:07:28 INFO - Return code: 0 23:07:28 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:07: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')]} 23:07:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07: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')]} 23:07:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07: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', '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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 23:07: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 jsonschema==2.5.1 23:07:28 INFO - Using env: {'DISPLAY': ':0', 23:07:28 INFO - 'HOME': '/home/cltbld', 23:07:28 INFO - 'LANG': 'en_US.UTF-8', 23:07:28 INFO - 'LANGUAGE': 'en_US:en', 23:07:28 INFO - 'LOGNAME': 'cltbld', 23:07:28 INFO - 'MAIL': '/var/mail/cltbld', 23:07:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:28 INFO - 'MOZ_NO_REMOTE': '1', 23:07:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:28 INFO - 'NO_EM_RESTART': '1', 23:07:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:28 INFO - 'PWD': '/builds/slave/test', 23:07:28 INFO - 'SHELL': '/bin/bash', 23:07:28 INFO - 'SHLVL': '1', 23:07:28 INFO - 'TERM': 'linux', 23:07:28 INFO - 'TMOUT': '86400', 23:07:28 INFO - 'USER': 'cltbld', 23:07:28 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:28 INFO - '_': '/tools/buildbot/bin/python'} 23:07:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:28 INFO - Downloading/unpacking jsonschema==2.5.1 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:07:30 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07:30 INFO - Downloading functools32-3.2.3-2.tar.gz 23:07:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:07:30 INFO - warning: no files found matching '*.txt' 23:07:30 INFO - no previously-included directories found matching 'build' 23:07:30 INFO - no previously-included directories found matching 'dist' 23:07:30 INFO - no previously-included directories found matching '.git*' 23:07:30 INFO - Installing collected packages: jsonschema, functools32 23:07:30 INFO - Running setup.py install for functools32 23:07:30 INFO - warning: no files found matching '*.txt' 23:07:30 INFO - no previously-included directories found matching 'build' 23:07:30 INFO - no previously-included directories found matching 'dist' 23:07:30 INFO - no previously-included directories found matching '.git*' 23:07:30 INFO - Successfully installed jsonschema functools32 23:07:30 INFO - Cleaning up... 23:07:30 INFO - Return code: 0 23:07:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:07:30 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')]} 23:07:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:30 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')]} 23:07:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:30 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:30 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 23:07:30 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 23:07:30 INFO - Using env: {'DISPLAY': ':0', 23:07:30 INFO - 'HOME': '/home/cltbld', 23:07:30 INFO - 'LANG': 'en_US.UTF-8', 23:07:30 INFO - 'LANGUAGE': 'en_US:en', 23:07:30 INFO - 'LOGNAME': 'cltbld', 23:07:30 INFO - 'MAIL': '/var/mail/cltbld', 23:07:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:30 INFO - 'MOZ_NO_REMOTE': '1', 23:07:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:30 INFO - 'NO_EM_RESTART': '1', 23:07:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:30 INFO - 'PWD': '/builds/slave/test', 23:07:30 INFO - 'SHELL': '/bin/bash', 23:07:30 INFO - 'SHLVL': '1', 23:07:30 INFO - 'TERM': 'linux', 23:07:30 INFO - 'TMOUT': '86400', 23:07:30 INFO - 'USER': 'cltbld', 23:07:30 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:30 INFO - '_': '/tools/buildbot/bin/python'} 23:07:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:30 INFO - Downloading/unpacking blobuploader==1.2.4 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07: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 23:07:32 INFO - Downloading blobuploader-1.2.4.tar.gz 23:07:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:07:32 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:07:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:07:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:07:33 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 23:07:33 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 23:07:33 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 23:07:33 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 23:07:33 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 23:07:33 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 23:07:33 INFO - Downloading docopt-0.6.1.tar.gz 23:07:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:07:33 INFO - Installing collected packages: blobuploader, requests, docopt 23:07:33 INFO - Running setup.py install for blobuploader 23:07:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:07:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:07:33 INFO - Running setup.py install for requests 23:07:33 INFO - Running setup.py install for docopt 23:07:34 INFO - Successfully installed blobuploader requests docopt 23:07:34 INFO - Cleaning up... 23:07:34 INFO - Return code: 0 23:07:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:07:34 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')]} 23:07:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:34 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')]} 23:07:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:34 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:34 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 23:07:34 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 23:07:34 INFO - Using env: {'DISPLAY': ':0', 23:07:34 INFO - 'HOME': '/home/cltbld', 23:07:34 INFO - 'LANG': 'en_US.UTF-8', 23:07:34 INFO - 'LANGUAGE': 'en_US:en', 23:07:34 INFO - 'LOGNAME': 'cltbld', 23:07:34 INFO - 'MAIL': '/var/mail/cltbld', 23:07:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:34 INFO - 'MOZ_NO_REMOTE': '1', 23:07:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:34 INFO - 'NO_EM_RESTART': '1', 23:07:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:34 INFO - 'PWD': '/builds/slave/test', 23:07:34 INFO - 'SHELL': '/bin/bash', 23:07:34 INFO - 'SHLVL': '1', 23:07:34 INFO - 'TERM': 'linux', 23:07:34 INFO - 'TMOUT': '86400', 23:07:34 INFO - 'USER': 'cltbld', 23:07:34 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:34 INFO - '_': '/tools/buildbot/bin/python'} 23:07:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:07:34 INFO - Running setup.py (path:/tmp/pip-6axjMv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:07:34 INFO - Running setup.py (path:/tmp/pip-DrHPke-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:07:34 INFO - Running setup.py (path:/tmp/pip-lf80iY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:07:34 INFO - Running setup.py (path:/tmp/pip-jWnF99-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:07:34 INFO - Running setup.py (path:/tmp/pip-x2GYNV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:07:34 INFO - Running setup.py (path:/tmp/pip-WKxoWH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:07:34 INFO - Running setup.py (path:/tmp/pip-G5qi9T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:07:34 INFO - Running setup.py (path:/tmp/pip-NETkyN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:07:34 INFO - Running setup.py (path:/tmp/pip-wbkftp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:07:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:07:34 INFO - Running setup.py (path:/tmp/pip-wrV0OC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:07:35 INFO - Running setup.py (path:/tmp/pip-Ydi37w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:07:35 INFO - Running setup.py (path:/tmp/pip-rcyYVR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:07:35 INFO - Running setup.py (path:/tmp/pip-BmjdVT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:07:35 INFO - Running setup.py (path:/tmp/pip-lCha_w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:07:35 INFO - Running setup.py (path:/tmp/pip-_PCNlz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:07:35 INFO - Running setup.py (path:/tmp/pip-BrAgYv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:07:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:07:35 INFO - Running setup.py (path:/tmp/pip-L2om5X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:07:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:07:35 INFO - Running setup.py install for manifestparser 23:07:35 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:07:35 INFO - Running setup.py install for mozcrash 23:07:35 INFO - Running setup.py install for mozdebug 23:07:35 INFO - Running setup.py install for mozdevice 23:07:35 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:07:35 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:07:35 INFO - Running setup.py install for mozfile 23:07:36 INFO - Running setup.py install for mozhttpd 23:07:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozinfo 23:07:36 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozInstall 23:07:36 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozleak 23:07:36 INFO - Running setup.py install for mozlog 23:07:36 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for moznetwork 23:07:36 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozprocess 23:07:36 INFO - Running setup.py install for mozprofile 23:07:36 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozrunner 23:07:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:07:36 INFO - Running setup.py install for mozscreenshot 23:07:37 INFO - Running setup.py install for moztest 23:07:37 INFO - Running setup.py install for mozversion 23:07:37 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:07:37 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:07:37 INFO - Cleaning up... 23:07:37 INFO - Return code: 0 23:07:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:07:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:37 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:37 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 23:07:37 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 23:07:37 INFO - Using env: {'DISPLAY': ':0', 23:07:37 INFO - 'HOME': '/home/cltbld', 23:07:37 INFO - 'LANG': 'en_US.UTF-8', 23:07:37 INFO - 'LANGUAGE': 'en_US:en', 23:07:37 INFO - 'LOGNAME': 'cltbld', 23:07:37 INFO - 'MAIL': '/var/mail/cltbld', 23:07:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:37 INFO - 'MOZ_NO_REMOTE': '1', 23:07:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:37 INFO - 'NO_EM_RESTART': '1', 23:07:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:37 INFO - 'PWD': '/builds/slave/test', 23:07:37 INFO - 'SHELL': '/bin/bash', 23:07:37 INFO - 'SHLVL': '1', 23:07:37 INFO - 'TERM': 'linux', 23:07:37 INFO - 'TMOUT': '86400', 23:07:37 INFO - 'USER': 'cltbld', 23:07:37 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:37 INFO - '_': '/tools/buildbot/bin/python'} 23:07:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:07:37 INFO - Running setup.py (path:/tmp/pip-lBf_II-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:07:37 INFO - Running setup.py (path:/tmp/pip-Ot2Ytj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:07:37 INFO - Running setup.py (path:/tmp/pip-bIe_G8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:07:37 INFO - Running setup.py (path:/tmp/pip-0LiXaa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:07:37 INFO - Running setup.py (path:/tmp/pip-6Z9Tt3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:07:37 INFO - Running setup.py (path:/tmp/pip-jCzLbH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:07:37 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)) 23:07:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:07:37 INFO - Running setup.py (path:/tmp/pip-XS3IQG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:07:38 INFO - Running setup.py (path:/tmp/pip-h5g2_h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:07:38 INFO - Running setup.py (path:/tmp/pip-Ecs2K2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:07:38 INFO - Running setup.py (path:/tmp/pip-Bf9kLg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:07:38 INFO - Running setup.py (path:/tmp/pip-3yYmyj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:07:38 INFO - Running setup.py (path:/tmp/pip-7GnxCN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:07:38 INFO - Running setup.py (path:/tmp/pip-1yF_wy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:07:38 INFO - Running setup.py (path:/tmp/pip-bAXvPU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:07:38 INFO - Running setup.py (path:/tmp/pip-42GrOW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:07:38 INFO - Running setup.py (path:/tmp/pip-jmBvxw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:07:38 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)) 23:07:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:07:38 INFO - Running setup.py (path:/tmp/pip-HSvRNR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:07:38 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)) 23:07:38 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)) 23:07:38 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)) 23:07:38 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)) 23:07:38 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)) 23:07:38 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)) 23:07:38 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:07:38 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 23:07:38 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 23:07:38 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 23:07:38 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 23:07:38 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 23:07:38 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 23:07:40 INFO - Downloading blessings-1.6.tar.gz 23:07:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:07:40 INFO - Installing collected packages: blessings 23:07:40 INFO - Running setup.py install for blessings 23:07:40 INFO - Successfully installed blessings 23:07:40 INFO - Cleaning up... 23:07:40 INFO - Return code: 0 23:07:40 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:07:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:07:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:07:41 INFO - Reading from file tmpfile_stdout 23:07:41 INFO - Current package versions: 23:07:41 INFO - argparse == 1.2.1 23:07:41 INFO - blessings == 1.6 23:07:41 INFO - blobuploader == 1.2.4 23:07:41 INFO - docopt == 0.6.1 23:07:41 INFO - functools32 == 3.2.3-2 23:07:41 INFO - jsonschema == 2.5.1 23:07:41 INFO - manifestparser == 1.1 23:07:41 INFO - mozInstall == 1.12 23:07:41 INFO - mozcrash == 0.17 23:07:41 INFO - mozdebug == 0.1 23:07:41 INFO - mozdevice == 0.48 23:07:41 INFO - mozfile == 1.2 23:07:41 INFO - mozhttpd == 0.7 23:07:41 INFO - mozinfo == 0.9 23:07:41 INFO - mozleak == 0.1 23:07:41 INFO - mozlog == 3.2 23:07:41 INFO - moznetwork == 0.27 23:07:41 INFO - mozprocess == 0.22 23:07:41 INFO - mozprofile == 0.28 23:07:41 INFO - mozrunner == 6.11 23:07:41 INFO - mozscreenshot == 0.1 23:07:41 INFO - mozsystemmonitor == 0.3 23:07:41 INFO - moztest == 0.7 23:07:41 INFO - mozversion == 1.4 23:07:41 INFO - psutil == 3.1.1 23:07:41 INFO - requests == 1.2.3 23:07:41 INFO - wsgiref == 0.1.2 23:07:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:07:41 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')]} 23:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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')]} 23:07:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:41 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 23:07:41 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 23:07:41 INFO - Using env: {'DISPLAY': ':0', 23:07:41 INFO - 'HOME': '/home/cltbld', 23:07:41 INFO - 'LANG': 'en_US.UTF-8', 23:07:41 INFO - 'LANGUAGE': 'en_US:en', 23:07:41 INFO - 'LOGNAME': 'cltbld', 23:07:41 INFO - 'MAIL': '/var/mail/cltbld', 23:07:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:41 INFO - 'MOZ_NO_REMOTE': '1', 23:07:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:41 INFO - 'NO_EM_RESTART': '1', 23:07:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:41 INFO - 'PWD': '/builds/slave/test', 23:07:41 INFO - 'SHELL': '/bin/bash', 23:07:41 INFO - 'SHLVL': '1', 23:07:41 INFO - 'TERM': 'linux', 23:07:41 INFO - 'TMOUT': '86400', 23:07:41 INFO - 'USER': 'cltbld', 23:07:41 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:41 INFO - '_': '/tools/buildbot/bin/python'} 23:07:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 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)) 23:07:41 INFO - Cleaning up... 23:07:41 INFO - Return code: 0 23:07:41 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:07:41 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')]} 23:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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')]} 23:07:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:41 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 23:07:41 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 23:07:41 INFO - Using env: {'DISPLAY': ':0', 23:07:41 INFO - 'HOME': '/home/cltbld', 23:07:41 INFO - 'LANG': 'en_US.UTF-8', 23:07:41 INFO - 'LANGUAGE': 'en_US:en', 23:07:41 INFO - 'LOGNAME': 'cltbld', 23:07:41 INFO - 'MAIL': '/var/mail/cltbld', 23:07:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:41 INFO - 'MOZ_NO_REMOTE': '1', 23:07:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:41 INFO - 'NO_EM_RESTART': '1', 23:07:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:41 INFO - 'PWD': '/builds/slave/test', 23:07:41 INFO - 'SHELL': '/bin/bash', 23:07:41 INFO - 'SHLVL': '1', 23:07:41 INFO - 'TERM': 'linux', 23:07:41 INFO - 'TMOUT': '86400', 23:07:41 INFO - 'USER': 'cltbld', 23:07:41 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:41 INFO - '_': '/tools/buildbot/bin/python'} 23:07:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:41 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:07:41 INFO - Cleaning up... 23:07:41 INFO - Return code: 0 23:07:41 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 23:07:41 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')]} 23:07:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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')]} 23:07:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:07:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:07:41 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 0x7f66ab86bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1463190>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', '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 23:07:41 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 23:07:41 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 23:07:41 INFO - Using env: {'DISPLAY': ':0', 23:07:41 INFO - 'HOME': '/home/cltbld', 23:07:41 INFO - 'LANG': 'en_US.UTF-8', 23:07:41 INFO - 'LANGUAGE': 'en_US:en', 23:07:41 INFO - 'LOGNAME': 'cltbld', 23:07:41 INFO - 'MAIL': '/var/mail/cltbld', 23:07:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:07:41 INFO - 'MOZ_NO_REMOTE': '1', 23:07:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:07:41 INFO - 'NO_EM_RESTART': '1', 23:07:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:07:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:07:41 INFO - 'PWD': '/builds/slave/test', 23:07:41 INFO - 'SHELL': '/bin/bash', 23:07:41 INFO - 'SHLVL': '1', 23:07:41 INFO - 'TERM': 'linux', 23:07:41 INFO - 'TMOUT': '86400', 23:07:41 INFO - 'USER': 'cltbld', 23:07:41 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:07:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:07:41 INFO - '_': '/tools/buildbot/bin/python'} 23:07:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:07:41 INFO - Downloading/unpacking flake8 23:07:41 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 23:07:41 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 23:07:41 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 23:07:41 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 23:07:41 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 23:07:41 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 23:07:43 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:07:43 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:07:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:43 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:07:43 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:07:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:07:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:07:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:07:44 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:07:44 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 23:07:44 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 23:07:44 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 23:07:44 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 23:07:44 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 23:07:44 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 23:07:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 23:07:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:07:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:07:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:07:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:07:44 INFO - no previously-included directories found matching 'docs/_build' 23:07:44 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:07:44 INFO - Running setup.py install for pep8 23:07:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:07:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:07:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:07:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:07:44 INFO - no previously-included directories found matching 'docs/_build' 23:07:44 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 23:07:44 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:07:44 INFO - Cleaning up... 23:07:44 INFO - Return code: 0 23:07:44 INFO - Running post-action listener: _resource_record_post_action 23:07:44 INFO - Running post-action listener: _start_resource_monitoring 23:07:44 INFO - Starting resource monitoring. 23:07:44 INFO - ##### 23:07:44 INFO - ##### Finished create-virtualenv step (success) 23:07:44 INFO - ##### 23:07:44 INFO - ##### 23:07:44 INFO - ##### Running install step. 23:07:44 INFO - ##### 23:07:44 INFO - Running pre-action listener: _resource_record_pre_action 23:07:44 INFO - Running main action method: install 23:07:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:07:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:07:44 INFO - Reading from file tmpfile_stdout 23:07:44 INFO - Detecting whether we're running mozinstall >=1.0... 23:07:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:07:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:07:45 INFO - Reading from file tmpfile_stdout 23:07:45 INFO - Output received: 23:07:45 INFO - Usage: mozinstall [options] installer 23:07:45 INFO - Options: 23:07:45 INFO - -h, --help show this help message and exit 23:07:45 INFO - -d DEST, --destination=DEST 23:07:45 INFO - Directory to install application into. [default: 23:07:45 INFO - "/builds/slave/test"] 23:07:45 INFO - --app=APP Application being installed. [default: firefox] 23:07:45 INFO - mkdir: /builds/slave/test/build/application 23:07:45 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'] 23:07:45 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 23:08:01 INFO - Reading from file tmpfile_stdout 23:08:01 INFO - Output received: 23:08:01 INFO - /builds/slave/test/build/application/firefox/firefox 23:08:01 INFO - Running post-action listener: _resource_record_post_action 23:08:01 INFO - ##### 23:08:01 INFO - ##### Finished install step (success) 23:08:01 INFO - ##### 23:08:01 INFO - ##### 23:08:01 INFO - ##### Running run-tests step. 23:08:01 INFO - ##### 23:08:01 INFO - Running pre-action listener: _resource_record_pre_action 23:08:01 INFO - Running main action method: run_tests 23:08:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:08:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:08:01 INFO - Python 2.7.3 23:08:01 INFO - Return code: 0 23:08:01 INFO - grabbing minidump binary from tooltool 23:08:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:01 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 0x14f5110>, '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 0x1461230>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14616c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:08:01 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 23:08:01 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 23:08:01 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 23:08:01 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:08:01 INFO - Return code: 0 23:08:01 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:08:01 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:08:01 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:08:01 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:08:01 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:08:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 23:08:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 23:08:02 INFO - Return code: 0 23:08:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 23:08:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-034 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 23:08:02 INFO - Using env: {'DISPLAY': ':0', 23:08:02 INFO - 'HOME': '/home/cltbld', 23:08:02 INFO - 'LANG': 'en_US.UTF-8', 23:08:02 INFO - 'LANGUAGE': 'en_US:en', 23:08:02 INFO - 'LOGNAME': 'cltbld', 23:08:02 INFO - 'MAIL': '/var/mail/cltbld', 23:08:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:08:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:08:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:02 INFO - 'MOZ_NO_REMOTE': '1', 23:08:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:08:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:02 INFO - 'NO_EM_RESTART': '1', 23:08:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:08:02 INFO - 'PWD': '/builds/slave/test', 23:08:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:08:02 INFO - 'SHELL': '/bin/bash', 23:08:02 INFO - 'SHLVL': '1', 23:08:02 INFO - 'TERM': 'linux', 23:08:02 INFO - 'TMOUT': '86400', 23:08:02 INFO - 'USER': 'cltbld', 23:08:02 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761', 23:08:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:02 INFO - '_': '/tools/buildbot/bin/python'} 23:08:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 23:08:03 INFO - mozversion application_buildid: 20160607203013 23:08:03 INFO - mozversion application_changeset: a7b31be0a19ae5413db3e10ad4e5251cac84b08d 23:08:03 INFO - mozversion application_display_name: Nightly 23:08:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:08:03 INFO - mozversion application_name: Firefox 23:08:03 INFO - mozversion application_remotingname: firefox 23:08:03 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 23:08:03 INFO - mozversion application_vendor: Mozilla 23:08:03 INFO - mozversion application_version: 50.0a1 23:08:03 INFO - mozversion platform_buildid: 20160607203013 23:08:03 INFO - mozversion platform_changeset: a7b31be0a19ae5413db3e10ad4e5251cac84b08d 23:08:03 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 23:08:03 INFO - mozversion platform_version: 50.0a1 23:08:03 INFO - using testdate: 1465366083 23:08:03 INFO - actual date: 1465366083 23:08:03 INFO - starting webserver on 'localhost:42163' 23:08:03 INFO - SUITE-START | Running 2 tests 23:08:03 INFO - TEST-START | dromaeo_css 23:08:03 INFO - operating with platform_type : linux_ 23:08:03 INFO - Initialising browser for dromaeo_css test... 23:08:03 INFO - TEST-INFO | started process 10872 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpTHKsVP/profile http://localhost:42163/getInfo.html) 23:08:07 INFO - PROCESS | 10872 | __metrics Screen width/height:1600/1200 23:08:07 INFO - PROCESS | 10872 | colorDepth:24 23:08:07 INFO - PROCESS | 10872 | Browser inner width/height: 1024/697 23:08:07 INFO - PROCESS | 10872 | __metrics 23:08:08 ERROR - PROCESS | 10872 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 23:08:09 INFO - TEST-INFO | 10872: exit 0 23:08:09 INFO - Browser initialized. 23:08:09 INFO - Running cycle 1/1 for dromaeo_css test... 23:08:09 INFO - TEST-INFO | started process 10990 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpTHKsVP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:08:20 INFO - PROCESS | 10990 | RSS: Main: 167473152 23:08:20 INFO - PROCESS | 10990 | 23:09:10 INFO - PROCESS | 10990 | 1465366150502 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] 23:11:17 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42163/tests/dromaeo/cssquery-ext.html) 23:11:18 INFO - PROCESS | 10990 | RSS: Main: 171462656 23:11:18 INFO - PROCESS | 10990 | 23:14:20 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-ext.html (next: http://localhost:42163/tests/dromaeo/cssquery-jquery.html) 23:14:21 INFO - PROCESS | 10990 | RSS: Main: 169881600 23:14:21 INFO - PROCESS | 10990 | 23:17:23 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42163/tests/dromaeo/cssquery-mootools.html) 23:17:23 INFO - PROCESS | 10990 | RSS: Main: 171921408 23:17:23 INFO - PROCESS | 10990 | 23:20:25 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42163/tests/dromaeo/cssquery-prototype.html) 23:20:26 INFO - PROCESS | 10990 | RSS: Main: 169029632 23:20:26 INFO - PROCESS | 10990 | 23:23:28 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42163/tests/dromaeo/cssquery-yui.html) 23:23:29 INFO - PROCESS | 10990 | RSS: Main: 171126784 23:23:29 INFO - PROCESS | 10990 | 23:26:31 INFO - PROCESS | 10990 | Cycle 1(1): loaded http://localhost:42163/tests/dromaeo/cssquery-yui.html (next: http://localhost:42163/tests/dromaeo/cssquery-dojo.html) 23:26:32 INFO - PROCESS | 10990 | RSS: Main: 172322816 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | __start_tp_report 23:26:32 INFO - PROCESS | 10990 | _x_x_mozilla_page_load 23:26:32 INFO - PROCESS | 10990 | _x_x_mozilla_page_load_details 23:26:32 INFO - PROCESS | 10990 | |i|pagename|runs| 23:26:32 INFO - PROCESS | 10990 | |0;dojo.html;3157.3685262947415;3168.366326734653;3173.9365212695734;3203.279262166013;3210.983945080274;5340.118880384737;5343.759530821113;5389.164679474688;5424.5117939385445;5470;5318;5407.810726624569;5470.890582188354;5494.752736126874;5539.058360078786;4930.679505832119;4956.3804524434445;5040.117979353617;5086.41506226785;5151.278820965068;467.9853644325778;4852.854414367557;4946.282788995593;4962.379702537183;5058.974705126488;4916.926246106294;4971.502849715036;4984.77568509418;4985.576226020775;5021.799128034874;4999.4250661174065;5012.8496145115705;5027.220780778948;5039.017391608638;5039.3196918415915;4906.681065730716;4919.7540122993705;4961.751912404401;4964.87587810304;4969.453360130383;5352.437994010651;5366.597505187087;5420.024395608789;5420.972895135499;5440.374356948962;5640.125780504029;5714.657120572779;5862.941370586283;5871.324797648283;5882.617629854046;5758.827235182951;5798.768049278024;5813.854653633651;5836.212111364954;5891.027980383232;5405.621606487547;5411.404745477994;5414.620976531644;5421;5438.564914806806;5744.253247077937;5881.5882888198275;5890.322612899486;5895.20414744004;5902.439268269508;5727.942720572741;5732.226149469851;5734.139879018181;5735.483806457439;5767;5803.941960580424;5804.216430781875;5806.4193580641595;5811.941880581225;5859.472647461749;5626.662400255997;5715.628484148517;5775;5801.361850196475;5844.503217226498;5811.79658711943;5812.273465816773;5830.2420685310635;5832.096025116114;5866.5893387462465;4430.867073987785;4431.091626216617;4472;4479.955200447954;4525;3917;3928.5678575356687;3930.3121953657997;3953.0907891184615;3963.4253033310583;5472.5621950243885;5524.972375138099;5534.640248383842;5541.168824676251;5597.328320601554;5834.299884013861;5883.646981181143;5948.672822994777;5953.374895635982;5996.5202783777195;5591;5616.5787565931905;5625.915611265835;5629.7185140742795;5640.576956728261;4902.313676085351;4945.530174633404;4949.82675606352;4955.801767929314;4999.600031997432;5953.22608060958;5966.075258334965;5995.670238136944;6053.818385448443;6057.818265452043;5853.151293062568;5875.853103672443;5889.676067816311;5895.380984996514;5906.940930590725;5733.684647344269;5905.852353691193;5972.552058595709;5984.461398474158;5990.221271234712;5733.082706766897;5775.740091695968;5786.710664466844;5813.76744930198;5846.970765146147;5808.7095645218415;5857.765689372548;5863.032599621015;5873.119032145212;5882.23530940975;5524.4199359066715;5601.243832082617;5623.2127502148915;5713.685747283939;5717.942820571741;5654.547636189012;5680.886382272414;5680.9147862781265;5683.147527870852;5713;5554.1391084381985;5595.804146854841;5602.719864006702;5606.6916319602815;5609.354924183771;5627.831165065055;5671.914921276267;5710.029295019774;5746.080627099644;5809.099589563624;5605.243292155506;5623.409541998195;5631.436856314336;5636.267285252891;5676.744546495335 23:26:32 INFO - PROCESS | 10990 | |1;ext.html;563.4956713741202;596.8209537138858;620.0977577624557;622.8909940760367;646.9547131700776;37903.24193516128;42963.3555496667;43016.139677206476;43150.13699726004;43157.568424315745;43762.34356484647;44307.55692443075;44541.55458445415;44679.32981005288;44727.55272447275;8675.826483470326;8807.119288071206;8856.778580535474;8864.556772161399;8866.86699699505;8637;8698.782530436758;8749.912500875005;8753.956230218871;8758.737237882873;8737.825243495126;8757.168069033432;8823.955880220621;8843.248323892476;8847.247983921374;8750.299976001905;8758.649654013896;8775.736727898142;8779;8803.911960880374;8727.650893964234;8755.868661970075;8829.911700882973;8833.60248788806;8856.070112638145;40782.59217407818;41001.38497922534;41212.58787412118;41297.1740565187;41468;3212.5341825435416;3398.3882901077795;3523.048776830267;3537.0803591066506;3956.3867600521967;30296;33114.834425827954;33358;33464.6653533464;33527.161820954425;4353.847615333448;4359.12817436514;4401.779911004437;4455.643548516144;4495.483019452739;330022;330368.34815826005;332251;334577;334966;34485.48271775925;61472;61674;62041;62105.37894621086;35695.82152089275;37064.444033339525;37330.06674833151;37344.25311493755;37485.250294993944;15664.216789160497;15822.446214382442;15874.761878571831;15894.284757185955;15898.205089745466;13380.732385352238;13397.196168229937;13495.797563036562;13521.59435216945;13538.323083845768;8376.916230837614;8422.073571907085;8425.747227583182;8504.872426913602;8516.1058088901;3285.3593549258144;3286.967130328714;3326.850291736878;3330.5670262865674;3332.133645252203;1006.6023920551341;1082.6860210539014;1117.3240189685123;1170.3563040327786;1206.5475446707485;31775.682243177736;32943.50584741231;32980;33455;33807.15482112967;1070.82866741321;1078.4392116099584;1133.6485689436136;1139.145640769423;1177.6761390617478;16763;17302.91348543249;17340.566485837953;17399.826001740075;17424.651506970044;563272;563652;567191;567873;568654;59224.407755921886;59879.70060149671;59936;60047.39952600506;60109.69945150334;1353.8240028796195;1385;1406.7889816527397;1412.427966673499;1413.964650883736;30830.383392332475;32427.18932026624;32432.67567324391;33108.503372449915;33869.15327116842;57058.7147064262;57153.42846571481;58248.12627810671;58290;58376;535658.5387803552;536959;539313;539456;540572;44530.33204502;45038.549614503434;45825.77087114543;45893.78743487924;46068.30897536607;49484.75257623689;50401.49598503968;50508.49491505038;51294.74352628362;51472.48527514677;41605.58394416017;41796.373054404816;41969.37045944252;42594.57405425906;42902.570974289854;41239;42062.57937420587;42187.578124219595;42555.36166957436;43231.13537729165;36234;41094.79452602718;41520.792396037825;42971.78514107409;43145.6854314566;36820.63179368279;37484;37558.8122059388;37903.24193516169;38232;28495.572566411105;28676.713232867405;28893.988710395035;28946;29023.7097629021 23:26:32 INFO - PROCESS | 10990 | |2;jquery.html;373.94203898395756;379.0977473612802;389.118646266207;394.5718894998926;402.9838806447742;17397.391091311805;19583.804161958375;20158.49603759905;20225.292114775984;20227.190912363487;18373.448796536126;18805.717914231296;18808.24767009318;18845.717314240297;19364.612707745837;5454.072807622694;5573.804916827912;5680.119581464859;5771.278590176228;5810.622309549865;5648.745806438699;5677.943220567803;5680.602357834953;5686.943130568683;5710.2862142232225;5489.231507588941;5601.3558440779425;5634.295713035871;5654.6324488908085;5658.0381335172915;5534.557235421197;5555.777768889239;5575.804846830361;5582.553395728332;5585.134304182858;4856.198727210006;4977.601791856679;5049.671771334888;5072.54347108762;5092.618053645954;22297.44256393603;22364.329070127922;22486.325410237718;22856.08575656972;22870.42823929415;2153.1710291537715;2168.5662867426577;2211.491356987902;2252.6958860553777;2372.6203807390734;13690.726185476335;14214.385942295672;14287.642808929755;14495;14519.346629401702;1834.4221570205343;1895.2987394663924;1918.1655979648897;1926.5568919148534;1942.951426214356;71621.64189179073;74605.25394746092;75273;75419;76150;9902.306838521234;9969.900300997042;10128.34165779222;10162.644307449204;10296.382217067;13372.130811497222;13464.730705386033;13473.730525389437;13485.123466974615;13558.86441135576;7774.8056298591855;7815.53106813593;7854.347728306251;7959.44283900133;8036.799080022929;7531.359834414026;7686.692532298645;7760.495567788075;7761.689532418753;7768.067831860213;6274.341194174546;6321.462675672619;6360.395762402564;6428.332242119468;6435.29464691857;1773.9467815965543;1807.3764551229804;1817.818218178198;1822.5170329862597;1825.4979880532694;974.5614473486959;986.5856340337076;1022.8056669232822;1058.9841152382721;1155.185594156118;18177.36379226747;19362.70955935634;19362.80637193638;19524.511887202934;19546.413607591796;974.1184228273424;993.3245393132595;1014.7818219082933;1019.4545917934018;1092.1699508373533;7393.926060739432;11187.608433704781;11425.31448113116;11457.255278407043;11499.827502587468;493027;498370;500505;506189;512680;77786;81383;82659;84075;85303.14696852952;1014.2139841622801;1019.2406657040552;1043.1967385113421;1056.12869382758;1057.164839776568;17241.91379043097;17404.216810243317;17717.911410442866;17795.73306400379;17892.194851231467;37291.81354093212;38334;38439.61560384472;39572.604273956895;40005.1998960025;50617.24074138964;51274.48725512697;51471.22793158031;51557.48442515527;51901;5066.746662666926;5102.974485127551;8319.334453243848;8338.207870252316;8485.448445851;12072.75854482923;12332.630021099381;12853.742925141632;13034.47862085544;13416.731665366833;10839.187060970302;11101.278416902875;11318.773624527299;11325.15061370384;11377.488013039267;10611.681649550526;10895.455227238765;11337.659870203577;11362.431878406212;11451.48468318911;9164.541772911462;11273.267237629529;11289.363042358977;11554;11759.353235572125;8112.391570632109;8197.590120494071;8205.03088747175;8255.752327430188;8261.586920654063;8354;10735.570577176826;11059.668209953714;11710.355930423908;11972.58095966637 23:26:32 INFO - PROCESS | 10990 | |3;mootools.html;1461.9342129604167;1505.5408100529337;1640.3110693508725;1766.4170823628203;1793.5426466251104;7504.66229019694;8476.660933562658;8540.871886921701;9105.499197544132;9117.726468205949;8457.95771021144;8835.558222088903;8847.646094156242;8873.378863479544;8909.599068041938;2316.918907838226;2342.8711420871846;2348.8708121053337;2350.459394339303;2358.5730632967066;2315.81473482121;2319;2349.753275906031;2354.446705024318;2358.6226203807396;2262.9773702262933;2297.7587353327913;2305.089489651595;2330.0563271874917;2332.4052366646483;2236.3626366485555;2271.205078222625;2273.2839155665997;2278.886055697225;2287.313805858236;2282.052948026567;2297.3682237384687;2301.4821665125382;2303.309007297804;2309.849859759127;8778.561071946377;8801.427907186013;8861.556922153932;8875.866861997076;8875.911240887574;5133.948660513384;5233.842984710464;5257.132573125468;5259.684418934876;5291;3206.7274281686086;3245.902622921316;3407.5910890693276;3431.8455669494683;3442.397580423416;1152.936588487633;1170.6371024982284;1182.408795602199;1189.5004098278744;1213.3629844331708;12094.818577721342;12102.939485302606;12130;12130.090243231793;12137.817932731015;4437.889052773707;4521.706089104197;4590.8163673453355;4592.425946756655;4611.262198048296;10119.898801012043;10228.181745460493;10255.435951022617;10257.435841028815;10271.897281027244;5194.662346947436;5194.740262986836;5195.896082078338;5196.428392876781;5200.323957885451;4140.565240649748;4609.078184363141;4732.905341893212;4752.95247047532;4767.118083154627;3786.2995345861104;3898.863539776094;3925.9018524536546;3950.3679411294056;3955.980220098881;1229.8770122987808;1236.394166858233;1243.4031664800946;1244.2410129820803;1252.8183413405004;909.1817364371985;1020.6733845169474;1024.144839059379;1052.3422860712055;1053.2206167436043;6080.331163572004;6159.907601385983;6231.283402408691;6279.748810047547;6352.777652782131;1024.4007255755319;1069.198101423932;1116.447358557503;1118.6644006797928;1121.5401685308984;4114;4403.889902752457;4412.602865742098;4438.112377524508;4490.371348011281;10698.73253168677;10873.673789786319;11027.393493357942;11030;11067.225294229487;10893.83659245112;10895.346279223271;10931.01620854127;10952.671419857417;10964.56141754321;7769.883451748228;7788.065432148065;8102.108768035511;8161.183881611792;8316.417850750511;6001.219841420588;6115.938840611715;6165.229346331708;6296.842578935563;6353.428191462791;10085;10197;10370.11853992389;10374.948125259325;10393.220508461744;10172.13536849376;10398.740031499274;10487.423191724223;10541.841872372073;10607.893921060999;6992.650367481504;7638.083429988437;7734.845303094019;7857.921420785948;7992;8585.957070214608;8661.263792577449;8684.39209255346;8706.91293087061;8743.38796284254;7376.262373762581;7707.34487568563;7750.186230445947;7753.728619498291;7839.137694853675;7283.8179045522165;7320.597367144858;7321.670524826289;7377.372923301579;7459.850802984019;7170.318819712119;7241.275872412927;7273.454490913097;7280.817979550554;7311.451641127043;5249.160134378481;5317.654352467077;5363.490468405495;5523.558115350682;5541.3904470509015;5385.865353366197;5451.863703407446;5498.835034948958;5500.50495455411;5615.606907516435 23:26:32 INFO - PROCESS | 10990 | |4;prototype.html;325.1448689945443;328.06665037966985;330.73045467943626;332.466391441736;337.675831202046;5539.529140023098;5601.411851755568;5637.267155269814;5681.6591004539705;5723.713814309289;5549.556035517159;5566.07970250264;5616.887662246752;5620.606557540974;5634.408387119355;4165.666746660268;4182.247195504808;4307.310830267143;4313.856827940583;4319.568043195687;4299.53815702661;4307.5261721210645;4312.245357062501;4312.676549258803;4354.303311470166;4236.385724070008;4285.778553112364;4304.074623955848;4310.353446982962;4316.97841510792;4049.7975101245115;4268.231718290706;4274.978625106885;4275.764832934187;4285.314349704048;3690.9630903690886;3696.5564132304025;3715.145516531186;3735.6451137141926;3755.9812200939095;5320.840374788762;5408.188771684239;5424.538914192299;5428.267183930158;5436.429174936614;4672.317965532406;4903.338049363361;4911.533404326619;4926.950730492685;4944.307796908436;5765.1352297155345;5796.62321949072;5804.780995990847;5817.156512305734;5825.475707186373;4065.3292206785845;4085.9591404085877;4103.158852435244;4113.4858142732155;4123.505179378464;5901.144334071536;6094;6096.69516524172;6101.206843110412;6101.542384321194;4165.10450253191;4201.6008479194425;4201.789910504463;4214.662826973835;4225.345071513921;4259.977605374688;4277.786110694453;4278.807453664593;4286.099919017041;4300.09697963425;4628.745419001987;4858.344123543347;4886.218205087169;4929.580985616263;4958.925616115761;5862.325832529228;5894.616849904743;5900.586958912835;5901.58688891782;5974.163617093611;1465.8680718735366;1470.5514817980618;1472.977905331421;1475.5499572630451;1487.5570696424452;920.6225447566466;930.3673502018693;962.7448726087453;989.4310771306527;998.9870411121595;5648.853435694492;5661.915071273934;5672.943270567324;5696.3164420269;5703.8859222816145;5963.105534169822;5977.342492325841;6004.558905862562;6013.639181649115;6043.7280322385595;5458.4541545845095;5642.4357564244065;5707.400722924116;5755.22304488897;5799.623024503394;3206.1183174627163;3248.431524483206;3252.910275057835;3261.1521004538517;3274.4433446314183;6091.299500557404;6231.781887633911;6236.532260080512;6252.09344645033;6252.624842509464;6155.569110162335;6202.968985155046;6222.875542489125;6224.470919971853;6234.844128896723;5948.549841092156;6208.875822483525;6226.813195604139;6256.843578910472;6265.624062556261;6020.464781480694;6048.366940926014;6072.362401947732;6082.9695851520455;6100.511959043355;6060.272767267956;6064.603821859772;6087.325985354063;6095.542834287357;6106.786262480792;5959.553033522589;6181.84545386369;6182.866910915727;6198.907016394667;6268.529860260407;4168.291000689703;4187.141635964559;4217.03008308097;4223.957760422357;4228.1966426378885;5816.41835816415;5850.765969361178;6101.572889897665;6109.694515274307;6139.386061393825;5867.266591676041;5868.677222752619;5884.6469211847425;5892.292924849045;5913.758110796609;5828.562857785599;5837.503812176013;5854.2389489366105;5865.706714664165;5891.1457838614015;5514.228008078952;5824.70876456167;5837.29952405714;5846.503047241032;5846.912296315644;5842.678652674143;5944.227250457586;5950.642961422329;6000.549958753199;6005.849853753516;5658.292713410824;5788.523926398741;5801.883962320814;5868.735906884286;5897.469227769349 23:26:32 INFO - PROCESS | 10990 | |5;yui.html;731.9788894492184;763.9083310002801;764.7896828372201;781.3514782730334;783.2832957843574;13725.51960681375;14712.970092093557;14736.557903262907;14839.258037098143;14875.181864997421;13684.863151368483;13689.110207836484;13758.518451854186;13796.310184490785;13818.378172982215;680.8672308899767;798.6446031515977;803.4014659078995;823.4647479138578;824.6618886256606;805.3516918880299;806.3307454812492;809.4091313341264;813.1177672225613;814.6700586262543;845.3955421873359;851.3529717414779;860.7288704058233;863.9265662418702;863.952482613456;850.3324889961351;855.2388374346837;856.3577317012241;856.443311847298;860.3977215948829;624.8375422390166;626.4988009592308;628.2523796681934;629.8205011571725;630.2562975688686;14441.133531988115;14479.927600362036;14501;14602.12387256768;14628.561143165616;14877.33052012662;15124.848751512454;15220.695586088215;15310.157941313224;15706.293216805272;12071.879281207164;12163.635090947197;12193.146479746421;12226.021918246519;12782.488700452064;3675.099600597844;3857.864974725899;3887.766733995941;3929.764214147132;3948.1116748731592;69434.30565694379;69492.3050769491;72072.2792772076;72104;72217;10545.683629491128;10621.734456638645;10716.410597417062;10783.08343790771;11160.441977901073;22257.332280031624;22266.888665556893;22274.331770046923;22290.665640015413;22372;8215.835683286421;8492.787680308042;8671.046184919654;8720;8934.374593778373;4448.755318457516;4642.303654451859;4678.274867395559;4742.5020372861045;4845.830395936126;3290.3090351026076;3445.104272889067;3456.70617997468;3460.2906404187083;3462.0133262020204;574.3022227993008;576.4063015094459;589.5813972079785;590.9025010873157;591.3052163707627;667.813012356541;680.6766785776716;683.0846665468297;754.8754455514778;762.5577165244256;9284.489353085644;9897.257705672104;10131.549387184603;10185.388876667275;10236;649.6167261315846;674.5177198303237;724.851405461879;767.8425922685836;775.6393277126164;4421.712588681726;4802.903941921142;4881.292212629149;4883.536064073978;4896.632752543503;70794.2920570798;75249.62375188089;112116.43941780402;117304;118149.40925295319;88929.55535222283;90980.5450972741;96868.51565742267;99888;101816;86062.56968715241;86086.13913860907;86483;87025;88612;8324.375671824517;8518.914810851813;8569.98706209696;8648.55230324391;8992.640294388151;48260.75869620629;49506;50009.749951250014;51306;51851.2222316658;67009;73315.03507166811;73519.63240183765;75183.24816751762;75483.62258188674;11996.880031199926;12066.879331206927;12153.270803751802;12215.694607634525;12675.683107922376;13435.596932092052;13454.26001569923;13535.458581656623;14006.929965350108;14231.146131232159;11212.943935280271;12169.81745273804;12870.034747393796;13012.934935325642;13505.189688618715;10312.27814053009;10341.63804266847;10404.219683523615;10677.14582833356;10924.836127457935;12146.696332591757;12153.08851836098;12174.269543827399;12376.443060062138;12724.809127862904;9514.23886089125;9930.304878658713;9956.950215248877;10049.748756280858;10292.536835842255;10370.481475926324;10862.185336099983;10879.347239165676;10965.780684386427;11142.944285278521 23:26:32 INFO - PROCESS | 10990 | __end_tp_report 23:26:32 INFO - PROCESS | 10990 | __start_cc_report 23:26:32 INFO - PROCESS | 10990 | _x_x_mozilla_cycle_collect,355 23:26:32 INFO - PROCESS | 10990 | __end_cc_report 23:26:32 INFO - PROCESS | 10990 | __startTimestamp1465367192219__endTimestamp 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | ------- Summary: start ------- 23:26:32 INFO - PROCESS | 10990 | Number of tests: 6 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#0] dojo.html Cycles:165 Average:5383.10 Median:5625.92 stddev:718.26 (12.8%) stddev-sans-first:698.92 23:26:32 INFO - PROCESS | 10990 | Values: 3157.4 3168.4 3173.9 3203.3 3211.0 5340.1 5343.8 5389.2 5424.5 5470.0 5318.0 5407.8 5470.9 5494.8 5539.1 4930.7 4956.4 5040.1 5086.4 5151.3 468.0 4852.9 4946.3 4962.4 5059.0 4916.9 4971.5 4984.8 4985.6 5021.8 4999.4 5012.8 5027.2 5039.0 5039.3 4906.7 4919.8 4961.8 4964.9 4969.5 5352.4 5366.6 5420.0 5421.0 5440.4 5640.1 5714.7 5862.9 5871.3 5882.6 5758.8 5798.8 5813.9 5836.2 5891.0 5405.6 5411.4 5414.6 5421.0 5438.6 5744.3 5881.6 5890.3 5895.2 5902.4 5727.9 5732.2 5734.1 5735.5 5767.0 5803.9 5804.2 5806.4 5811.9 5859.5 5626.7 5715.6 5775.0 5801.4 5844.5 5811.8 5812.3 5830.2 5832.1 5866.6 4430.9 4431.1 4472.0 4480.0 4525.0 3917.0 3928.6 3930.3 3953.1 3963.4 5472.6 5525.0 5534.6 5541.2 5597.3 5834.3 5883.6 5948.7 5953.4 5996.5 5591.0 5616.6 5625.9 5629.7 5640.6 4902.3 4945.5 4949.8 4955.8 4999.6 5953.2 5966.1 5995.7 6053.8 6057.8 5853.2 5875.9 5889.7 5895.4 5906.9 5733.7 5905.9 5972.6 5984.5 5990.2 5733.1 5775.7 5786.7 5813.8 5847.0 5808.7 5857.8 5863.0 5873.1 5882.2 5524.4 5601.2 5623.2 5713.7 5717.9 5654.5 5680.9 5680.9 5683.1 5713.0 5554.1 5595.8 5602.7 5606.7 5609.4 5627.8 5671.9 5710.0 5746.1 5809.1 5605.2 5623.4 5631.4 5636.3 5676.7 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#1] ext.html Cycles:180 Average:63226.70 Median:42371.47 stddev:130597.00 (308.2%) stddev-sans-first:130878.61 23:26:32 INFO - PROCESS | 10990 | Values: 563.5 596.8 620.1 622.9 647.0 37903.2 42963.4 43016.1 43150.1 43157.6 43762.3 44307.6 44541.6 44679.3 44727.6 8675.8 8807.1 8856.8 8864.6 8866.9 8637.0 8698.8 8749.9 8754.0 8758.7 8737.8 8757.2 8824.0 8843.2 8847.2 8750.3 8758.6 8775.7 8779.0 8803.9 8727.7 8755.9 8829.9 8833.6 8856.1 40782.6 41001.4 41212.6 41297.2 41468.0 3212.5 3398.4 3523.0 3537.1 3956.4 30296.0 33114.8 33358.0 33464.7 33527.2 4353.8 4359.1 4401.8 4455.6 4495.5 330022.0 330368.3 332251.0 334577.0 334966.0 34485.5 61472.0 61674.0 62041.0 62105.4 35695.8 37064.4 37330.1 37344.3 37485.3 15664.2 15822.4 15874.8 15894.3 15898.2 13380.7 13397.2 13495.8 13521.6 13538.3 8376.9 8422.1 8425.7 8504.9 8516.1 3285.4 3287.0 3326.9 3330.6 3332.1 1006.6 1082.7 1117.3 1170.4 1206.5 31775.7 32943.5 32980.0 33455.0 33807.2 1070.8 1078.4 1133.6 1139.1 1177.7 16763.0 17302.9 17340.6 17399.8 17424.7 563272.0 563652.0 567191.0 567873.0 568654.0 59224.4 59879.7 59936.0 60047.4 60109.7 1353.8 1385.0 1406.8 1412.4 1414.0 30830.4 32427.2 32432.7 33108.5 33869.2 57058.7 57153.4 58248.1 58290.0 58376.0 535658.5 536959.0 539313.0 539456.0 540572.0 44530.3 45038.5 45825.8 45893.8 46068.3 49484.8 50401.5 50508.5 51294.7 51472.5 41605.6 41796.4 41969.4 42594.6 42902.6 41239.0 42062.6 42187.6 42555.4 43231.1 36234.0 41094.8 41520.8 42971.8 43145.7 36820.6 37484.0 37558.8 37903.2 38232.0 28495.6 28676.7 28894.0 28946.0 29023.7 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#2] jquery.html Cycles:180 Average:28507.02 Median:19832.22 stddev:82396.97 (415.5%) stddev-sans-first:82601.04 23:26:32 INFO - PROCESS | 10990 | Values: 373.9 379.1 389.1 394.6 403.0 17397.4 19583.8 20158.5 20225.3 20227.2 18373.4 18805.7 18808.2 18845.7 19364.6 5454.1 5573.8 5680.1 5771.3 5810.6 5648.7 5677.9 5680.6 5686.9 5710.3 5489.2 5601.4 5634.3 5654.6 5658.0 5534.6 5555.8 5575.8 5582.6 5585.1 4856.2 4977.6 5049.7 5072.5 5092.6 22297.4 22364.3 22486.3 22856.1 22870.4 2153.2 2168.6 2211.5 2252.7 2372.6 13690.7 14214.4 14287.6 14495.0 14519.3 1834.4 1895.3 1918.2 1926.6 1943.0 71621.6 74605.3 75273.0 75419.0 76150.0 9902.3 9969.9 10128.3 10162.6 10296.4 13372.1 13464.7 13473.7 13485.1 13558.9 7774.8 7815.5 7854.3 7959.4 8036.8 7531.4 7686.7 7760.5 7761.7 7768.1 6274.3 6321.5 6360.4 6428.3 6435.3 1773.9 1807.4 1817.8 1822.5 1825.5 974.6 986.6 1022.8 1059.0 1155.2 18177.4 19362.7 19362.8 19524.5 19546.4 974.1 993.3 1014.8 1019.5 1092.2 7393.9 11187.6 11425.3 11457.3 11499.8 493027.0 498370.0 500505.0 506189.0 512680.0 77786.0 81383.0 82659.0 84075.0 85303.1 1014.2 1019.2 1043.2 1056.1 1057.2 17241.9 17404.2 17717.9 17795.7 17892.2 37291.8 38334.0 38439.6 39572.6 40005.2 50617.2 51274.5 51471.2 51557.5 51901.0 5066.7 5103.0 8319.3 8338.2 8485.4 12072.8 12332.6 12853.7 13034.5 13416.7 10839.2 11101.3 11318.8 11325.2 11377.5 10611.7 10895.5 11337.7 11362.4 11451.5 9164.5 11273.3 11289.4 11554.0 11759.4 8112.4 8197.6 8205.0 8255.8 8261.6 8354.0 10735.6 11059.7 11710.4 11972.6 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#3] mootools.html Cycles:180 Average:5832.47 Median:4272.23 stddev:3285.37 (76.9%) stddev-sans-first:3278.17 23:26:32 INFO - PROCESS | 10990 | Values: 1461.9 1505.5 1640.3 1766.4 1793.5 7504.7 8476.7 8540.9 9105.5 9117.7 8458.0 8835.6 8847.6 8873.4 8909.6 2316.9 2342.9 2348.9 2350.5 2358.6 2315.8 2319.0 2349.8 2354.4 2358.6 2263.0 2297.8 2305.1 2330.1 2332.4 2236.4 2271.2 2273.3 2278.9 2287.3 2282.1 2297.4 2301.5 2303.3 2309.8 8778.6 8801.4 8861.6 8875.9 8875.9 5133.9 5233.8 5257.1 5259.7 5291.0 3206.7 3245.9 3407.6 3431.8 3442.4 1152.9 1170.6 1182.4 1189.5 1213.4 12094.8 12102.9 12130.0 12130.1 12137.8 4437.9 4521.7 4590.8 4592.4 4611.3 10119.9 10228.2 10255.4 10257.4 10271.9 5194.7 5194.7 5195.9 5196.4 5200.3 4140.6 4609.1 4732.9 4753.0 4767.1 3786.3 3898.9 3925.9 3950.4 3956.0 1229.9 1236.4 1243.4 1244.2 1252.8 909.2 1020.7 1024.1 1052.3 1053.2 6080.3 6159.9 6231.3 6279.7 6352.8 1024.4 1069.2 1116.4 1118.7 1121.5 4114.0 4403.9 4412.6 4438.1 4490.4 10698.7 10873.7 11027.4 11030.0 11067.2 10893.8 10895.3 10931.0 10952.7 10964.6 7769.9 7788.1 8102.1 8161.2 8316.4 6001.2 6115.9 6165.2 6296.8 6353.4 10085.0 10197.0 10370.1 10374.9 10393.2 10172.1 10398.7 10487.4 10541.8 10607.9 6992.7 7638.1 7734.8 7857.9 7992.0 8586.0 8661.3 8684.4 8706.9 8743.4 7376.3 7707.3 7750.2 7753.7 7839.1 7283.8 7320.6 7321.7 7377.4 7459.9 7170.3 7241.3 7273.5 7280.8 7311.5 5249.2 5317.7 5363.5 5523.6 5541.4 5385.9 5451.9 5498.8 5500.5 5615.6 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#4] prototype.html Cycles:180 Average:4924.25 Median:5688.99 stddev:1476.21 (25.9%) stddev-sans-first:1439.43 23:26:32 INFO - PROCESS | 10990 | Values: 325.1 328.1 330.7 332.5 337.7 5539.5 5601.4 5637.3 5681.7 5723.7 5549.6 5566.1 5616.9 5620.6 5634.4 4165.7 4182.2 4307.3 4313.9 4319.6 4299.5 4307.5 4312.2 4312.7 4354.3 4236.4 4285.8 4304.1 4310.4 4317.0 4049.8 4268.2 4275.0 4275.8 4285.3 3691.0 3696.6 3715.1 3735.6 3756.0 5320.8 5408.2 5424.5 5428.3 5436.4 4672.3 4903.3 4911.5 4927.0 4944.3 5765.1 5796.6 5804.8 5817.2 5825.5 4065.3 4086.0 4103.2 4113.5 4123.5 5901.1 6094.0 6096.7 6101.2 6101.5 4165.1 4201.6 4201.8 4214.7 4225.3 4260.0 4277.8 4278.8 4286.1 4300.1 4628.7 4858.3 4886.2 4929.6 4958.9 5862.3 5894.6 5900.6 5901.6 5974.2 1465.9 1470.6 1473.0 1475.5 1487.6 920.6 930.4 962.7 989.4 999.0 5648.9 5661.9 5672.9 5696.3 5703.9 5963.1 5977.3 6004.6 6013.6 6043.7 5458.5 5642.4 5707.4 5755.2 5799.6 3206.1 3248.4 3252.9 3261.2 3274.4 6091.3 6231.8 6236.5 6252.1 6252.6 6155.6 6203.0 6222.9 6224.5 6234.8 5948.5 6208.9 6226.8 6256.8 6265.6 6020.5 6048.4 6072.4 6083.0 6100.5 6060.3 6064.6 6087.3 6095.5 6106.8 5959.6 6181.8 6182.9 6198.9 6268.5 4168.3 4187.1 4217.0 4224.0 4228.2 5816.4 5850.8 6101.6 6109.7 6139.4 5867.3 5868.7 5884.6 5892.3 5913.8 5828.6 5837.5 5854.2 5865.7 5891.1 5514.2 5824.7 5837.3 5846.5 5846.9 5842.7 5944.2 5950.6 6000.5 6005.8 5658.3 5788.5 5801.9 5868.7 5897.5 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - PROCESS | 10990 | [#5] yui.html Cycles:180 Average:19767.66 Median:26553.29 stddev:28293.08 (106.6%) stddev-sans-first:28336.34 23:26:32 INFO - PROCESS | 10990 | Values: 732.0 763.9 764.8 781.4 783.3 13725.5 14713.0 14736.6 14839.3 14875.2 13684.9 13689.1 13758.5 13796.3 13818.4 680.9 798.6 803.4 823.5 824.7 805.4 806.3 809.4 813.1 814.7 845.4 851.4 860.7 863.9 864.0 850.3 855.2 856.4 856.4 860.4 624.8 626.5 628.3 629.8 630.3 14441.1 14479.9 14501.0 14602.1 14628.6 14877.3 15124.8 15220.7 15310.2 15706.3 12071.9 12163.6 12193.1 12226.0 12782.5 3675.1 3857.9 3887.8 3929.8 3948.1 69434.3 69492.3 72072.3 72104.0 72217.0 10545.7 10621.7 10716.4 10783.1 11160.4 22257.3 22266.9 22274.3 22290.7 22372.0 8215.8 8492.8 8671.0 8720.0 8934.4 4448.8 4642.3 4678.3 4742.5 4845.8 3290.3 3445.1 3456.7 3460.3 3462.0 574.3 576.4 589.6 590.9 591.3 667.8 680.7 683.1 754.9 762.6 9284.5 9897.3 10131.5 10185.4 10236.0 649.6 674.5 724.9 767.8 775.6 4421.7 4802.9 4881.3 4883.5 4896.6 70794.3 75249.6 112116.4 117304.0 118149.4 88929.6 90980.5 96868.5 99888.0 101816.0 86062.6 86086.1 86483.0 87025.0 88612.0 8324.4 8518.9 8570.0 8648.6 8992.6 48260.8 49506.0 50009.7 51306.0 51851.2 67009.0 73315.0 73519.6 75183.2 75483.6 11996.9 12066.9 12153.3 12215.7 12675.7 13435.6 13454.3 13535.5 14006.9 14231.1 11212.9 12169.8 12870.0 13012.9 13505.2 10312.3 10341.6 10404.2 10677.1 10924.8 12146.7 12153.1 12174.3 12376.4 12724.8 9514.2 9930.3 9957.0 10049.7 10292.5 10370.5 10862.2 10879.3 10965.8 11142.9 23:26:32 INFO - PROCESS | 10990 | -------- Summary: end -------- 23:26:32 INFO - PROCESS | 10990 | 23:26:32 INFO - TEST-INFO | 10990: exit 0 23:26:32 INFO - TEST-OK | dromaeo_css | took 1109828ms 23:26:32 INFO - TEST-START | kraken 23:26:32 INFO - operating with platform_type : linux_ 23:26:32 INFO - Initialising browser for kraken test... 23:26:32 INFO - TEST-INFO | started process 11222 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpewB9Ny/profile http://localhost:42163/getInfo.html) 23:26:37 INFO - PROCESS | 11222 | __metrics Screen width/height:1600/1200 23:26:37 INFO - PROCESS | 11222 | colorDepth:24 23:26:37 INFO - PROCESS | 11222 | Browser inner width/height: 1024/697 23:26:37 INFO - PROCESS | 11222 | __metrics 23:26:38 ERROR - PROCESS | 11222 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 23:26:38 INFO - TEST-INFO | 11222: exit 0 23:26:38 INFO - Browser initialized. 23:26:38 INFO - Running cycle 1/1 for kraken test... 23:26:38 INFO - TEST-INFO | started process 11339 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpewB9Ny/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:26:50 INFO - PROCESS | 11339 | RSS: Main: 167763968 23:26:50 INFO - PROCESS | 11339 | 23:26:53 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42163/tests/kraken/driver.html?testName=audio-beat-detection) 23:26:53 INFO - PROCESS | 11339 | RSS: Main: 172851200 23:26:53 INFO - PROCESS | 11339 | 23:26:56 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42163/tests/kraken/driver.html?testName=audio-dft) 23:26:57 INFO - PROCESS | 11339 | RSS: Main: 172126208 23:26:57 INFO - PROCESS | 11339 | 23:27:00 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42163/tests/kraken/driver.html?testName=audio-fft) 23:27:00 INFO - PROCESS | 11339 | RSS: Main: 166879232 23:27:00 INFO - PROCESS | 11339 | 23:27:03 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42163/tests/kraken/driver.html?testName=audio-oscillator) 23:27:03 INFO - PROCESS | 11339 | RSS: Main: 167878656 23:27:03 INFO - PROCESS | 11339 | 23:27:05 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42163/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:27:06 INFO - PROCESS | 11339 | RSS: Main: 168071168 23:27:06 INFO - PROCESS | 11339 | 23:27:09 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42163/tests/kraken/driver.html?testName=imaging-darkroom) 23:27:10 INFO - PROCESS | 11339 | RSS: Main: 168386560 23:27:10 INFO - PROCESS | 11339 | 23:27:13 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42163/tests/kraken/driver.html?testName=imaging-desaturate) 23:27:14 INFO - PROCESS | 11339 | RSS: Main: 168751104 23:27:14 INFO - PROCESS | 11339 | 23:27:17 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42163/tests/kraken/driver.html?testName=json-parse-financial) 23:27:17 INFO - PROCESS | 11339 | RSS: Main: 168845312 23:27:17 INFO - PROCESS | 11339 | 23:27:19 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42163/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:27:19 INFO - PROCESS | 11339 | RSS: Main: 168800256 23:27:19 INFO - PROCESS | 11339 | 23:27:21 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:27:22 INFO - PROCESS | 11339 | RSS: Main: 169086976 23:27:22 INFO - PROCESS | 11339 | 23:27:24 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:27:25 INFO - PROCESS | 11339 | RSS: Main: 169267200 23:27:25 INFO - PROCESS | 11339 | 23:27:27 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:27:28 INFO - PROCESS | 11339 | RSS: Main: 169730048 23:27:28 INFO - PROCESS | 11339 | 23:27:31 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:27:31 INFO - PROCESS | 11339 | RSS: Main: 169250816 23:27:31 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | Cycle 1(1): loaded http://localhost:42163/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42163/tests/kraken/driver.html?testName=ai-astar) 23:27:33 INFO - PROCESS | 11339 | RSS: Main: 170090496 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | __start_tp_report 23:27:33 INFO - PROCESS | 11339 | _x_x_mozilla_page_load 23:27:33 INFO - PROCESS | 11339 | _x_x_mozilla_page_load_details 23:27:33 INFO - PROCESS | 11339 | |i|pagename|runs| 23:27:33 INFO - PROCESS | 11339 | |0;ai-astar;110;108;113;111;111;112;110;112;111;111 23:27:33 INFO - PROCESS | 11339 | |1;audio-beat-detection;160;128;153;192;128;163;181;127;189;127 23:27:33 INFO - PROCESS | 11339 | |2;audio-dft;167;163;162;163;162;168;167;163;164;163 23:27:33 INFO - PROCESS | 11339 | |3;audio-fft;75;76;75;161;75;78;74;76;177;75 23:27:33 INFO - PROCESS | 11339 | |4;audio-oscillator;87;90;156;86;85;85;149;85;84;146 23:27:33 INFO - PROCESS | 11339 | |5;imaging-gaussian-blur;117;118;118;117;118;117;117;117;118;118 23:27:33 INFO - PROCESS | 11339 | |6;imaging-darkroom;146;146;147;148;146;146;147;146;146;146 23:27:33 INFO - PROCESS | 11339 | |7;imaging-desaturate;96;95;95;96;96;96;96;96;95;95 23:27:33 INFO - PROCESS | 11339 | |8;json-parse-financial;55;55;55;56;60;55;55;57;54;57 23:27:33 INFO - PROCESS | 11339 | |9;json-stringify-tinderbox;63;64;64;63;63;63;62;62;63;63 23:27:33 INFO - PROCESS | 11339 | |10;stanford-crypto-aes;80;80;80;82;81;83;84;82;114;81 23:27:33 INFO - PROCESS | 11339 | |11;stanford-crypto-ccm;124;129;135;130;133;121;123;124;124;133 23:27:33 INFO - PROCESS | 11339 | |12;stanford-crypto-pbkdf2;162;163;162;159;161;156;166;173;166;165 23:27:33 INFO - PROCESS | 11339 | |13;stanford-crypto-sha256-iterative;62;64;63;64;63;63;62;66;64;61 23:27:33 INFO - PROCESS | 11339 | __end_tp_report 23:27:33 INFO - PROCESS | 11339 | __start_cc_report 23:27:33 INFO - PROCESS | 11339 | _x_x_mozilla_cycle_collect,889 23:27:33 INFO - PROCESS | 11339 | __end_cc_report 23:27:33 INFO - PROCESS | 11339 | __startTimestamp1465367253595__endTimestamp 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | ------- Summary: start ------- 23:27:33 INFO - PROCESS | 11339 | Number of tests: 14 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#0] ai-astar Cycles:10 Average:110.90 Median:111.00 stddev:1.37 (1.2%) stddev-sans-first:1.41 23:27:33 INFO - PROCESS | 11339 | Values: 110.0 108.0 113.0 111.0 111.0 112.0 110.0 112.0 111.0 111.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#1] audio-beat-detection Cycles:10 Average:154.80 Median:161.50 stddev:26.50 (16.4%) stddev-sans-first:28.04 23:27:33 INFO - PROCESS | 11339 | Values: 160.0 128.0 153.0 192.0 128.0 163.0 181.0 127.0 189.0 127.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#2] audio-dft Cycles:10 Average:164.20 Median:163.50 stddev:2.25 (1.4%) stddev-sans-first:2.15 23:27:33 INFO - PROCESS | 11339 | Values: 167.0 163.0 162.0 163.0 162.0 168.0 167.0 163.0 164.0 163.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#3] audio-fft Cycles:10 Average:94.20 Median:75.00 stddev:39.62 (52.8%) stddev-sans-first:41.41 23:27:33 INFO - PROCESS | 11339 | Values: 75.0 76.0 75.0 161.0 75.0 78.0 74.0 76.0 177.0 75.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#4] audio-oscillator Cycles:10 Average:105.30 Median:85.00 stddev:31.21 (36.7%) stddev-sans-first:32.40 23:27:33 INFO - PROCESS | 11339 | Values: 87.0 90.0 156.0 86.0 85.0 85.0 149.0 85.0 84.0 146.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 23:27:33 INFO - PROCESS | 11339 | Values: 117.0 118.0 118.0 117.0 118.0 117.0 117.0 117.0 118.0 118.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 23:27:33 INFO - PROCESS | 11339 | Values: 146.0 146.0 147.0 148.0 146.0 146.0 147.0 146.0 146.0 146.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.53 23:27:33 INFO - PROCESS | 11339 | Values: 96.0 95.0 95.0 96.0 96.0 96.0 96.0 96.0 95.0 95.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#8] json-parse-financial Cycles:10 Average:55.90 Median:55.50 stddev:1.73 (3.1%) stddev-sans-first:1.80 23:27:33 INFO - PROCESS | 11339 | Values: 55.0 55.0 55.0 56.0 60.0 55.0 55.0 57.0 54.0 57.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#9] json-stringify-tinderbox Cycles:10 Average:63.00 Median:63.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 23:27:33 INFO - PROCESS | 11339 | Values: 63.0 64.0 64.0 63.0 63.0 63.0 62.0 62.0 63.0 63.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#10] stanford-crypto-aes Cycles:10 Average:84.70 Median:81.50 stddev:10.38 (12.7%) stddev-sans-first:10.87 23:27:33 INFO - PROCESS | 11339 | Values: 80.0 80.0 80.0 82.0 81.0 83.0 84.0 82.0 114.0 81.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#11] stanford-crypto-ccm Cycles:10 Average:127.60 Median:129.50 stddev:4.99 (3.9%) stddev-sans-first:5.12 23:27:33 INFO - PROCESS | 11339 | Values: 124.0 129.0 135.0 130.0 133.0 121.0 123.0 124.0 124.0 133.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.30 Median:164.00 stddev:4.62 (2.8%) stddev-sans-first:4.88 23:27:33 INFO - PROCESS | 11339 | Values: 162.0 163.0 162.0 159.0 161.0 156.0 166.0 173.0 166.0 165.0 23:27:33 INFO - PROCESS | 11339 | 23:27:33 INFO - PROCESS | 11339 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.20 Median:63.50 stddev:1.40 (2.2%) stddev-sans-first:1.41 23:27:33 INFO - PROCESS | 11339 | Values: 62.0 64.0 63.0 64.0 63.0 63.0 62.0 66.0 64.0 61.0 23:27:33 INFO - PROCESS | 11339 | -------- Summary: end -------- 23:27:33 INFO - PROCESS | 11339 | 23:27:34 INFO - TEST-INFO | 11339: exit 0 23:27:34 INFO - TEST-OK | kraken | took 61668ms 23:27:34 INFO - SUITE-END | took 1171s 23:27:34 INFO - Completed test suite (00:19:31) 23:27:34 INFO - javascript benchmark 23:27:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7237.200020056867, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3157.3685262947415, 3168.366326734653, 3173.9365212695734, 3203.279262166013, 3210.983945080274, 5340.118880384737, 5343.759530821113, 5389.164679474688, 5424.5117939385445, 5470.0, 5318.0, 5407.810726624569, 5470.890582188354, 5494.752736126874, 5539.058360078786, 4930.679505832119, 4956.3804524434445, 5040.117979353617, 5086.41506226785, 5151.278820965068, 467.9853644325778, 4852.854414367557, 4946.282788995593, 4962.379702537183, 5058.974705126488, 4916.926246106294, 4971.502849715036, 4984.77568509418, 4985.576226020775, 5021.799128034874, 4999.4250661174065, 5012.8496145115705, 5027.220780778948, 5039.017391608638, 5039.3196918415915, 4906.681065730716, 4919.7540122993705, 4961.751912404401, 4964.87587810304, 4969.453360130383, 5352.437994010651, 5366.597505187087, 5420.024395608789, 5420.972895135499, 5440.374356948962, 5640.125780504029, 5714.657120572779, 5862.941370586283, 5871.324797648283, 5882.617629854046, 5758.827235182951, 5798.768049278024, 5813.854653633651, 5836.212111364954, 5891.027980383232, 5405.621606487547, 5411.404745477994, 5414.620976531644, 5421.0, 5438.564914806806, 5744.253247077937, 5881.5882888198275, 5890.322612899486, 5895.20414744004, 5902.439268269508, 5727.942720572741, 5732.226149469851, 5734.139879018181, 5735.483806457439, 5767.0, 5803.941960580424, 5804.216430781875, 5806.4193580641595, 5811.941880581225, 5859.472647461749, 5626.662400255997, 5715.628484148517, 5775.0, 5801.361850196475, 5844.503217226498, 5811.79658711943, 5812.273465816773, 5830.2420685310635, 5832.096025116114, 5866.5893387462465, 4430.867073987785, 4431.091626216617, 4472.0, 4479.955200447954, 4525.0, 3917.0, 3928.5678575356687, 3930.3121953657997, 3953.0907891184615, 3963.4253033310583, 5472.5621950243885, 5524.972375138099, 5534.640248383842, 5541.168824676251, 5597.328320601554, 5834.299884013861, 5883.646981181143, 5948.672822994777, 5953.374895635982, 5996.5202783777195, 5591.0, 5616.5787565931905, 5625.915611265835, 5629.7185140742795, 5640.576956728261, 4902.313676085351, 4945.530174633404, 4949.82675606352, 4955.801767929314, 4999.600031997432, 5953.22608060958, 5966.075258334965, 5995.670238136944, 6053.818385448443, 6057.818265452043, 5853.151293062568, 5875.853103672443, 5889.676067816311, 5895.380984996514, 5906.940930590725, 5733.684647344269, 5905.852353691193, 5972.552058595709, 5984.461398474158, 5990.221271234712, 5733.082706766897, 5775.740091695968, 5786.710664466844, 5813.76744930198, 5846.970765146147, 5808.7095645218415, 5857.765689372548, 5863.032599621015, 5873.119032145212, 5882.23530940975, 5524.4199359066715, 5601.243832082617, 5623.2127502148915, 5713.685747283939, 5717.942820571741, 5654.547636189012, 5680.886382272414, 5680.9147862781265, 5683.147527870852, 5713.0, 5554.1391084381985, 5595.804146854841, 5602.719864006702, 5606.6916319602815, 5609.354924183771, 5627.831165065055, 5671.914921276267, 5710.029295019774, 5746.080627099644, 5809.099589563624, 5605.243292155506, 5623.409541998195, 5631.436856314336, 5636.267285252891, 5676.744546495335], "value": 5337.288167878529, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [563.4956713741202, 596.8209537138858, 620.0977577624557, 622.8909940760367, 646.9547131700776, 37903.24193516128, 42963.3555496667, 43016.139677206476, 43150.13699726004, 43157.568424315745, 43762.34356484647, 44307.55692443075, 44541.55458445415, 44679.32981005288, 44727.55272447275, 8675.826483470326, 8807.119288071206, 8856.778580535474, 8864.556772161399, 8866.86699699505, 8637.0, 8698.782530436758, 8749.912500875005, 8753.956230218871, 8758.737237882873, 8737.825243495126, 8757.168069033432, 8823.955880220621, 8843.248323892476, 8847.247983921374, 8750.299976001905, 8758.649654013896, 8775.736727898142, 8779.0, 8803.911960880374, 8727.650893964234, 8755.868661970075, 8829.911700882973, 8833.60248788806, 8856.070112638145, 40782.59217407818, 41001.38497922534, 41212.58787412118, 41297.1740565187, 41468.0, 3212.5341825435416, 3398.3882901077795, 3523.048776830267, 3537.0803591066506, 3956.3867600521967, 30296.0, 33114.834425827954, 33358.0, 33464.6653533464, 33527.161820954425, 4353.847615333448, 4359.12817436514, 4401.779911004437, 4455.643548516144, 4495.483019452739, 330022.0, 330368.34815826005, 332251.0, 334577.0, 334966.0, 34485.48271775925, 61472.0, 61674.0, 62041.0, 62105.37894621086, 35695.82152089275, 37064.444033339525, 37330.06674833151, 37344.25311493755, 37485.250294993944, 15664.216789160497, 15822.446214382442, 15874.761878571831, 15894.284757185955, 15898.205089745466, 13380.732385352238, 13397.196168229937, 13495.797563036562, 13521.59435216945, 13538.323083845768, 8376.916230837614, 8422.073571907085, 8425.747227583182, 8504.872426913602, 8516.1058088901, 3285.3593549258144, 3286.967130328714, 3326.850291736878, 3330.5670262865674, 3332.133645252203, 1006.6023920551341, 1082.6860210539014, 1117.3240189685123, 1170.3563040327786, 1206.5475446707485, 31775.682243177736, 32943.50584741231, 32980.0, 33455.0, 33807.15482112967, 1070.82866741321, 1078.4392116099584, 1133.6485689436136, 1139.145640769423, 1177.6761390617478, 16763.0, 17302.91348543249, 17340.566485837953, 17399.826001740075, 17424.651506970044, 563272.0, 563652.0, 567191.0, 567873.0, 568654.0, 59224.407755921886, 59879.70060149671, 59936.0, 60047.39952600506, 60109.69945150334, 1353.8240028796195, 1385.0, 1406.7889816527397, 1412.427966673499, 1413.964650883736, 30830.383392332475, 32427.18932026624, 32432.67567324391, 33108.503372449915, 33869.15327116842, 57058.7147064262, 57153.42846571481, 58248.12627810671, 58290.0, 58376.0, 535658.5387803552, 536959.0, 539313.0, 539456.0, 540572.0, 44530.33204502, 45038.549614503434, 45825.77087114543, 45893.78743487924, 46068.30897536607, 49484.75257623689, 50401.49598503968, 50508.49491505038, 51294.74352628362, 51472.48527514677, 41605.58394416017, 41796.373054404816, 41969.37045944252, 42594.57405425906, 42902.570974289854, 41239.0, 42062.57937420587, 42187.578124219595, 42555.36166957436, 43231.13537729165, 36234.0, 41094.79452602718, 41520.792396037825, 42971.78514107409, 43145.6854314566, 36820.63179368279, 37484.0, 37558.8122059388, 37903.24193516169, 38232.0, 28495.572566411105, 28676.713232867405, 28893.988710395035, 28946.0, 29023.7097629021], "value": 19581.98772403313, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [373.94203898395756, 379.0977473612802, 389.118646266207, 394.5718894998926, 402.9838806447742, 17397.391091311805, 19583.804161958375, 20158.49603759905, 20225.292114775984, 20227.190912363487, 18373.448796536126, 18805.717914231296, 18808.24767009318, 18845.717314240297, 19364.612707745837, 5454.072807622694, 5573.804916827912, 5680.119581464859, 5771.278590176228, 5810.622309549865, 5648.745806438699, 5677.943220567803, 5680.602357834953, 5686.943130568683, 5710.2862142232225, 5489.231507588941, 5601.3558440779425, 5634.295713035871, 5654.6324488908085, 5658.0381335172915, 5534.557235421197, 5555.777768889239, 5575.804846830361, 5582.553395728332, 5585.134304182858, 4856.198727210006, 4977.601791856679, 5049.671771334888, 5072.54347108762, 5092.618053645954, 22297.44256393603, 22364.329070127922, 22486.325410237718, 22856.08575656972, 22870.42823929415, 2153.1710291537715, 2168.5662867426577, 2211.491356987902, 2252.6958860553777, 2372.6203807390734, 13690.726185476335, 14214.385942295672, 14287.642808929755, 14495.0, 14519.346629401702, 1834.4221570205343, 1895.2987394663924, 1918.1655979648897, 1926.5568919148534, 1942.951426214356, 71621.64189179073, 74605.25394746092, 75273.0, 75419.0, 76150.0, 9902.306838521234, 9969.900300997042, 10128.34165779222, 10162.644307449204, 10296.382217067, 13372.130811497222, 13464.730705386033, 13473.730525389437, 13485.123466974615, 13558.86441135576, 7774.8056298591855, 7815.53106813593, 7854.347728306251, 7959.44283900133, 8036.799080022929, 7531.359834414026, 7686.692532298645, 7760.495567788075, 7761.689532418753, 7768.067831860213, 6274.341194174546, 6321.462675672619, 6360.395762402564, 6428.332242119468, 6435.29464691857, 1773.9467815965543, 1807.3764551229804, 1817.818218178198, 1822.5170329862597, 1825.4979880532694, 974.5614473486959, 986.5856340337076, 1022.8056669232822, 1058.9841152382721, 1155.185594156118, 18177.36379226747, 19362.70955935634, 19362.80637193638, 19524.511887202934, 19546.413607591796, 974.1184228273424, 993.3245393132595, 1014.7818219082933, 1019.4545917934018, 1092.1699508373533, 7393.926060739432, 11187.608433704781, 11425.31448113116, 11457.255278407043, 11499.827502587468, 493027.0, 498370.0, 500505.0, 506189.0, 512680.0, 77786.0, 81383.0, 82659.0, 84075.0, 85303.14696852952, 1014.2139841622801, 1019.2406657040552, 1043.1967385113421, 1056.12869382758, 1057.164839776568, 17241.91379043097, 17404.216810243317, 17717.911410442866, 17795.73306400379, 17892.194851231467, 37291.81354093212, 38334.0, 38439.61560384472, 39572.604273956895, 40005.1998960025, 50617.24074138964, 51274.48725512697, 51471.22793158031, 51557.48442515527, 51901.0, 5066.746662666926, 5102.974485127551, 8319.334453243848, 8338.207870252316, 8485.448445851, 12072.75854482923, 12332.630021099381, 12853.742925141632, 13034.47862085544, 13416.731665366833, 10839.187060970302, 11101.278416902875, 11318.773624527299, 11325.15061370384, 11377.488013039267, 10611.681649550526, 10895.455227238765, 11337.659870203577, 11362.431878406212, 11451.48468318911, 9164.541772911462, 11273.267237629529, 11289.363042358977, 11554.0, 11759.353235572125, 8112.391570632109, 8197.590120494071, 8205.03088747175, 8255.752327430188, 8261.586920654063, 8354.0, 10735.570577176826, 11059.668209953714, 11710.355930423908, 11972.58095966637], "value": 9022.50198120384, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1461.9342129604167, 1505.5408100529337, 1640.3110693508725, 1766.4170823628203, 1793.5426466251104, 7504.66229019694, 8476.660933562658, 8540.871886921701, 9105.499197544132, 9117.726468205949, 8457.95771021144, 8835.558222088903, 8847.646094156242, 8873.378863479544, 8909.599068041938, 2316.918907838226, 2342.8711420871846, 2348.8708121053337, 2350.459394339303, 2358.5730632967066, 2315.81473482121, 2319.0, 2349.753275906031, 2354.446705024318, 2358.6226203807396, 2262.9773702262933, 2297.7587353327913, 2305.089489651595, 2330.0563271874917, 2332.4052366646483, 2236.3626366485555, 2271.205078222625, 2273.2839155665997, 2278.886055697225, 2287.313805858236, 2282.052948026567, 2297.3682237384687, 2301.4821665125382, 2303.309007297804, 2309.849859759127, 8778.561071946377, 8801.427907186013, 8861.556922153932, 8875.866861997076, 8875.911240887574, 5133.948660513384, 5233.842984710464, 5257.132573125468, 5259.684418934876, 5291.0, 3206.7274281686086, 3245.902622921316, 3407.5910890693276, 3431.8455669494683, 3442.397580423416, 1152.936588487633, 1170.6371024982284, 1182.408795602199, 1189.5004098278744, 1213.3629844331708, 12094.818577721342, 12102.939485302606, 12130.0, 12130.090243231793, 12137.817932731015, 4437.889052773707, 4521.706089104197, 4590.8163673453355, 4592.425946756655, 4611.262198048296, 10119.898801012043, 10228.181745460493, 10255.435951022617, 10257.435841028815, 10271.897281027244, 5194.662346947436, 5194.740262986836, 5195.896082078338, 5196.428392876781, 5200.323957885451, 4140.565240649748, 4609.078184363141, 4732.905341893212, 4752.95247047532, 4767.118083154627, 3786.2995345861104, 3898.863539776094, 3925.9018524536546, 3950.3679411294056, 3955.980220098881, 1229.8770122987808, 1236.394166858233, 1243.4031664800946, 1244.2410129820803, 1252.8183413405004, 909.1817364371985, 1020.6733845169474, 1024.144839059379, 1052.3422860712055, 1053.2206167436043, 6080.331163572004, 6159.907601385983, 6231.283402408691, 6279.748810047547, 6352.777652782131, 1024.4007255755319, 1069.198101423932, 1116.447358557503, 1118.6644006797928, 1121.5401685308984, 4114.0, 4403.889902752457, 4412.602865742098, 4438.112377524508, 4490.371348011281, 10698.73253168677, 10873.673789786319, 11027.393493357942, 11030.0, 11067.225294229487, 10893.83659245112, 10895.346279223271, 10931.01620854127, 10952.671419857417, 10964.56141754321, 7769.883451748228, 7788.065432148065, 8102.108768035511, 8161.183881611792, 8316.417850750511, 6001.219841420588, 6115.938840611715, 6165.229346331708, 6296.842578935563, 6353.428191462791, 10085.0, 10197.0, 10370.11853992389, 10374.948125259325, 10393.220508461744, 10172.13536849376, 10398.740031499274, 10487.423191724223, 10541.841872372073, 10607.893921060999, 6992.650367481504, 7638.083429988437, 7734.845303094019, 7857.921420785948, 7992.0, 8585.957070214608, 8661.263792577449, 8684.39209255346, 8706.91293087061, 8743.38796284254, 7376.262373762581, 7707.34487568563, 7750.186230445947, 7753.728619498291, 7839.137694853675, 7283.8179045522165, 7320.597367144858, 7321.670524826289, 7377.372923301579, 7459.850802984019, 7170.318819712119, 7241.275872412927, 7273.454490913097, 7280.817979550554, 7311.451641127043, 5249.160134378481, 5317.654352467077, 5363.490468405495, 5523.558115350682, 5541.3904470509015, 5385.865353366197, 5451.863703407446, 5498.835034948958, 5500.50495455411, 5615.606907516435], "value": 4693.731948810914, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [325.1448689945443, 328.06665037966985, 330.73045467943626, 332.466391441736, 337.675831202046, 5539.529140023098, 5601.411851755568, 5637.267155269814, 5681.6591004539705, 5723.713814309289, 5549.556035517159, 5566.07970250264, 5616.887662246752, 5620.606557540974, 5634.408387119355, 4165.666746660268, 4182.247195504808, 4307.310830267143, 4313.856827940583, 4319.568043195687, 4299.53815702661, 4307.5261721210645, 4312.245357062501, 4312.676549258803, 4354.303311470166, 4236.385724070008, 4285.778553112364, 4304.074623955848, 4310.353446982962, 4316.97841510792, 4049.7975101245115, 4268.231718290706, 4274.978625106885, 4275.764832934187, 4285.314349704048, 3690.9630903690886, 3696.5564132304025, 3715.145516531186, 3735.6451137141926, 3755.9812200939095, 5320.840374788762, 5408.188771684239, 5424.538914192299, 5428.267183930158, 5436.429174936614, 4672.317965532406, 4903.338049363361, 4911.533404326619, 4926.950730492685, 4944.307796908436, 5765.1352297155345, 5796.62321949072, 5804.780995990847, 5817.156512305734, 5825.475707186373, 4065.3292206785845, 4085.9591404085877, 4103.158852435244, 4113.4858142732155, 4123.505179378464, 5901.144334071536, 6094.0, 6096.69516524172, 6101.206843110412, 6101.542384321194, 4165.10450253191, 4201.6008479194425, 4201.789910504463, 4214.662826973835, 4225.345071513921, 4259.977605374688, 4277.786110694453, 4278.807453664593, 4286.099919017041, 4300.09697963425, 4628.745419001987, 4858.344123543347, 4886.218205087169, 4929.580985616263, 4958.925616115761, 5862.325832529228, 5894.616849904743, 5900.586958912835, 5901.58688891782, 5974.163617093611, 1465.8680718735366, 1470.5514817980618, 1472.977905331421, 1475.5499572630451, 1487.5570696424452, 920.6225447566466, 930.3673502018693, 962.7448726087453, 989.4310771306527, 998.9870411121595, 5648.853435694492, 5661.915071273934, 5672.943270567324, 5696.3164420269, 5703.8859222816145, 5963.105534169822, 5977.342492325841, 6004.558905862562, 6013.639181649115, 6043.7280322385595, 5458.4541545845095, 5642.4357564244065, 5707.400722924116, 5755.22304488897, 5799.623024503394, 3206.1183174627163, 3248.431524483206, 3252.910275057835, 3261.1521004538517, 3274.4433446314183, 6091.299500557404, 6231.781887633911, 6236.532260080512, 6252.09344645033, 6252.624842509464, 6155.569110162335, 6202.968985155046, 6222.875542489125, 6224.470919971853, 6234.844128896723, 5948.549841092156, 6208.875822483525, 6226.813195604139, 6256.843578910472, 6265.624062556261, 6020.464781480694, 6048.366940926014, 6072.362401947732, 6082.9695851520455, 6100.511959043355, 6060.272767267956, 6064.603821859772, 6087.325985354063, 6095.542834287357, 6106.786262480792, 5959.553033522589, 6181.84545386369, 6182.866910915727, 6198.907016394667, 6268.529860260407, 4168.291000689703, 4187.141635964559, 4217.03008308097, 4223.957760422357, 4228.1966426378885, 5816.41835816415, 5850.765969361178, 6101.572889897665, 6109.694515274307, 6139.386061393825, 5867.266591676041, 5868.677222752619, 5884.6469211847425, 5892.292924849045, 5913.758110796609, 5828.562857785599, 5837.503812176013, 5854.2389489366105, 5865.706714664165, 5891.1457838614015, 5514.228008078952, 5824.70876456167, 5837.29952405714, 5846.503047241032, 5846.912296315644, 5842.678652674143, 5944.227250457586, 5950.642961422329, 6000.549958753199, 6005.849853753516, 5658.292713410824, 5788.523926398741, 5801.883962320814, 5868.735906884286, 5897.469227769349], "value": 4445.889728130574, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [731.9788894492184, 763.9083310002801, 764.7896828372201, 781.3514782730334, 783.2832957843574, 13725.51960681375, 14712.970092093557, 14736.557903262907, 14839.258037098143, 14875.181864997421, 13684.863151368483, 13689.110207836484, 13758.518451854186, 13796.310184490785, 13818.378172982215, 680.8672308899767, 798.6446031515977, 803.4014659078995, 823.4647479138578, 824.6618886256606, 805.3516918880299, 806.3307454812492, 809.4091313341264, 813.1177672225613, 814.6700586262543, 845.3955421873359, 851.3529717414779, 860.7288704058233, 863.9265662418702, 863.952482613456, 850.3324889961351, 855.2388374346837, 856.3577317012241, 856.443311847298, 860.3977215948829, 624.8375422390166, 626.4988009592308, 628.2523796681934, 629.8205011571725, 630.2562975688686, 14441.133531988115, 14479.927600362036, 14501.0, 14602.12387256768, 14628.561143165616, 14877.33052012662, 15124.848751512454, 15220.695586088215, 15310.157941313224, 15706.293216805272, 12071.879281207164, 12163.635090947197, 12193.146479746421, 12226.021918246519, 12782.488700452064, 3675.099600597844, 3857.864974725899, 3887.766733995941, 3929.764214147132, 3948.1116748731592, 69434.30565694379, 69492.3050769491, 72072.2792772076, 72104.0, 72217.0, 10545.683629491128, 10621.734456638645, 10716.410597417062, 10783.08343790771, 11160.441977901073, 22257.332280031624, 22266.888665556893, 22274.331770046923, 22290.665640015413, 22372.0, 8215.835683286421, 8492.787680308042, 8671.046184919654, 8720.0, 8934.374593778373, 4448.755318457516, 4642.303654451859, 4678.274867395559, 4742.5020372861045, 4845.830395936126, 3290.3090351026076, 3445.104272889067, 3456.70617997468, 3460.2906404187083, 3462.0133262020204, 574.3022227993008, 576.4063015094459, 589.5813972079785, 590.9025010873157, 591.3052163707627, 667.813012356541, 680.6766785776716, 683.0846665468297, 754.8754455514778, 762.5577165244256, 9284.489353085644, 9897.257705672104, 10131.549387184603, 10185.388876667275, 10236.0, 649.6167261315846, 674.5177198303237, 724.851405461879, 767.8425922685836, 775.6393277126164, 4421.712588681726, 4802.903941921142, 4881.292212629149, 4883.536064073978, 4896.632752543503, 70794.2920570798, 75249.62375188089, 112116.43941780402, 117304.0, 118149.40925295319, 88929.55535222283, 90980.5450972741, 96868.51565742267, 99888.0, 101816.0, 86062.56968715241, 86086.13913860907, 86483.0, 87025.0, 88612.0, 8324.375671824517, 8518.914810851813, 8569.98706209696, 8648.55230324391, 8992.640294388151, 48260.75869620629, 49506.0, 50009.749951250014, 51306.0, 51851.2222316658, 67009.0, 73315.03507166811, 73519.63240183765, 75183.24816751762, 75483.62258188674, 11996.880031199926, 12066.879331206927, 12153.270803751802, 12215.694607634525, 12675.683107922376, 13435.596932092052, 13454.26001569923, 13535.458581656623, 14006.929965350108, 14231.146131232159, 11212.943935280271, 12169.81745273804, 12870.034747393796, 13012.934935325642, 13505.189688618715, 10312.27814053009, 10341.63804266847, 10404.219683523615, 10677.14582833356, 10924.836127457935, 12146.696332591757, 12153.08851836098, 12174.269543827399, 12376.443060062138, 12724.809127862904, 9514.23886089125, 9930.304878658713, 9956.950215248877, 10049.748756280858, 10292.536835842255, 10370.481475926324, 10862.185336099983, 10879.347239165676, 10965.780684386427, 11142.944285278521], "value": 7301.309511763232, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1546.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 108.0, 113.0, 111.0, 111.0, 112.0, 110.0, 112.0, 111.0, 111.0], "value": 110.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 128.0, 153.0, 192.0, 128.0, 163.0, 181.0, 127.0, 189.0, 127.0], "value": 154.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 163.0, 162.0, 163.0, 162.0, 168.0, 167.0, 163.0, 164.0, 163.0], "value": 164.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 75.0, 161.0, 75.0, 78.0, 74.0, 76.0, 177.0, 75.0], "value": 94.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 90.0, 156.0, 86.0, 85.0, 85.0, 149.0, 85.0, 84.0, 146.0], "value": 105.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 117.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 147.0, 148.0, 146.0, 146.0, 147.0, 146.0, 146.0, 146.0], "value": 146.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.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": [55.0, 55.0, 55.0, 56.0, 60.0, 55.0, 55.0, 57.0, 54.0, 57.0], "value": 55.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 64.0, 63.0, 63.0, 63.0, 62.0, 62.0, 63.0, 63.0], "value": 63.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 80.0, 80.0, 82.0, 81.0, 83.0, 84.0, 82.0, 114.0, 81.0], "value": 84.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 129.0, 135.0, 130.0, 133.0, 121.0, 123.0, 124.0, 124.0, 133.0], "value": 127.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 162.0, 159.0, 161.0, 156.0, 166.0, 173.0, 166.0, 165.0], "value": 163.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 64.0, 63.0, 64.0, 63.0, 63.0, 62.0, 66.0, 64.0, 61.0], "value": 63.2, "unit": "score"}]}]} 23:27:34 INFO - Return code: 0 23:27:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 23:27:34 ERROR - # TBPL SUCCESS # 23:27:34 INFO - Running post-action listener: _resource_record_post_action 23:27:34 INFO - ##### 23:27:34 INFO - ##### Finished run-tests step (success) 23:27:34 INFO - ##### 23:27:34 INFO - Running post-run listener: _resource_record_post_run 23:27:35 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 542265344; Read time: 12; Write time: 529160 23:27:35 INFO - TinderboxPrint: CPU usage
13.4% 23:27:35 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 23:27:35 INFO - TinderboxPrint: I/O write bytes / time
542,265,344 / 529,160 23:27:35 INFO - TinderboxPrint: CPU idle
8,218.0 (86.5%) 23:27:35 INFO - TinderboxPrint: CPU user
1,221.7 (12.9%) 23:27:35 INFO - TinderboxPrint: Swap in / out
0 / 0 23:27:35 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 248524800; Read time: 0; Write time: 349668 23:27:35 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 4096; Write bytes: 293740544; Read time: 12; Write time: 179492 23:27:35 INFO - Running post-run listener: _upload_blobber_files 23:27:35 INFO - Blob upload gear active. 23:27:35 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 23:27:35 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 23:27:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 23:27:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 23:27:35 INFO - (blobuploader) - INFO - Open directory for files ... 23:27:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 23:27:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:27:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:27:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 23:27:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:27:36 INFO - (blobuploader) - INFO - Done attempting. 23:27:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 23:27:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:27:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:27:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 23:27:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:27:37 INFO - (blobuploader) - INFO - Done attempting. 23:27:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 23:27:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:27:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:27:42 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 23:27:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:27:42 INFO - (blobuploader) - INFO - Done attempting. 23:27:42 INFO - (blobuploader) - INFO - Iteration through files over. 23:27:42 INFO - Return code: 0 23:27:42 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 23:27:42 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 23:27:42 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/685d4254d373e4714c0ef961c58c4d975162fd87c811cf627849172b689b90731d24ec0e85574070869e88324cc382d84b4d3a03aaf9b39ceb0000625115f091", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/92fd37f945637ef853c69cb329a02a0c2d78462e201e03ba04106a9191ecec6951f6c9cab1b6390f8dbcdfe9d784173f1d392859f4f3c75f3c32aebecfcb5a7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/360cd658f88ee212277b671bc26d11f2a1ce46263b9c09fd273d4e2f35e3c71e534eac9c6ce63d58b342500a660fcd92da5632041dce5072e92bb473aa95f905"} 23:27:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 23:27:42 INFO - Writing to file /builds/slave/test/properties/blobber_files 23:27:42 INFO - Contents: 23:27:42 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/685d4254d373e4714c0ef961c58c4d975162fd87c811cf627849172b689b90731d24ec0e85574070869e88324cc382d84b4d3a03aaf9b39ceb0000625115f091", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/92fd37f945637ef853c69cb329a02a0c2d78462e201e03ba04106a9191ecec6951f6c9cab1b6390f8dbcdfe9d784173f1d392859f4f3c75f3c32aebecfcb5a7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/360cd658f88ee212277b671bc26d11f2a1ce46263b9c09fd273d4e2f35e3c71e534eac9c6ce63d58b342500a660fcd92da5632041dce5072e92bb473aa95f905"} 23:27:42 INFO - Running post-run listener: copy_logs_to_upload_dir 23:27:42 INFO - Copying logs to upload dir... 23:27:42 INFO - mkdir: /builds/slave/test/build/upload/logs 23:27:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.356599 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-06-07 23:27:42.589906) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-07 23:27:42.593676) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 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/sha512/685d4254d373e4714c0ef961c58c4d975162fd87c811cf627849172b689b90731d24ec0e85574070869e88324cc382d84b4d3a03aaf9b39ceb0000625115f091", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/92fd37f945637ef853c69cb329a02a0c2d78462e201e03ba04106a9191ecec6951f6c9cab1b6390f8dbcdfe9d784173f1d392859f4f3c75f3c32aebecfcb5a7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/360cd658f88ee212277b671bc26d11f2a1ce46263b9c09fd273d4e2f35e3c71e534eac9c6ce63d58b342500a660fcd92da5632041dce5072e92bb473aa95f905"} build_url:https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011228 build_url: 'https://queue.taskcluster.net/v1/task/FEi06RDARjWL9aVedZ5jtQ/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/sha512/685d4254d373e4714c0ef961c58c4d975162fd87c811cf627849172b689b90731d24ec0e85574070869e88324cc382d84b4d3a03aaf9b39ceb0000625115f091", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/92fd37f945637ef853c69cb329a02a0c2d78462e201e03ba04106a9191ecec6951f6c9cab1b6390f8dbcdfe9d784173f1d392859f4f3c75f3c32aebecfcb5a7f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/360cd658f88ee212277b671bc26d11f2a1ce46263b9c09fd273d4e2f35e3c71e534eac9c6ce63d58b342500a660fcd92da5632041dce5072e92bb473aa95f905"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-07 23:27:42.618896) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:27:42.619192) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d6bbd613908ccac0c6c9cb47000001f7-1465364389.106265-416643761 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004433 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 23:27:42.702031) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-07 23:27:42.702361) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-07 23:27:42.702652) ========= ========= Total master_lag: 0.19 =========