builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-053 starttime: 1467526634.19 results: success (0) buildid: 20160702004021 builduid: cba7f276d3d54b85ad6d3821d90a3962 revision: b59259518acd507a14c72a0f106f70158ef8d7c6 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.194541) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.195020) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.195342) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.210522) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.210930) ========= 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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-02 23:17:14-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 47.0M=0s 2016-07-02 23:17:14 (47.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.193274 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.419129) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.419490) ========= 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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016413 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.469184) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:14.469542) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b59259518acd507a14c72a0f106f70158ef8d7c6 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b59259518acd507a14c72a0f106f70158ef8d7c6 --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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-02 23:17:14,830 truncating revision to first 12 chars 2016-07-02 23:17:14,830 Setting DEBUG logging. 2016-07-02 23:17:14,830 attempt 1/10 2016-07-02 23:17:14,830 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/b59259518acd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-02 23:17:15,133 unpacking tar archive at: mozilla-aurora-b59259518acd/testing/mozharness/ program finished with exit code 0 elapsedTime=0.936452 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:15.423226) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:15.423967) ========= script_repo_revision: b59259518acd507a14c72a0f106f70158ef8d7c6 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:15.424850) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:15.425523) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-02 23:17:15.436975) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-07-02 23:17:15.437695) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:17:15 INFO - MultiFileLogger online at 20160702 23:17:15 in /builds/slave/test 23:17:15 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 23:17:15 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:17:15 INFO - {'append_to_log': False, 23:17:15 INFO - 'base_work_dir': '/builds/slave/test', 23:17:15 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 23:17:15 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:17:15 INFO - 'branch': 'Mozilla-Aurora', 23:17:15 INFO - 'buildbot_json_path': 'buildprops.json', 23:17:15 INFO - 'config_files': ('talos/linux_config.py',), 23:17:15 INFO - 'default_actions': ('clobber', 23:17:15 INFO - 'read-buildbot-config', 23:17:15 INFO - 'download-and-extract', 23:17:15 INFO - 'populate-webroot', 23:17:15 INFO - 'create-virtualenv', 23:17:15 INFO - 'install', 23:17:15 INFO - 'run-tests'), 23:17:15 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:17:15 INFO - 'download_minidump_stackwalk': True, 23:17:15 INFO - 'download_symbols': 'ondemand', 23:17:15 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:17:15 INFO - 'tooltool.py': '/tools/tooltool.py', 23:17:15 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:17:15 INFO - '/tools/misc-python/virtualenv.py')}, 23:17:15 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:17:15 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:17:15 INFO - 'installer_path': 'installer.exe', 23:17:15 INFO - 'log_level': 'info', 23:17:15 INFO - 'log_name': 'talos', 23:17:15 INFO - 'log_to_console': True, 23:17:15 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:17:15 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:17:15 INFO - 'opt_config_files': (), 23:17:15 INFO - 'pip_index': False, 23:17:15 INFO - 'sps_profile': False, 23:17:15 INFO - 'sps_profile_interval': 0, 23:17:15 INFO - 'suite': 'dromaeojs-e10s', 23:17:15 INFO - 'system_bits': '32', 23:17:15 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:17:15 INFO - 'title': 'talos-linux64-ix-053', 23:17:15 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:17:15 INFO - 'use_talos_json': True, 23:17:15 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:17:15 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:17:15 INFO - 'work_dir': 'build'} 23:17:15 INFO - ##### 23:17:15 INFO - ##### Running clobber step. 23:17:15 INFO - ##### 23:17:15 INFO - Running pre-action listener: _resource_record_pre_action 23:17:15 INFO - Running main action method: clobber 23:17:15 INFO - rmtree: /builds/slave/test/build 23:17:15 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:17:16 INFO - Running post-action listener: _resource_record_post_action 23:17:16 INFO - ##### 23:17:16 INFO - ##### Finished clobber step (success) 23:17:16 INFO - ##### 23:17:16 INFO - ##### 23:17:16 INFO - ##### Running read-buildbot-config step. 23:17:16 INFO - ##### 23:17:16 INFO - Running pre-action listener: _resource_record_pre_action 23:17:16 INFO - Running main action method: read_buildbot_config 23:17:16 INFO - Using buildbot properties: 23:17:16 INFO - { 23:17:16 INFO - "project": "", 23:17:16 INFO - "product": "firefox", 23:17:16 INFO - "script_repo_revision": "production", 23:17:16 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 23:17:16 INFO - "repository": "", 23:17:16 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 23:17:16 INFO - "buildid": "20160702004021", 23:17:16 INFO - "stage_platform": "linux64-pgo", 23:17:16 INFO - "basedir": "/builds/slave/test", 23:17:16 INFO - "nightly_build": "True", 23:17:16 INFO - "buildnumber": 427, 23:17:16 INFO - "slavename": "talos-linux64-ix-053", 23:17:16 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 23:17:16 INFO - "platform": "ubuntu64_hw", 23:17:16 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 23:17:16 INFO - "branch": "mozilla-aurora", 23:17:16 INFO - "repo_path": "releases/mozilla-aurora", 23:17:16 INFO - "revision": "b59259518acd507a14c72a0f106f70158ef8d7c6", 23:17:16 INFO - "pgo_build": "True", 23:17:16 INFO - "builduid": "cba7f276d3d54b85ad6d3821d90a3962", 23:17:16 INFO - "slavebuilddir": "test" 23:17:16 INFO - } 23:17:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2. 23:17:16 INFO - Running post-action listener: _resource_record_post_action 23:17:16 INFO - ##### 23:17:16 INFO - ##### Finished read-buildbot-config step (success) 23:17:16 INFO - ##### 23:17:16 INFO - ##### 23:17:16 INFO - ##### Running download-and-extract step. 23:17:16 INFO - ##### 23:17:16 INFO - Running pre-action listener: _resource_record_pre_action 23:17:16 INFO - Running main action method: download_and_extract 23:17:16 INFO - mkdir: /builds/slave/test/build/tests 23:17: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:17:16 INFO - https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 23:17:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:17:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:17:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:17:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 23:17:17 INFO - Downloaded 1361 bytes. 23:17:17 INFO - Reading from file /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:17:17 INFO - Using the following test package requirements: 23:17:17 INFO - {u'common': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 23:17:17 INFO - u'cppunittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 23:17:17 INFO - u'gtest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.gtest.tests.zip'], 23:17:17 INFO - u'jittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'jsshell-linux-x86_64.zip'], 23:17:17 INFO - u'mochitest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 23:17:17 INFO - u'mozbase': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 23:17:17 INFO - u'reftest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.reftest.tests.zip'], 23:17:17 INFO - u'talos': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'], 23:17:17 INFO - u'web-platform': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 23:17:17 INFO - u'xpcshell': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:17:17 INFO - u'firefox-49.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 23:17:17 INFO - Downloading packages: [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:17:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:17 INFO - https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:17:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:17:18 INFO - Downloaded 24526247 bytes. 23:17:18 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:17:18 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 23:17:19 INFO - Return code: 0 23:17:19 INFO - Downloading packages: [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:17:19 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:17:19 INFO - https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:17:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:17:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:17:20 INFO - Downloaded 24526247 bytes. 23:17:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:17:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 23:17:22 INFO - Return code: 0 23:17: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:17:22 INFO - https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:17:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:17:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:17:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:17:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:17:22 INFO - Downloaded 10833369 bytes. 23:17:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:17:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 23:17:23 INFO - Return code: 0 23:17:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:23 INFO - https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:17:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:17:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:17:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:17:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:17:24 INFO - Downloaded 63606784 bytes. 23:17:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:17:24 INFO - mkdir: /builds/slave/test/properties 23:17:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:17:24 INFO - Writing to file /builds/slave/test/properties/build_url 23:17:24 INFO - Contents: 23:17:24 INFO - build_url:https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:17:25 INFO - Running post-action listener: _resource_record_post_action 23:17:25 INFO - Running post-action listener: set_extra_try_arguments 23:17:25 INFO - ##### 23:17:25 INFO - ##### Finished download-and-extract step (success) 23:17:25 INFO - ##### 23:17:25 INFO - ##### 23:17:25 INFO - ##### Running populate-webroot step. 23:17:25 INFO - ##### 23:17:25 INFO - Running pre-action listener: _resource_record_pre_action 23:17:25 INFO - Running main action method: populate_webroot 23:17:25 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:17:25 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:17:25 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:17:25 INFO - '--tppagecycles', 23:17:25 INFO - '7'], 23:17:25 INFO - 'tests': ['tsvgm']}}, 23:17:25 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:17:25 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:17:25 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:17:25 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:17:25 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:17:25 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:17:25 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['damp', 'tps']}, 23:17:25 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'tests': ['damp', 'tps']}, 23:17:25 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['dromaeo_dom']}, 23:17:25 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:17:25 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'other-e10s': {'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['a11yr', 23:17:25 INFO - 'ts_paint', 23:17:25 INFO - 'tpaint', 23:17:25 INFO - 'sessionrestore', 23:17:25 INFO - 'sessionrestore_no_auto_restore', 23:17:25 INFO - 'tabpaint']}, 23:17:25 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['tsvgx', 23:17:25 INFO - 'tsvgr_opacity', 23:17:25 INFO - 'tart', 23:17:25 INFO - 'tscrollx', 23:17:25 INFO - 'cart']}, 23:17:25 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:17:25 INFO - 'tsvgr_opacity', 23:17:25 INFO - 'tart', 23:17:25 INFO - 'tscrollx', 23:17:25 INFO - 'cart']}, 23:17:25 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'talos_options': ['--disable-e10s'], 23:17:25 INFO - 'tests': ['tp5o']}, 23:17:25 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'tests': ['tp5o']}, 23:17:25 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'talos_options': ['--disable-e10s', 23:17:25 INFO - '--xperf_path', 23:17:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:17:25 INFO - 'tests': ['tp5n']}, 23:17:25 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:17:25 INFO - 'talos_options': ['--xperf_path', 23:17:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:17:25 INFO - 'tests': ['tp5n']}}, 23:17:25 INFO - 'talos.zip': {'path': '', 23:17:25 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:17:25 INFO - Running post-action listener: _resource_record_post_action 23:17:25 INFO - ##### 23:17:25 INFO - ##### Finished populate-webroot step (success) 23:17:25 INFO - ##### 23:17:25 INFO - ##### 23:17:25 INFO - ##### Running create-virtualenv step. 23:17:25 INFO - ##### 23:17:25 INFO - Running pre-action listener: _resource_record_pre_action 23:17:25 INFO - Running main action method: create_virtualenv 23:17:25 INFO - Creating virtualenv /builds/slave/test/build/venv 23:17:25 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:17:25 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:17:25 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:17:25 INFO - Using real prefix '/usr' 23:17:25 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:17:25 INFO - Installing distribute.............................................................................................................................................................................................done. 23:17:27 INFO - Installing pip.................done. 23:17:27 INFO - Return code: 0 23:17:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:27 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 23:17:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 23:17:27 INFO - Using env: {'DISPLAY': ':0', 23:17:27 INFO - 'HOME': '/home/cltbld', 23:17:27 INFO - 'LANG': 'en_US.UTF-8', 23:17:27 INFO - 'LANGUAGE': 'en_US:en', 23:17:27 INFO - 'LOGNAME': 'cltbld', 23:17:27 INFO - 'MAIL': '/var/mail/cltbld', 23:17:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:27 INFO - 'MOZ_NO_REMOTE': '1', 23:17:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:27 INFO - 'NO_EM_RESTART': '1', 23:17:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:27 INFO - 'PWD': '/builds/slave/test', 23:17:27 INFO - 'SHELL': '/bin/bash', 23:17:27 INFO - 'SHLVL': '1', 23:17:27 INFO - 'TERM': 'linux', 23:17:27 INFO - 'TMOUT': '86400', 23:17:27 INFO - 'USER': 'cltbld', 23:17:27 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:27 INFO - '_': '/tools/buildbot/bin/python'} 23:17:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:28 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:17:28 INFO - Cleaning up... 23:17:28 INFO - Return code: 0 23:17:28 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:17:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 23:17:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 23:17:28 INFO - Using env: {'DISPLAY': ':0', 23:17:28 INFO - 'HOME': '/home/cltbld', 23:17:28 INFO - 'LANG': 'en_US.UTF-8', 23:17:28 INFO - 'LANGUAGE': 'en_US:en', 23:17:28 INFO - 'LOGNAME': 'cltbld', 23:17:28 INFO - 'MAIL': '/var/mail/cltbld', 23:17:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:28 INFO - 'MOZ_NO_REMOTE': '1', 23:17:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:28 INFO - 'NO_EM_RESTART': '1', 23:17:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:28 INFO - 'PWD': '/builds/slave/test', 23:17:28 INFO - 'SHELL': '/bin/bash', 23:17:28 INFO - 'SHLVL': '1', 23:17:28 INFO - 'TERM': 'linux', 23:17:28 INFO - 'TMOUT': '86400', 23:17:28 INFO - 'USER': 'cltbld', 23:17:28 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:28 INFO - '_': '/tools/buildbot/bin/python'} 23:17:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:28 INFO - Downloading/unpacking psutil>=3.1.1 23:17:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:17:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:17:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:17:30 INFO - Installing collected packages: psutil 23:17:30 INFO - Running setup.py install for psutil 23:17:30 INFO - building 'psutil._psutil_linux' extension 23:17:30 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:17:30 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:17:30 INFO - building 'psutil._psutil_posix' extension 23:17:30 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:17:30 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:17:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:17:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:17:31 INFO - Successfully installed psutil 23:17:31 INFO - Cleaning up... 23:17:32 INFO - Return code: 0 23:17:32 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:17:32 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:17:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:32 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:17:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:32 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:32 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:17:32 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:17:32 INFO - Using env: {'DISPLAY': ':0', 23:17:32 INFO - 'HOME': '/home/cltbld', 23:17:32 INFO - 'LANG': 'en_US.UTF-8', 23:17:32 INFO - 'LANGUAGE': 'en_US:en', 23:17:32 INFO - 'LOGNAME': 'cltbld', 23:17:32 INFO - 'MAIL': '/var/mail/cltbld', 23:17:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:32 INFO - 'MOZ_NO_REMOTE': '1', 23:17:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:32 INFO - 'NO_EM_RESTART': '1', 23:17:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:32 INFO - 'PWD': '/builds/slave/test', 23:17:32 INFO - 'SHELL': '/bin/bash', 23:17:32 INFO - 'SHLVL': '1', 23:17:32 INFO - 'TERM': 'linux', 23:17:32 INFO - 'TMOUT': '86400', 23:17:32 INFO - 'USER': 'cltbld', 23:17:32 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:32 INFO - '_': '/tools/buildbot/bin/python'} 23:17:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:32 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:17: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:17: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:17: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:17: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:17: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:17: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:17:34 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:17:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:17:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:17:34 INFO - Installing collected packages: mozsystemmonitor 23:17:34 INFO - Running setup.py install for mozsystemmonitor 23:17:34 INFO - Successfully installed mozsystemmonitor 23:17:34 INFO - Cleaning up... 23:17:34 INFO - Return code: 0 23:17:34 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:17: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:17:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17: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:17:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:34 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:34 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:17:34 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:17:34 INFO - Using env: {'DISPLAY': ':0', 23:17:34 INFO - 'HOME': '/home/cltbld', 23:17:34 INFO - 'LANG': 'en_US.UTF-8', 23:17:34 INFO - 'LANGUAGE': 'en_US:en', 23:17:34 INFO - 'LOGNAME': 'cltbld', 23:17:34 INFO - 'MAIL': '/var/mail/cltbld', 23:17:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:34 INFO - 'MOZ_NO_REMOTE': '1', 23:17:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:34 INFO - 'NO_EM_RESTART': '1', 23:17:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:34 INFO - 'PWD': '/builds/slave/test', 23:17:34 INFO - 'SHELL': '/bin/bash', 23:17:34 INFO - 'SHLVL': '1', 23:17:34 INFO - 'TERM': 'linux', 23:17:34 INFO - 'TMOUT': '86400', 23:17:34 INFO - 'USER': 'cltbld', 23:17:34 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:34 INFO - '_': '/tools/buildbot/bin/python'} 23:17:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:34 INFO - Downloading/unpacking jsonschema==2.5.1 23:17:34 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:17:34 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:17:34 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:17:34 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:17:34 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:17:34 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:17:36 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:17:36 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:17:36 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:17:36 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:17:36 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:17:36 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:17:36 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:17:36 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:17:36 INFO - Downloading functools32-3.2.3-2.tar.gz 23:17:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:17:36 INFO - warning: no files found matching '*.txt' 23:17:36 INFO - no previously-included directories found matching 'build' 23:17:36 INFO - no previously-included directories found matching 'dist' 23:17:36 INFO - no previously-included directories found matching '.git*' 23:17:36 INFO - Installing collected packages: jsonschema, functools32 23:17:36 INFO - Running setup.py install for functools32 23:17:36 INFO - warning: no files found matching '*.txt' 23:17:36 INFO - no previously-included directories found matching 'build' 23:17:36 INFO - no previously-included directories found matching 'dist' 23:17:36 INFO - no previously-included directories found matching '.git*' 23:17:36 INFO - Successfully installed jsonschema functools32 23:17:36 INFO - Cleaning up... 23:17:36 INFO - Return code: 0 23:17:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:17:36 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:17:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:36 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:17:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:36 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:36 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:17:36 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:17:36 INFO - Using env: {'DISPLAY': ':0', 23:17:36 INFO - 'HOME': '/home/cltbld', 23:17:36 INFO - 'LANG': 'en_US.UTF-8', 23:17:36 INFO - 'LANGUAGE': 'en_US:en', 23:17:36 INFO - 'LOGNAME': 'cltbld', 23:17:36 INFO - 'MAIL': '/var/mail/cltbld', 23:17:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:36 INFO - 'MOZ_NO_REMOTE': '1', 23:17:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:36 INFO - 'NO_EM_RESTART': '1', 23:17:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:36 INFO - 'PWD': '/builds/slave/test', 23:17:36 INFO - 'SHELL': '/bin/bash', 23:17:36 INFO - 'SHLVL': '1', 23:17:36 INFO - 'TERM': 'linux', 23:17:36 INFO - 'TMOUT': '86400', 23:17:36 INFO - 'USER': 'cltbld', 23:17:36 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:36 INFO - '_': '/tools/buildbot/bin/python'} 23:17:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:37 INFO - Downloading/unpacking blobuploader==1.2.4 23:17:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:39 INFO - Downloading blobuploader-1.2.4.tar.gz 23:17:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:17:39 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:17:39 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:17:39 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:17:39 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:17:39 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:17:39 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:17:39 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:17:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:17:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:17:39 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:17:39 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:17:39 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:17:39 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:17:39 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:17:39 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:17:39 INFO - Downloading docopt-0.6.1.tar.gz 23:17:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:17:39 INFO - Installing collected packages: blobuploader, requests, docopt 23:17:39 INFO - Running setup.py install for blobuploader 23:17:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:17:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:17:39 INFO - Running setup.py install for requests 23:17:40 INFO - Running setup.py install for docopt 23:17:40 INFO - Successfully installed blobuploader requests docopt 23:17:40 INFO - Cleaning up... 23:17:40 INFO - Return code: 0 23:17:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:17:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:40 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:40 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:17:40 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:17:40 INFO - Using env: {'DISPLAY': ':0', 23:17:40 INFO - 'HOME': '/home/cltbld', 23:17:40 INFO - 'LANG': 'en_US.UTF-8', 23:17:40 INFO - 'LANGUAGE': 'en_US:en', 23:17:40 INFO - 'LOGNAME': 'cltbld', 23:17:40 INFO - 'MAIL': '/var/mail/cltbld', 23:17:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:40 INFO - 'MOZ_NO_REMOTE': '1', 23:17:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:40 INFO - 'NO_EM_RESTART': '1', 23:17:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:40 INFO - 'PWD': '/builds/slave/test', 23:17:40 INFO - 'SHELL': '/bin/bash', 23:17:40 INFO - 'SHLVL': '1', 23:17:40 INFO - 'TERM': 'linux', 23:17:40 INFO - 'TMOUT': '86400', 23:17:40 INFO - 'USER': 'cltbld', 23:17:40 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:40 INFO - '_': '/tools/buildbot/bin/python'} 23:17:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:17:40 INFO - Running setup.py (path:/tmp/pip-5aUOmS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:17:40 INFO - Running setup.py (path:/tmp/pip-nkZ1JS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:17:40 INFO - Running setup.py (path:/tmp/pip-C7sa_p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:17:40 INFO - Running setup.py (path:/tmp/pip-Z7fqrL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:17:40 INFO - Running setup.py (path:/tmp/pip-_p2slt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:17:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:17:40 INFO - Running setup.py (path:/tmp/pip-UHTc6o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:17:41 INFO - Running setup.py (path:/tmp/pip-ZvfPhw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:17:41 INFO - Running setup.py (path:/tmp/pip-uL5Lf4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:17:41 INFO - Running setup.py (path:/tmp/pip-DZaYu6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:17:41 INFO - Running setup.py (path:/tmp/pip-uCo044-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:17:41 INFO - Running setup.py (path:/tmp/pip-Oc34bn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:17:41 INFO - Running setup.py (path:/tmp/pip-MJkfbs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:17:41 INFO - Running setup.py (path:/tmp/pip-OaKf10-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:17:41 INFO - Running setup.py (path:/tmp/pip-LN6mHy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:17:41 INFO - Running setup.py (path:/tmp/pip-gZOhry-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:17:41 INFO - Running setup.py (path:/tmp/pip-k0y_y1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:17:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:17:41 INFO - Running setup.py (path:/tmp/pip-MRxmXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:17:41 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:17:41 INFO - Running setup.py install for manifestparser 23:17:41 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:17:41 INFO - Running setup.py install for mozcrash 23:17:42 INFO - Running setup.py install for mozdebug 23:17:42 INFO - Running setup.py install for mozdevice 23:17:42 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for mozfile 23:17:42 INFO - Running setup.py install for mozhttpd 23:17:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for mozinfo 23:17:42 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for mozInstall 23:17:42 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for mozleak 23:17:42 INFO - Running setup.py install for mozlog 23:17:42 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for moznetwork 23:17:42 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:17:42 INFO - Running setup.py install for mozprocess 23:17:43 INFO - Running setup.py install for mozprofile 23:17:43 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:17:43 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:17:43 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:17:43 INFO - Running setup.py install for mozrunner 23:17:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:17:43 INFO - Running setup.py install for mozscreenshot 23:17:43 INFO - Running setup.py install for moztest 23:17:43 INFO - Running setup.py install for mozversion 23:17:43 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:17:43 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:17:43 INFO - Cleaning up... 23:17:43 INFO - Return code: 0 23:17:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:17:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:43 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:43 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:17:43 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:17:43 INFO - Using env: {'DISPLAY': ':0', 23:17:43 INFO - 'HOME': '/home/cltbld', 23:17:43 INFO - 'LANG': 'en_US.UTF-8', 23:17:43 INFO - 'LANGUAGE': 'en_US:en', 23:17:43 INFO - 'LOGNAME': 'cltbld', 23:17:43 INFO - 'MAIL': '/var/mail/cltbld', 23:17:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:43 INFO - 'MOZ_NO_REMOTE': '1', 23:17:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:43 INFO - 'NO_EM_RESTART': '1', 23:17:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:43 INFO - 'PWD': '/builds/slave/test', 23:17:43 INFO - 'SHELL': '/bin/bash', 23:17:43 INFO - 'SHLVL': '1', 23:17:43 INFO - 'TERM': 'linux', 23:17:43 INFO - 'TMOUT': '86400', 23:17:43 INFO - 'USER': 'cltbld', 23:17:43 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:43 INFO - '_': '/tools/buildbot/bin/python'} 23:17:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:17:43 INFO - Running setup.py (path:/tmp/pip-VBDNUQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:17:43 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:17:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:17:43 INFO - Running setup.py (path:/tmp/pip-CP8Nfk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:17:43 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:17:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:17:43 INFO - Running setup.py (path:/tmp/pip-9WalVT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:17:44 INFO - Running setup.py (path:/tmp/pip-B_8cPX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:17:44 INFO - Running setup.py (path:/tmp/pip-Uff_ID-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:17:44 INFO - Running setup.py (path:/tmp/pip-Z7oGXT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:17:44 INFO - Running setup.py (path:/tmp/pip-qIGR8_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:17:44 INFO - Running setup.py (path:/tmp/pip-Xvu4Lf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:17:44 INFO - Running setup.py (path:/tmp/pip-UxgpwW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:17:44 INFO - Running setup.py (path:/tmp/pip-bi6fG2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:17:44 INFO - Running setup.py (path:/tmp/pip-0i07jv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:17:44 INFO - Running setup.py (path:/tmp/pip-5zmq8q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:17:44 INFO - Running setup.py (path:/tmp/pip-klzQ0p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:17:44 INFO - Running setup.py (path:/tmp/pip-0jNXkd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:17:44 INFO - Running setup.py (path:/tmp/pip-iJPqK_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:17:44 INFO - Running setup.py (path:/tmp/pip-cDE8SH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:17:44 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:17:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:17:44 INFO - Running setup.py (path:/tmp/pip-gPTIJ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:17:45 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:17:45 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:17:45 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:17:45 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:17:45 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:17:45 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:17:45 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:17:45 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:17:45 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:17:45 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:17:45 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:17:45 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:17:45 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:17:46 INFO - Downloading blessings-1.6.tar.gz 23:17:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:17:47 INFO - Installing collected packages: blessings 23:17:47 INFO - Running setup.py install for blessings 23:17:47 INFO - Successfully installed blessings 23:17:47 INFO - Cleaning up... 23:17:47 INFO - Return code: 0 23:17:47 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:17:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:17:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:17:47 INFO - Reading from file tmpfile_stdout 23:17:47 INFO - Current package versions: 23:17:47 INFO - argparse == 1.2.1 23:17:47 INFO - blessings == 1.6 23:17:47 INFO - blobuploader == 1.2.4 23:17:47 INFO - docopt == 0.6.1 23:17:47 INFO - functools32 == 3.2.3-2 23:17:47 INFO - jsonschema == 2.5.1 23:17:47 INFO - manifestparser == 1.1 23:17:47 INFO - mozInstall == 1.12 23:17:47 INFO - mozcrash == 0.17 23:17:47 INFO - mozdebug == 0.1 23:17:47 INFO - mozdevice == 0.48 23:17:47 INFO - mozfile == 1.2 23:17:47 INFO - mozhttpd == 0.7 23:17:47 INFO - mozinfo == 0.9 23:17:47 INFO - mozleak == 0.1 23:17:47 INFO - mozlog == 3.2 23:17:47 INFO - moznetwork == 0.27 23:17:47 INFO - mozprocess == 0.22 23:17:47 INFO - mozprofile == 0.28 23:17:47 INFO - mozrunner == 6.11 23:17:47 INFO - mozscreenshot == 0.1 23:17:47 INFO - mozsystemmonitor == 0.3 23:17:47 INFO - moztest == 0.7 23:17:47 INFO - mozversion == 1.4 23:17:47 INFO - psutil == 3.1.1 23:17:47 INFO - requests == 1.2.3 23:17:47 INFO - wsgiref == 0.1.2 23:17:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:47 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:17:47 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:17:47 INFO - Using env: {'DISPLAY': ':0', 23:17:47 INFO - 'HOME': '/home/cltbld', 23:17:47 INFO - 'LANG': 'en_US.UTF-8', 23:17:47 INFO - 'LANGUAGE': 'en_US:en', 23:17:47 INFO - 'LOGNAME': 'cltbld', 23:17:47 INFO - 'MAIL': '/var/mail/cltbld', 23:17:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:47 INFO - 'MOZ_NO_REMOTE': '1', 23:17:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:47 INFO - 'NO_EM_RESTART': '1', 23:17:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:47 INFO - 'PWD': '/builds/slave/test', 23:17:47 INFO - 'SHELL': '/bin/bash', 23:17:47 INFO - 'SHLVL': '1', 23:17:47 INFO - 'TERM': 'linux', 23:17:47 INFO - 'TMOUT': '86400', 23:17:47 INFO - 'USER': 'cltbld', 23:17:47 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:47 INFO - '_': '/tools/buildbot/bin/python'} 23:17:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 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:17:47 INFO - Cleaning up... 23:17:47 INFO - Return code: 0 23:17:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:47 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:17:47 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:17:47 INFO - Using env: {'DISPLAY': ':0', 23:17:47 INFO - 'HOME': '/home/cltbld', 23:17:47 INFO - 'LANG': 'en_US.UTF-8', 23:17:47 INFO - 'LANGUAGE': 'en_US:en', 23:17:47 INFO - 'LOGNAME': 'cltbld', 23:17:47 INFO - 'MAIL': '/var/mail/cltbld', 23:17:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:47 INFO - 'MOZ_NO_REMOTE': '1', 23:17:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:47 INFO - 'NO_EM_RESTART': '1', 23:17:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:47 INFO - 'PWD': '/builds/slave/test', 23:17:47 INFO - 'SHELL': '/bin/bash', 23:17:47 INFO - 'SHLVL': '1', 23:17:47 INFO - 'TERM': 'linux', 23:17:47 INFO - 'TMOUT': '86400', 23:17:47 INFO - 'USER': 'cltbld', 23:17:47 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:47 INFO - '_': '/tools/buildbot/bin/python'} 23:17:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:17:47 INFO - Cleaning up... 23:17:47 INFO - Return code: 0 23:17:47 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:17:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:17:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:17:47 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 0x7f90d7671f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24e78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25b4020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, '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': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', '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:17:47 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:17:47 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:17:47 INFO - Using env: {'DISPLAY': ':0', 23:17:47 INFO - 'HOME': '/home/cltbld', 23:17:47 INFO - 'LANG': 'en_US.UTF-8', 23:17:47 INFO - 'LANGUAGE': 'en_US:en', 23:17:47 INFO - 'LOGNAME': 'cltbld', 23:17:47 INFO - 'MAIL': '/var/mail/cltbld', 23:17:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:17:47 INFO - 'MOZ_NO_REMOTE': '1', 23:17:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:17:47 INFO - 'NO_EM_RESTART': '1', 23:17:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:17:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:17:47 INFO - 'PWD': '/builds/slave/test', 23:17:47 INFO - 'SHELL': '/bin/bash', 23:17:47 INFO - 'SHLVL': '1', 23:17:47 INFO - 'TERM': 'linux', 23:17:47 INFO - 'TMOUT': '86400', 23:17:47 INFO - 'USER': 'cltbld', 23:17:47 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:17:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:17:47 INFO - '_': '/tools/buildbot/bin/python'} 23:17:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:17:48 INFO - Downloading/unpacking flake8 23:17:48 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:17:48 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:17:48 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:17:48 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:17:48 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:17:48 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:17:49 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:17:49 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:17:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:17:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:17:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:17:50 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:17:50 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:17:50 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:17:50 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:17:50 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:17:50 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:17:50 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:17:50 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:17:50 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:17:50 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:17:50 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:17:50 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:17:50 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:17:50 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:17:50 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:17:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 23:17:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:17:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:17:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:17:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:17:50 INFO - no previously-included directories found matching 'docs/_build' 23:17:50 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:17:50 INFO - Running setup.py install for pep8 23:17:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:17:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:17:50 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:17:50 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:17:50 INFO - no previously-included directories found matching 'docs/_build' 23:17:50 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 23:17:50 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:17:50 INFO - Cleaning up... 23:17:50 INFO - Return code: 0 23:17:50 INFO - Running post-action listener: _resource_record_post_action 23:17:50 INFO - Running post-action listener: _start_resource_monitoring 23:17:50 INFO - Starting resource monitoring. 23:17:50 INFO - ##### 23:17:50 INFO - ##### Finished create-virtualenv step (success) 23:17:50 INFO - ##### 23:17:50 INFO - ##### 23:17:50 INFO - ##### Running install step. 23:17:50 INFO - ##### 23:17:50 INFO - Running pre-action listener: _resource_record_pre_action 23:17:50 INFO - Running main action method: install 23:17:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:17:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:17:51 INFO - Reading from file tmpfile_stdout 23:17:51 INFO - Detecting whether we're running mozinstall >=1.0... 23:17:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:17:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:17:51 INFO - Reading from file tmpfile_stdout 23:17:51 INFO - Output received: 23:17:51 INFO - Usage: mozinstall [options] installer 23:17:51 INFO - Options: 23:17:51 INFO - -h, --help show this help message and exit 23:17:51 INFO - -d DEST, --destination=DEST 23:17:51 INFO - Directory to install application into. [default: 23:17:51 INFO - "/builds/slave/test"] 23:17:51 INFO - --app=APP Application being installed. [default: firefox] 23:17:51 INFO - mkdir: /builds/slave/test/build/application 23:17:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 23:17:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 23:18:07 INFO - Reading from file tmpfile_stdout 23:18:07 INFO - Output received: 23:18:07 INFO - /builds/slave/test/build/application/firefox/firefox 23:18:07 INFO - Running post-action listener: _resource_record_post_action 23:18:07 INFO - ##### 23:18:07 INFO - ##### Finished install step (success) 23:18:07 INFO - ##### 23:18:07 INFO - ##### 23:18:07 INFO - ##### Running run-tests step. 23:18:07 INFO - ##### 23:18:07 INFO - Running pre-action listener: _resource_record_pre_action 23:18:07 INFO - Running main action method: run_tests 23:18:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:18:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:18:07 INFO - Python 2.7.3 23:18:07 INFO - Return code: 0 23:18:07 INFO - grabbing minidump binary from tooltool 23:18:07 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:18:07 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 0x26462e0>, '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 0x25b2140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x25b25d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:18:07 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:18:07 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:18:07 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:18:07 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:18:07 INFO - Return code: 0 23:18:07 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:18:07 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:18:07 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:18:07 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:18:07 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:18:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 23:18:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 23:18:08 INFO - Return code: 0 23:18:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--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:18:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-053 --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:18:08 INFO - Using env: {'DISPLAY': ':0', 23:18:08 INFO - 'HOME': '/home/cltbld', 23:18:08 INFO - 'LANG': 'en_US.UTF-8', 23:18:08 INFO - 'LANGUAGE': 'en_US:en', 23:18:08 INFO - 'LOGNAME': 'cltbld', 23:18:08 INFO - 'MAIL': '/var/mail/cltbld', 23:18:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:18:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:18:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:18:08 INFO - 'MOZ_NO_REMOTE': '1', 23:18:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:18:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:18:08 INFO - 'NO_EM_RESTART': '1', 23:18:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:18:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:18:08 INFO - 'PWD': '/builds/slave/test', 23:18:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:18:08 INFO - 'SHELL': '/bin/bash', 23:18:08 INFO - 'SHLVL': '1', 23:18:08 INFO - 'TERM': 'linux', 23:18:08 INFO - 'TMOUT': '86400', 23:18:08 INFO - 'USER': 'cltbld', 23:18:08 INFO - 'XDG_SESSION_COOKIE': '920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417', 23:18:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:18:08 INFO - '_': '/tools/buildbot/bin/python'} 23:18:08 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--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:18:08 INFO - mozversion application_buildid: 20160702004021 23:18:08 INFO - mozversion application_changeset: b59259518acd507a14c72a0f106f70158ef8d7c6 23:18:08 INFO - mozversion application_display_name: FirefoxDeveloperEdition 23:18:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:18:08 INFO - mozversion application_name: Firefox 23:18:08 INFO - mozversion application_remotingname: firefox-dev 23:18:08 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:18:08 INFO - mozversion application_vendor: Mozilla 23:18:08 INFO - mozversion application_version: 49.0a2 23:18:08 INFO - mozversion platform_buildid: 20160702004021 23:18:08 INFO - mozversion platform_changeset: b59259518acd507a14c72a0f106f70158ef8d7c6 23:18:08 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:18:08 INFO - mozversion platform_version: 49.0a2 23:18:08 INFO - using testdate: 1467526688 23:18:08 INFO - actual date: 1467526688 23:18:08 INFO - starting webserver on 'localhost:41371' 23:18:08 INFO - SUITE-START | Running 2 tests 23:18:08 INFO - TEST-START | dromaeo_css 23:18:08 INFO - operating with platform_type : linux_ 23:18:08 INFO - Initialising browser for dromaeo_css test... 23:18:08 INFO - TEST-INFO | started process 9311 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJhZ6ZK/profile http://localhost:41371/getInfo.html) 23:18:12 INFO - PROCESS | 9311 | __metrics Screen width/height:1600/1200 23:18:12 INFO - PROCESS | 9311 | colorDepth:24 23:18:12 INFO - PROCESS | 9311 | Browser inner width/height: 1024/697 23:18:12 INFO - PROCESS | 9311 | __metrics 23:18:13 ERROR - PROCESS | 9311 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 23:18:14 INFO - TEST-INFO | 9311: exit 0 23:18:14 INFO - Browser initialized. 23:18:14 INFO - Running cycle 1/1 for dromaeo_css test... 23:18:14 INFO - TEST-INFO | started process 9437 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJhZ6ZK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:18:26 INFO - PROCESS | 9437 | RSS: Main: 156364800 23:18:26 INFO - PROCESS | 9437 | 23:19:15 INFO - PROCESS | 9437 | 1467526755826 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:21:23 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41371/tests/dromaeo/cssquery-ext.html) 23:21:24 INFO - PROCESS | 9437 | RSS: Main: 159121408 23:21:24 INFO - PROCESS | 9437 | 23:24:26 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-ext.html (next: http://localhost:41371/tests/dromaeo/cssquery-jquery.html) 23:24:27 INFO - PROCESS | 9437 | RSS: Main: 157065216 23:24:27 INFO - PROCESS | 9437 | 23:27:29 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41371/tests/dromaeo/cssquery-mootools.html) 23:27:29 INFO - PROCESS | 9437 | RSS: Main: 156504064 23:27:29 INFO - PROCESS | 9437 | 23:30:31 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41371/tests/dromaeo/cssquery-prototype.html) 23:30:32 INFO - PROCESS | 9437 | RSS: Main: 155955200 23:30:32 INFO - PROCESS | 9437 | 23:33:34 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41371/tests/dromaeo/cssquery-yui.html) 23:33:35 INFO - PROCESS | 9437 | RSS: Main: 157999104 23:33:35 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | Cycle 1(1): loaded http://localhost:41371/tests/dromaeo/cssquery-yui.html (next: http://localhost:41371/tests/dromaeo/cssquery-dojo.html) 23:36:37 INFO - PROCESS | 9437 | RSS: Main: 159051776 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | __start_tp_report 23:36:37 INFO - PROCESS | 9437 | _x_x_mozilla_page_load 23:36:37 INFO - PROCESS | 9437 | _x_x_mozilla_page_load_details 23:36:37 INFO - PROCESS | 9437 | |i|pagename|runs| 23:36:37 INFO - PROCESS | 9437 | |0;dojo.html;3318.767686261963;3320.551725517055;3360.0255925781526;3362.9663703362967;3366.612839523454;5449.673019618821;5486.451354864512;5544.528715059215;5545.25139106221;5555.333359996806;5526.032944234763;5576.637518561291;5592.189132575774;5599;5614.803481878135;5010.423801262856;5070.569001634865;5092.9236061459105;5123.5901127909865;5127.33344665193;4963.25551167326;4975.4527002029745;5014.548690617844;5053.36832895888;5079.593632509391;5042.168042273021;5101.744912754366;5108.259302401149;5113.872153196181;5127.641065125443;5177.611679124062;5183.3261675981885;5185.299984502081;5186.688798672092;5214.8696282592855;4915.238138088602;4992.40091189056;5083.059633967728;5102.38771347437;5155.407128180233;5454.018276710191;5466.1527463243265;5504.972475137639;5510.228568000483;5560.86097847553;5965.821025369202;5972.940270597282;6017.879642407127;6021.066734656135;6021.307549631761;5838.854028649275;5959.255093113361;5970.164177015221;5993.520518358521;6028.5478589106;5551.861203469864;5559.861003474905;5564.8330550083565;5568.554515638739;5586.190002449622;6099;6099.573029887865;6109.2974307955155;6135.386461353918;6139.662318572432;5784.421557844182;5809.912851307234;5832.679202643811;5853.268341457318;5903.6457812530525;5885.6468611882565;5889.4699477046415;5902.911456328158;5921.230240068763;5922.703864806743;5724.25584673998;5860.384659610765;5860.589758716934;5864.47219750216;5877.471027607536;5778.133280008033;5795.1886735857015;5801.8549536261935;5885.117232415087;5886.23478947734;4460.553944605514;4511.909761804745;4519.344695019204;4524.16302983949;4525.027119169328;4041.474608300902;4046.251443482965;4080.1431699342875;4082;4111.7944102794745;5638.351589567253;5669.829905102853;5704.3154821421695;5739.454751798572;5781.71091445426;6001.2498437695285;6060.606060606046;6061.242344706911;6068.848278793065;6071.180390647294;5632.746526406321;5700.885982280414;5811.651300921958;5819.79630712923;5822.854428639233;4944.703317800943;4987.077390682735;5014.498550145029;5022.698638081727;5050.570701490341;6118.755249790048;6191.349908259658;6198;6216.627002379872;6232.3144454110015;5930.673812940157;5963.7912673056235;6001.339852616209;6007.729652165575;6015.5488338373925;6166.445019948226;6171.259448866164;6180.81457556274;6192.752289908353;6217;5914.704264786829;5923.733431995657;5943.4948029416255;5945.910811337747;5950;5779.855503612275;5890.263717035371;5908.527317814651;5963.403659634002;5982.982892908129;5844.883102337844;5864.736086876186;5864.794732184524;5877.35349111606;5882.294124704892;5661.490465858093;5810.4189581041555;5835.066389377679;5839.416058394127;5840.240768700041;5574.721263936868;5578;5581.051221292309;5610.270664813548;5683.5737319700365;5715.599908006399;5745.827625171251;5772.163036359789;5786.392428795084;5795.652260864362;5616.69108199053;5639.295088113986;5660.264165658438;5665.433456654301;5673.177389278614 23:36:37 INFO - PROCESS | 9437 | |1;ext.html;600.7927265093543;644.6647743173547;653.8365408647838;657.1293036726339;668.415136755339;35134.472982905274;38674.41988370173;45004.32493512596;45855.54144458554;45919.77040114803;48799;49292.26061609079;49323.260151097675;49380;49388.27141050064;9060.139286767746;9081.137291957286;9150.954245228764;9211.30915181364;9232.584533695966;9022.639094436214;9053;9065.637374505011;9125.087491250888;9136.862947055799;9137.40606860552;9159.496227707474;9199.586018629145;9206.49364284964;9207;9106.453612783222;9132.680356187568;9138.177564019237;9162.221211197057;9172.8624070639;9023.54882255891;9069.410488318304;9091.454512729257;9106.043865394171;9121.5439228039;44637.10725785499;45367.31949020767;45371;45432;45548.544514554764;3771.8679846205528;3816.8091595420397;3870.07118291608;4319.438472998521;4587.128445595359;34621.6537834621;34653.13367165816;35106.648933510594;35138.47292290618;35219.82390088059;4687.695299805502;4740.312654665088;4804.183288840905;4818.180909245401;4837.637177211724;388833;389108;391992;392023;392041;61161;61805;61970.69014654898;62132;62218;39063.21873562513;40023.59976400257;40062.1987560253;41923.37114943278;42167.15665686669;17859;17926.820731792777;18135.546611334823;18242.179101940445;18273.543161421072;13394.129381590166;13440.193588384729;13470.39383227757;13521;13566.253856038013;20557.588848222953;20562.79437205639;20597.691034634492;20699.793002070088;20744.896275518528;7786.727464538827;7827;7851.607419628996;7885.526868387915;7909.485883417559;990.8117457683018;1121.831725241204;1150.045462266317;1172.8240763885315;1221.694576355911;33753.49369759455;33951.4907276391;34020.31959360848;34061.659383406346;34594.308113837586;1155.5320095361392;1180.734334774686;1189.8929096381194;1195.1693572966706;1263.8357013588175;17144.571385715208;17700.114994250493;17852.821471785115;17882.463526094238;17911.552211194823;670693;1038215;1094308;1114312;1119843;60869;61601.383986160465;61656.69171654203;61929.38070619326;61982.38017619856;1480.2968589919917;1497.1541079290166;1502.706972140422;1507.366905899525;1509.0115974037024;31547.684523154476;31582.36835263236;31912.840435797672;32245.67754322427;32467.18832029218;51128.74435627798;51809.481905180466;52038;52082.739586301825;52122.47877521176;450639;459055;461297;461894;462765;29660.55509167321;29811;29842.253943651584;30022.24944376408;30058.69941300559;51874;52551.211731823285;53101;56329;56824;43031.354529681455;44968.55031449644;45091.09817803691;45377.77311113424;46047.76976115098;44409.55590444183;44559.55440445554;44701.329480057175;44809.775951120035;45549.31676024928;44821.32768008548;45234.547654523034;45367.319490208334;45465.77267113643;45615;39153.92836726139;39525.20949580935;39652.80173599113;39771.80114099411;40998.1800363997;30508;30527.54208686827;30740.237147827444;30741.692583073884;30777.38445231038 23:36:37 INFO - PROCESS | 9437 | |2;jquery.html;428.2505615173445;429.54039178079427;430.6447181075611;430.82982222022304;440.0977995110024;19365.128569214383;20316.492087697814;20916.16335346586;21676.458088547795;21680.2411915583;18891;19810.801891981075;19915.103820328084;20474.976251187454;20580.897095514538;5201.323827902367;5412;5422.132458806592;5449.64577302474;5462.808801691942;5358.812441564546;5434.83695489136;5438.048341540234;5651;5905.822825315247;5850.619709718876;5864.266966629171;5870.148828419877;5879.823605291848;5884.117382392633;5430.429804870471;5482.616216864821;5604.663720176803;5784.479396854283;5854.912176317359;5249.1338929076655;5335.573154147659;5354.196870469422;5387.811426600089;5403.621746477748;14304.642383940381;14726.558203253919;14810.259487025713;15035.473758418511;15093.54719358421;2349.6710460535537;2553.0681301325067;2571.2029270926073;2626.3171575390347;2994.715502027304;10696.625618103408;10933.726656833564;11021.614243501439;11287.435628218556;11339.262947908443;1990.572027014199;2004.8997550122435;2021.6866385710239;2099.7900209979034;2113.249796322314;88285;90599;91448;92628;93873;11816.231944923553;11858.703532411586;11918.225315354473;11963.40182990847;12028.939855300667;16857.325706971827;16983.49049528516;17123.486295411156;17132.743008854875;17138.485845424657;8566.742997710078;8665.913340866511;8710.738677839676;8772.605232764541;8802.38383313162;8254.793630159174;8300.335973122135;8372.916270837335;8377.37169712274;8385.413021088587;5025.824096156617;5055.2954169519135;5083.72039537829;5097.923531147036;5215.400228973716;2041.826444752183;2063.9793602063787;2098.370488853338;2116.745990481121;2143.2391501017228;993.8459538771502;1002.318423472046;1094.6278265389647;1108.8336749487642;1137.4028634966544;20061.899690501454;20430.284940027028;20593.897030514752;20628;20815.687764683542;1022.9028242316969;1050.5640159333943;1068.150820098024;1114.905233055183;1118.904893084097;11364.374959377148;11596.362200078907;11710.473028713557;11809.940950295193;11885.168038237412;517585;547083;547602;581498;582856;85224.57387713021;92479;93226.53386733023;103618.48190758999;107157;1108.6507750058706;1144.8740638529755;1148.6898537394857;1151.4703236511298;1163.627639155462;18480;18775.812241877407;18827.15277812529;18987.33544325942;19117.94851283193;44051.559484404745;44909.55090449184;44922.10155796931;44932;46004;59487.10769338377;60758.39241607527;65814;66275;67101.3289867095;5925.259342582177;6812.14848143982;8664.263537599374;8821.691240806542;9095.317851161057;13384.732305354033;13714.382852771849;13770;13902.582922512342;13973.790393143907;11848.76302473963;12224.87775122273;12275.631731048083;12296.016318694305;12317.876821231674;10022.44652078929;11835.526578936746;12239.915497448752;12309.384530773605;12399.442025108712;12497.312647804458;12532.37338133108;12623;12638.620841374774;12858.0999330046;7454.105507339154;7902.68389264423;8104.189581042085;8849.911500885166;9187.03536128697;9105.362624616213;12451.750964980469;12683.302418367079;12699.42852571655;12853.228806271654 23:36:37 INFO - PROCESS | 9437 | |3;mootools.html;1529.5411376587022;1550.7828903953446;1738.269926630815;1834.7064469684854;1873.9718904216438;8104.716334928279;8834.558272086395;8944.59749311281;9452.29107816913;9468.66859659912;8980.640774369018;9293.953530232357;9337.206337461306;9365.531723413818;9397.29520285978;2442.1452491627965;2460.8769561521854;2473.703155621319;2477.2196758021255;2484.714257860342;2401.435662619283;2469.271564888353;2470.888810003545;2473.6165894286323;2476.2695004973575;2425.575524283252;2426.4783071639595;2468.3458883395824;2470.962935555968;2472.6414669872856;2344.894479748407;2367.2069856597973;2382.106709983756;2388.0567175965484;2400.9879950600134;2387.415083304584;2393.4495066134714;2410.192585483865;2415.3237093613816;2421.987890060556;9199.540022998823;9255.444673319622;9266.675666351714;9288.907110928872;9296.116868897443;5417.756200970965;5442.700651464168;5490.094134467808;5505.256790333294;5514.862128446781;3395.0833275015607;3446.1556918555116;3536.2672290577434;3551.2897420516;3572.696320812734;1163.4357336691698;1164.598213616301;1179.710970812148;1192.7554851255472;1206.0351718625152;12671.936640316831;12846.35768211595;12876.163049401759;12915.935420322932;12923.224606523545;4698.88252793676;4741.241401375763;4842.15262329091;4853.247746599282;4881.536254055859;10951.34291942486;10964.506597203144;10980.066694331072;10989.780204395867;10998.505067271992;5534.695591742412;5546.972265138648;5552.139418390156;5552.3892371839065;5592.804251851166;4422.778861056934;4974.950250497521;5035.7985680572365;5124.5131712487255;5125.538701516882;4213.662906967435;4215.367694845798;4215.852445164466;4287.399764033038;4287.7641729705165;1256.8428946381703;1305.8824705776526;1307.0589175793414;1308.1562392256942;1313.4352228541818;943.3820847345;1049.2759995603162;1067.5196161727254;1069.2354966199205;1072.2172813845937;6347.619142851444;6362.1093046973465;6402.967985160044;6412.9679351602945;6431.292557818636;424.49061126648144;426.6373582454888;430.670537039159;433.0645805061053;442.4469413233458;4255.851045213464;4283.079137985348;4284.871453856389;4291.763952982616;4319.4816622005565;11430.314181149157;11663.941680291713;11686.76626467466;11753.647390578297;11808.94095529517;10992.28550144254;11656.41717914101;11662;11716.824247636292;11754.471048802825;8684.956575217084;8839.29285657146;8840.027596964328;8879.467231965973;8916.643334266557;6409.743610255724;6438.8390290243115;6487.610743355413;6571.934280657132;6604.5046621502615;10364.222683298633;10569.471526423802;10716.981886720749;10766.192535559707;10818.02637762605;10826.51280692355;11026.283291586022;11039.227254092137;11040.613578524713;11057.391843448366;7338.302861228175;8156.184381561797;8406.495610263404;8411.873821892554;8440.155984401756;9092.818143636958;9194;9196.586153623237;9210.98679145307;9226.261899048195;8134.75595732129;8337.916620833714;8374.748757537283;8416.915830841614;8433.536155511505;8009.759707208793;8096.5546894921345;8136.308413784658;8208.712695055883;8275.668973241003;7156.964215178891;7204;7220.530665506725;7251.23861994483;7289.963550182428;5779.768809247583;5788.247527821356;5801.912971305349;5803.65178089316;5909.143174239797;5770.682612456188;5812.9709351452975;5830.970845145747;5853.912191317048;5939.643621382731 23:36:37 INFO - PROCESS | 9437 | |4;prototype.html;344.0727240087964;351.32194863912656;351.90146758907497;354.93611149993006;355.6674509333773;5624.2969628796345;5663.971680141593;5678.148277758328;5686.573506986977;5738.483536481715;5618.353889302721;5659.207710920475;5675.801346952858;5694.629849059818;5699.658020518761;4378.759168245753;4420.160169567772;4431.667624928144;4441.133978874121;4443.244648409762;4432.8005239764125;4462.286034234523;4462.553744625544;4470.150671372445;4476.4556228101255;4417.491988421324;4431.401760762305;4447.310666846644;4465.397171381871;4468.798904049309;4326.675499337546;4345.78271086446;4375.47494300686;4387.605115539617;4389.18800021997;3891.6650009993778;3895.454636350913;3925.4308125321954;3936.6063393660693;3938.7636741795295;5412;5430.51125398716;5432.565394768409;5453.3728621208675;5473.124300111963;4898.8775280618265;5062.519060689228;5067.113255180328;5069.315642388267;5072.213806859942;5902.586818922634;5914.940850591525;5936.881262374772;5977.193078934375;5980;4331;4333.198358303724;4348.8692939835555;4356.738595684269;4356.978215108936;6035.366286539938;6101.413632455549;6193.473554747852;6202.62784232952;6236.750529978795;4288.5711428857485;4333.58830911063;4337.956620433755;4344.283193273138;4348.565143485626;4428.114377124588;4434.246178149722;4440;4443.644508439317;4445.955540444619;4941.654084214142;5080.314157588752;5106.387233532;5121.308623335876;5135.743212839343;5952.434518720715;5987.191729116514;6008.639481631116;6011.338752737195;6015.789447369321;1522.4214798376768;1531.7319469092863;1535.6775077233683;1537.8850333508117;1540.8135735483615;968.5254225429488;1002.3761506359743;1012.1396812709286;1019.6737044145802;1020.7805321855836;5224.190250511177;5231.476852314738;5313.335833020872;5327.573794096463;5331.3868905076415;5419.132938729863;5495.477929596682;5499.890002200013;5538.972305138448;5568.526675232651;5186.974065129726;5307.575393968474;5488.807891723771;5988.940110598838;5990.610610310316;3220.3398303348226;3269.316302104418;3270.8855190068234;3275.5250488679008;3289;6124.785632502841;6387;6406.135171751847;6424.229092508929;6427;6281.560290779693;6284.24589049317;6355.205599300088;6355.745770169234;6365.936340636627;6345.460635846005;6384.361563843671;6387.393197646216;6389.456896163785;6404.967975160094;5875.588708790344;6169.5064394849205;6188.019833653188;6192.969035154795;6213.751449942132;5755.769769209185;6044.516438684983;6092.45167934888;6104.908426373519;6131.601445906002;6153.784617538365;6386.648734319657;6390.329015453311;6397.680115994089;6447.161868957006;4392.780360981874;4413.668974826836;4432.091421258569;4435.82256709728;4453.55464453552;5961.374055724086;6164.47601953839;6204.193454850841;6237.906431403442;6245.625262484084;6035.698215089315;6085.561657663406;6098.542609304409;6102.145699602148;6102.436976469805;5780.335261444988;6041.365656606169;6058.787942421994;6060.060780550181;6074.3925607438905;5893.823185304448;5899.938011158033;5914.201582786269;5944.405559444021;5972.313183983723;6122;6133.141360209485;6147.262328520606;6159.168512250968;6192.225971753531;5730.484256416942;5891.3224979127945;5940.46535811779;6001.399860013964;6001.879962400815 23:36:37 INFO - PROCESS | 9437 | |5;yui.html;825.9463134896228;873.7553485024191;889.0798024045115;896.4755617963493;909.6270529083073;14696.41214351426;15258.542243732692;16143.434979775695;16518.504444866645;16591.83408165918;13741.58775236742;13777.93111034446;13825.446982120704;13843.792343114836;13873.306334683251;838.9119142490042;847.555033607358;863.8013256950906;868.4528746889482;873.5937788928147;860.2472836268265;861.1259571534897;862.9525376104311;864.9437786543886;868.4832524647825;909.9545022748869;910.8906931168269;911.6717981526646;912.1516989200042;913.0686699566438;893.9776505587347;898.5327629632554;900.4012331799346;901.8061116859841;902.1249388093539;666.0675054923098;666.3270097201813;666.4501786026548;666.6067020457953;666.823291827666;14948.850511494855;15056;15138.924305378512;15154;15221.771673424908;15381.384744610203;15566.143862087582;15649.374025038986;15836.366545338173;16014.5996350091;11716.355600441972;12139.939300303442;12233.082518811036;12251.93874030633;12289.877101228964;4037.9007295492192;4151.14901445203;4171.3325867860995;4176.164767046603;4183.45615070042;63877;65424.67287663531;66188;73871.63064184645;74608.62695686487;11727.237729547553;12105.576304829288;12116.75766484683;12124.57563985274;12149.453274602663;21512.4621884451;22338.66492002621;22418;22419.215327463462;22479.21322753696;9236.07639236071;9243.768905777275;9348.813023739487;9392.812143757086;9601.711948641552;5239.449857764956;5328.733563321818;5383.515483606494;5521.1442226454965;5559.027170245191;3851.4993050903204;3970.781607011642;3972.145988612462;3983.083890705154;4008.9599104008585;644.532713782504;644.5874640230256;644.8581312111328;651.5341530805497;658.5456035335603;566.8384510414512;743.1119811824817;757.7840315510164;766.2529034191618;792.3067316098413;10079.647212347532;10243.48782560869;10495.632652857113;10578.629747958785;10625.5218515167;723.7973367457121;743.5278598090143;762.771168649403;771.8070482379405;804.5655346113033;4636.39726835516;4677.2750223715375;4721.480637129913;4824.155772739757;4861.7326047067045;121104.39447802704;123096;124861.37569312095;124907;127203.36398317949;68483;93839.53080234556;99828.50085749525;102013;106282;94204.52897735467;95473.52263238779;96965.5151724237;97344.99999999859;98662;9854.507274636382;9884.802303953737;9945;10046.648367307109;10113.747156321151;53278.73360633172;53875.19187212116;54050.459495404546;55360.44639553714;55442.72278638581;72496.63751681207;79986.20013799788;80461;83681;84450;12434.875651243372;12542.372881356077;12759.808602870778;12773.680657983625;12798.104132710992;13192.472301107848;13409.463621455032;13820.447182112603;14168.787468187778;14287.071340362843;12514.74970500603;12826;12857.935710321388;12971.416286266953;13237.073404861567;13641.38613762403;13747.587572372844;13910.58268251954;13994.300284985506;14253.073550219202;13009.544665936646;13446.865531344562;13486.595402137951;13629.659258518617;14050.578482645536;11352.148588855704;11606.593769218036;12029.977451916686;12036.75926481483;12089;11802.82295765547;11839.348835814113;11919.642410727693;12000.519979201083;12088.456019478968 23:36:37 INFO - PROCESS | 9437 | __end_tp_report 23:36:37 INFO - PROCESS | 9437 | __start_cc_report 23:36:37 INFO - PROCESS | 9437 | _x_x_mozilla_cycle_collect,321 23:36:37 INFO - PROCESS | 9437 | __end_cc_report 23:36:37 INFO - PROCESS | 9437 | __startTimestamp1467527797658__endTimestamp 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | ------- Summary: start ------- 23:36:37 INFO - PROCESS | 9437 | Number of tests: 6 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#0] dojo.html Cycles:165 Average:5527.83 Median:5724.26 stddev:615.66 (10.8%) stddev-sans-first:592.66 23:36:37 INFO - PROCESS | 9437 | Values: 3318.8 3320.6 3360.0 3363.0 3366.6 5449.7 5486.5 5544.5 5545.3 5555.3 5526.0 5576.6 5592.2 5599.0 5614.8 5010.4 5070.6 5092.9 5123.6 5127.3 4963.3 4975.5 5014.5 5053.4 5079.6 5042.2 5101.7 5108.3 5113.9 5127.6 5177.6 5183.3 5185.3 5186.7 5214.9 4915.2 4992.4 5083.1 5102.4 5155.4 5454.0 5466.2 5505.0 5510.2 5560.9 5965.8 5972.9 6017.9 6021.1 6021.3 5838.9 5959.3 5970.2 5993.5 6028.5 5551.9 5559.9 5564.8 5568.6 5586.2 6099.0 6099.6 6109.3 6135.4 6139.7 5784.4 5809.9 5832.7 5853.3 5903.6 5885.6 5889.5 5902.9 5921.2 5922.7 5724.3 5860.4 5860.6 5864.5 5877.5 5778.1 5795.2 5801.9 5885.1 5886.2 4460.6 4511.9 4519.3 4524.2 4525.0 4041.5 4046.3 4080.1 4082.0 4111.8 5638.4 5669.8 5704.3 5739.5 5781.7 6001.2 6060.6 6061.2 6068.8 6071.2 5632.7 5700.9 5811.7 5819.8 5822.9 4944.7 4987.1 5014.5 5022.7 5050.6 6118.8 6191.3 6198.0 6216.6 6232.3 5930.7 5963.8 6001.3 6007.7 6015.5 6166.4 6171.3 6180.8 6192.8 6217.0 5914.7 5923.7 5943.5 5945.9 5950.0 5779.9 5890.3 5908.5 5963.4 5983.0 5844.9 5864.7 5864.8 5877.4 5882.3 5661.5 5810.4 5835.1 5839.4 5840.2 5574.7 5578.0 5581.1 5610.3 5683.6 5715.6 5745.8 5772.2 5786.4 5795.7 5616.7 5639.3 5660.3 5665.4 5673.2 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#1] ext.html Cycles:180 Average:76032.35 Median:44894.94 stddev:185769.04 (413.8%) stddev-sans-first:186203.83 23:36:37 INFO - PROCESS | 9437 | Values: 600.8 644.7 653.8 657.1 668.4 35134.5 38674.4 45004.3 45855.5 45919.8 48799.0 49292.3 49323.3 49380.0 49388.3 9060.1 9081.1 9151.0 9211.3 9232.6 9022.6 9053.0 9065.6 9125.1 9136.9 9137.4 9159.5 9199.6 9206.5 9207.0 9106.5 9132.7 9138.2 9162.2 9172.9 9023.5 9069.4 9091.5 9106.0 9121.5 44637.1 45367.3 45371.0 45432.0 45548.5 3771.9 3816.8 3870.1 4319.4 4587.1 34621.7 34653.1 35106.6 35138.5 35219.8 4687.7 4740.3 4804.2 4818.2 4837.6 388833.0 389108.0 391992.0 392023.0 392041.0 61161.0 61805.0 61970.7 62132.0 62218.0 39063.2 40023.6 40062.2 41923.4 42167.2 17859.0 17926.8 18135.5 18242.2 18273.5 13394.1 13440.2 13470.4 13521.0 13566.3 20557.6 20562.8 20597.7 20699.8 20744.9 7786.7 7827.0 7851.6 7885.5 7909.5 990.8 1121.8 1150.0 1172.8 1221.7 33753.5 33951.5 34020.3 34061.7 34594.3 1155.5 1180.7 1189.9 1195.2 1263.8 17144.6 17700.1 17852.8 17882.5 17911.6 670693.0 1038215.0 1094308.0 1114312.0 1119843.0 60869.0 61601.4 61656.7 61929.4 61982.4 1480.3 1497.2 1502.7 1507.4 1509.0 31547.7 31582.4 31912.8 32245.7 32467.2 51128.7 51809.5 52038.0 52082.7 52122.5 450639.0 459055.0 461297.0 461894.0 462765.0 29660.6 29811.0 29842.3 30022.2 30058.7 51874.0 52551.2 53101.0 56329.0 56824.0 43031.4 44968.6 45091.1 45377.8 46047.8 44409.6 44559.6 44701.3 44809.8 45549.3 44821.3 45234.5 45367.3 45465.8 45615.0 39153.9 39525.2 39652.8 39771.8 40998.2 30508.0 30527.5 30740.2 30741.7 30777.4 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#2] jquery.html Cycles:180 Average:31591.74 Median:2115.00 stddev:91639.52 (4332.8%) stddev-sans-first:91866.72 23:36:37 INFO - PROCESS | 9437 | Values: 428.3 429.5 430.6 430.8 440.1 19365.1 20316.5 20916.2 21676.5 21680.2 18891.0 19810.8 19915.1 20475.0 20580.9 5201.3 5412.0 5422.1 5449.6 5462.8 5358.8 5434.8 5438.0 5651.0 5905.8 5850.6 5864.3 5870.1 5879.8 5884.1 5430.4 5482.6 5604.7 5784.5 5854.9 5249.1 5335.6 5354.2 5387.8 5403.6 14304.6 14726.6 14810.3 15035.5 15093.5 2349.7 2553.1 2571.2 2626.3 2994.7 10696.6 10933.7 11021.6 11287.4 11339.3 1990.6 2004.9 2021.7 2099.8 2113.2 88285.0 90599.0 91448.0 92628.0 93873.0 11816.2 11858.7 11918.2 11963.4 12028.9 16857.3 16983.5 17123.5 17132.7 17138.5 8566.7 8665.9 8710.7 8772.6 8802.4 8254.8 8300.3 8372.9 8377.4 8385.4 5025.8 5055.3 5083.7 5097.9 5215.4 2041.8 2064.0 2098.4 2116.7 2143.2 993.8 1002.3 1094.6 1108.8 1137.4 20061.9 20430.3 20593.9 20628.0 20815.7 1022.9 1050.6 1068.2 1114.9 1118.9 11364.4 11596.4 11710.5 11809.9 11885.2 517585.0 547083.0 547602.0 581498.0 582856.0 85224.6 92479.0 93226.5 103618.5 107157.0 1108.7 1144.9 1148.7 1151.5 1163.6 18480.0 18775.8 18827.2 18987.3 19117.9 44051.6 44909.6 44922.1 44932.0 46004.0 59487.1 60758.4 65814.0 66275.0 67101.3 5925.3 6812.1 8664.3 8821.7 9095.3 13384.7 13714.4 13770.0 13902.6 13973.8 11848.8 12224.9 12275.6 12296.0 12317.9 10022.4 11835.5 12239.9 12309.4 12399.4 12497.3 12532.4 12623.0 12638.6 12858.1 7454.1 7902.7 8104.2 8849.9 9187.0 9105.4 12451.8 12683.3 12699.4 12853.2 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#3] mootools.html Cycles:180 Average:6145.52 Median:2375.08 stddev:3523.62 (148.4%) stddev-sans-first:3516.43 23:36:37 INFO - PROCESS | 9437 | Values: 1529.5 1550.8 1738.3 1834.7 1874.0 8104.7 8834.6 8944.6 9452.3 9468.7 8980.6 9294.0 9337.2 9365.5 9397.3 2442.1 2460.9 2473.7 2477.2 2484.7 2401.4 2469.3 2470.9 2473.6 2476.3 2425.6 2426.5 2468.3 2471.0 2472.6 2344.9 2367.2 2382.1 2388.1 2401.0 2387.4 2393.4 2410.2 2415.3 2422.0 9199.5 9255.4 9266.7 9288.9 9296.1 5417.8 5442.7 5490.1 5505.3 5514.9 3395.1 3446.2 3536.3 3551.3 3572.7 1163.4 1164.6 1179.7 1192.8 1206.0 12671.9 12846.4 12876.2 12915.9 12923.2 4698.9 4741.2 4842.2 4853.2 4881.5 10951.3 10964.5 10980.1 10989.8 10998.5 5534.7 5547.0 5552.1 5552.4 5592.8 4422.8 4975.0 5035.8 5124.5 5125.5 4213.7 4215.4 4215.9 4287.4 4287.8 1256.8 1305.9 1307.1 1308.2 1313.4 943.4 1049.3 1067.5 1069.2 1072.2 6347.6 6362.1 6403.0 6413.0 6431.3 424.5 426.6 430.7 433.1 442.4 4255.9 4283.1 4284.9 4291.8 4319.5 11430.3 11663.9 11686.8 11753.6 11808.9 10992.3 11656.4 11662.0 11716.8 11754.5 8685.0 8839.3 8840.0 8879.5 8916.6 6409.7 6438.8 6487.6 6571.9 6604.5 10364.2 10569.5 10717.0 10766.2 10818.0 10826.5 11026.3 11039.2 11040.6 11057.4 7338.3 8156.2 8406.5 8411.9 8440.2 9092.8 9194.0 9196.6 9211.0 9226.3 8134.8 8337.9 8374.7 8416.9 8433.5 8009.8 8096.6 8136.3 8208.7 8275.7 7157.0 7204.0 7220.5 7251.2 7290.0 5779.8 5788.2 5801.9 5803.7 5909.1 5770.7 5813.0 5831.0 5853.9 5939.6 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#4] prototype.html Cycles:180 Average:5013.71 Median:5553.75 stddev:1476.82 (26.6%) stddev-sans-first:1438.77 23:36:37 INFO - PROCESS | 9437 | Values: 344.1 351.3 351.9 354.9 355.7 5624.3 5664.0 5678.1 5686.6 5738.5 5618.4 5659.2 5675.8 5694.6 5699.7 4378.8 4420.2 4431.7 4441.1 4443.2 4432.8 4462.3 4462.6 4470.2 4476.5 4417.5 4431.4 4447.3 4465.4 4468.8 4326.7 4345.8 4375.5 4387.6 4389.2 3891.7 3895.5 3925.4 3936.6 3938.8 5412.0 5430.5 5432.6 5453.4 5473.1 4898.9 5062.5 5067.1 5069.3 5072.2 5902.6 5914.9 5936.9 5977.2 5980.0 4331.0 4333.2 4348.9 4356.7 4357.0 6035.4 6101.4 6193.5 6202.6 6236.8 4288.6 4333.6 4338.0 4344.3 4348.6 4428.1 4434.2 4440.0 4443.6 4446.0 4941.7 5080.3 5106.4 5121.3 5135.7 5952.4 5987.2 6008.6 6011.3 6015.8 1522.4 1531.7 1535.7 1537.9 1540.8 968.5 1002.4 1012.1 1019.7 1020.8 5224.2 5231.5 5313.3 5327.6 5331.4 5419.1 5495.5 5499.9 5539.0 5568.5 5187.0 5307.6 5488.8 5988.9 5990.6 3220.3 3269.3 3270.9 3275.5 3289.0 6124.8 6387.0 6406.1 6424.2 6427.0 6281.6 6284.2 6355.2 6355.7 6365.9 6345.5 6384.4 6387.4 6389.5 6405.0 5875.6 6169.5 6188.0 6193.0 6213.8 5755.8 6044.5 6092.5 6104.9 6131.6 6153.8 6386.6 6390.3 6397.7 6447.2 4392.8 4413.7 4432.1 4435.8 4453.6 5961.4 6164.5 6204.2 6237.9 6245.6 6035.7 6085.6 6098.5 6102.1 6102.4 5780.3 6041.4 6058.8 6060.1 6074.4 5893.8 5899.9 5914.2 5944.4 5972.3 6122.0 6133.1 6147.3 6159.2 6192.2 5730.5 5891.3 5940.5 6001.4 6001.9 23:36:37 INFO - PROCESS | 9437 | 23:36:37 INFO - PROCESS | 9437 | [#5] yui.html Cycles:180 Average:21411.83 Median:4161.24 stddev:31140.61 (748.3%) stddev-sans-first:31189.61 23:36:37 INFO - PROCESS | 9437 | Values: 825.9 873.8 889.1 896.5 909.6 14696.4 15258.5 16143.4 16518.5 16591.8 13741.6 13777.9 13825.4 13843.8 13873.3 838.9 847.6 863.8 868.5 873.6 860.2 861.1 863.0 864.9 868.5 910.0 910.9 911.7 912.2 913.1 894.0 898.5 900.4 901.8 902.1 666.1 666.3 666.5 666.6 666.8 14948.9 15056.0 15138.9 15154.0 15221.8 15381.4 15566.1 15649.4 15836.4 16014.6 11716.4 12139.9 12233.1 12251.9 12289.9 4037.9 4151.1 4171.3 4176.2 4183.5 63877.0 65424.7 66188.0 73871.6 74608.6 11727.2 12105.6 12116.8 12124.6 12149.5 21512.5 22338.7 22418.0 22419.2 22479.2 9236.1 9243.8 9348.8 9392.8 9601.7 5239.4 5328.7 5383.5 5521.1 5559.0 3851.5 3970.8 3972.1 3983.1 4009.0 644.5 644.6 644.9 651.5 658.5 566.8 743.1 757.8 766.3 792.3 10079.6 10243.5 10495.6 10578.6 10625.5 723.8 743.5 762.8 771.8 804.6 4636.4 4677.3 4721.5 4824.2 4861.7 121104.4 123096.0 124861.4 124907.0 127203.4 68483.0 93839.5 99828.5 102013.0 106282.0 94204.5 95473.5 96965.5 97345.0 98662.0 9854.5 9884.8 9945.0 10046.6 10113.7 53278.7 53875.2 54050.5 55360.4 55442.7 72496.6 79986.2 80461.0 83681.0 84450.0 12434.9 12542.4 12759.8 12773.7 12798.1 13192.5 13409.5 13820.4 14168.8 14287.1 12514.7 12826.0 12857.9 12971.4 13237.1 13641.4 13747.6 13910.6 13994.3 14253.1 13009.5 13446.9 13486.6 13629.7 14050.6 11352.1 11606.6 12030.0 12036.8 12089.0 11802.8 11839.3 11919.6 12000.5 12088.5 23:36:37 INFO - PROCESS | 9437 | -------- Summary: end -------- 23:36:37 INFO - PROCESS | 9437 | 23:36:38 INFO - TEST-INFO | 9437: exit 0 23:36:38 INFO - TEST-OK | dromaeo_css | took 1110106ms 23:36:38 INFO - TEST-START | kraken 23:36:38 INFO - operating with platform_type : linux_ 23:36:38 INFO - Initialising browser for kraken test... 23:36:38 INFO - TEST-INFO | started process 9680 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb8_Ys0/profile http://localhost:41371/getInfo.html) 23:36:42 INFO - PROCESS | 9680 | __metrics Screen width/height:1600/1200 23:36:42 INFO - PROCESS | 9680 | colorDepth:24 23:36:42 INFO - PROCESS | 9680 | Browser inner width/height: 1024/697 23:36:42 INFO - PROCESS | 9680 | __metrics 23:36:43 ERROR - PROCESS | 9680 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 23:36:44 INFO - TEST-INFO | 9680: exit 0 23:36:44 INFO - Browser initialized. 23:36:44 INFO - Running cycle 1/1 for kraken test... 23:36:44 INFO - TEST-INFO | started process 9810 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpb8_Ys0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:36:56 INFO - PROCESS | 9810 | RSS: Main: 155680768 23:36:56 INFO - PROCESS | 9810 | 23:36:58 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41371/tests/kraken/driver.html?testName=audio-beat-detection) 23:36:59 INFO - PROCESS | 9810 | RSS: Main: 160911360 23:36:59 INFO - PROCESS | 9810 | 23:37:02 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41371/tests/kraken/driver.html?testName=audio-dft) 23:37:02 INFO - PROCESS | 9810 | RSS: Main: 160665600 23:37:02 INFO - PROCESS | 9810 | 23:37:05 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41371/tests/kraken/driver.html?testName=audio-fft) 23:37:06 INFO - PROCESS | 9810 | RSS: Main: 161206272 23:37:06 INFO - PROCESS | 9810 | 23:37:08 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41371/tests/kraken/driver.html?testName=audio-oscillator) 23:37:09 INFO - PROCESS | 9810 | RSS: Main: 161075200 23:37:09 INFO - PROCESS | 9810 | 23:37:11 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41371/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:37:11 INFO - PROCESS | 9810 | RSS: Main: 161009664 23:37:11 INFO - PROCESS | 9810 | 23:37:14 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41371/tests/kraken/driver.html?testName=imaging-darkroom) 23:37:15 INFO - PROCESS | 9810 | RSS: Main: 160976896 23:37:15 INFO - PROCESS | 9810 | 23:37:18 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41371/tests/kraken/driver.html?testName=imaging-desaturate) 23:37:19 INFO - PROCESS | 9810 | RSS: Main: 161366016 23:37:19 INFO - PROCESS | 9810 | 23:37:22 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41371/tests/kraken/driver.html?testName=json-parse-financial) 23:37:23 INFO - PROCESS | 9810 | RSS: Main: 161259520 23:37:23 INFO - PROCESS | 9810 | 23:37:24 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41371/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:37:25 INFO - PROCESS | 9810 | RSS: Main: 161046528 23:37:25 INFO - PROCESS | 9810 | 23:37:26 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:37:27 INFO - PROCESS | 9810 | RSS: Main: 161169408 23:37:27 INFO - PROCESS | 9810 | 23:37:29 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:37:30 INFO - PROCESS | 9810 | RSS: Main: 161837056 23:37:30 INFO - PROCESS | 9810 | 23:37:32 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:37:33 INFO - PROCESS | 9810 | RSS: Main: 161681408 23:37:33 INFO - PROCESS | 9810 | 23:37:35 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:37:36 INFO - PROCESS | 9810 | RSS: Main: 161886208 23:37:36 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | Cycle 1(1): loaded http://localhost:41371/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41371/tests/kraken/driver.html?testName=ai-astar) 23:37:38 INFO - PROCESS | 9810 | RSS: Main: 162217984 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | __start_tp_report 23:37:38 INFO - PROCESS | 9810 | _x_x_mozilla_page_load 23:37:38 INFO - PROCESS | 9810 | _x_x_mozilla_page_load_details 23:37:38 INFO - PROCESS | 9810 | |i|pagename|runs| 23:37:38 INFO - PROCESS | 9810 | |0;ai-astar;112;105;110;112;112;113;112;109;111;112 23:37:38 INFO - PROCESS | 9810 | |1;audio-beat-detection;157;125;153;179;128;165;154;125;185;125 23:37:38 INFO - PROCESS | 9810 | |2;audio-dft;162;163;165;162;161;164;164;161;161;160 23:37:38 INFO - PROCESS | 9810 | |3;audio-fft;75;75;75;170;76;75;74;75;179;76 23:37:38 INFO - PROCESS | 9810 | |4;audio-oscillator;84;84;146;85;84;84;150;84;86;139 23:37:38 INFO - PROCESS | 9810 | |5;imaging-gaussian-blur;118;117;117;118;121;118;117;117;118;119 23:37:38 INFO - PROCESS | 9810 | |6;imaging-darkroom;148;146;147;146;147;149;147;149;151;150 23:37:38 INFO - PROCESS | 9810 | |7;imaging-desaturate;96;96;96;94;95;95;95;96;95;95 23:37:38 INFO - PROCESS | 9810 | |8;json-parse-financial;53;54;55;54;53;54;54;52;55;54 23:37:38 INFO - PROCESS | 9810 | |9;json-stringify-tinderbox;59;60;59;59;59;60;60;59;59;59 23:37:38 INFO - PROCESS | 9810 | |10;stanford-crypto-aes;77;76;77;75;77;78;76;78;103;76 23:37:38 INFO - PROCESS | 9810 | |11;stanford-crypto-ccm;123;133;126;131;114;119;124;129;125;122 23:37:38 INFO - PROCESS | 9810 | |12;stanford-crypto-pbkdf2;156;155;153;158;156;161;155;156;155;153 23:37:38 INFO - PROCESS | 9810 | |13;stanford-crypto-sha256-iterative;65;65;61;62;65;61;61;64;60;60 23:37:38 INFO - PROCESS | 9810 | __end_tp_report 23:37:38 INFO - PROCESS | 9810 | __start_cc_report 23:37:38 INFO - PROCESS | 9810 | _x_x_mozilla_cycle_collect,854 23:37:38 INFO - PROCESS | 9810 | __end_cc_report 23:37:38 INFO - PROCESS | 9810 | __startTimestamp1467527858465__endTimestamp 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | ------- Summary: start ------- 23:37:38 INFO - PROCESS | 9810 | Number of tests: 14 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#0] ai-astar Cycles:10 Average:110.80 Median:112.00 stddev:2.35 (2.1%) stddev-sans-first:2.45 23:37:38 INFO - PROCESS | 9810 | Values: 112.0 105.0 110.0 112.0 112.0 113.0 112.0 109.0 111.0 112.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#1] audio-beat-detection Cycles:10 Average:149.60 Median:155.50 stddev:22.91 (14.7%) stddev-sans-first:24.14 23:37:38 INFO - PROCESS | 9810 | Values: 157.0 125.0 153.0 179.0 128.0 165.0 154.0 125.0 185.0 125.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#2] audio-dft Cycles:10 Average:162.30 Median:162.50 stddev:1.64 (1.0%) stddev-sans-first:1.73 23:37:38 INFO - PROCESS | 9810 | Values: 162.0 163.0 165.0 162.0 161.0 164.0 164.0 161.0 161.0 160.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#3] audio-fft Cycles:10 Average:95.00 Median:75.00 stddev:41.96 (55.9%) stddev-sans-first:43.87 23:37:38 INFO - PROCESS | 9810 | Values: 75.0 75.0 75.0 170.0 76.0 75.0 74.0 75.0 179.0 76.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#4] audio-oscillator Cycles:10 Average:102.60 Median:84.00 stddev:29.38 (35.0%) stddev-sans-first:30.39 23:37:38 INFO - PROCESS | 9810 | Values: 84.0 84.0 146.0 85.0 84.0 84.0 150.0 84.0 86.0 139.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:1.25 (1.1%) stddev-sans-first:1.32 23:37:38 INFO - PROCESS | 9810 | Values: 118.0 117.0 117.0 118.0 121.0 118.0 117.0 117.0 118.0 119.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.50 stddev:1.70 (1.1%) stddev-sans-first:1.80 23:37:38 INFO - PROCESS | 9810 | Values: 148.0 146.0 147.0 146.0 147.0 149.0 147.0 149.0 151.0 150.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.50 stddev:0.67 (0.7%) stddev-sans-first:0.67 23:37:38 INFO - PROCESS | 9810 | Values: 96.0 96.0 96.0 94.0 95.0 95.0 95.0 96.0 95.0 95.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#8] json-parse-financial Cycles:10 Average:53.80 Median:54.00 stddev:0.92 (1.7%) stddev-sans-first:0.93 23:37:38 INFO - PROCESS | 9810 | Values: 53.0 54.0 55.0 54.0 53.0 54.0 54.0 52.0 55.0 54.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#9] json-stringify-tinderbox Cycles:10 Average:59.30 Median:59.00 stddev:0.48 (0.8%) stddev-sans-first:0.50 23:37:38 INFO - PROCESS | 9810 | Values: 59.0 60.0 59.0 59.0 59.0 60.0 60.0 59.0 59.0 59.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#10] stanford-crypto-aes Cycles:10 Average:79.30 Median:77.00 stddev:8.38 (10.9%) stddev-sans-first:8.85 23:37:38 INFO - PROCESS | 9810 | Values: 77.0 76.0 77.0 75.0 77.0 78.0 76.0 78.0 103.0 76.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#11] stanford-crypto-ccm Cycles:10 Average:124.60 Median:125.50 stddev:5.64 (4.5%) stddev-sans-first:5.95 23:37:38 INFO - PROCESS | 9810 | Values: 123.0 133.0 126.0 131.0 114.0 119.0 124.0 129.0 125.0 122.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.80 Median:156.00 stddev:2.35 (1.5%) stddev-sans-first:2.49 23:37:38 INFO - PROCESS | 9810 | Values: 156.0 155.0 153.0 158.0 156.0 161.0 155.0 156.0 155.0 153.0 23:37:38 INFO - PROCESS | 9810 | 23:37:38 INFO - PROCESS | 9810 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.40 Median:63.00 stddev:2.12 (3.4%) stddev-sans-first:2.03 23:37:38 INFO - PROCESS | 9810 | Values: 65.0 65.0 61.0 62.0 65.0 61.0 61.0 64.0 60.0 60.0 23:37:38 INFO - PROCESS | 9810 | -------- Summary: end -------- 23:37:38 INFO - PROCESS | 9810 | 23:37:39 INFO - TEST-INFO | 9810: exit 0 23:37:39 INFO - TEST-OK | kraken | took 61087ms 23:37:39 INFO - SUITE-END | took 1171s 23:37:39 INFO - Completed test suite (00:19:31) 23:37:39 INFO - javascript benchmark 23:37:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7615.130990872783, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3318.767686261963, 3320.551725517055, 3360.0255925781526, 3362.9663703362967, 3366.612839523454, 5449.673019618821, 5486.451354864512, 5544.528715059215, 5545.25139106221, 5555.333359996806, 5526.032944234763, 5576.637518561291, 5592.189132575774, 5599.0, 5614.803481878135, 5010.423801262856, 5070.569001634865, 5092.9236061459105, 5123.5901127909865, 5127.33344665193, 4963.25551167326, 4975.4527002029745, 5014.548690617844, 5053.36832895888, 5079.593632509391, 5042.168042273021, 5101.744912754366, 5108.259302401149, 5113.872153196181, 5127.641065125443, 5177.611679124062, 5183.3261675981885, 5185.299984502081, 5186.688798672092, 5214.8696282592855, 4915.238138088602, 4992.40091189056, 5083.059633967728, 5102.38771347437, 5155.407128180233, 5454.018276710191, 5466.1527463243265, 5504.972475137639, 5510.228568000483, 5560.86097847553, 5965.821025369202, 5972.940270597282, 6017.879642407127, 6021.066734656135, 6021.307549631761, 5838.854028649275, 5959.255093113361, 5970.164177015221, 5993.520518358521, 6028.5478589106, 5551.861203469864, 5559.861003474905, 5564.8330550083565, 5568.554515638739, 5586.190002449622, 6099.0, 6099.573029887865, 6109.2974307955155, 6135.386461353918, 6139.662318572432, 5784.421557844182, 5809.912851307234, 5832.679202643811, 5853.268341457318, 5903.6457812530525, 5885.6468611882565, 5889.4699477046415, 5902.911456328158, 5921.230240068763, 5922.703864806743, 5724.25584673998, 5860.384659610765, 5860.589758716934, 5864.47219750216, 5877.471027607536, 5778.133280008033, 5795.1886735857015, 5801.8549536261935, 5885.117232415087, 5886.23478947734, 4460.553944605514, 4511.909761804745, 4519.344695019204, 4524.16302983949, 4525.027119169328, 4041.474608300902, 4046.251443482965, 4080.1431699342875, 4082.0, 4111.7944102794745, 5638.351589567253, 5669.829905102853, 5704.3154821421695, 5739.454751798572, 5781.71091445426, 6001.2498437695285, 6060.606060606046, 6061.242344706911, 6068.848278793065, 6071.180390647294, 5632.746526406321, 5700.885982280414, 5811.651300921958, 5819.79630712923, 5822.854428639233, 4944.703317800943, 4987.077390682735, 5014.498550145029, 5022.698638081727, 5050.570701490341, 6118.755249790048, 6191.349908259658, 6198.0, 6216.627002379872, 6232.3144454110015, 5930.673812940157, 5963.7912673056235, 6001.339852616209, 6007.729652165575, 6015.5488338373925, 6166.445019948226, 6171.259448866164, 6180.81457556274, 6192.752289908353, 6217.0, 5914.704264786829, 5923.733431995657, 5943.4948029416255, 5945.910811337747, 5950.0, 5779.855503612275, 5890.263717035371, 5908.527317814651, 5963.403659634002, 5982.982892908129, 5844.883102337844, 5864.736086876186, 5864.794732184524, 5877.35349111606, 5882.294124704892, 5661.490465858093, 5810.4189581041555, 5835.066389377679, 5839.416058394127, 5840.240768700041, 5574.721263936868, 5578.0, 5581.051221292309, 5610.270664813548, 5683.5737319700365, 5715.599908006399, 5745.827625171251, 5772.163036359789, 5786.392428795084, 5795.652260864362, 5616.69108199053, 5639.295088113986, 5660.264165658438, 5665.433456654301, 5673.177389278614], "value": 5487.723407360014, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [600.7927265093543, 644.6647743173547, 653.8365408647838, 657.1293036726339, 668.415136755339, 35134.472982905274, 38674.41988370173, 45004.32493512596, 45855.54144458554, 45919.77040114803, 48799.0, 49292.26061609079, 49323.260151097675, 49380.0, 49388.27141050064, 9060.139286767746, 9081.137291957286, 9150.954245228764, 9211.30915181364, 9232.584533695966, 9022.639094436214, 9053.0, 9065.637374505011, 9125.087491250888, 9136.862947055799, 9137.40606860552, 9159.496227707474, 9199.586018629145, 9206.49364284964, 9207.0, 9106.453612783222, 9132.680356187568, 9138.177564019237, 9162.221211197057, 9172.8624070639, 9023.54882255891, 9069.410488318304, 9091.454512729257, 9106.043865394171, 9121.5439228039, 44637.10725785499, 45367.31949020767, 45371.0, 45432.0, 45548.544514554764, 3771.8679846205528, 3816.8091595420397, 3870.07118291608, 4319.438472998521, 4587.128445595359, 34621.6537834621, 34653.13367165816, 35106.648933510594, 35138.47292290618, 35219.82390088059, 4687.695299805502, 4740.312654665088, 4804.183288840905, 4818.180909245401, 4837.637177211724, 388833.0, 389108.0, 391992.0, 392023.0, 392041.0, 61161.0, 61805.0, 61970.69014654898, 62132.0, 62218.0, 39063.21873562513, 40023.59976400257, 40062.1987560253, 41923.37114943278, 42167.15665686669, 17859.0, 17926.820731792777, 18135.546611334823, 18242.179101940445, 18273.543161421072, 13394.129381590166, 13440.193588384729, 13470.39383227757, 13521.0, 13566.253856038013, 20557.588848222953, 20562.79437205639, 20597.691034634492, 20699.793002070088, 20744.896275518528, 7786.727464538827, 7827.0, 7851.607419628996, 7885.526868387915, 7909.485883417559, 990.8117457683018, 1121.831725241204, 1150.045462266317, 1172.8240763885315, 1221.694576355911, 33753.49369759455, 33951.4907276391, 34020.31959360848, 34061.659383406346, 34594.308113837586, 1155.5320095361392, 1180.734334774686, 1189.8929096381194, 1195.1693572966706, 1263.8357013588175, 17144.571385715208, 17700.114994250493, 17852.821471785115, 17882.463526094238, 17911.552211194823, 670693.0, 1038215.0, 1094308.0, 1114312.0, 1119843.0, 60869.0, 61601.383986160465, 61656.69171654203, 61929.38070619326, 61982.38017619856, 1480.2968589919917, 1497.1541079290166, 1502.706972140422, 1507.366905899525, 1509.0115974037024, 31547.684523154476, 31582.36835263236, 31912.840435797672, 32245.67754322427, 32467.18832029218, 51128.74435627798, 51809.481905180466, 52038.0, 52082.739586301825, 52122.47877521176, 450639.0, 459055.0, 461297.0, 461894.0, 462765.0, 29660.55509167321, 29811.0, 29842.253943651584, 30022.24944376408, 30058.69941300559, 51874.0, 52551.211731823285, 53101.0, 56329.0, 56824.0, 43031.354529681455, 44968.55031449644, 45091.09817803691, 45377.77311113424, 46047.76976115098, 44409.55590444183, 44559.55440445554, 44701.329480057175, 44809.775951120035, 45549.31676024928, 44821.32768008548, 45234.547654523034, 45367.319490208334, 45465.77267113643, 45615.0, 39153.92836726139, 39525.20949580935, 39652.80173599113, 39771.80114099411, 40998.1800363997, 30508.0, 30527.54208686827, 30740.237147827444, 30741.692583073884, 30777.38445231038], "value": 21577.630370362407, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [428.2505615173445, 429.54039178079427, 430.6447181075611, 430.82982222022304, 440.0977995110024, 19365.128569214383, 20316.492087697814, 20916.16335346586, 21676.458088547795, 21680.2411915583, 18891.0, 19810.801891981075, 19915.103820328084, 20474.976251187454, 20580.897095514538, 5201.323827902367, 5412.0, 5422.132458806592, 5449.64577302474, 5462.808801691942, 5358.812441564546, 5434.83695489136, 5438.048341540234, 5651.0, 5905.822825315247, 5850.619709718876, 5864.266966629171, 5870.148828419877, 5879.823605291848, 5884.117382392633, 5430.429804870471, 5482.616216864821, 5604.663720176803, 5784.479396854283, 5854.912176317359, 5249.1338929076655, 5335.573154147659, 5354.196870469422, 5387.811426600089, 5403.621746477748, 14304.642383940381, 14726.558203253919, 14810.259487025713, 15035.473758418511, 15093.54719358421, 2349.6710460535537, 2553.0681301325067, 2571.2029270926073, 2626.3171575390347, 2994.715502027304, 10696.625618103408, 10933.726656833564, 11021.614243501439, 11287.435628218556, 11339.262947908443, 1990.572027014199, 2004.8997550122435, 2021.6866385710239, 2099.7900209979034, 2113.249796322314, 88285.0, 90599.0, 91448.0, 92628.0, 93873.0, 11816.231944923553, 11858.703532411586, 11918.225315354473, 11963.40182990847, 12028.939855300667, 16857.325706971827, 16983.49049528516, 17123.486295411156, 17132.743008854875, 17138.485845424657, 8566.742997710078, 8665.913340866511, 8710.738677839676, 8772.605232764541, 8802.38383313162, 8254.793630159174, 8300.335973122135, 8372.916270837335, 8377.37169712274, 8385.413021088587, 5025.824096156617, 5055.2954169519135, 5083.72039537829, 5097.923531147036, 5215.400228973716, 2041.826444752183, 2063.9793602063787, 2098.370488853338, 2116.745990481121, 2143.2391501017228, 993.8459538771502, 1002.318423472046, 1094.6278265389647, 1108.8336749487642, 1137.4028634966544, 20061.899690501454, 20430.284940027028, 20593.897030514752, 20628.0, 20815.687764683542, 1022.9028242316969, 1050.5640159333943, 1068.150820098024, 1114.905233055183, 1118.904893084097, 11364.374959377148, 11596.362200078907, 11710.473028713557, 11809.940950295193, 11885.168038237412, 517585.0, 547083.0, 547602.0, 581498.0, 582856.0, 85224.57387713021, 92479.0, 93226.53386733023, 103618.48190758999, 107157.0, 1108.6507750058706, 1144.8740638529755, 1148.6898537394857, 1151.4703236511298, 1163.627639155462, 18480.0, 18775.812241877407, 18827.15277812529, 18987.33544325942, 19117.94851283193, 44051.559484404745, 44909.55090449184, 44922.10155796931, 44932.0, 46004.0, 59487.10769338377, 60758.39241607527, 65814.0, 66275.0, 67101.3289867095, 5925.259342582177, 6812.14848143982, 8664.263537599374, 8821.691240806542, 9095.317851161057, 13384.732305354033, 13714.382852771849, 13770.0, 13902.582922512342, 13973.790393143907, 11848.76302473963, 12224.87775122273, 12275.631731048083, 12296.016318694305, 12317.876821231674, 10022.44652078929, 11835.526578936746, 12239.915497448752, 12309.384530773605, 12399.442025108712, 12497.312647804458, 12532.37338133108, 12623.0, 12638.620841374774, 12858.0999330046, 7454.105507339154, 7902.68389264423, 8104.189581042085, 8849.911500885166, 9187.03536128697, 9105.362624616213, 12451.750964980469, 12683.302418367079, 12699.42852571655, 12853.228806271654], "value": 9578.195759947199, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1529.5411376587022, 1550.7828903953446, 1738.269926630815, 1834.7064469684854, 1873.9718904216438, 8104.716334928279, 8834.558272086395, 8944.59749311281, 9452.29107816913, 9468.66859659912, 8980.640774369018, 9293.953530232357, 9337.206337461306, 9365.531723413818, 9397.29520285978, 2442.1452491627965, 2460.8769561521854, 2473.703155621319, 2477.2196758021255, 2484.714257860342, 2401.435662619283, 2469.271564888353, 2470.888810003545, 2473.6165894286323, 2476.2695004973575, 2425.575524283252, 2426.4783071639595, 2468.3458883395824, 2470.962935555968, 2472.6414669872856, 2344.894479748407, 2367.2069856597973, 2382.106709983756, 2388.0567175965484, 2400.9879950600134, 2387.415083304584, 2393.4495066134714, 2410.192585483865, 2415.3237093613816, 2421.987890060556, 9199.540022998823, 9255.444673319622, 9266.675666351714, 9288.907110928872, 9296.116868897443, 5417.756200970965, 5442.700651464168, 5490.094134467808, 5505.256790333294, 5514.862128446781, 3395.0833275015607, 3446.1556918555116, 3536.2672290577434, 3551.2897420516, 3572.696320812734, 1163.4357336691698, 1164.598213616301, 1179.710970812148, 1192.7554851255472, 1206.0351718625152, 12671.936640316831, 12846.35768211595, 12876.163049401759, 12915.935420322932, 12923.224606523545, 4698.88252793676, 4741.241401375763, 4842.15262329091, 4853.247746599282, 4881.536254055859, 10951.34291942486, 10964.506597203144, 10980.066694331072, 10989.780204395867, 10998.505067271992, 5534.695591742412, 5546.972265138648, 5552.139418390156, 5552.3892371839065, 5592.804251851166, 4422.778861056934, 4974.950250497521, 5035.7985680572365, 5124.5131712487255, 5125.538701516882, 4213.662906967435, 4215.367694845798, 4215.852445164466, 4287.399764033038, 4287.7641729705165, 1256.8428946381703, 1305.8824705776526, 1307.0589175793414, 1308.1562392256942, 1313.4352228541818, 943.3820847345, 1049.2759995603162, 1067.5196161727254, 1069.2354966199205, 1072.2172813845937, 6347.619142851444, 6362.1093046973465, 6402.967985160044, 6412.9679351602945, 6431.292557818636, 424.49061126648144, 426.6373582454888, 430.670537039159, 433.0645805061053, 442.4469413233458, 4255.851045213464, 4283.079137985348, 4284.871453856389, 4291.763952982616, 4319.4816622005565, 11430.314181149157, 11663.941680291713, 11686.76626467466, 11753.647390578297, 11808.94095529517, 10992.28550144254, 11656.41717914101, 11662.0, 11716.824247636292, 11754.471048802825, 8684.956575217084, 8839.29285657146, 8840.027596964328, 8879.467231965973, 8916.643334266557, 6409.743610255724, 6438.8390290243115, 6487.610743355413, 6571.934280657132, 6604.5046621502615, 10364.222683298633, 10569.471526423802, 10716.981886720749, 10766.192535559707, 10818.02637762605, 10826.51280692355, 11026.283291586022, 11039.227254092137, 11040.613578524713, 11057.391843448366, 7338.302861228175, 8156.184381561797, 8406.495610263404, 8411.873821892554, 8440.155984401756, 9092.818143636958, 9194.0, 9196.586153623237, 9210.98679145307, 9226.261899048195, 8134.75595732129, 8337.916620833714, 8374.748757537283, 8416.915830841614, 8433.536155511505, 8009.759707208793, 8096.5546894921345, 8136.308413784658, 8208.712695055883, 8275.668973241003, 7156.964215178891, 7204.0, 7220.530665506725, 7251.23861994483, 7289.963550182428, 5779.768809247583, 5788.247527821356, 5801.912971305349, 5803.65178089316, 5909.143174239797, 5770.682612456188, 5812.9709351452975, 5830.970845145747, 5853.912191317048, 5939.643621382731], "value": 4810.3155685121055, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [344.0727240087964, 351.32194863912656, 351.90146758907497, 354.93611149993006, 355.6674509333773, 5624.2969628796345, 5663.971680141593, 5678.148277758328, 5686.573506986977, 5738.483536481715, 5618.353889302721, 5659.207710920475, 5675.801346952858, 5694.629849059818, 5699.658020518761, 4378.759168245753, 4420.160169567772, 4431.667624928144, 4441.133978874121, 4443.244648409762, 4432.8005239764125, 4462.286034234523, 4462.553744625544, 4470.150671372445, 4476.4556228101255, 4417.491988421324, 4431.401760762305, 4447.310666846644, 4465.397171381871, 4468.798904049309, 4326.675499337546, 4345.78271086446, 4375.47494300686, 4387.605115539617, 4389.18800021997, 3891.6650009993778, 3895.454636350913, 3925.4308125321954, 3936.6063393660693, 3938.7636741795295, 5412.0, 5430.51125398716, 5432.565394768409, 5453.3728621208675, 5473.124300111963, 4898.8775280618265, 5062.519060689228, 5067.113255180328, 5069.315642388267, 5072.213806859942, 5902.586818922634, 5914.940850591525, 5936.881262374772, 5977.193078934375, 5980.0, 4331.0, 4333.198358303724, 4348.8692939835555, 4356.738595684269, 4356.978215108936, 6035.366286539938, 6101.413632455549, 6193.473554747852, 6202.62784232952, 6236.750529978795, 4288.5711428857485, 4333.58830911063, 4337.956620433755, 4344.283193273138, 4348.565143485626, 4428.114377124588, 4434.246178149722, 4440.0, 4443.644508439317, 4445.955540444619, 4941.654084214142, 5080.314157588752, 5106.387233532, 5121.308623335876, 5135.743212839343, 5952.434518720715, 5987.191729116514, 6008.639481631116, 6011.338752737195, 6015.789447369321, 1522.4214798376768, 1531.7319469092863, 1535.6775077233683, 1537.8850333508117, 1540.8135735483615, 968.5254225429488, 1002.3761506359743, 1012.1396812709286, 1019.6737044145802, 1020.7805321855836, 5224.190250511177, 5231.476852314738, 5313.335833020872, 5327.573794096463, 5331.3868905076415, 5419.132938729863, 5495.477929596682, 5499.890002200013, 5538.972305138448, 5568.526675232651, 5186.974065129726, 5307.575393968474, 5488.807891723771, 5988.940110598838, 5990.610610310316, 3220.3398303348226, 3269.316302104418, 3270.8855190068234, 3275.5250488679008, 3289.0, 6124.785632502841, 6387.0, 6406.135171751847, 6424.229092508929, 6427.0, 6281.560290779693, 6284.24589049317, 6355.205599300088, 6355.745770169234, 6365.936340636627, 6345.460635846005, 6384.361563843671, 6387.393197646216, 6389.456896163785, 6404.967975160094, 5875.588708790344, 6169.5064394849205, 6188.019833653188, 6192.969035154795, 6213.751449942132, 5755.769769209185, 6044.516438684983, 6092.45167934888, 6104.908426373519, 6131.601445906002, 6153.784617538365, 6386.648734319657, 6390.329015453311, 6397.680115994089, 6447.161868957006, 4392.780360981874, 4413.668974826836, 4432.091421258569, 4435.82256709728, 4453.55464453552, 5961.374055724086, 6164.47601953839, 6204.193454850841, 6237.906431403442, 6245.625262484084, 6035.698215089315, 6085.561657663406, 6098.542609304409, 6102.145699602148, 6102.436976469805, 5780.335261444988, 6041.365656606169, 6058.787942421994, 6060.060780550181, 6074.3925607438905, 5893.823185304448, 5899.938011158033, 5914.201582786269, 5944.405559444021, 5972.313183983723, 6122.0, 6133.141360209485, 6147.262328520606, 6159.168512250968, 6192.225971753531, 5730.484256416942, 5891.3224979127945, 5940.46535811779, 6001.399860013964, 6001.879962400815], "value": 4542.217143568395, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [825.9463134896228, 873.7553485024191, 889.0798024045115, 896.4755617963493, 909.6270529083073, 14696.41214351426, 15258.542243732692, 16143.434979775695, 16518.504444866645, 16591.83408165918, 13741.58775236742, 13777.93111034446, 13825.446982120704, 13843.792343114836, 13873.306334683251, 838.9119142490042, 847.555033607358, 863.8013256950906, 868.4528746889482, 873.5937788928147, 860.2472836268265, 861.1259571534897, 862.9525376104311, 864.9437786543886, 868.4832524647825, 909.9545022748869, 910.8906931168269, 911.6717981526646, 912.1516989200042, 913.0686699566438, 893.9776505587347, 898.5327629632554, 900.4012331799346, 901.8061116859841, 902.1249388093539, 666.0675054923098, 666.3270097201813, 666.4501786026548, 666.6067020457953, 666.823291827666, 14948.850511494855, 15056.0, 15138.924305378512, 15154.0, 15221.771673424908, 15381.384744610203, 15566.143862087582, 15649.374025038986, 15836.366545338173, 16014.5996350091, 11716.355600441972, 12139.939300303442, 12233.082518811036, 12251.93874030633, 12289.877101228964, 4037.9007295492192, 4151.14901445203, 4171.3325867860995, 4176.164767046603, 4183.45615070042, 63877.0, 65424.67287663531, 66188.0, 73871.63064184645, 74608.62695686487, 11727.237729547553, 12105.576304829288, 12116.75766484683, 12124.57563985274, 12149.453274602663, 21512.4621884451, 22338.66492002621, 22418.0, 22419.215327463462, 22479.21322753696, 9236.07639236071, 9243.768905777275, 9348.813023739487, 9392.812143757086, 9601.711948641552, 5239.449857764956, 5328.733563321818, 5383.515483606494, 5521.1442226454965, 5559.027170245191, 3851.4993050903204, 3970.781607011642, 3972.145988612462, 3983.083890705154, 4008.9599104008585, 644.532713782504, 644.5874640230256, 644.8581312111328, 651.5341530805497, 658.5456035335603, 566.8384510414512, 743.1119811824817, 757.7840315510164, 766.2529034191618, 792.3067316098413, 10079.647212347532, 10243.48782560869, 10495.632652857113, 10578.629747958785, 10625.5218515167, 723.7973367457121, 743.5278598090143, 762.771168649403, 771.8070482379405, 804.5655346113033, 4636.39726835516, 4677.2750223715375, 4721.480637129913, 4824.155772739757, 4861.7326047067045, 121104.39447802704, 123096.0, 124861.37569312095, 124907.0, 127203.36398317949, 68483.0, 93839.53080234556, 99828.50085749525, 102013.0, 106282.0, 94204.52897735467, 95473.52263238779, 96965.5151724237, 97344.99999999859, 98662.0, 9854.507274636382, 9884.802303953737, 9945.0, 10046.648367307109, 10113.747156321151, 53278.73360633172, 53875.19187212116, 54050.459495404546, 55360.44639553714, 55442.72278638581, 72496.63751681207, 79986.20013799788, 80461.0, 83681.0, 84450.0, 12434.875651243372, 12542.372881356077, 12759.808602870778, 12773.680657983625, 12798.104132710992, 13192.472301107848, 13409.463621455032, 13820.447182112603, 14168.787468187778, 14287.071340362843, 12514.74970500603, 12826.0, 12857.935710321388, 12971.416286266953, 13237.073404861567, 13641.38613762403, 13747.587572372844, 13910.58268251954, 13994.300284985506, 14253.073550219202, 13009.544665936646, 13446.865531344562, 13486.595402137951, 13629.659258518617, 14050.578482645536, 11352.148588855704, 11606.593769218036, 12029.977451916686, 12036.75926481483, 12089.0, 11802.82295765547, 11839.348835814113, 11919.642410727693, 12000.519979201083, 12088.456019478968], "value": 7868.639205878026, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1516.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 105.0, 110.0, 112.0, 112.0, 113.0, 112.0, 109.0, 111.0, 112.0], "value": 110.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 125.0, 153.0, 179.0, 128.0, 165.0, 154.0, 125.0, 185.0, 125.0], "value": 149.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 165.0, 162.0, 161.0, 164.0, 164.0, 161.0, 161.0, 160.0], "value": 162.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 170.0, 76.0, 75.0, 74.0, 75.0, 179.0, 76.0], "value": 95.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 146.0, 85.0, 84.0, 84.0, 150.0, 84.0, 86.0, 139.0], "value": 102.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 121.0, 118.0, 117.0, 117.0, 118.0, 119.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 146.0, 147.0, 146.0, 147.0, 149.0, 147.0, 149.0, 151.0, 150.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 94.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "value": 95.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 54.0, 55.0, 54.0, 53.0, 54.0, 54.0, 52.0, 55.0, 54.0], "value": 53.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 60.0, 59.0, 59.0, 59.0, 60.0, 60.0, 59.0, 59.0, 59.0], "value": 59.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 77.0, 75.0, 77.0, 78.0, 76.0, 78.0, 103.0, 76.0], "value": 79.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 133.0, 126.0, 131.0, 114.0, 119.0, 124.0, 129.0, 125.0, 122.0], "value": 124.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 155.0, 153.0, 158.0, 156.0, 161.0, 155.0, 156.0, 155.0, 153.0], "value": 155.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 61.0, 62.0, 65.0, 61.0, 61.0, 64.0, 60.0, 60.0], "value": 62.4, "unit": "score"}]}]} 23:37:39 INFO - Return code: 0 23:37:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 23:37:39 ERROR - # TBPL SUCCESS # 23:37:39 INFO - Running post-action listener: _resource_record_post_action 23:37:39 INFO - ##### 23:37:39 INFO - ##### Finished run-tests step (success) 23:37:39 INFO - ##### 23:37:39 INFO - Running post-run listener: _resource_record_post_run 23:37:39 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 3584000; Write bytes: 270331904; Read time: 516; Write time: 222732 23:37:39 INFO - TinderboxPrint: CPU usage
13.3% 23:37:39 INFO - TinderboxPrint: I/O read bytes / time
3,584,000 / 516 23:37:39 INFO - TinderboxPrint: I/O write bytes / time
270,331,904 / 222,732 23:37:39 INFO - TinderboxPrint: CPU idle
8,212.3 (86.6%) 23:37:39 INFO - TinderboxPrint: CPU user
1,210.6 (12.8%) 23:37:39 INFO - TinderboxPrint: Swap in / out
0 / 0 23:37:39 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 23257088; Read time: 0; Write time: 27564 23:37:39 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 3584000; Write bytes: 247074816; Read time: 516; Write time: 195168 23:37:40 INFO - Running post-run listener: _upload_blobber_files 23:37:40 INFO - Blob upload gear active. 23:37:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 23:37:40 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:37:40 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 23:37:40 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 23:37:40 INFO - (blobuploader) - INFO - Open directory for files ... 23:37:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 23:37:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:37:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:37:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 23:37:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:37:41 INFO - (blobuploader) - INFO - Done attempting. 23:37:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 23:37:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:37:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:37:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 23:37:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:37:42 INFO - (blobuploader) - INFO - Done attempting. 23:37:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 23:37:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:37:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:37:46 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 23:37:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:37:46 INFO - (blobuploader) - INFO - Done attempting. 23:37:46 INFO - (blobuploader) - INFO - Iteration through files over. 23:37:46 INFO - Return code: 0 23:37:46 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 23:37:46 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 23:37:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/96a8354c60ccbc34180cdeb4a57179db61a655073a68aa448d907eb0b3c3624f5609c356beb2aa46c2417573999f03a10391230275e8206fb2a9f011e2e50931", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/89f05ba4bd89b0a7a132651e47fb82ae75c5a2cf0ca0a4508aeaad748e6e2d52922b2842b3e54cd41068a0d2395d98033e073fbfcbc6c2e9d96a2e46073dfb44", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5f5fb3662dc20b727815238ce65c5d9d52712b256f057cc0b501701e528d07b643dbfd70b17285e174132a835affdcb036c450fd6eb260af02b85e01827fab57"} 23:37:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 23:37:46 INFO - Writing to file /builds/slave/test/properties/blobber_files 23:37:46 INFO - Contents: 23:37:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/96a8354c60ccbc34180cdeb4a57179db61a655073a68aa448d907eb0b3c3624f5609c356beb2aa46c2417573999f03a10391230275e8206fb2a9f011e2e50931", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/89f05ba4bd89b0a7a132651e47fb82ae75c5a2cf0ca0a4508aeaad748e6e2d52922b2842b3e54cd41068a0d2395d98033e073fbfcbc6c2e9d96a2e46073dfb44", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5f5fb3662dc20b727815238ce65c5d9d52712b256f057cc0b501701e528d07b643dbfd70b17285e174132a835affdcb036c450fd6eb260af02b85e01827fab57"} 23:37:46 INFO - Running post-run listener: copy_logs_to_upload_dir 23:37:46 INFO - Copying logs to upload dir... 23:37:46 INFO - mkdir: /builds/slave/test/build/upload/logs 23:37:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.386356 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-07-02 23:37:45.832580) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-02 23:37:45.836429) ========= 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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 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/Mozilla-Aurora/sha512/96a8354c60ccbc34180cdeb4a57179db61a655073a68aa448d907eb0b3c3624f5609c356beb2aa46c2417573999f03a10391230275e8206fb2a9f011e2e50931", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/89f05ba4bd89b0a7a132651e47fb82ae75c5a2cf0ca0a4508aeaad748e6e2d52922b2842b3e54cd41068a0d2395d98033e073fbfcbc6c2e9d96a2e46073dfb44", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5f5fb3662dc20b727815238ce65c5d9d52712b256f057cc0b501701e528d07b643dbfd70b17285e174132a835affdcb036c450fd6eb260af02b85e01827fab57"} build_url:https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011131 build_url: 'https://queue.taskcluster.net/v1/task/FsxWn-duRhSsfHokcRpN0A/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/96a8354c60ccbc34180cdeb4a57179db61a655073a68aa448d907eb0b3c3624f5609c356beb2aa46c2417573999f03a10391230275e8206fb2a9f011e2e50931", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/89f05ba4bd89b0a7a132651e47fb82ae75c5a2cf0ca0a4508aeaad748e6e2d52922b2842b3e54cd41068a0d2395d98033e073fbfcbc6c2e9d96a2e46073dfb44", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/5f5fb3662dc20b727815238ce65c5d9d52712b256f057cc0b501701e528d07b643dbfd70b17285e174132a835affdcb036c450fd6eb260af02b85e01827fab57"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-02 23:37:45.861325) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:37:45.861627) ========= 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=920470bf432669ad7e3a5387000001ca-1467526633.830046-1332058417 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004454 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 23:37:45.945666) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-02 23:37:45.945973) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-02 23:37:45.946268) ========= ========= Total master_lag: 0.17 =========