builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-001 starttime: 1465232499.27 results: success (0) buildid: 20160606073136 builduid: c89a5eac9b81491a9f28c772a8802835 revision: 581cba07c3793b9788f8e041481e99874f05fa01 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.269272) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.269720) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.270029) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.313489) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.313826) ========= 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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-06 10:01:39-- 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% 51.0M=0s 2016-06-06 10:01:39 (51.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.085859 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.414041) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.414448) ========= 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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015956 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.464808) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:39.465247) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 581cba07c3793b9788f8e041481e99874f05fa01 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 581cba07c3793b9788f8e041481e99874f05fa01 --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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-06 10:01:39,563 truncating revision to first 12 chars 2016-06-06 10:01:39,563 Setting DEBUG logging. 2016-06-06 10:01:39,563 attempt 1/10 2016-06-06 10:01:39,563 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/581cba07c379?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-06 10:01:39,911 unpacking tar archive at: mozilla-inbound-581cba07c379/testing/mozharness/ program finished with exit code 0 elapsedTime=0.717213 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:40.200911) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:40.201585) ========= script_repo_revision: 581cba07c3793b9788f8e041481e99874f05fa01 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:40.202651) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:40.203291) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 10:01:40.217281) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-06 10:01:40.217599) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 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-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:01:40 INFO - MultiFileLogger online at 20160606 10:01:40 in /builds/slave/test 10:01:40 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 10:01:40 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:01:40 INFO - {'append_to_log': False, 10:01:40 INFO - 'base_work_dir': '/builds/slave/test', 10:01:40 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 10:01:40 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:01:40 INFO - 'branch': 'Mozilla-Inbound', 10:01:40 INFO - 'buildbot_json_path': 'buildprops.json', 10:01:40 INFO - 'config_files': ('talos/linux_config.py',), 10:01:40 INFO - 'default_actions': ('clobber', 10:01:40 INFO - 'read-buildbot-config', 10:01:40 INFO - 'download-and-extract', 10:01:40 INFO - 'populate-webroot', 10:01:40 INFO - 'create-virtualenv', 10:01:40 INFO - 'install', 10:01:40 INFO - 'run-tests'), 10:01:40 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:01:40 INFO - 'download_minidump_stackwalk': True, 10:01:40 INFO - 'download_symbols': 'ondemand', 10:01:40 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:01:40 INFO - 'tooltool.py': '/tools/tooltool.py', 10:01:40 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:01:40 INFO - '/tools/misc-python/virtualenv.py')}, 10:01:40 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:01:40 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:01:40 INFO - 'installer_path': 'installer.exe', 10:01:40 INFO - 'log_level': 'info', 10:01:40 INFO - 'log_name': 'talos', 10:01:40 INFO - 'log_to_console': True, 10:01:40 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:01:40 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:01:40 INFO - 'opt_config_files': (), 10:01:40 INFO - 'pip_index': False, 10:01:40 INFO - 'sps_profile': False, 10:01:40 INFO - 'sps_profile_interval': 0, 10:01:40 INFO - 'suite': 'dromaeojs-e10s', 10:01:40 INFO - 'system_bits': '32', 10:01:40 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:01:40 INFO - 'title': 'talos-linux64-ix-001', 10:01:40 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:01:40 INFO - 'use_talos_json': True, 10:01:40 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:01:40 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:01:40 INFO - 'work_dir': 'build'} 10:01:40 INFO - ##### 10:01:40 INFO - ##### Running clobber step. 10:01:40 INFO - ##### 10:01:40 INFO - Running pre-action listener: _resource_record_pre_action 10:01:40 INFO - Running main action method: clobber 10:01:40 INFO - rmtree: /builds/slave/test/build 10:01:40 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:01:40 INFO - Running post-action listener: _resource_record_post_action 10:01:40 INFO - ##### 10:01:40 INFO - ##### Finished clobber step (success) 10:01:40 INFO - ##### 10:01:40 INFO - ##### 10:01:40 INFO - ##### Running read-buildbot-config step. 10:01:40 INFO - ##### 10:01:40 INFO - Running pre-action listener: _resource_record_pre_action 10:01:40 INFO - Running main action method: read_buildbot_config 10:01:40 INFO - Using buildbot properties: 10:01:40 INFO - { 10:01:40 INFO - "project": "", 10:01:40 INFO - "product": "firefox", 10:01:40 INFO - "script_repo_revision": "production", 10:01:40 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 10:01:40 INFO - "repository": "", 10:01:40 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 10:01:40 INFO - "buildid": "20160606073136", 10:01:40 INFO - "pgo_build": "True", 10:01:40 INFO - "basedir": "/builds/slave/test", 10:01:40 INFO - "buildnumber": 1127, 10:01:40 INFO - "slavename": "talos-linux64-ix-001", 10:01:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 10:01:40 INFO - "platform": "ubuntu64_hw", 10:01:40 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 10:01:40 INFO - "branch": "mozilla-inbound", 10:01:40 INFO - "repo_path": "integration/mozilla-inbound", 10:01:40 INFO - "revision": "581cba07c3793b9788f8e041481e99874f05fa01", 10:01:40 INFO - "stage_platform": "linux64-pgo", 10:01:40 INFO - "builduid": "c89a5eac9b81491a9f28c772a8802835", 10:01:40 INFO - "slavebuilddir": "test" 10:01:40 INFO - } 10:01:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 10:01:40 INFO - Running post-action listener: _resource_record_post_action 10:01:40 INFO - ##### 10:01:40 INFO - ##### Finished read-buildbot-config step (success) 10:01:40 INFO - ##### 10:01:40 INFO - ##### 10:01:40 INFO - ##### Running download-and-extract step. 10:01:40 INFO - ##### 10:01:40 INFO - Running pre-action listener: _resource_record_pre_action 10:01:40 INFO - Running main action method: download_and_extract 10:01:40 INFO - mkdir: /builds/slave/test/build/tests 10:01: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')]} 10:01:40 INFO - https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 10:01:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:01:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:01:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:01:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:01:44 INFO - Downloaded 1361 bytes. 10:01:44 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:01:44 INFO - Using the following test package requirements: 10:01:44 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 10:01:44 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:01:44 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:01:44 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'jsshell-linux-x86_64.zip'], 10:01:44 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:01:44 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 10:01:44 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:01:44 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:01:44 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:01:44 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:44 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:01:44 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:01:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:01:44 INFO - https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:01:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:01:48 INFO - Downloaded 24443871 bytes. 10:01:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:01:50 INFO - Return code: 0 10:01:50 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:01:50 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')]} 10:01:50 INFO - https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:01:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:01:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:01:51 INFO - Downloaded 24443871 bytes. 10:01:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:01:53 INFO - Return code: 0 10:01:53 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')]} 10:01:53 INFO - https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:01:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 10:01:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 10:01:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 10:01:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:01:54 INFO - Downloaded 10833369 bytes. 10:01:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:01:54 INFO - Return code: 0 10:01:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:01:54 INFO - https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:01:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:01:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:01:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:01:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:01:58 INFO - Downloaded 59185180 bytes. 10:01:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:01:58 INFO - mkdir: /builds/slave/test/properties 10:01:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:01:58 INFO - Writing to file /builds/slave/test/properties/build_url 10:01:58 INFO - Contents: 10:01:58 INFO - build_url:https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:01:59 INFO - Running post-action listener: _resource_record_post_action 10:01:59 INFO - Running post-action listener: set_extra_try_arguments 10:01:59 INFO - ##### 10:01:59 INFO - ##### Finished download-and-extract step (success) 10:01:59 INFO - ##### 10:01:59 INFO - ##### 10:01:59 INFO - ##### Running populate-webroot step. 10:01:59 INFO - ##### 10:01:59 INFO - Running pre-action listener: _resource_record_pre_action 10:01:59 INFO - Running main action method: populate_webroot 10:01:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:01:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:01:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:01:59 INFO - '--tppagecycles', 10:01:59 INFO - '7'], 10:01:59 INFO - 'tests': ['tsvgm']}}, 10:01:59 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:01:59 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:01:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:01:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:01:59 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:01:59 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:01:59 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['damp', 'tps']}, 10:01:59 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'tests': ['damp', 'tps']}, 10:01:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['dromaeo_dom']}, 10:01:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:01:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'other-e10s': {'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['a11yr', 10:01:59 INFO - 'ts_paint', 10:01:59 INFO - 'tpaint', 10:01:59 INFO - 'sessionrestore', 10:01:59 INFO - 'sessionrestore_no_auto_restore', 10:01:59 INFO - 'tabpaint']}, 10:01:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['tsvgx', 10:01:59 INFO - 'tsvgr_opacity', 10:01:59 INFO - 'tart', 10:01:59 INFO - 'tscrollx', 10:01:59 INFO - 'cart']}, 10:01:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:01:59 INFO - 'tsvgr_opacity', 10:01:59 INFO - 'tart', 10:01:59 INFO - 'tscrollx', 10:01:59 INFO - 'cart']}, 10:01:59 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'talos_options': ['--disable-e10s'], 10:01:59 INFO - 'tests': ['tp5o']}, 10:01:59 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'tests': ['tp5o']}, 10:01:59 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'talos_options': ['--disable-e10s', 10:01:59 INFO - '--xperf_path', 10:01:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:01:59 INFO - 'tests': ['tp5n']}, 10:01:59 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:59 INFO - 'talos_options': ['--xperf_path', 10:01:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:01:59 INFO - 'tests': ['tp5n']}}, 10:01:59 INFO - 'talos.zip': {'path': '', 10:01:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:01:59 INFO - Running post-action listener: _resource_record_post_action 10:01:59 INFO - ##### 10:01:59 INFO - ##### Finished populate-webroot step (success) 10:01:59 INFO - ##### 10:01:59 INFO - ##### 10:01:59 INFO - ##### Running create-virtualenv step. 10:01:59 INFO - ##### 10:01:59 INFO - Running pre-action listener: _resource_record_pre_action 10:01:59 INFO - Running main action method: create_virtualenv 10:01:59 INFO - Creating virtualenv /builds/slave/test/build/venv 10:01:59 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 10:01:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:01:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:01:59 INFO - Using real prefix '/usr' 10:01:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:01:59 INFO - Installing distribute.............................................................................................................................................................................................done. 10:02:01 INFO - Installing pip.................done. 10:02:01 INFO - Return code: 0 10:02:01 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:02:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:01 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:01 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 10:02:01 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 10:02:01 INFO - Using env: {'DISPLAY': ':0', 10:02:01 INFO - 'HOME': '/home/cltbld', 10:02:01 INFO - 'LANG': 'en_US.UTF-8', 10:02:01 INFO - 'LANGUAGE': 'en_US:en', 10:02:01 INFO - 'LOGNAME': 'cltbld', 10:02:01 INFO - 'MAIL': '/var/mail/cltbld', 10:02:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:01 INFO - 'MOZ_NO_REMOTE': '1', 10:02:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:01 INFO - 'NO_EM_RESTART': '1', 10:02:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:01 INFO - 'PWD': '/builds/slave/test', 10:02:01 INFO - 'SHELL': '/bin/bash', 10:02:01 INFO - 'SHLVL': '1', 10:02:01 INFO - 'TERM': 'linux', 10:02:01 INFO - 'TMOUT': '86400', 10:02:01 INFO - 'USER': 'cltbld', 10:02:01 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:01 INFO - '_': '/tools/buildbot/bin/python'} 10:02:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:02 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 10:02:02 INFO - Cleaning up... 10:02:02 INFO - Return code: 0 10:02:02 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:02:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 10:02:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 10:02:02 INFO - Using env: {'DISPLAY': ':0', 10:02:02 INFO - 'HOME': '/home/cltbld', 10:02:02 INFO - 'LANG': 'en_US.UTF-8', 10:02:02 INFO - 'LANGUAGE': 'en_US:en', 10:02:02 INFO - 'LOGNAME': 'cltbld', 10:02:02 INFO - 'MAIL': '/var/mail/cltbld', 10:02:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:02 INFO - 'MOZ_NO_REMOTE': '1', 10:02:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:02 INFO - 'NO_EM_RESTART': '1', 10:02:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:02 INFO - 'PWD': '/builds/slave/test', 10:02:02 INFO - 'SHELL': '/bin/bash', 10:02:02 INFO - 'SHLVL': '1', 10:02:02 INFO - 'TERM': 'linux', 10:02:02 INFO - 'TMOUT': '86400', 10:02:02 INFO - 'USER': 'cltbld', 10:02:02 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:02 INFO - '_': '/tools/buildbot/bin/python'} 10:02:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:02 INFO - Downloading/unpacking psutil>=3.1.1 10:02:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:02:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:02:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:02:04 INFO - Installing collected packages: psutil 10:02:04 INFO - Running setup.py install for psutil 10:02:04 INFO - building 'psutil._psutil_linux' extension 10:02:04 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 10:02:04 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 10:02:04 INFO - building 'psutil._psutil_posix' extension 10:02:04 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 10:02:04 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 10:02:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:02:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:02:04 INFO - Successfully installed psutil 10:02:04 INFO - Cleaning up... 10:02:04 INFO - Return code: 0 10:02:04 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:02:04 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')]} 10:02:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:04 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')]} 10:02:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:04 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:04 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 10:02:04 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 10:02:04 INFO - Using env: {'DISPLAY': ':0', 10:02:04 INFO - 'HOME': '/home/cltbld', 10:02:04 INFO - 'LANG': 'en_US.UTF-8', 10:02:04 INFO - 'LANGUAGE': 'en_US:en', 10:02:04 INFO - 'LOGNAME': 'cltbld', 10:02:04 INFO - 'MAIL': '/var/mail/cltbld', 10:02:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:04 INFO - 'MOZ_NO_REMOTE': '1', 10:02:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:04 INFO - 'NO_EM_RESTART': '1', 10:02:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:04 INFO - 'PWD': '/builds/slave/test', 10:02:04 INFO - 'SHELL': '/bin/bash', 10:02:04 INFO - 'SHLVL': '1', 10:02:04 INFO - 'TERM': 'linux', 10:02:04 INFO - 'TMOUT': '86400', 10:02:04 INFO - 'USER': 'cltbld', 10:02:04 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:04 INFO - '_': '/tools/buildbot/bin/python'} 10:02:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:05 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:02:05 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 10:02:05 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 10:02:05 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 10:02:05 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 10:02:05 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 10:02:05 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 10:02:06 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:02:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:02:06 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:02:06 INFO - Installing collected packages: mozsystemmonitor 10:02:06 INFO - Running setup.py install for mozsystemmonitor 10:02:07 INFO - Successfully installed mozsystemmonitor 10:02:07 INFO - Cleaning up... 10:02:07 INFO - Return code: 0 10:02:07 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:02: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')]} 10:02:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02: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')]} 10:02:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:07 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:07 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 10:02:07 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 10:02:07 INFO - Using env: {'DISPLAY': ':0', 10:02:07 INFO - 'HOME': '/home/cltbld', 10:02:07 INFO - 'LANG': 'en_US.UTF-8', 10:02:07 INFO - 'LANGUAGE': 'en_US:en', 10:02:07 INFO - 'LOGNAME': 'cltbld', 10:02:07 INFO - 'MAIL': '/var/mail/cltbld', 10:02:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:07 INFO - 'MOZ_NO_REMOTE': '1', 10:02:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:07 INFO - 'NO_EM_RESTART': '1', 10:02:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:07 INFO - 'PWD': '/builds/slave/test', 10:02:07 INFO - 'SHELL': '/bin/bash', 10:02:07 INFO - 'SHLVL': '1', 10:02:07 INFO - 'TERM': 'linux', 10:02:07 INFO - 'TMOUT': '86400', 10:02:07 INFO - 'USER': 'cltbld', 10:02:07 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:07 INFO - '_': '/tools/buildbot/bin/python'} 10:02:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:07 INFO - Downloading/unpacking jsonschema==2.5.1 10:02:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:02:09 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:02:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:09 INFO - Downloading functools32-3.2.3-2.tar.gz 10:02:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:02:09 INFO - warning: no files found matching '*.txt' 10:02:09 INFO - no previously-included directories found matching 'build' 10:02:09 INFO - no previously-included directories found matching 'dist' 10:02:09 INFO - no previously-included directories found matching '.git*' 10:02:09 INFO - Installing collected packages: jsonschema, functools32 10:02:09 INFO - Running setup.py install for functools32 10:02:09 INFO - warning: no files found matching '*.txt' 10:02:09 INFO - no previously-included directories found matching 'build' 10:02:09 INFO - no previously-included directories found matching 'dist' 10:02:09 INFO - no previously-included directories found matching '.git*' 10:02:09 INFO - Successfully installed jsonschema functools32 10:02:09 INFO - Cleaning up... 10:02:09 INFO - Return code: 0 10:02:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:02:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:02:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:02:09 INFO - Using env: {'DISPLAY': ':0', 10:02:09 INFO - 'HOME': '/home/cltbld', 10:02:09 INFO - 'LANG': 'en_US.UTF-8', 10:02:09 INFO - 'LANGUAGE': 'en_US:en', 10:02:09 INFO - 'LOGNAME': 'cltbld', 10:02:09 INFO - 'MAIL': '/var/mail/cltbld', 10:02:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:09 INFO - 'MOZ_NO_REMOTE': '1', 10:02:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:09 INFO - 'NO_EM_RESTART': '1', 10:02:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:09 INFO - 'PWD': '/builds/slave/test', 10:02:09 INFO - 'SHELL': '/bin/bash', 10:02:09 INFO - 'SHLVL': '1', 10:02:09 INFO - 'TERM': 'linux', 10:02:09 INFO - 'TMOUT': '86400', 10:02:09 INFO - 'USER': 'cltbld', 10:02:09 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:09 INFO - '_': '/tools/buildbot/bin/python'} 10:02:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:09 INFO - Downloading/unpacking blobuploader==1.2.4 10:02:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:11 INFO - Downloading blobuploader-1.2.4.tar.gz 10:02:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:02:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:02:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:02:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:12 INFO - Downloading docopt-0.6.1.tar.gz 10:02:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:02:12 INFO - Installing collected packages: blobuploader, requests, docopt 10:02:12 INFO - Running setup.py install for blobuploader 10:02:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:02:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:02:12 INFO - Running setup.py install for requests 10:02:13 INFO - Running setup.py install for docopt 10:02:13 INFO - Successfully installed blobuploader requests docopt 10:02:13 INFO - Cleaning up... 10:02:13 INFO - Return code: 0 10:02:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02:13 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')]} 10:02:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:13 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')]} 10:02:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:13 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:13 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 10:02:13 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 10:02:13 INFO - Using env: {'DISPLAY': ':0', 10:02:13 INFO - 'HOME': '/home/cltbld', 10:02:13 INFO - 'LANG': 'en_US.UTF-8', 10:02:13 INFO - 'LANGUAGE': 'en_US:en', 10:02:13 INFO - 'LOGNAME': 'cltbld', 10:02:13 INFO - 'MAIL': '/var/mail/cltbld', 10:02:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:13 INFO - 'MOZ_NO_REMOTE': '1', 10:02:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:13 INFO - 'NO_EM_RESTART': '1', 10:02:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:13 INFO - 'PWD': '/builds/slave/test', 10:02:13 INFO - 'SHELL': '/bin/bash', 10:02:13 INFO - 'SHLVL': '1', 10:02:13 INFO - 'TERM': 'linux', 10:02:13 INFO - 'TMOUT': '86400', 10:02:13 INFO - 'USER': 'cltbld', 10:02:13 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:13 INFO - '_': '/tools/buildbot/bin/python'} 10:02:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:02:13 INFO - Running setup.py (path:/tmp/pip-LIASEm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:02:13 INFO - Running setup.py (path:/tmp/pip-gmM3tE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:02:13 INFO - Running setup.py (path:/tmp/pip-54c9zf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:02:13 INFO - Running setup.py (path:/tmp/pip-qBerFh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:02:13 INFO - Running setup.py (path:/tmp/pip-1p5JBv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:02:13 INFO - Running setup.py (path:/tmp/pip-XOUeeO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:02:13 INFO - Running setup.py (path:/tmp/pip-5KGOjp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:02:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:02:13 INFO - Running setup.py (path:/tmp/pip-4HqHJV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:02:14 INFO - Running setup.py (path:/tmp/pip-8ktf3v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:02:14 INFO - Running setup.py (path:/tmp/pip-oRRCaB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:02:14 INFO - Running setup.py (path:/tmp/pip-GD3lYt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:02:14 INFO - Running setup.py (path:/tmp/pip-HVuSHj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:02:14 INFO - Running setup.py (path:/tmp/pip-eYDhHz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:02:14 INFO - Running setup.py (path:/tmp/pip-zdeotW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:14 INFO - Running setup.py (path:/tmp/pip-Fj3y4F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:02:14 INFO - Running setup.py (path:/tmp/pip-qPdwDq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:02:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:02:14 INFO - Running setup.py (path:/tmp/pip-YG4ZAy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:02:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:02:14 INFO - Running setup.py install for manifestparser 10:02:14 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:02:14 INFO - Running setup.py install for mozcrash 10:02:14 INFO - Running setup.py install for mozdebug 10:02:14 INFO - Running setup.py install for mozdevice 10:02:15 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for mozfile 10:02:15 INFO - Running setup.py install for mozhttpd 10:02:15 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for mozinfo 10:02:15 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for mozInstall 10:02:15 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for mozleak 10:02:15 INFO - Running setup.py install for mozlog 10:02:15 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for moznetwork 10:02:15 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:02:15 INFO - Running setup.py install for mozprocess 10:02:15 INFO - Running setup.py install for mozprofile 10:02:16 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:02:16 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:02:16 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:02:16 INFO - Running setup.py install for mozrunner 10:02:16 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:02:16 INFO - Running setup.py install for mozscreenshot 10:02:16 INFO - Running setup.py install for moztest 10:02:16 INFO - Running setup.py install for mozversion 10:02:16 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:02:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:02:16 INFO - Cleaning up... 10:02:16 INFO - Return code: 0 10:02:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02: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')]} 10:02:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02: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')]} 10:02:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:16 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:16 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 10:02:16 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 10:02:16 INFO - Using env: {'DISPLAY': ':0', 10:02:16 INFO - 'HOME': '/home/cltbld', 10:02:16 INFO - 'LANG': 'en_US.UTF-8', 10:02:16 INFO - 'LANGUAGE': 'en_US:en', 10:02:16 INFO - 'LOGNAME': 'cltbld', 10:02:16 INFO - 'MAIL': '/var/mail/cltbld', 10:02:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:16 INFO - 'MOZ_NO_REMOTE': '1', 10:02:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:16 INFO - 'NO_EM_RESTART': '1', 10:02:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:16 INFO - 'PWD': '/builds/slave/test', 10:02:16 INFO - 'SHELL': '/bin/bash', 10:02:16 INFO - 'SHLVL': '1', 10:02:16 INFO - 'TERM': 'linux', 10:02:16 INFO - 'TMOUT': '86400', 10:02:16 INFO - 'USER': 'cltbld', 10:02:16 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:16 INFO - '_': '/tools/buildbot/bin/python'} 10:02:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:02:16 INFO - Running setup.py (path:/tmp/pip-3f2ESb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:02:16 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)) 10:02:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:02:16 INFO - Running setup.py (path:/tmp/pip-ozCmMq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:02:16 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)) 10:02:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:02:16 INFO - Running setup.py (path:/tmp/pip-Hz80US-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:02:16 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)) 10:02:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:02:16 INFO - Running setup.py (path:/tmp/pip-AAnzIV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:02:17 INFO - Running setup.py (path:/tmp/pip-qJ9HLs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:02:17 INFO - Running setup.py (path:/tmp/pip-mdtVju-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:02:17 INFO - Running setup.py (path:/tmp/pip-vVXOok-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:02:17 INFO - Running setup.py (path:/tmp/pip-1SLYcT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:02:17 INFO - Running setup.py (path:/tmp/pip-upY0oX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:02:17 INFO - Running setup.py (path:/tmp/pip-kkCHXy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:02:17 INFO - Running setup.py (path:/tmp/pip-KMVD7s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:02:17 INFO - Running setup.py (path:/tmp/pip-EuST8g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:02:17 INFO - Running setup.py (path:/tmp/pip-Ka0x0e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:02:17 INFO - Running setup.py (path:/tmp/pip-dRxqxU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:17 INFO - Running setup.py (path:/tmp/pip-UtZ7tm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:02:17 INFO - Running setup.py (path:/tmp/pip-3Dj9cV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:02:17 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)) 10:02:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:02:17 INFO - Running setup.py (path:/tmp/pip-UZqT7P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:02:17 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)) 10:02:17 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)) 10:02:17 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)) 10:02:17 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)) 10:02:17 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)) 10:02:17 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)) 10:02:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:02:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:19 INFO - Downloading blessings-1.6.tar.gz 10:02:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:02:19 INFO - Installing collected packages: blessings 10:02:19 INFO - Running setup.py install for blessings 10:02:20 INFO - Successfully installed blessings 10:02:20 INFO - Cleaning up... 10:02:20 INFO - Return code: 0 10:02:20 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:02:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:02:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:02:20 INFO - Reading from file tmpfile_stdout 10:02:20 INFO - Current package versions: 10:02:20 INFO - argparse == 1.2.1 10:02:20 INFO - blessings == 1.6 10:02:20 INFO - blobuploader == 1.2.4 10:02:20 INFO - docopt == 0.6.1 10:02:20 INFO - functools32 == 3.2.3-2 10:02:20 INFO - jsonschema == 2.5.1 10:02:20 INFO - manifestparser == 1.1 10:02:20 INFO - mozInstall == 1.12 10:02:20 INFO - mozcrash == 0.17 10:02:20 INFO - mozdebug == 0.1 10:02:20 INFO - mozdevice == 0.48 10:02:20 INFO - mozfile == 1.2 10:02:20 INFO - mozhttpd == 0.7 10:02:20 INFO - mozinfo == 0.9 10:02:20 INFO - mozleak == 0.1 10:02:20 INFO - mozlog == 3.2 10:02:20 INFO - moznetwork == 0.27 10:02:20 INFO - mozprocess == 0.22 10:02:20 INFO - mozprofile == 0.28 10:02:20 INFO - mozrunner == 6.11 10:02:20 INFO - mozscreenshot == 0.1 10:02:20 INFO - mozsystemmonitor == 0.3 10:02:20 INFO - moztest == 0.7 10:02:20 INFO - mozversion == 1.4 10:02:20 INFO - psutil == 3.1.1 10:02:20 INFO - requests == 1.2.3 10:02:20 INFO - wsgiref == 0.1.2 10:02:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:20 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 10:02:20 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 10:02:20 INFO - Using env: {'DISPLAY': ':0', 10:02:20 INFO - 'HOME': '/home/cltbld', 10:02:20 INFO - 'LANG': 'en_US.UTF-8', 10:02:20 INFO - 'LANGUAGE': 'en_US:en', 10:02:20 INFO - 'LOGNAME': 'cltbld', 10:02:20 INFO - 'MAIL': '/var/mail/cltbld', 10:02:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:20 INFO - 'MOZ_NO_REMOTE': '1', 10:02:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:20 INFO - 'NO_EM_RESTART': '1', 10:02:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:20 INFO - 'PWD': '/builds/slave/test', 10:02:20 INFO - 'SHELL': '/bin/bash', 10:02:20 INFO - 'SHLVL': '1', 10:02:20 INFO - 'TERM': 'linux', 10:02:20 INFO - 'TMOUT': '86400', 10:02:20 INFO - 'USER': 'cltbld', 10:02:20 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:20 INFO - '_': '/tools/buildbot/bin/python'} 10:02:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 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)) 10:02:20 INFO - Cleaning up... 10:02:20 INFO - Return code: 0 10:02:20 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:20 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 10:02:20 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 10:02:20 INFO - Using env: {'DISPLAY': ':0', 10:02:20 INFO - 'HOME': '/home/cltbld', 10:02:20 INFO - 'LANG': 'en_US.UTF-8', 10:02:20 INFO - 'LANGUAGE': 'en_US:en', 10:02:20 INFO - 'LOGNAME': 'cltbld', 10:02:20 INFO - 'MAIL': '/var/mail/cltbld', 10:02:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:20 INFO - 'MOZ_NO_REMOTE': '1', 10:02:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:20 INFO - 'NO_EM_RESTART': '1', 10:02:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:20 INFO - 'PWD': '/builds/slave/test', 10:02:20 INFO - 'SHELL': '/bin/bash', 10:02:20 INFO - 'SHLVL': '1', 10:02:20 INFO - 'TERM': 'linux', 10:02:20 INFO - 'TMOUT': '86400', 10:02:20 INFO - 'USER': 'cltbld', 10:02:20 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:20 INFO - '_': '/tools/buildbot/bin/python'} 10:02:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:20 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:02:20 INFO - Cleaning up... 10:02:20 INFO - Return code: 0 10:02:20 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:20 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 0x7f12472e8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15d08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x169b350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, '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': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', '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 10:02:20 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 10:02:20 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 10:02:20 INFO - Using env: {'DISPLAY': ':0', 10:02:20 INFO - 'HOME': '/home/cltbld', 10:02:20 INFO - 'LANG': 'en_US.UTF-8', 10:02:20 INFO - 'LANGUAGE': 'en_US:en', 10:02:20 INFO - 'LOGNAME': 'cltbld', 10:02:20 INFO - 'MAIL': '/var/mail/cltbld', 10:02:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:20 INFO - 'MOZ_NO_REMOTE': '1', 10:02:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:20 INFO - 'NO_EM_RESTART': '1', 10:02:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:20 INFO - 'PWD': '/builds/slave/test', 10:02:20 INFO - 'SHELL': '/bin/bash', 10:02:20 INFO - 'SHLVL': '1', 10:02:20 INFO - 'TERM': 'linux', 10:02:20 INFO - 'TMOUT': '86400', 10:02:20 INFO - 'USER': 'cltbld', 10:02:20 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:20 INFO - '_': '/tools/buildbot/bin/python'} 10:02:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:20 INFO - Downloading/unpacking flake8 10:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:22 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:02:22 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:02:22 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 10:02:22 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 10:02:22 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 10:02:22 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 10:02:22 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 10:02:22 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 10:02:23 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:02:23 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:02:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:23 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:02:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:02:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:02:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:02:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:02:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:02:23 INFO - no previously-included directories found matching 'docs/_build' 10:02:23 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:02:23 INFO - Running setup.py install for pep8 10:02:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:02:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:02:23 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:02:23 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:02:23 INFO - no previously-included directories found matching 'docs/_build' 10:02:23 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:02:23 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:02:23 INFO - Cleaning up... 10:02:23 INFO - Return code: 0 10:02:23 INFO - Running post-action listener: _resource_record_post_action 10:02:23 INFO - Running post-action listener: _start_resource_monitoring 10:02:23 INFO - Starting resource monitoring. 10:02:23 INFO - ##### 10:02:23 INFO - ##### Finished create-virtualenv step (success) 10:02:23 INFO - ##### 10:02:23 INFO - ##### 10:02:23 INFO - ##### Running install step. 10:02:23 INFO - ##### 10:02:23 INFO - Running pre-action listener: _resource_record_pre_action 10:02:23 INFO - Running main action method: install 10:02:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:02:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:02:24 INFO - Reading from file tmpfile_stdout 10:02:24 INFO - Detecting whether we're running mozinstall >=1.0... 10:02:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:02:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:02:24 INFO - Reading from file tmpfile_stdout 10:02:24 INFO - Output received: 10:02:24 INFO - Usage: mozinstall [options] installer 10:02:24 INFO - Options: 10:02:24 INFO - -h, --help show this help message and exit 10:02:24 INFO - -d DEST, --destination=DEST 10:02:24 INFO - Directory to install application into. [default: 10:02:24 INFO - "/builds/slave/test"] 10:02:24 INFO - --app=APP Application being installed. [default: firefox] 10:02:24 INFO - mkdir: /builds/slave/test/build/application 10:02:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:02:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:02:41 INFO - Reading from file tmpfile_stdout 10:02:41 INFO - Output received: 10:02:41 INFO - /builds/slave/test/build/application/firefox/firefox 10:02:41 INFO - Running post-action listener: _resource_record_post_action 10:02:41 INFO - ##### 10:02:41 INFO - ##### Finished install step (success) 10:02:41 INFO - ##### 10:02:41 INFO - ##### 10:02:41 INFO - ##### Running run-tests step. 10:02:41 INFO - ##### 10:02:41 INFO - Running pre-action listener: _resource_record_pre_action 10:02:41 INFO - Running main action method: run_tests 10:02:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:02:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:02:41 INFO - Python 2.7.3 10:02:41 INFO - Return code: 0 10:02:41 INFO - grabbing minidump binary from tooltool 10:02:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:02:41 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 0x172a1c0>, '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 0x172b0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x172b550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:02:41 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 10:02:41 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 10:02:41 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 10:02:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:02:41 INFO - Return code: 0 10:02:41 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:02:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:02:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:02:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:02:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:02:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:02:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:02:42 INFO - Return code: 0 10:02:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--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 10:02:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-001 --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 10:02:42 INFO - Using env: {'DISPLAY': ':0', 10:02:42 INFO - 'HOME': '/home/cltbld', 10:02:42 INFO - 'LANG': 'en_US.UTF-8', 10:02:42 INFO - 'LANGUAGE': 'en_US:en', 10:02:42 INFO - 'LOGNAME': 'cltbld', 10:02:42 INFO - 'MAIL': '/var/mail/cltbld', 10:02:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:02:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:02:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:42 INFO - 'MOZ_NO_REMOTE': '1', 10:02:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:02:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:42 INFO - 'NO_EM_RESTART': '1', 10:02:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:42 INFO - 'PWD': '/builds/slave/test', 10:02:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:02:42 INFO - 'SHELL': '/bin/bash', 10:02:42 INFO - 'SHLVL': '1', 10:02:42 INFO - 'TERM': 'linux', 10:02:42 INFO - 'TMOUT': '86400', 10:02:42 INFO - 'USER': 'cltbld', 10:02:42 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876', 10:02:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:42 INFO - '_': '/tools/buildbot/bin/python'} 10:02:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--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 10:02:42 INFO - mozversion application_buildid: 20160606073136 10:02:42 INFO - mozversion application_changeset: 581cba07c3793b9788f8e041481e99874f05fa01 10:02:42 INFO - mozversion application_display_name: Nightly 10:02:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:02:42 INFO - mozversion application_name: Firefox 10:02:42 INFO - mozversion application_remotingname: firefox 10:02:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:02:42 INFO - mozversion application_vendor: Mozilla 10:02:42 INFO - mozversion application_version: 49.0a1 10:02:42 INFO - mozversion platform_buildid: 20160606073136 10:02:42 INFO - mozversion platform_changeset: 581cba07c3793b9788f8e041481e99874f05fa01 10:02:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:02:42 INFO - mozversion platform_version: 49.0a1 10:02:42 INFO - using testdate: 1465232562 10:02:42 INFO - actual date: 1465232562 10:02:42 INFO - starting webserver on 'localhost:45146' 10:02:42 INFO - SUITE-START | Running 2 tests 10:02:42 INFO - TEST-START | dromaeo_css 10:02:42 INFO - operating with platform_type : linux_ 10:02:42 INFO - Initialising browser for dromaeo_css test... 10:02:42 INFO - TEST-INFO | started process 5596 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJpgGfC/profile http://localhost:45146/getInfo.html) 10:02:47 INFO - PROCESS | 5596 | __metrics Screen width/height:1600/1200 10:02:47 INFO - PROCESS | 5596 | colorDepth:24 10:02:47 INFO - PROCESS | 5596 | Browser inner width/height: 1024/697 10:02:47 INFO - PROCESS | 5596 | __metrics 10:02:47 ERROR - PROCESS | 5596 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 10:02:48 INFO - TEST-INFO | 5596: exit 0 10:02:48 INFO - Browser initialized. 10:02:48 INFO - Running cycle 1/1 for dromaeo_css test... 10:02:48 INFO - TEST-INFO | started process 5712 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJpgGfC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:03:00 INFO - PROCESS | 5712 | RSS: Main: 167313408 10:03:00 INFO - PROCESS | 5712 | 10:03:49 INFO - PROCESS | 5712 | 1465232629946 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] 10:05:57 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45146/tests/dromaeo/cssquery-ext.html) 10:05:58 INFO - PROCESS | 5712 | RSS: Main: 170749952 10:05:58 INFO - PROCESS | 5712 | 10:09:00 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-ext.html (next: http://localhost:45146/tests/dromaeo/cssquery-jquery.html) 10:09:01 INFO - PROCESS | 5712 | RSS: Main: 170119168 10:09:01 INFO - PROCESS | 5712 | 10:12:03 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45146/tests/dromaeo/cssquery-mootools.html) 10:12:03 INFO - PROCESS | 5712 | RSS: Main: 171507712 10:12:03 INFO - PROCESS | 5712 | 10:15:05 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45146/tests/dromaeo/cssquery-prototype.html) 10:15:06 INFO - PROCESS | 5712 | RSS: Main: 168927232 10:15:06 INFO - PROCESS | 5712 | 10:18:08 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45146/tests/dromaeo/cssquery-yui.html) 10:18:09 INFO - PROCESS | 5712 | RSS: Main: 170823680 10:18:09 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | Cycle 1(1): loaded http://localhost:45146/tests/dromaeo/cssquery-yui.html (next: http://localhost:45146/tests/dromaeo/cssquery-dojo.html) 10:21:11 INFO - PROCESS | 5712 | RSS: Main: 172126208 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | __start_tp_report 10:21:11 INFO - PROCESS | 5712 | _x_x_mozilla_page_load 10:21:11 INFO - PROCESS | 5712 | _x_x_mozilla_page_load_details 10:21:11 INFO - PROCESS | 5712 | |i|pagename|runs| 10:21:11 INFO - PROCESS | 5712 | |0;dojo.html;3155.4477966355885;3203.407369636619;3208.4866421372585;3214.132184310238;3218.388506183825;5337.759800808968;5355.277037599923;5400;5520;5564.221009058725;5204.167333226685;5402.297701298836;5469.480399362054;5489.176623506476;5523.088690366085;4899.706017638944;4916.385451818523;4954.083494553519;5054.090263752523;5102.464241254671;4903.705777653335;5117.385913690362;5145.202493613478;5158.742062896859;5159.690418574879;4932.827351042714;4943.604511639061;4964.826231081913;4984.975075124637;5003.249512573107;5062.468440813698;5064.088464076464;5072.746362681851;5080.517350851663;5153.381594208681;5053.36832895888;5053.873653158664;5062.620303477217;5070.442251352349;5077.136886729265;5350.411454740014;5355.544778693816;5368.275282836806;5412.539934105605;5426.077566813612;5895.233619629464;5901.232839730807;5903.881922361572;5905.940940590625;5915.556333274979;5676.035074037423;5783.942160578383;5911.408859114097;5942.10868369748;5955.940440595582;5440.591955603346;5475.123980163195;5493.340799104093;5497.780088796443;5516.91724624127;5946;5949.613275137189;5955.225820643289;5958.851028724316;5996.940030599638;5452.154915988028;5655.3779084300695;5698.116791897262;5715.457031581993;5754.0505816540635;5794.88410231793;5834.416558344132;5836.182934389189;5850.444207800252;5905.911411328833;5613.607047506635;5708.457696518907;5827.970860145672;5828.184054232411;5832.300123985149;5756.366799652035;5765.711714414262;5803.82588522345;5818.650880947157;5863.618864773776;4400.75795831226;4448.977755111204;4452.354408610733;4456.331550267421;4486.910261794746;3883.0486530800135;3909.198614284065;3961.088949541564;3973.0861901762755;4028.0332720146953;5526.226328314039;5528.668279903139;5544.69504177266;5547.667139971614;5592.133219351007;5879.764809407661;5906.704664766745;5912.438318359749;5913.674747888907;5915.112733090071;5288.497592728685;5459.972700136474;5484.862878428071;5516;5520.723963801875;4888.291197776302;4902.607791376681;4943.382077240345;4957.355543779286;4972.428170760337;6073.726682299307;6083.11794789753;6103.511719062464;6114.296855861633;6120.234970628671;5609.831705048855;5763.538916886723;5828.184054232326;5833.066709326487;5897.233359663216;6044.184035155197;6056.394360564084;6064.545159113172;6088.238970128734;6096.268447786294;5656.971715141398;5779.450952159538;5781.132830075522;5800.593958423039;5807.506361959281;5795.884082318245;5813.6221145625395;5874.412558744091;5882.5293976480925;5958;5752.309722833287;5765.8558536036935;5766.394528574439;5773.393793651606;5775.27809023872;5393.568514518907;5587.217789509553;5734.283214598176;5744.511716504144;5758.71206439668;5298.470152984825;5398.973005134949;5411.621186516906;5456.09974354243;5578.470045345685;5602.075657516464;5611.691356975405;5646.943530564806;5669.149627555899;5672.319321681424;5421.891562168656;5527.613067085265;5532.1425179097305;5542.307211598551;5553.111502159635 10:21:11 INFO - PROCESS | 5712 | |1;ext.html;592.2744637818672;630.4987534909747;644.4522156167255;646.1728986896771;652.139176287301;43260.3510947336;44193.7790311048;44449.7777511112;44719.329210061835;46990;44713.776431117796;45152.774236128775;45517.31724024142;45520.317195242096;45795.542044579546;8729.7817554561;8857.645694172226;8868.955655221715;8885.777855553599;8943.418677785923;8753.693620723276;8855.070217627153;8855.203031727144;8857.645694172226;8863.157999989991;8835.690750823722;8901.06538813425;8946.64213431462;8962.327825413087;8972.775680607972;8858.645654173826;8871.068537803534;8874.733757987271;8899.377043606917;8926.955365223164;8789.165029322205;8801.867971980426;8823.294136469067;8857.070007649232;8869.46783193004;40566;41441.1711765763;41442.79278603618;41454.37818432726;41510.584894150976;3390.7965522068753;3520.9119772005647;3549.8757543486113;3574.267275208576;4169.4162817205615;32619;32842.6715732842;32882.34235315304;32930;34378.656213438044;3976.7613943163215;3983.40248962655;4016.879493615196;4118.629323360912;4174.144300418407;329594;330274;333770;333902;335603;33789.83105084459;34712;34824.82587587096;56702;57160;36149.27701446009;36167.638323616426;36238.63761362405;36305.63694363075;36369.81815090908;15107.848921510644;15258.542243732705;15261.465848695243;15267.236638168048;15280.847191528164;12758;12877.420516076612;12895.613131606067;12919.289439080942;12946.029047821452;8190.180981901762;8203.75388738327;8205.917940820635;8242.17578242171;8259.752207433787;3187.5218717192142;3211.935761284808;3230.6769323067974;3261.3803377358226;3271.7382609391666;1065;1082.5994382078525;1100.1528822806395;1138.5445821671399;1164.3770582738193;32217;32453.675463245065;32579.02262932116;32916.67083329184;35974.28051438957;1080.3247970018738;1182.8876256755595;1190.0360707826687;1196.4316949448942;1205.873383294759;16480.34078636865;16562.50312490627;16643.3342666292;16849.157542122844;17103.82896171047;525208;525707;526165;528842;532977;56300.43699563034;56494.152587711214;56681.380317034906;56742.43257567454;56905.43094569084;1380.0753495158267;1387.6947071644424;1389.1248513436672;1392.6031081142028;1402.1587047771256;30660.693393065783;30890;31587;31769.682303176673;31835.840820795747;49160.2625960618;55672.16491752708;57282.71358643347;57435.42564574468;60245.698771505864;371492;371842;376890;377239;378184;44546;44946.3258051123;45380.77309613431;45785;46160.53839461562;48115.75942120267;48464.7576762128;48903.510964889894;49209.507904920494;49280.507194927595;41090.79454602708;42152.36771448369;42513;43101.35347969846;43355.566444335156;41483.58516414918;41850.1629967405;42091.15817683691;42243.15513689647;42662.36006459968;38438;38870.22259554736;39576.40635390414;41648.58351416447;41776;35632.46551301784;36485.635143649284;36682.8165859169;37277.440838387985;37897.81051094727;28348.43303133967;29005.854970725857;29168.41663166767;29301.26746831261;29432.705672942997 10:21:11 INFO - PROCESS | 5712 | |2;jquery.html;387.6453045463401;391.65925644689145;397.2075708960624;403.4734671254014;416.18427881352545;14166;18259.178336974834;19633.803661963375;19657.410277691673;19800;17980.73028904564;18075.638487230248;18368.908155459238;19437.902810485928;19464.12411441485;5434.130539113743;5694.800681976131;5709.885802283952;5808.157817116516;5854.414558544154;5737.3688894221605;5763.942360576403;5798.391168927265;5802.042662960606;5814.912776308359;5631.1271752878365;5681.119426488901;5757.596968212227;5762.308522977228;5775.797847075353;5715.342735585398;5717.71411429431;5737.082066869322;5747.080467125261;5752.626079304852;4937.925931111036;5188.066148093341;5203.245529398254;5208.739563021833;5212.687238765686;22034.33896983093;22222.222222222146;22549.21077762287;22918;22924.54150916989;2318.1538738360546;2417.084323396092;2433.245693834899;2756.9035083772173;2957.4824405729128;14490.20303883286;14617;14651.780223296659;14788.926055369655;15263.847361526354;1884.1897983866932;1946.6690662587393;1986.860919735619;2059.073416962373;2089.9059542320633;76367.61816190938;78454.607726961;79162.20837791606;79611.60194198992;80247.19752802455;10344.844827327595;10345.793084138275;10771;10922.617708380169;10931.617393391192;14677.706445871023;14799.704005920037;14800;14822.332995015251;14830.62923426923;7540.17058123606;7673.501222420637;7722.575258360732;7844.725434609875;7850.214978502104;7360.889586656204;7456.142543607554;7485.363744081705;7524.510906791041;7565.092188937363;6450.4839612830865;6619.569727967667;6675.866482670416;6683.43190828785;6758.898616520756;1879.1074239736015;1943.7084437334513;1953.4823271832975;1959.4513536209884;1986.4338663481128;988.3032462114193;1002.0830939690102;1083.469100140941;1084.7559299157626;1145.5623192893033;19165.233390664496;19526.90236548808;19730;20034.499137521387;20187.495312617302;1037.3361048928691;1056.804491169136;1087.9891201088046;1126.1610100475198;1149;10724.356538607708;11074;11375;11412.771744565229;11436.885631143748;521572;522138;525678;532566;534690;91550;92279.53860230657;93910;93924;95756;1079.8272276435732;1145.381493993251;1146.7993101207255;1170.62539987205;1170.987096161831;17733.733993990358;17747.201375937857;17844;17892.642147156723;18199;41261.79369103135;41763.373549397395;41839;43060.569394305654;43172.920676983325;58115;59349;59696.40303596909;60312.396876032435;60371.09443358265;7581.583012934341;7884.802879928047;7994.080680721559;8610;8912.598933047899;9328.045076726148;12945.870541294467;13047.347632618521;13050.934745326593;13099.607011789662;11188.720281993015;11343.376114313462;11438.370889601152;11457.940212533254;11654.242474239147;10971.067459266053;11037.889621103686;11130.554777808797;11262.211645184758;11343.319400835977;10505.422201778976;10754.193435492212;10774.46127693628;11002.119830413387;11159.553617855196;7974.84050319002;8007.83984320322;8089.87865182011;8108.878366824384;8119.188081191834;9191.67879802651;10408.791824163625;10432.791344173225;10451.320664156805;10462.529186186792 10:21:11 INFO - PROCESS | 5712 | |3;mootools.html;1452.7385070687278;1506.532974777819;1581.4939219449773;1695.1439523040863;1714.4685147604237;7630.389568834494;8028.558429286394;8630.827383452335;8638.956805215974;8683.522406267668;8747.256483198937;9021.233195178402;9073.455592664428;9079.909200907989;9093.454392736441;2370.679958205642;2413.3845869303304;2420.4674971506242;2426.3570153909227;2430.744771798962;2345.2612427085414;2379.607364784817;2410.867402292873;2411.8191135664806;2420.225527831095;2383.392234980078;2387.6776635154292;2395.2694428199393;2406.0496104038893;2418.1899063813557;2274.931752047441;2279.350385140227;2290.3358026172555;2304.124432715566;2354.2466410748566;2326.430024643956;2337.5558643857785;2338.871362075085;2342.8945697443655;2346.753590872968;8932.062133476022;8964.238039766627;8992.640294388217;8993.28053755698;8996.460212387277;5349.170878513836;5526.364468086182;5533.889322213533;5534.418886016951;5545.473180047889;3559.7330200235087;3580.1765593913547;3638.745287829853;3644.708423326154;3697.186618943828;1127.3236058364998;1143.8055530559825;1187.1749134351628;1227.858796238426;1237.2638280223252;12525.624231272985;12536.937315313457;12558.497660093586;12568.497260109676;12660.936695316557;4552.9772351138035;4581.5647513486165;4646.4888862225125;4665.953340466552;4690.179218636793;10560.735981600521;10598.682039538826;10613.416262105504;10616.256862019585;10618.946905265424;5316.93661267748;5357.35711714589;5381.246625472437;5401.648892821954;5405.7567409466665;4356.847510337187;4895.4370247422;4976.8755781105765;5044.066847633127;5049.924251136236;4060.553339132693;4074.5517993020744;4105.6326554794005;4128.318827393447;4159.667226621863;1306.6210798868221;1333.8466076401337;1339.4642143142821;1346.6767975685764;1346.838379394479;886.096181894464;970.5972021611094;979.8383266761048;987.195435719886;988.8467287570438;5899.67551784656;5937.673427961504;6020.277566691937;6088.756449742049;6172.158167146523;454.03517525258826;455.1375144101908;468.5197672385832;469.73694730950774;470.78108679464214;4126.216018956388;4138.358554424069;4152.231837110145;4177.6866734995;4194.412782210493;10520.105791007696;10894.782104357868;10975.176861735401;10996.450177491093;10998.560057597606;10725.731856703645;10752.946235268773;10826.945865270623;10829.29609575375;10848.349099054081;8056.113827478973;8162.918370816335;8246;8247.298979586682;8275.08974012858;5861.531077513703;5942.465178133989;5948.643081414956;5998.370171132143;6010.849728756816;9946.651867184613;10097.495125243855;10206.13247873939;10254.077133058061;10263.589456421958;10081.596736130767;10156.44139572301;10184;10311.22665800053;10341.74145646365;7650.6174691264105;7700.653470593725;8091.474054186459;8160.551169685724;8168.632411541376;8772.561371931506;8779.078196789245;8788.98926623421;8799;8845.955770221108;7625.6949722010495;7736.806579835324;7856.978592782902;7953.085395179628;8165.79585510367;7534.886976695464;7558.962205188939;7667.961660191663;7713.267239612228;7892.4869883457395;7121.9643901780155;7167.390771784457;7201.063861697946;7228.20489746117;7255.347018768125;5181.611379146654;5294.417614062373;5310.654807437504;5313.2561441397465;5329.493698098674;5132.743362831919;5192.688438693691;5211.062008838446;5310.787568497217;5333.7333133343955 10:21:11 INFO - PROCESS | 5712 | |4;prototype.html;326.6231489353527;340.0631260876285;341.35483935362157;344.40761889549964;346.79539071947545;5464.863378415532;5512.173174023898;5638.605297629168;5698.373178950323;5708.429157084294;5528.143137813635;5538.169274608801;5541.667499950006;5559.471850174237;5571.467846342258;4344.304911214206;4344.652427805784;4365.628921541673;4408.382826404306;4430.136123455927;4098.4876890388705;4316.20150272199;4323.524412314643;4405.295152775557;4406.206882761102;4239.59723826236;4245.341971994346;4270.252705776492;4285.592868677486;4295.484541854982;4299.570042995707;4310.4396428464415;4318.870433886988;4318.926915080748;4338.891527711801;3673.3571624965793;3771.679407250387;3783.2055268393397;3785.886423407302;3796.791176485292;5286.6035047371215;5416.160495123262;5441.483059109379;5462.754176062087;5466.316710411199;4936.457724272002;4945.653804233705;4953.900921981576;4956.083124621957;4961.751912404366;5690.630109042899;5800.867531532967;5826.659868230288;5839.182514447981;5858.41415858415;4101.52832424272;4148.23257697324;4148.315527937887;4166.437530933315;4172.937405938914;5905.789313190742;6056.273247210319;6083.847903802396;6092.51259899207;6151.600145990541;4189.685773566995;4205.516365617932;4205.873823785291;4233.618974292329;4243.893902652459;4245.724027938174;4271.5514870938105;4273.910152910988;4277.187334406515;4286.164197981364;4893.902121957541;4919.311296418504;4928.334674818853;4934.6545741798445;4957.132501812169;5700.629459085146;5747.850429914034;5816.360200377955;5879.559033072536;5899.528037756969;1445.6169115184484;1470.8014418053426;1472.9247649215918;1474.1965628732366;1476.350405821435;931.5249222896372;936.3110336081178;950.8716323296405;955.7241083154067;958.1807554540907;5038.420581633086;5045.318881950963;5052.812589041572;5054.545090941833;5141.511556402136;5335.985168379853;5342.412334643186;5379.466851947176;5387.757550910218;5405.459454054641;4990.975045124751;5003.274525193827;5025.3718285214345;5198.246254293106;5607.383187849333;3172.825494597819;3179.491281394966;3222.564953731216;3231.773775835669;3255.202475393544;6161.860055889675;6266.780662676784;6301.149344838388;6340.365963403715;6343.397377249154;6120.969395153084;6180.690965451709;6208.751649934043;6209.223847019122;6213.502919766408;6217.6891155442045;6232.470240029557;6290.207290922065;6305.022721478178;6316.968415157987;5768.990426675399;5977.462028417463;6009.699515024318;6025.668588227514;6092.634441933498;5915.70421478933;5929.814037192493;5938.317093534299;5952.464278214981;6003.729832157476;6050.58142149684;6182.938170618237;6220.688965551795;6275.152854364603;6292.4966002720585;4188.308929026798;4194.727342722836;4204.07510347723;4226.281532139606;4265.850695225652;5883.85239387629;5972.522198224218;6059.33347331802;6062.818115456544;6122.530592657819;5917.230760001173;5946.108083787466;5950.34546199909;5956.868195042928;5962.5987892846015;5882.176495290577;5904.763809447574;5923.526117910643;5928.318243401892;5945.227120474311;5581;5734.34055083654;5742.598018138858;5744.195812586325;5745.569082318926;5927.733252003756;5974.910376344272;5976.940230597638;5984.58107932458;5995.160677505066;5691.857703557444;5775.422457754191;5815.709214539341;5835.9708201458725;5851.61964472308 10:21:11 INFO - PROCESS | 5712 | |5;yui.html;729.7263526177687;791.55672823219;807.0033508616857;823.8105235795769;843.4981186194212;14994.40022399104;15177.772333415007;15400;15879.761803572927;16736.748948765748;15459.768103478456;15523.146226957513;15564.37742490299;15665.765013524806;15745.60635984101;794.9085855126676;833.5082301442147;835.8829763833038;837.0457678246803;844.932405407569;822.6585966823761;828.7016673997356;831.9558953513332;831.9875201871977;833.5207255827893;875.7066382761751;877.3376101043704;879.4415546128223;881.6870011146048;882.6469412235093;861.8534849075672;866.7139843851545;868.6699054359366;869.7390782765145;873.9861760357986;634.8000379880369;637.4263163153199;640.3020707428925;640.6412409050946;642.6947200079925;15859.127747973856;15895.364185432569;15940.840591594051;15943.20283985796;15950.361985520565;14889.553313400507;14909.105453672815;14912.17983010934;14947.701045979129;14964.476243331432;12320.938395307967;12502.687432814162;12659.240445573296;12843.48626054966;12893.419796109198;3909.7849618270984;3910.7458015228917;3934.252492026506;4005.639492445694;4021.97989010056;76516.02645828003;76585;76696;77219;78486.6075669618;10962.232643714864;11503.044482438007;11519.769604607862;11685.357305348287;11694.122940779476;21210.36368908935;21272.680909786366;21479.78520214809;21521.89239053826;21530;8147.144549822302;8198.344132469389;8498.66005359791;8592.097829727914;8621.2671922886;4853.0779151961015;4871.805127794849;4953.578945789576;4975.975120124376;5032.496750325012;3503.5270238517983;3597.5143355647174;3628.2743451309316;3650.6896913762625;3663.084228942764;627.1063734178776;647.4917190005823;664.4020381656547;667.9833004174934;711.5161690050816;665.3346653346654;716.688240615334;762.9427792915553;773.1109224391881;795.1094773853206;10475.423851688078;10554.788904222027;10696.679099627023;10728.570857165625;10941.343519388703;696.885013972699;788.1015642167933;791.5013541468953;793.9325157361689;841.995790021046;4940.629452791055;4996.7001979881325;5011.4236862761245;5025.949740502549;5044.268581055726;124293.37853310676;129718;131106;131166.34416827853;133128;70367.64816175989;79554.6022269885;110785;111861;112514;96301;98140;98413.55552555626;99495;102492;9086.22767064807;9580.520973951136;9966.950165249127;10026.749331266778;10222;47221;50614.49385506098;50699;51096.23355649743;51117.23324150066;75595;75860.62069689616;76560;77855;80546.59726701329;12151.939240303742;12168.330741809286;12250.938745306217;12483.875161248634;12600.55898043564;13285.402156903156;13661.521846735317;13940.442382305;13959.511417100353;13965.371558280105;12276.877231227574;12491.687707807378;12812.935935320264;13106.541271055466;13125;12668.683282918;12845.550405735754;12904.612861614167;12922.353882306035;13055.412506437424;12167.81748273759;12240.938795305967;12244.693882653006;12562.375373260069;13159.868401316247;10104.090631842875;10245.948770256102;10603.649929923979;10656;10777.568897244337;10397;10595.682129536126;10707.732306692395;10771.569137234423;10793.892061079603 10:21:11 INFO - PROCESS | 5712 | __end_tp_report 10:21:11 INFO - PROCESS | 5712 | __start_cc_report 10:21:11 INFO - PROCESS | 5712 | _x_x_mozilla_cycle_collect,348 10:21:11 INFO - PROCESS | 5712 | __end_cc_report 10:21:11 INFO - PROCESS | 5712 | __startTimestamp1465233671774__endTimestamp 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | ------- Summary: start ------- 10:21:11 INFO - PROCESS | 5712 | Number of tests: 6 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#0] dojo.html Cycles:165 Average:5415.81 Median:5547.67 stddev:609.24 (11.0%) stddev-sans-first:584.73 10:21:11 INFO - PROCESS | 5712 | Values: 3155.4 3203.4 3208.5 3214.1 3218.4 5337.8 5355.3 5400.0 5520.0 5564.2 5204.2 5402.3 5469.5 5489.2 5523.1 4899.7 4916.4 4954.1 5054.1 5102.5 4903.7 5117.4 5145.2 5158.7 5159.7 4932.8 4943.6 4964.8 4985.0 5003.2 5062.5 5064.1 5072.7 5080.5 5153.4 5053.4 5053.9 5062.6 5070.4 5077.1 5350.4 5355.5 5368.3 5412.5 5426.1 5895.2 5901.2 5903.9 5905.9 5915.6 5676.0 5783.9 5911.4 5942.1 5955.9 5440.6 5475.1 5493.3 5497.8 5516.9 5946.0 5949.6 5955.2 5958.9 5996.9 5452.2 5655.4 5698.1 5715.5 5754.1 5794.9 5834.4 5836.2 5850.4 5905.9 5613.6 5708.5 5828.0 5828.2 5832.3 5756.4 5765.7 5803.8 5818.7 5863.6 4400.8 4449.0 4452.4 4456.3 4486.9 3883.0 3909.2 3961.1 3973.1 4028.0 5526.2 5528.7 5544.7 5547.7 5592.1 5879.8 5906.7 5912.4 5913.7 5915.1 5288.5 5460.0 5484.9 5516.0 5520.7 4888.3 4902.6 4943.4 4957.4 4972.4 6073.7 6083.1 6103.5 6114.3 6120.2 5609.8 5763.5 5828.2 5833.1 5897.2 6044.2 6056.4 6064.5 6088.2 6096.3 5657.0 5779.5 5781.1 5800.6 5807.5 5795.9 5813.6 5874.4 5882.5 5958.0 5752.3 5765.9 5766.4 5773.4 5775.3 5393.6 5587.2 5734.3 5744.5 5758.7 5298.5 5399.0 5411.6 5456.1 5578.5 5602.1 5611.7 5646.9 5669.1 5672.3 5421.9 5527.6 5532.1 5542.3 5553.1 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#1] ext.html Cycles:180 Average:57057.26 Median:22779.90 stddev:111410.58 (489.1%) stddev-sans-first:111642.46 10:21:11 INFO - PROCESS | 5712 | Values: 592.3 630.5 644.5 646.2 652.1 43260.4 44193.8 44449.8 44719.3 46990.0 44713.8 45152.8 45517.3 45520.3 45795.5 8729.8 8857.6 8869.0 8885.8 8943.4 8753.7 8855.1 8855.2 8857.6 8863.2 8835.7 8901.1 8946.6 8962.3 8972.8 8858.6 8871.1 8874.7 8899.4 8927.0 8789.2 8801.9 8823.3 8857.1 8869.5 40566.0 41441.2 41442.8 41454.4 41510.6 3390.8 3520.9 3549.9 3574.3 4169.4 32619.0 32842.7 32882.3 32930.0 34378.7 3976.8 3983.4 4016.9 4118.6 4174.1 329594.0 330274.0 333770.0 333902.0 335603.0 33789.8 34712.0 34824.8 56702.0 57160.0 36149.3 36167.6 36238.6 36305.6 36369.8 15107.8 15258.5 15261.5 15267.2 15280.8 12758.0 12877.4 12895.6 12919.3 12946.0 8190.2 8203.8 8205.9 8242.2 8259.8 3187.5 3211.9 3230.7 3261.4 3271.7 1065.0 1082.6 1100.2 1138.5 1164.4 32217.0 32453.7 32579.0 32916.7 35974.3 1080.3 1182.9 1190.0 1196.4 1205.9 16480.3 16562.5 16643.3 16849.2 17103.8 525208.0 525707.0 526165.0 528842.0 532977.0 56300.4 56494.2 56681.4 56742.4 56905.4 1380.1 1387.7 1389.1 1392.6 1402.2 30660.7 30890.0 31587.0 31769.7 31835.8 49160.3 55672.2 57282.7 57435.4 60245.7 371492.0 371842.0 376890.0 377239.0 378184.0 44546.0 44946.3 45380.8 45785.0 46160.5 48115.8 48464.8 48903.5 49209.5 49280.5 41090.8 42152.4 42513.0 43101.4 43355.6 41483.6 41850.2 42091.2 42243.2 42662.4 38438.0 38870.2 39576.4 41648.6 41776.0 35632.5 36485.6 36682.8 37277.4 37897.8 28348.4 29005.9 29168.4 29301.3 29432.7 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#2] jquery.html Cycles:180 Average:30060.61 Median:22921.27 stddev:86768.95 (378.6%) stddev-sans-first:86983.75 10:21:11 INFO - PROCESS | 5712 | Values: 387.6 391.7 397.2 403.5 416.2 14166.0 18259.2 19633.8 19657.4 19800.0 17980.7 18075.6 18368.9 19437.9 19464.1 5434.1 5694.8 5709.9 5808.2 5854.4 5737.4 5763.9 5798.4 5802.0 5814.9 5631.1 5681.1 5757.6 5762.3 5775.8 5715.3 5717.7 5737.1 5747.1 5752.6 4937.9 5188.1 5203.2 5208.7 5212.7 22034.3 22222.2 22549.2 22918.0 22924.5 2318.2 2417.1 2433.2 2756.9 2957.5 14490.2 14617.0 14651.8 14788.9 15263.8 1884.2 1946.7 1986.9 2059.1 2089.9 76367.6 78454.6 79162.2 79611.6 80247.2 10344.8 10345.8 10771.0 10922.6 10931.6 14677.7 14799.7 14800.0 14822.3 14830.6 7540.2 7673.5 7722.6 7844.7 7850.2 7360.9 7456.1 7485.4 7524.5 7565.1 6450.5 6619.6 6675.9 6683.4 6758.9 1879.1 1943.7 1953.5 1959.5 1986.4 988.3 1002.1 1083.5 1084.8 1145.6 19165.2 19526.9 19730.0 20034.5 20187.5 1037.3 1056.8 1088.0 1126.2 1149.0 10724.4 11074.0 11375.0 11412.8 11436.9 521572.0 522138.0 525678.0 532566.0 534690.0 91550.0 92279.5 93910.0 93924.0 95756.0 1079.8 1145.4 1146.8 1170.6 1171.0 17733.7 17747.2 17844.0 17892.6 18199.0 41261.8 41763.4 41839.0 43060.6 43172.9 58115.0 59349.0 59696.4 60312.4 60371.1 7581.6 7884.8 7994.1 8610.0 8912.6 9328.0 12945.9 13047.3 13050.9 13099.6 11188.7 11343.4 11438.4 11457.9 11654.2 10971.1 11037.9 11130.6 11262.2 11343.3 10505.4 10754.2 10774.5 11002.1 11159.6 7974.8 8007.8 8089.9 8108.9 8119.2 9191.7 10408.8 10432.8 10451.3 10462.5 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#3] mootools.html Cycles:180 Average:5870.20 Median:2567.24 stddev:3331.77 (129.8%) stddev-sans-first:3324.57 10:21:11 INFO - PROCESS | 5712 | Values: 1452.7 1506.5 1581.5 1695.1 1714.5 7630.4 8028.6 8630.8 8639.0 8683.5 8747.3 9021.2 9073.5 9079.9 9093.5 2370.7 2413.4 2420.5 2426.4 2430.7 2345.3 2379.6 2410.9 2411.8 2420.2 2383.4 2387.7 2395.3 2406.0 2418.2 2274.9 2279.4 2290.3 2304.1 2354.2 2326.4 2337.6 2338.9 2342.9 2346.8 8932.1 8964.2 8992.6 8993.3 8996.5 5349.2 5526.4 5533.9 5534.4 5545.5 3559.7 3580.2 3638.7 3644.7 3697.2 1127.3 1143.8 1187.2 1227.9 1237.3 12525.6 12536.9 12558.5 12568.5 12660.9 4553.0 4581.6 4646.5 4666.0 4690.2 10560.7 10598.7 10613.4 10616.3 10618.9 5316.9 5357.4 5381.2 5401.6 5405.8 4356.8 4895.4 4976.9 5044.1 5049.9 4060.6 4074.6 4105.6 4128.3 4159.7 1306.6 1333.8 1339.5 1346.7 1346.8 886.1 970.6 979.8 987.2 988.8 5899.7 5937.7 6020.3 6088.8 6172.2 454.0 455.1 468.5 469.7 470.8 4126.2 4138.4 4152.2 4177.7 4194.4 10520.1 10894.8 10975.2 10996.5 10998.6 10725.7 10752.9 10826.9 10829.3 10848.3 8056.1 8162.9 8246.0 8247.3 8275.1 5861.5 5942.5 5948.6 5998.4 6010.8 9946.7 10097.5 10206.1 10254.1 10263.6 10081.6 10156.4 10184.0 10311.2 10341.7 7650.6 7700.7 8091.5 8160.6 8168.6 8772.6 8779.1 8789.0 8799.0 8846.0 7625.7 7736.8 7857.0 7953.1 8165.8 7534.9 7559.0 7668.0 7713.3 7892.5 7122.0 7167.4 7201.1 7228.2 7255.3 5181.6 5294.4 5310.7 5313.3 5329.5 5132.7 5192.7 5211.1 5310.8 5333.7 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#4] prototype.html Cycles:180 Average:4883.23 Median:5520.16 stddev:1453.42 (26.3%) stddev-sans-first:1416.69 10:21:11 INFO - PROCESS | 5712 | Values: 326.6 340.1 341.4 344.4 346.8 5464.9 5512.2 5638.6 5698.4 5708.4 5528.1 5538.2 5541.7 5559.5 5571.5 4344.3 4344.7 4365.6 4408.4 4430.1 4098.5 4316.2 4323.5 4405.3 4406.2 4239.6 4245.3 4270.3 4285.6 4295.5 4299.6 4310.4 4318.9 4318.9 4338.9 3673.4 3771.7 3783.2 3785.9 3796.8 5286.6 5416.2 5441.5 5462.8 5466.3 4936.5 4945.7 4953.9 4956.1 4961.8 5690.6 5800.9 5826.7 5839.2 5858.4 4101.5 4148.2 4148.3 4166.4 4172.9 5905.8 6056.3 6083.8 6092.5 6151.6 4189.7 4205.5 4205.9 4233.6 4243.9 4245.7 4271.6 4273.9 4277.2 4286.2 4893.9 4919.3 4928.3 4934.7 4957.1 5700.6 5747.9 5816.4 5879.6 5899.5 1445.6 1470.8 1472.9 1474.2 1476.4 931.5 936.3 950.9 955.7 958.2 5038.4 5045.3 5052.8 5054.5 5141.5 5336.0 5342.4 5379.5 5387.8 5405.5 4991.0 5003.3 5025.4 5198.2 5607.4 3172.8 3179.5 3222.6 3231.8 3255.2 6161.9 6266.8 6301.1 6340.4 6343.4 6121.0 6180.7 6208.8 6209.2 6213.5 6217.7 6232.5 6290.2 6305.0 6317.0 5769.0 5977.5 6009.7 6025.7 6092.6 5915.7 5929.8 5938.3 5952.5 6003.7 6050.6 6182.9 6220.7 6275.2 6292.5 4188.3 4194.7 4204.1 4226.3 4265.9 5883.9 5972.5 6059.3 6062.8 6122.5 5917.2 5946.1 5950.3 5956.9 5962.6 5882.2 5904.8 5923.5 5928.3 5945.2 5581.0 5734.3 5742.6 5744.2 5745.6 5927.7 5974.9 5976.9 5984.6 5995.2 5691.9 5775.4 5815.7 5836.0 5851.6 10:21:11 INFO - PROCESS | 5712 | 10:21:11 INFO - PROCESS | 5712 | [#5] yui.html Cycles:180 Average:21576.14 Median:3786.43 stddev:32247.90 (851.7%) stddev-sans-first:32300.38 10:21:11 INFO - PROCESS | 5712 | Values: 729.7 791.6 807.0 823.8 843.5 14994.4 15177.8 15400.0 15879.8 16736.7 15459.8 15523.1 15564.4 15665.8 15745.6 794.9 833.5 835.9 837.0 844.9 822.7 828.7 832.0 832.0 833.5 875.7 877.3 879.4 881.7 882.6 861.9 866.7 868.7 869.7 874.0 634.8 637.4 640.3 640.6 642.7 15859.1 15895.4 15940.8 15943.2 15950.4 14889.6 14909.1 14912.2 14947.7 14964.5 12320.9 12502.7 12659.2 12843.5 12893.4 3909.8 3910.7 3934.3 4005.6 4022.0 76516.0 76585.0 76696.0 77219.0 78486.6 10962.2 11503.0 11519.8 11685.4 11694.1 21210.4 21272.7 21479.8 21521.9 21530.0 8147.1 8198.3 8498.7 8592.1 8621.3 4853.1 4871.8 4953.6 4976.0 5032.5 3503.5 3597.5 3628.3 3650.7 3663.1 627.1 647.5 664.4 668.0 711.5 665.3 716.7 762.9 773.1 795.1 10475.4 10554.8 10696.7 10728.6 10941.3 696.9 788.1 791.5 793.9 842.0 4940.6 4996.7 5011.4 5025.9 5044.3 124293.4 129718.0 131106.0 131166.3 133128.0 70367.6 79554.6 110785.0 111861.0 112514.0 96301.0 98140.0 98413.6 99495.0 102492.0 9086.2 9580.5 9967.0 10026.7 10222.0 47221.0 50614.5 50699.0 51096.2 51117.2 75595.0 75860.6 76560.0 77855.0 80546.6 12151.9 12168.3 12250.9 12483.9 12600.6 13285.4 13661.5 13940.4 13959.5 13965.4 12276.9 12491.7 12812.9 13106.5 13125.0 12668.7 12845.6 12904.6 12922.4 13055.4 12167.8 12240.9 12244.7 12562.4 13159.9 10104.1 10245.9 10603.6 10656.0 10777.6 10397.0 10595.7 10707.7 10771.6 10793.9 10:21:11 INFO - PROCESS | 5712 | -------- Summary: end -------- 10:21:11 INFO - PROCESS | 5712 | 10:21:12 INFO - TEST-INFO | 5712: exit 0 10:21:12 INFO - TEST-OK | dromaeo_css | took 1110231ms 10:21:12 INFO - TEST-START | kraken 10:21:12 INFO - operating with platform_type : linux_ 10:21:12 INFO - Initialising browser for kraken test... 10:21:12 INFO - TEST-INFO | started process 5946 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpn7o6mf/profile http://localhost:45146/getInfo.html) 10:21:17 INFO - PROCESS | 5946 | __metrics Screen width/height:1600/1200 10:21:17 INFO - PROCESS | 5946 | colorDepth:24 10:21:17 INFO - PROCESS | 5946 | Browser inner width/height: 1024/697 10:21:17 INFO - PROCESS | 5946 | __metrics 10:21:17 ERROR - PROCESS | 5946 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 10:21:18 INFO - TEST-INFO | 5946: exit 0 10:21:18 INFO - Browser initialized. 10:21:18 INFO - Running cycle 1/1 for kraken test... 10:21:18 INFO - TEST-INFO | started process 6065 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpn7o6mf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:21:30 INFO - PROCESS | 6065 | RSS: Main: 167456768 10:21:30 INFO - PROCESS | 6065 | 10:21:32 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45146/tests/kraken/driver.html?testName=audio-beat-detection) 10:21:33 INFO - PROCESS | 6065 | RSS: Main: 173133824 10:21:33 INFO - PROCESS | 6065 | 10:21:36 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45146/tests/kraken/driver.html?testName=audio-dft) 10:21:37 INFO - PROCESS | 6065 | RSS: Main: 171892736 10:21:37 INFO - PROCESS | 6065 | 10:21:39 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45146/tests/kraken/driver.html?testName=audio-fft) 10:21:40 INFO - PROCESS | 6065 | RSS: Main: 167657472 10:21:40 INFO - PROCESS | 6065 | 10:21:42 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45146/tests/kraken/driver.html?testName=audio-oscillator) 10:21:43 INFO - PROCESS | 6065 | RSS: Main: 167718912 10:21:43 INFO - PROCESS | 6065 | 10:21:45 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45146/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:21:46 INFO - PROCESS | 6065 | RSS: Main: 168132608 10:21:46 INFO - PROCESS | 6065 | 10:21:49 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45146/tests/kraken/driver.html?testName=imaging-darkroom) 10:21:50 INFO - PROCESS | 6065 | RSS: Main: 168775680 10:21:50 INFO - PROCESS | 6065 | 10:21:53 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45146/tests/kraken/driver.html?testName=imaging-desaturate) 10:21:54 INFO - PROCESS | 6065 | RSS: Main: 166080512 10:21:54 INFO - PROCESS | 6065 | 10:21:57 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45146/tests/kraken/driver.html?testName=json-parse-financial) 10:21:57 INFO - PROCESS | 6065 | RSS: Main: 167321600 10:21:57 INFO - PROCESS | 6065 | 10:21:59 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45146/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:21:59 INFO - PROCESS | 6065 | RSS: Main: 167862272 10:21:59 INFO - PROCESS | 6065 | 10:22:01 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:22:02 INFO - PROCESS | 6065 | RSS: Main: 168243200 10:22:02 INFO - PROCESS | 6065 | 10:22:04 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:22:05 INFO - PROCESS | 6065 | RSS: Main: 168501248 10:22:05 INFO - PROCESS | 6065 | 10:22:07 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:22:08 INFO - PROCESS | 6065 | RSS: Main: 168501248 10:22:08 INFO - PROCESS | 6065 | 10:22:10 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:22:11 INFO - PROCESS | 6065 | RSS: Main: 168628224 10:22:11 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | Cycle 1(1): loaded http://localhost:45146/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45146/tests/kraken/driver.html?testName=ai-astar) 10:22:13 INFO - PROCESS | 6065 | RSS: Main: 169365504 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | __start_tp_report 10:22:13 INFO - PROCESS | 6065 | _x_x_mozilla_page_load 10:22:13 INFO - PROCESS | 6065 | _x_x_mozilla_page_load_details 10:22:13 INFO - PROCESS | 6065 | |i|pagename|runs| 10:22:13 INFO - PROCESS | 6065 | |0;ai-astar;115;108;113;113;114;114;114;112;113;114 10:22:13 INFO - PROCESS | 6065 | |1;audio-beat-detection;157;126;154;191;128;151;155;128;209;142 10:22:13 INFO - PROCESS | 6065 | |2;audio-dft;163;162;163;163;162;169;168;162;161;162 10:22:13 INFO - PROCESS | 6065 | |3;audio-fft;75;77;77;150;76;75;74;74;165;76 10:22:13 INFO - PROCESS | 6065 | |4;audio-oscillator;86;88;150;87;86;85;142;86;84;147 10:22:13 INFO - PROCESS | 6065 | |5;imaging-gaussian-blur;117;117;117;119;118;117;117;118;117;117 10:22:13 INFO - PROCESS | 6065 | |6;imaging-darkroom;148;147;147;147;146;147;146;147;146;146 10:22:13 INFO - PROCESS | 6065 | |7;imaging-desaturate;101;100;100;96;95;95;96;96;96;96 10:22:13 INFO - PROCESS | 6065 | |8;json-parse-financial;53;54;57;54;56;54;55;55;54;54 10:22:13 INFO - PROCESS | 6065 | |9;json-stringify-tinderbox;63;63;63;64;64;63;63;64;64;65 10:22:13 INFO - PROCESS | 6065 | |10;stanford-crypto-aes;81;79;85;81;82;85;84;92;105;81 10:22:13 INFO - PROCESS | 6065 | |11;stanford-crypto-ccm;133;123;137;129;126;122;132;131;139;128 10:22:13 INFO - PROCESS | 6065 | |12;stanford-crypto-pbkdf2;164;166;164;166;161;160;165;162;163;164 10:22:13 INFO - PROCESS | 6065 | |13;stanford-crypto-sha256-iterative;68;64;69;62;66;63;66;64;65;69 10:22:13 INFO - PROCESS | 6065 | __end_tp_report 10:22:13 INFO - PROCESS | 6065 | __start_cc_report 10:22:13 INFO - PROCESS | 6065 | _x_x_mozilla_cycle_collect,870 10:22:13 INFO - PROCESS | 6065 | __end_cc_report 10:22:13 INFO - PROCESS | 6065 | __startTimestamp1465233733541__endTimestamp 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | ------- Summary: start ------- 10:22:13 INFO - PROCESS | 6065 | Number of tests: 14 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#0] ai-astar Cycles:10 Average:113.00 Median:114.00 stddev:1.94 (1.7%) stddev-sans-first:1.92 10:22:13 INFO - PROCESS | 6065 | Values: 115.0 108.0 113.0 113.0 114.0 114.0 114.0 112.0 113.0 114.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#1] audio-beat-detection Cycles:10 Average:154.10 Median:154.50 stddev:27.27 (17.7%) stddev-sans-first:28.90 10:22:13 INFO - PROCESS | 6065 | Values: 157.0 126.0 154.0 191.0 128.0 151.0 155.0 128.0 209.0 142.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#2] audio-dft Cycles:10 Average:163.50 Median:163.00 stddev:2.72 (1.7%) stddev-sans-first:2.88 10:22:13 INFO - PROCESS | 6065 | Values: 163.0 162.0 163.0 163.0 162.0 169.0 168.0 162.0 161.0 162.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#3] audio-fft Cycles:10 Average:91.90 Median:75.50 stddev:34.77 (46.1%) stddev-sans-first:36.34 10:22:13 INFO - PROCESS | 6065 | Values: 75.0 77.0 77.0 150.0 76.0 75.0 74.0 74.0 165.0 76.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#4] audio-oscillator Cycles:10 Average:104.10 Median:86.00 stddev:29.22 (34.0%) stddev-sans-first:30.25 10:22:13 INFO - PROCESS | 6065 | Values: 86.0 88.0 150.0 87.0 86.0 85.0 142.0 86.0 84.0 147.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.00 stddev:0.70 (0.6%) stddev-sans-first:0.73 10:22:13 INFO - PROCESS | 6065 | Values: 117.0 117.0 117.0 119.0 118.0 117.0 117.0 118.0 117.0 117.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.53 10:22:13 INFO - PROCESS | 6065 | Values: 148.0 147.0 147.0 147.0 146.0 147.0 146.0 147.0 146.0 146.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#7] imaging-desaturate Cycles:10 Average:97.10 Median:96.00 stddev:2.28 (2.4%) stddev-sans-first:1.94 10:22:13 INFO - PROCESS | 6065 | Values: 101.0 100.0 100.0 96.0 95.0 95.0 96.0 96.0 96.0 96.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#8] json-parse-financial Cycles:10 Average:54.60 Median:54.50 stddev:1.17 (2.2%) stddev-sans-first:1.09 10:22:13 INFO - PROCESS | 6065 | Values: 53.0 54.0 57.0 54.0 56.0 54.0 55.0 55.0 54.0 54.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#9] json-stringify-tinderbox Cycles:10 Average:63.60 Median:64.00 stddev:0.70 (1.1%) stddev-sans-first:0.71 10:22:13 INFO - PROCESS | 6065 | Values: 63.0 63.0 63.0 64.0 64.0 63.0 63.0 64.0 64.0 65.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#10] stanford-crypto-aes Cycles:10 Average:85.50 Median:83.00 stddev:7.75 (9.3%) stddev-sans-first:8.05 10:22:13 INFO - PROCESS | 6065 | Values: 81.0 79.0 85.0 81.0 82.0 85.0 84.0 92.0 105.0 81.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#11] stanford-crypto-ccm Cycles:10 Average:130.00 Median:131.50 stddev:5.56 (4.2%) stddev-sans-first:5.79 10:22:13 INFO - PROCESS | 6065 | Values: 133.0 123.0 137.0 129.0 126.0 122.0 132.0 131.0 139.0 128.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.50 Median:164.00 stddev:2.01 (1.2%) stddev-sans-first:2.13 10:22:13 INFO - PROCESS | 6065 | Values: 164.0 166.0 164.0 166.0 161.0 160.0 165.0 162.0 163.0 164.0 10:22:13 INFO - PROCESS | 6065 | 10:22:13 INFO - PROCESS | 6065 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.60 Median:66.00 stddev:2.46 (3.7%) stddev-sans-first:2.45 10:22:13 INFO - PROCESS | 6065 | Values: 68.0 64.0 69.0 62.0 66.0 63.0 66.0 64.0 65.0 69.0 10:22:13 INFO - PROCESS | 6065 | -------- Summary: end -------- 10:22:13 INFO - PROCESS | 6065 | 10:22:14 INFO - TEST-INFO | 6065: exit 0 10:22:14 INFO - TEST-OK | kraken | took 62016ms 10:22:14 INFO - SUITE-END | took 1172s 10:22:14 INFO - Completed test suite (00:19:32) 10:22:14 INFO - javascript benchmark 10:22:14 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7300.012050955838, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3155.4477966355885, 3203.407369636619, 3208.4866421372585, 3214.132184310238, 3218.388506183825, 5337.759800808968, 5355.277037599923, 5400.0, 5520.0, 5564.221009058725, 5204.167333226685, 5402.297701298836, 5469.480399362054, 5489.176623506476, 5523.088690366085, 4899.706017638944, 4916.385451818523, 4954.083494553519, 5054.090263752523, 5102.464241254671, 4903.705777653335, 5117.385913690362, 5145.202493613478, 5158.742062896859, 5159.690418574879, 4932.827351042714, 4943.604511639061, 4964.826231081913, 4984.975075124637, 5003.249512573107, 5062.468440813698, 5064.088464076464, 5072.746362681851, 5080.517350851663, 5153.381594208681, 5053.36832895888, 5053.873653158664, 5062.620303477217, 5070.442251352349, 5077.136886729265, 5350.411454740014, 5355.544778693816, 5368.275282836806, 5412.539934105605, 5426.077566813612, 5895.233619629464, 5901.232839730807, 5903.881922361572, 5905.940940590625, 5915.556333274979, 5676.035074037423, 5783.942160578383, 5911.408859114097, 5942.10868369748, 5955.940440595582, 5440.591955603346, 5475.123980163195, 5493.340799104093, 5497.780088796443, 5516.91724624127, 5946.0, 5949.613275137189, 5955.225820643289, 5958.851028724316, 5996.940030599638, 5452.154915988028, 5655.3779084300695, 5698.116791897262, 5715.457031581993, 5754.0505816540635, 5794.88410231793, 5834.416558344132, 5836.182934389189, 5850.444207800252, 5905.911411328833, 5613.607047506635, 5708.457696518907, 5827.970860145672, 5828.184054232411, 5832.300123985149, 5756.366799652035, 5765.711714414262, 5803.82588522345, 5818.650880947157, 5863.618864773776, 4400.75795831226, 4448.977755111204, 4452.354408610733, 4456.331550267421, 4486.910261794746, 3883.0486530800135, 3909.198614284065, 3961.088949541564, 3973.0861901762755, 4028.0332720146953, 5526.226328314039, 5528.668279903139, 5544.69504177266, 5547.667139971614, 5592.133219351007, 5879.764809407661, 5906.704664766745, 5912.438318359749, 5913.674747888907, 5915.112733090071, 5288.497592728685, 5459.972700136474, 5484.862878428071, 5516.0, 5520.723963801875, 4888.291197776302, 4902.607791376681, 4943.382077240345, 4957.355543779286, 4972.428170760337, 6073.726682299307, 6083.11794789753, 6103.511719062464, 6114.296855861633, 6120.234970628671, 5609.831705048855, 5763.538916886723, 5828.184054232326, 5833.066709326487, 5897.233359663216, 6044.184035155197, 6056.394360564084, 6064.545159113172, 6088.238970128734, 6096.268447786294, 5656.971715141398, 5779.450952159538, 5781.132830075522, 5800.593958423039, 5807.506361959281, 5795.884082318245, 5813.6221145625395, 5874.412558744091, 5882.5293976480925, 5958.0, 5752.309722833287, 5765.8558536036935, 5766.394528574439, 5773.393793651606, 5775.27809023872, 5393.568514518907, 5587.217789509553, 5734.283214598176, 5744.511716504144, 5758.71206439668, 5298.470152984825, 5398.973005134949, 5411.621186516906, 5456.09974354243, 5578.470045345685, 5602.075657516464, 5611.691356975405, 5646.943530564806, 5669.149627555899, 5672.319321681424, 5421.891562168656, 5527.613067085265, 5532.1425179097305, 5542.307211598551, 5553.111502159635], "value": 5375.439581333473, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [592.2744637818672, 630.4987534909747, 644.4522156167255, 646.1728986896771, 652.139176287301, 43260.3510947336, 44193.7790311048, 44449.7777511112, 44719.329210061835, 46990.0, 44713.776431117796, 45152.774236128775, 45517.31724024142, 45520.317195242096, 45795.542044579546, 8729.7817554561, 8857.645694172226, 8868.955655221715, 8885.777855553599, 8943.418677785923, 8753.693620723276, 8855.070217627153, 8855.203031727144, 8857.645694172226, 8863.157999989991, 8835.690750823722, 8901.06538813425, 8946.64213431462, 8962.327825413087, 8972.775680607972, 8858.645654173826, 8871.068537803534, 8874.733757987271, 8899.377043606917, 8926.955365223164, 8789.165029322205, 8801.867971980426, 8823.294136469067, 8857.070007649232, 8869.46783193004, 40566.0, 41441.1711765763, 41442.79278603618, 41454.37818432726, 41510.584894150976, 3390.7965522068753, 3520.9119772005647, 3549.8757543486113, 3574.267275208576, 4169.4162817205615, 32619.0, 32842.6715732842, 32882.34235315304, 32930.0, 34378.656213438044, 3976.7613943163215, 3983.40248962655, 4016.879493615196, 4118.629323360912, 4174.144300418407, 329594.0, 330274.0, 333770.0, 333902.0, 335603.0, 33789.83105084459, 34712.0, 34824.82587587096, 56702.0, 57160.0, 36149.27701446009, 36167.638323616426, 36238.63761362405, 36305.63694363075, 36369.81815090908, 15107.848921510644, 15258.542243732705, 15261.465848695243, 15267.236638168048, 15280.847191528164, 12758.0, 12877.420516076612, 12895.613131606067, 12919.289439080942, 12946.029047821452, 8190.180981901762, 8203.75388738327, 8205.917940820635, 8242.17578242171, 8259.752207433787, 3187.5218717192142, 3211.935761284808, 3230.6769323067974, 3261.3803377358226, 3271.7382609391666, 1065.0, 1082.5994382078525, 1100.1528822806395, 1138.5445821671399, 1164.3770582738193, 32217.0, 32453.675463245065, 32579.02262932116, 32916.67083329184, 35974.28051438957, 1080.3247970018738, 1182.8876256755595, 1190.0360707826687, 1196.4316949448942, 1205.873383294759, 16480.34078636865, 16562.50312490627, 16643.3342666292, 16849.157542122844, 17103.82896171047, 525208.0, 525707.0, 526165.0, 528842.0, 532977.0, 56300.43699563034, 56494.152587711214, 56681.380317034906, 56742.43257567454, 56905.43094569084, 1380.0753495158267, 1387.6947071644424, 1389.1248513436672, 1392.6031081142028, 1402.1587047771256, 30660.693393065783, 30890.0, 31587.0, 31769.682303176673, 31835.840820795747, 49160.2625960618, 55672.16491752708, 57282.71358643347, 57435.42564574468, 60245.698771505864, 371492.0, 371842.0, 376890.0, 377239.0, 378184.0, 44546.0, 44946.3258051123, 45380.77309613431, 45785.0, 46160.53839461562, 48115.75942120267, 48464.7576762128, 48903.510964889894, 49209.507904920494, 49280.507194927595, 41090.79454602708, 42152.36771448369, 42513.0, 43101.35347969846, 43355.566444335156, 41483.58516414918, 41850.1629967405, 42091.15817683691, 42243.15513689647, 42662.36006459968, 38438.0, 38870.22259554736, 39576.40635390414, 41648.58351416447, 41776.0, 35632.46551301784, 36485.635143649284, 36682.8165859169, 37277.440838387985, 37897.81051094727, 28348.43303133967, 29005.854970725857, 29168.41663166767, 29301.26746831261, 29432.705672942997], "value": 19096.997116242528, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.6453045463401, 391.65925644689145, 397.2075708960624, 403.4734671254014, 416.18427881352545, 14166.0, 18259.178336974834, 19633.803661963375, 19657.410277691673, 19800.0, 17980.73028904564, 18075.638487230248, 18368.908155459238, 19437.902810485928, 19464.12411441485, 5434.130539113743, 5694.800681976131, 5709.885802283952, 5808.157817116516, 5854.414558544154, 5737.3688894221605, 5763.942360576403, 5798.391168927265, 5802.042662960606, 5814.912776308359, 5631.1271752878365, 5681.119426488901, 5757.596968212227, 5762.308522977228, 5775.797847075353, 5715.342735585398, 5717.71411429431, 5737.082066869322, 5747.080467125261, 5752.626079304852, 4937.925931111036, 5188.066148093341, 5203.245529398254, 5208.739563021833, 5212.687238765686, 22034.33896983093, 22222.222222222146, 22549.21077762287, 22918.0, 22924.54150916989, 2318.1538738360546, 2417.084323396092, 2433.245693834899, 2756.9035083772173, 2957.4824405729128, 14490.20303883286, 14617.0, 14651.780223296659, 14788.926055369655, 15263.847361526354, 1884.1897983866932, 1946.6690662587393, 1986.860919735619, 2059.073416962373, 2089.9059542320633, 76367.61816190938, 78454.607726961, 79162.20837791606, 79611.60194198992, 80247.19752802455, 10344.844827327595, 10345.793084138275, 10771.0, 10922.617708380169, 10931.617393391192, 14677.706445871023, 14799.704005920037, 14800.0, 14822.332995015251, 14830.62923426923, 7540.17058123606, 7673.501222420637, 7722.575258360732, 7844.725434609875, 7850.214978502104, 7360.889586656204, 7456.142543607554, 7485.363744081705, 7524.510906791041, 7565.092188937363, 6450.4839612830865, 6619.569727967667, 6675.866482670416, 6683.43190828785, 6758.898616520756, 1879.1074239736015, 1943.7084437334513, 1953.4823271832975, 1959.4513536209884, 1986.4338663481128, 988.3032462114193, 1002.0830939690102, 1083.469100140941, 1084.7559299157626, 1145.5623192893033, 19165.233390664496, 19526.90236548808, 19730.0, 20034.499137521387, 20187.495312617302, 1037.3361048928691, 1056.804491169136, 1087.9891201088046, 1126.1610100475198, 1149.0, 10724.356538607708, 11074.0, 11375.0, 11412.771744565229, 11436.885631143748, 521572.0, 522138.0, 525678.0, 532566.0, 534690.0, 91550.0, 92279.53860230657, 93910.0, 93924.0, 95756.0, 1079.8272276435732, 1145.381493993251, 1146.7993101207255, 1170.62539987205, 1170.987096161831, 17733.733993990358, 17747.201375937857, 17844.0, 17892.642147156723, 18199.0, 41261.79369103135, 41763.373549397395, 41839.0, 43060.569394305654, 43172.920676983325, 58115.0, 59349.0, 59696.40303596909, 60312.396876032435, 60371.09443358265, 7581.583012934341, 7884.802879928047, 7994.080680721559, 8610.0, 8912.598933047899, 9328.045076726148, 12945.870541294467, 13047.347632618521, 13050.934745326593, 13099.607011789662, 11188.720281993015, 11343.376114313462, 11438.370889601152, 11457.940212533254, 11654.242474239147, 10971.067459266053, 11037.889621103686, 11130.554777808797, 11262.211645184758, 11343.319400835977, 10505.422201778976, 10754.193435492212, 10774.46127693628, 11002.119830413387, 11159.553617855196, 7974.84050319002, 8007.83984320322, 8089.87865182011, 8108.878366824384, 8119.188081191834, 9191.67879802651, 10408.791824163625, 10432.791344173225, 10451.320664156805, 10462.529186186792], "value": 9351.496790121977, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1452.7385070687278, 1506.532974777819, 1581.4939219449773, 1695.1439523040863, 1714.4685147604237, 7630.389568834494, 8028.558429286394, 8630.827383452335, 8638.956805215974, 8683.522406267668, 8747.256483198937, 9021.233195178402, 9073.455592664428, 9079.909200907989, 9093.454392736441, 2370.679958205642, 2413.3845869303304, 2420.4674971506242, 2426.3570153909227, 2430.744771798962, 2345.2612427085414, 2379.607364784817, 2410.867402292873, 2411.8191135664806, 2420.225527831095, 2383.392234980078, 2387.6776635154292, 2395.2694428199393, 2406.0496104038893, 2418.1899063813557, 2274.931752047441, 2279.350385140227, 2290.3358026172555, 2304.124432715566, 2354.2466410748566, 2326.430024643956, 2337.5558643857785, 2338.871362075085, 2342.8945697443655, 2346.753590872968, 8932.062133476022, 8964.238039766627, 8992.640294388217, 8993.28053755698, 8996.460212387277, 5349.170878513836, 5526.364468086182, 5533.889322213533, 5534.418886016951, 5545.473180047889, 3559.7330200235087, 3580.1765593913547, 3638.745287829853, 3644.708423326154, 3697.186618943828, 1127.3236058364998, 1143.8055530559825, 1187.1749134351628, 1227.858796238426, 1237.2638280223252, 12525.624231272985, 12536.937315313457, 12558.497660093586, 12568.497260109676, 12660.936695316557, 4552.9772351138035, 4581.5647513486165, 4646.4888862225125, 4665.953340466552, 4690.179218636793, 10560.735981600521, 10598.682039538826, 10613.416262105504, 10616.256862019585, 10618.946905265424, 5316.93661267748, 5357.35711714589, 5381.246625472437, 5401.648892821954, 5405.7567409466665, 4356.847510337187, 4895.4370247422, 4976.8755781105765, 5044.066847633127, 5049.924251136236, 4060.553339132693, 4074.5517993020744, 4105.6326554794005, 4128.318827393447, 4159.667226621863, 1306.6210798868221, 1333.8466076401337, 1339.4642143142821, 1346.6767975685764, 1346.838379394479, 886.096181894464, 970.5972021611094, 979.8383266761048, 987.195435719886, 988.8467287570438, 5899.67551784656, 5937.673427961504, 6020.277566691937, 6088.756449742049, 6172.158167146523, 454.03517525258826, 455.1375144101908, 468.5197672385832, 469.73694730950774, 470.78108679464214, 4126.216018956388, 4138.358554424069, 4152.231837110145, 4177.6866734995, 4194.412782210493, 10520.105791007696, 10894.782104357868, 10975.176861735401, 10996.450177491093, 10998.560057597606, 10725.731856703645, 10752.946235268773, 10826.945865270623, 10829.29609575375, 10848.349099054081, 8056.113827478973, 8162.918370816335, 8246.0, 8247.298979586682, 8275.08974012858, 5861.531077513703, 5942.465178133989, 5948.643081414956, 5998.370171132143, 6010.849728756816, 9946.651867184613, 10097.495125243855, 10206.13247873939, 10254.077133058061, 10263.589456421958, 10081.596736130767, 10156.44139572301, 10184.0, 10311.22665800053, 10341.74145646365, 7650.6174691264105, 7700.653470593725, 8091.474054186459, 8160.551169685724, 8168.632411541376, 8772.561371931506, 8779.078196789245, 8788.98926623421, 8799.0, 8845.955770221108, 7625.6949722010495, 7736.806579835324, 7856.978592782902, 7953.085395179628, 8165.79585510367, 7534.886976695464, 7558.962205188939, 7667.961660191663, 7713.267239612228, 7892.4869883457395, 7121.9643901780155, 7167.390771784457, 7201.063861697946, 7228.20489746117, 7255.347018768125, 5181.611379146654, 5294.417614062373, 5310.654807437504, 5313.2561441397465, 5329.493698098674, 5132.743362831919, 5192.688438693691, 5211.062008838446, 5310.787568497217, 5333.7333133343955], "value": 4632.45131461387, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [326.6231489353527, 340.0631260876285, 341.35483935362157, 344.40761889549964, 346.79539071947545, 5464.863378415532, 5512.173174023898, 5638.605297629168, 5698.373178950323, 5708.429157084294, 5528.143137813635, 5538.169274608801, 5541.667499950006, 5559.471850174237, 5571.467846342258, 4344.304911214206, 4344.652427805784, 4365.628921541673, 4408.382826404306, 4430.136123455927, 4098.4876890388705, 4316.20150272199, 4323.524412314643, 4405.295152775557, 4406.206882761102, 4239.59723826236, 4245.341971994346, 4270.252705776492, 4285.592868677486, 4295.484541854982, 4299.570042995707, 4310.4396428464415, 4318.870433886988, 4318.926915080748, 4338.891527711801, 3673.3571624965793, 3771.679407250387, 3783.2055268393397, 3785.886423407302, 3796.791176485292, 5286.6035047371215, 5416.160495123262, 5441.483059109379, 5462.754176062087, 5466.316710411199, 4936.457724272002, 4945.653804233705, 4953.900921981576, 4956.083124621957, 4961.751912404366, 5690.630109042899, 5800.867531532967, 5826.659868230288, 5839.182514447981, 5858.41415858415, 4101.52832424272, 4148.23257697324, 4148.315527937887, 4166.437530933315, 4172.937405938914, 5905.789313190742, 6056.273247210319, 6083.847903802396, 6092.51259899207, 6151.600145990541, 4189.685773566995, 4205.516365617932, 4205.873823785291, 4233.618974292329, 4243.893902652459, 4245.724027938174, 4271.5514870938105, 4273.910152910988, 4277.187334406515, 4286.164197981364, 4893.902121957541, 4919.311296418504, 4928.334674818853, 4934.6545741798445, 4957.132501812169, 5700.629459085146, 5747.850429914034, 5816.360200377955, 5879.559033072536, 5899.528037756969, 1445.6169115184484, 1470.8014418053426, 1472.9247649215918, 1474.1965628732366, 1476.350405821435, 931.5249222896372, 936.3110336081178, 950.8716323296405, 955.7241083154067, 958.1807554540907, 5038.420581633086, 5045.318881950963, 5052.812589041572, 5054.545090941833, 5141.511556402136, 5335.985168379853, 5342.412334643186, 5379.466851947176, 5387.757550910218, 5405.459454054641, 4990.975045124751, 5003.274525193827, 5025.3718285214345, 5198.246254293106, 5607.383187849333, 3172.825494597819, 3179.491281394966, 3222.564953731216, 3231.773775835669, 3255.202475393544, 6161.860055889675, 6266.780662676784, 6301.149344838388, 6340.365963403715, 6343.397377249154, 6120.969395153084, 6180.690965451709, 6208.751649934043, 6209.223847019122, 6213.502919766408, 6217.6891155442045, 6232.470240029557, 6290.207290922065, 6305.022721478178, 6316.968415157987, 5768.990426675399, 5977.462028417463, 6009.699515024318, 6025.668588227514, 6092.634441933498, 5915.70421478933, 5929.814037192493, 5938.317093534299, 5952.464278214981, 6003.729832157476, 6050.58142149684, 6182.938170618237, 6220.688965551795, 6275.152854364603, 6292.4966002720585, 4188.308929026798, 4194.727342722836, 4204.07510347723, 4226.281532139606, 4265.850695225652, 5883.85239387629, 5972.522198224218, 6059.33347331802, 6062.818115456544, 6122.530592657819, 5917.230760001173, 5946.108083787466, 5950.34546199909, 5956.868195042928, 5962.5987892846015, 5882.176495290577, 5904.763809447574, 5923.526117910643, 5928.318243401892, 5945.227120474311, 5581.0, 5734.34055083654, 5742.598018138858, 5744.195812586325, 5745.569082318926, 5927.733252003756, 5974.910376344272, 5976.940230597638, 5984.58107932458, 5995.160677505066, 5691.857703557444, 5775.422457754191, 5815.709214539341, 5835.9708201458725, 5851.61964472308], "value": 4415.80569314914, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [729.7263526177687, 791.55672823219, 807.0033508616857, 823.8105235795769, 843.4981186194212, 14994.40022399104, 15177.772333415007, 15400.0, 15879.761803572927, 16736.748948765748, 15459.768103478456, 15523.146226957513, 15564.37742490299, 15665.765013524806, 15745.60635984101, 794.9085855126676, 833.5082301442147, 835.8829763833038, 837.0457678246803, 844.932405407569, 822.6585966823761, 828.7016673997356, 831.9558953513332, 831.9875201871977, 833.5207255827893, 875.7066382761751, 877.3376101043704, 879.4415546128223, 881.6870011146048, 882.6469412235093, 861.8534849075672, 866.7139843851545, 868.6699054359366, 869.7390782765145, 873.9861760357986, 634.8000379880369, 637.4263163153199, 640.3020707428925, 640.6412409050946, 642.6947200079925, 15859.127747973856, 15895.364185432569, 15940.840591594051, 15943.20283985796, 15950.361985520565, 14889.553313400507, 14909.105453672815, 14912.17983010934, 14947.701045979129, 14964.476243331432, 12320.938395307967, 12502.687432814162, 12659.240445573296, 12843.48626054966, 12893.419796109198, 3909.7849618270984, 3910.7458015228917, 3934.252492026506, 4005.639492445694, 4021.97989010056, 76516.02645828003, 76585.0, 76696.0, 77219.0, 78486.6075669618, 10962.232643714864, 11503.044482438007, 11519.769604607862, 11685.357305348287, 11694.122940779476, 21210.36368908935, 21272.680909786366, 21479.78520214809, 21521.89239053826, 21530.0, 8147.144549822302, 8198.344132469389, 8498.66005359791, 8592.097829727914, 8621.2671922886, 4853.0779151961015, 4871.805127794849, 4953.578945789576, 4975.975120124376, 5032.496750325012, 3503.5270238517983, 3597.5143355647174, 3628.2743451309316, 3650.6896913762625, 3663.084228942764, 627.1063734178776, 647.4917190005823, 664.4020381656547, 667.9833004174934, 711.5161690050816, 665.3346653346654, 716.688240615334, 762.9427792915553, 773.1109224391881, 795.1094773853206, 10475.423851688078, 10554.788904222027, 10696.679099627023, 10728.570857165625, 10941.343519388703, 696.885013972699, 788.1015642167933, 791.5013541468953, 793.9325157361689, 841.995790021046, 4940.629452791055, 4996.7001979881325, 5011.4236862761245, 5025.949740502549, 5044.268581055726, 124293.37853310676, 129718.0, 131106.0, 131166.34416827853, 133128.0, 70367.64816175989, 79554.6022269885, 110785.0, 111861.0, 112514.0, 96301.0, 98140.0, 98413.55552555626, 99495.0, 102492.0, 9086.22767064807, 9580.520973951136, 9966.950165249127, 10026.749331266778, 10222.0, 47221.0, 50614.49385506098, 50699.0, 51096.23355649743, 51117.23324150066, 75595.0, 75860.62069689616, 76560.0, 77855.0, 80546.59726701329, 12151.939240303742, 12168.330741809286, 12250.938745306217, 12483.875161248634, 12600.55898043564, 13285.402156903156, 13661.521846735317, 13940.442382305, 13959.511417100353, 13965.371558280105, 12276.877231227574, 12491.687707807378, 12812.935935320264, 13106.541271055466, 13125.0, 12668.683282918, 12845.550405735754, 12904.612861614167, 12922.353882306035, 13055.412506437424, 12167.81748273759, 12240.938795305967, 12244.693882653006, 12562.375373260069, 13159.868401316247, 10104.090631842875, 10245.948770256102, 10603.649929923979, 10656.0, 10777.568897244337, 10397.0, 10595.682129536126, 10707.732306692395, 10771.569137234423, 10793.892061079603], "value": 7705.822075836012, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1550.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 108.0, 113.0, 113.0, 114.0, 114.0, 114.0, 112.0, 113.0, 114.0], "value": 113.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 126.0, 154.0, 191.0, 128.0, 151.0, 155.0, 128.0, 209.0, 142.0], "value": 154.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 163.0, 163.0, 162.0, 169.0, 168.0, 162.0, 161.0, 162.0], "value": 163.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 77.0, 150.0, 76.0, 75.0, 74.0, 74.0, 165.0, 76.0], "value": 91.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 88.0, 150.0, 87.0, 86.0, 85.0, 142.0, 86.0, 84.0, 147.0], "value": 104.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 119.0, 118.0, 117.0, 117.0, 118.0, 117.0, 117.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 147.0, 147.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 100.0, 100.0, 96.0, 95.0, 95.0, 96.0, 96.0, 96.0, 96.0], "value": 97.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 54.0, 57.0, 54.0, 56.0, 54.0, 55.0, 55.0, 54.0, 54.0], "value": 54.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 63.0, 64.0, 64.0, 63.0, 63.0, 64.0, 64.0, 65.0], "value": 63.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 79.0, 85.0, 81.0, 82.0, 85.0, 84.0, 92.0, 105.0, 81.0], "value": 85.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 123.0, 137.0, 129.0, 126.0, 122.0, 132.0, 131.0, 139.0, 128.0], "value": 130.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 166.0, 164.0, 166.0, 161.0, 160.0, 165.0, 162.0, 163.0, 164.0], "value": 163.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 64.0, 69.0, 62.0, 66.0, 63.0, 66.0, 64.0, 65.0, 69.0], "value": 65.6, "unit": "score"}]}]} 10:22:14 INFO - Return code: 0 10:22:14 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:22:14 ERROR - # TBPL SUCCESS # 10:22:14 INFO - Running post-action listener: _resource_record_post_action 10:22:14 INFO - ##### 10:22:14 INFO - ##### Finished run-tests step (success) 10:22:14 INFO - ##### 10:22:14 INFO - Running post-run listener: _resource_record_post_run 10:22:14 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 12288; Write bytes: 540565504; Read time: 96; Write time: 435800 10:22:14 INFO - TinderboxPrint: CPU usage
13.4% 10:22:14 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 96 10:22:14 INFO - TinderboxPrint: I/O write bytes / time
540,565,504 / 435,800 10:22:14 INFO - TinderboxPrint: CPU idle
8,220.0 (86.6%) 10:22:14 INFO - TinderboxPrint: CPU user
1,218.2 (12.8%) 10:22:14 INFO - TinderboxPrint: Swap in / out
0 / 0 10:22:14 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 168755200; Read time: 0; Write time: 217252 10:22:14 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 12288; Write bytes: 292229120; Read time: 96; Write time: 179304 10:22:15 INFO - Running post-run listener: _upload_blobber_files 10:22:15 INFO - Blob upload gear active. 10:22:15 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:22:15 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 10:22:15 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-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:22:15 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-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:22:15 INFO - (blobuploader) - INFO - Open directory for files ... 10:22:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:22:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:19 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:22:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:19 INFO - (blobuploader) - INFO - Done attempting. 10:22:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:22:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:22:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:20 INFO - (blobuploader) - INFO - Done attempting. 10:22:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:22:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:22:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:21 INFO - (blobuploader) - INFO - Done attempting. 10:22:21 INFO - (blobuploader) - INFO - Iteration through files over. 10:22:21 INFO - Return code: 0 10:22:21 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:22:21 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:22:21 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4d567e5dae161a2af06019774c7dea814be47a027108ea5c11b3da72e4ea7fca04fac4f9bd9c48e21582f116f28dcc536d63b8602f2cdc7fed0a75b6139c8e11", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/428be552ab7da8ebae89e3b6fe72b037f6770611668d5fee7a9b83c2e31e1fad93e5604851ff6ccda5f420065e3d51452bfdc68bc0c6a6a627128992306f800c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/017bd31b20b8e497a037c77e01fe4a50cde0f4be4279894845cc01fea67b178915c54545d462a51a7ed84e1cbf527f0b7b1108a82aecb63b4b83a2b242945a9a"} 10:22:21 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:22:21 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:22:21 INFO - Contents: 10:22:21 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4d567e5dae161a2af06019774c7dea814be47a027108ea5c11b3da72e4ea7fca04fac4f9bd9c48e21582f116f28dcc536d63b8602f2cdc7fed0a75b6139c8e11", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/428be552ab7da8ebae89e3b6fe72b037f6770611668d5fee7a9b83c2e31e1fad93e5604851ff6ccda5f420065e3d51452bfdc68bc0c6a6a627128992306f800c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/017bd31b20b8e497a037c77e01fe4a50cde0f4be4279894845cc01fea67b178915c54545d462a51a7ed84e1cbf527f0b7b1108a82aecb63b4b83a2b242945a9a"} 10:22:21 INFO - Running post-run listener: copy_logs_to_upload_dir 10:22:21 INFO - Copying logs to upload dir... 10:22:21 INFO - mkdir: /builds/slave/test/build/upload/logs 10:22:21 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.016097 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-06 10:22:21.275002) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 10:22:21.279146) ========= 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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 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-Inbound/sha512/4d567e5dae161a2af06019774c7dea814be47a027108ea5c11b3da72e4ea7fca04fac4f9bd9c48e21582f116f28dcc536d63b8602f2cdc7fed0a75b6139c8e11", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/428be552ab7da8ebae89e3b6fe72b037f6770611668d5fee7a9b83c2e31e1fad93e5604851ff6ccda5f420065e3d51452bfdc68bc0c6a6a627128992306f800c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/017bd31b20b8e497a037c77e01fe4a50cde0f4be4279894845cc01fea67b178915c54545d462a51a7ed84e1cbf527f0b7b1108a82aecb63b4b83a2b242945a9a"} build_url:https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011244 build_url: 'https://queue.taskcluster.net/v1/task/XFucm0-JQ3qenwfLKTrzPw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4d567e5dae161a2af06019774c7dea814be47a027108ea5c11b3da72e4ea7fca04fac4f9bd9c48e21582f116f28dcc536d63b8602f2cdc7fed0a75b6139c8e11", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/428be552ab7da8ebae89e3b6fe72b037f6770611668d5fee7a9b83c2e31e1fad93e5604851ff6ccda5f420065e3d51452bfdc68bc0c6a6a627128992306f800c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/017bd31b20b8e497a037c77e01fe4a50cde0f4be4279894845cc01fea67b178915c54545d462a51a7ed84e1cbf527f0b7b1108a82aecb63b4b83a2b242945a9a"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 10:22:21.305690) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:22:21.306034) ========= 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=8887e36bb8e381bfd44124ac000001a8-1465230438.908582-1850309876 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004421 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 10:22:21.391834) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 10:22:21.392496) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 10:22:21.393017) ========= ========= Total master_lag: 0.21 =========