builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo
slave: talos-linux64-ix-005
starttime: 1465417433.67
results: success (0)
buildid: 20160608103005
builduid: c8da4bd6c9184e9788377909dff0c87a
revision: f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61
========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:53.668935) =========
master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/
========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:53.669385) =========
========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:53.669670) =========
========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:53.684030) =========
========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:53.684318) =========
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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
--2016-06-08 13:23:54-- 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% 217M=0s
2016-06-08 13:23:54 (217 MB/s) - `archiver_client.py' saved [12141/12141]
program finished with exit code 0
elapsedTime=0.383140
========= master_lag: 0.01 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.081704) =========
========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.082028) =========
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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
program finished with exit code 0
elapsedTime=0.018697
========= master_lag: 0.03 =========
========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.131863) =========
========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.132220) =========
bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61 --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 f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61 --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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
2016-06-08 13:23:54,586 truncating revision to first 12 chars
2016-06-08 13:23:54,586 Setting DEBUG logging.
2016-06-08 13:23:54,586 attempt 1/10
2016-06-08 13:23:54,586 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/f0006e4f551e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness
2016-06-08 13:23:54,905 unpacking tar archive at: mozilla-inbound-f0006e4f551e/testing/mozharness/
program finished with exit code 0
elapsedTime=0.680768
========= master_lag: 0.01 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.826571) =========
========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.826908) =========
script_repo_revision: f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61
========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.827336) =========
========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.827610) =========
========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-08 13:23:54.837879) =========
========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-06-08 13:23:54.838277) =========
/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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
13:23:55 INFO - MultiFileLogger online at 20160608 13:23:55 in /builds/slave/test
13:23:55 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
13:23:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json.
13:23:55 INFO - {'append_to_log': False,
13:23:55 INFO - 'base_work_dir': '/builds/slave/test',
13:23:55 INFO - 'blob_upload_branch': 'Mozilla-Inbound',
13:23:55 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt',
13:23:55 INFO - 'branch': 'Mozilla-Inbound',
13:23:55 INFO - 'buildbot_json_path': 'buildprops.json',
13:23:55 INFO - 'config_files': ('talos/linux_config.py',),
13:23:55 INFO - 'default_actions': ('clobber',
13:23:55 INFO - 'read-buildbot-config',
13:23:55 INFO - 'download-and-extract',
13:23:55 INFO - 'populate-webroot',
13:23:55 INFO - 'create-virtualenv',
13:23:55 INFO - 'install',
13:23:55 INFO - 'run-tests'),
13:23:55 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',),
13:23:55 INFO - 'download_minidump_stackwalk': True,
13:23:55 INFO - 'download_symbols': 'ondemand',
13:23:55 INFO - 'exes': {'python': '/tools/buildbot/bin/python',
13:23:55 INFO - 'tooltool.py': '/tools/tooltool.py',
13:23:55 INFO - 'virtualenv': ('/tools/buildbot/bin/python',
13:23:55 INFO - '/tools/misc-python/virtualenv.py')},
13:23:55 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub',
13:23:55 INFO - 'http://pypi.pub.build.mozilla.org/pub'),
13:23:55 INFO - 'installer_path': 'installer.exe',
13:23:55 INFO - 'log_level': 'info',
13:23:55 INFO - 'log_name': 'talos',
13:23:55 INFO - 'log_to_console': True,
13:23:55 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk',
13:23:55 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest',
13:23:55 INFO - 'opt_config_files': (),
13:23:55 INFO - 'pip_index': False,
13:23:55 INFO - 'sps_profile': False,
13:23:55 INFO - 'sps_profile_interval': 0,
13:23:55 INFO - 'suite': 'dromaeojs-e10s',
13:23:55 INFO - 'system_bits': '32',
13:23:55 INFO - 'talos_extra_options': ('--webServer', 'localhost'),
13:23:55 INFO - 'title': 'talos-linux64-ix-005',
13:23:55 INFO - 'tooltool_cache': '/builds/tooltool_cache',
13:23:55 INFO - 'use_talos_json': True,
13:23:55 INFO - 'virtualenv_path': '/builds/slave/test/build/venv',
13:23:55 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None},
13:23:55 INFO - 'work_dir': 'build'}
13:23:55 INFO - #####
13:23:55 INFO - ##### Running clobber step.
13:23:55 INFO - #####
13:23:55 INFO - Running pre-action listener: _resource_record_pre_action
13:23:55 INFO - Running main action method: clobber
13:23:55 INFO - rmtree: /builds/slave/test/build
13:23:55 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1
13:23:56 INFO - Running post-action listener: _resource_record_post_action
13:23:56 INFO - #####
13:23:56 INFO - ##### Finished clobber step (success)
13:23:56 INFO - #####
13:23:56 INFO - #####
13:23:56 INFO - ##### Running read-buildbot-config step.
13:23:56 INFO - #####
13:23:56 INFO - Running pre-action listener: _resource_record_pre_action
13:23:56 INFO - Running main action method: read_buildbot_config
13:23:56 INFO - Using buildbot properties:
13:23:56 INFO - {
13:23:56 INFO - "project": "",
13:23:56 INFO - "product": "firefox",
13:23:56 INFO - "script_repo_revision": "production",
13:23:56 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s",
13:23:56 INFO - "repository": "",
13:23:56 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s",
13:23:56 INFO - "buildid": "20160608103005",
13:23:56 INFO - "pgo_build": "True",
13:23:56 INFO - "basedir": "/builds/slave/test",
13:23:56 INFO - "buildnumber": 834,
13:23:56 INFO - "slavename": "talos-linux64-ix-005",
13:23:56 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/",
13:23:56 INFO - "platform": "ubuntu64_hw",
13:23:56 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos",
13:23:56 INFO - "branch": "mozilla-inbound",
13:23:56 INFO - "repo_path": "integration/mozilla-inbound",
13:23:56 INFO - "revision": "f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61",
13:23:56 INFO - "stage_platform": "linux64-pgo",
13:23:56 INFO - "builduid": "c8da4bd6c9184e9788377909dff0c87a",
13:23:56 INFO - "slavebuilddir": "test"
13:23:56 INFO - }
13:23:56 INFO - Found installer url https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2.
13:23:56 INFO - Running post-action listener: _resource_record_post_action
13:23:56 INFO - #####
13:23:56 INFO - ##### Finished read-buildbot-config step (success)
13:23:56 INFO - #####
13:23:56 INFO - #####
13:23:56 INFO - ##### Running download-and-extract step.
13:23:56 INFO - #####
13:23:56 INFO - Running pre-action listener: _resource_record_pre_action
13:23:56 INFO - Running main action method: download_and_extract
13:23:56 INFO - mkdir: /builds/slave/test/build/tests
13:23:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:23:56 INFO - https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net
13:23:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json
13:23:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json
13:23:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json
13:23:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1
13:23:57 INFO - Downloaded 1361 bytes.
13:23:57 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json
13:23:57 INFO - Using the following test package requirements:
13:23:57 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'],
13:23:57 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'],
13:23:57 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'],
13:23:57 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'jsshell-linux-x86_64.zip'],
13:23:57 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'],
13:23:57 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'],
13:23:57 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'],
13:23:57 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'],
13:23:57 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'],
13:23:57 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip',
13:23:57 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']}
13:23:57 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common
13:23:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:23:57 INFO - https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net
13:23:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:23:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:23:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:23:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1
13:23:59 INFO - Downloaded 24451587 bytes.
13:23:59 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests']
13:23:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests
13:24:00 INFO - Return code: 0
13:24:00 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos
13:24:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:00 INFO - https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net
13:24:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:24:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:24:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip
13:24:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1
13:24:02 INFO - Downloaded 24451587 bytes.
13:24:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests']
13:24:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests
13:24:03 INFO - Return code: 0
13:24:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:03 INFO - https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net
13:24:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip
13:24:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip
13:24:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip
13:24:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1
13:24:04 INFO - Downloaded 10833369 bytes.
13:24:04 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests']
13:24:04 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests
13:24:05 INFO - Return code: 0
13:24:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:05 INFO - https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net
13:24:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
13:24:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
13:24:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
13:24:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1
13:24:11 INFO - Downloaded 59244751 bytes.
13:24:11 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
13:24:11 INFO - mkdir: /builds/slave/test/properties
13:24:11 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url
13:24:11 INFO - Writing to file /builds/slave/test/properties/build_url
13:24:11 INFO - Contents:
13:24:11 INFO - build_url:https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
13:24:12 INFO - Running post-action listener: _resource_record_post_action
13:24:12 INFO - Running post-action listener: set_extra_try_arguments
13:24:12 INFO - #####
13:24:12 INFO - ##### Finished download-and-extract step (success)
13:24:12 INFO - #####
13:24:12 INFO - #####
13:24:12 INFO - ##### Running populate-webroot step.
13:24:12 INFO - #####
13:24:12 INFO - Running pre-action listener: _resource_record_pre_action
13:24:12 INFO - Running main action method: populate_webroot
13:24:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']},
13:24:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']},
13:24:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome',
13:24:12 INFO - '--tppagecycles',
13:24:12 INFO - '7'],
13:24:12 INFO - 'tests': ['tsvgm']}},
13:24:12 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['tresize', 'tcanvasmark']},
13:24:12 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']},
13:24:12 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['dromaeo_css', 'kraken']},
13:24:12 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']},
13:24:12 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']},
13:24:12 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']},
13:24:12 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['damp', 'tps']},
13:24:12 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'tests': ['damp', 'tps']},
13:24:12 INFO - 'g3': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['dromaeo_dom']},
13:24:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']},
13:24:12 INFO - 'other': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'other-e10s': {'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'other-e10s_l64': {'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'other-e10s_nol64': {'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'other_l64': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['a11yr',
13:24:12 INFO - 'ts_paint',
13:24:12 INFO - 'tpaint',
13:24:12 INFO - 'sessionrestore',
13:24:12 INFO - 'sessionrestore_no_auto_restore',
13:24:12 INFO - 'tabpaint']},
13:24:12 INFO - 'svgr': {'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['tsvgx',
13:24:12 INFO - 'tsvgr_opacity',
13:24:12 INFO - 'tart',
13:24:12 INFO - 'tscrollx',
13:24:12 INFO - 'cart']},
13:24:12 INFO - 'svgr-e10s': {'tests': ['tsvgx',
13:24:12 INFO - 'tsvgr_opacity',
13:24:12 INFO - 'tart',
13:24:12 INFO - 'tscrollx',
13:24:12 INFO - 'cart']},
13:24:12 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'talos_options': ['--disable-e10s'],
13:24:12 INFO - 'tests': ['tp5o']},
13:24:12 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'tests': ['tp5o']},
13:24:12 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'talos_options': ['--disable-e10s',
13:24:12 INFO - '--xperf_path',
13:24:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
13:24:12 INFO - 'tests': ['tp5n']},
13:24:12 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
13:24:12 INFO - 'talos_options': ['--xperf_path',
13:24:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
13:24:12 INFO - 'tests': ['tp5n']}},
13:24:12 INFO - 'talos.zip': {'path': '',
13:24:12 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}}
13:24:12 INFO - Running post-action listener: _resource_record_post_action
13:24:12 INFO - #####
13:24:12 INFO - ##### Finished populate-webroot step (success)
13:24:12 INFO - #####
13:24:12 INFO - #####
13:24:12 INFO - ##### Running create-virtualenv step.
13:24:12 INFO - #####
13:24:12 INFO - Running pre-action listener: _resource_record_pre_action
13:24:12 INFO - Running main action method: create_virtualenv
13:24:12 INFO - Creating virtualenv /builds/slave/test/build/venv
13:24:12 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
13:24:12 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv
13:24:12 INFO - The --no-site-packages flag is deprecated; it is now the default behavior.
13:24:12 INFO - Using real prefix '/usr'
13:24:12 INFO - New python executable in /builds/slave/test/build/venv/bin/python
13:24:13 INFO - Installing distribute.............................................................................................................................................................................................done.
13:24:15 INFO - Installing pip.................done.
13:24:15 INFO - Return code: 0
13:24:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv
13:24:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:15 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:15 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
13:24:15 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
13:24:15 INFO - Using env: {'DISPLAY': ':0',
13:24:15 INFO - 'HOME': '/home/cltbld',
13:24:15 INFO - 'LANG': 'en_US.UTF-8',
13:24:15 INFO - 'LANGUAGE': 'en_US:en',
13:24:15 INFO - 'LOGNAME': 'cltbld',
13:24:15 INFO - 'MAIL': '/var/mail/cltbld',
13:24:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:15 INFO - 'MOZ_NO_REMOTE': '1',
13:24:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:15 INFO - 'NO_EM_RESTART': '1',
13:24:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:15 INFO - 'PWD': '/builds/slave/test',
13:24:15 INFO - 'SHELL': '/bin/bash',
13:24:15 INFO - 'SHLVL': '1',
13:24:15 INFO - 'TERM': 'linux',
13:24:15 INFO - 'TMOUT': '86400',
13:24:15 INFO - 'USER': 'cltbld',
13:24:15 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:15 INFO - '_': '/tools/buildbot/bin/python'}
13:24:15 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:15 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
13:24:15 INFO - Cleaning up...
13:24:15 INFO - Return code: 0
13:24:15 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv
13:24:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:15 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:15 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
13:24:15 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
13:24:15 INFO - Using env: {'DISPLAY': ':0',
13:24:15 INFO - 'HOME': '/home/cltbld',
13:24:15 INFO - 'LANG': 'en_US.UTF-8',
13:24:15 INFO - 'LANGUAGE': 'en_US:en',
13:24:15 INFO - 'LOGNAME': 'cltbld',
13:24:15 INFO - 'MAIL': '/var/mail/cltbld',
13:24:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:15 INFO - 'MOZ_NO_REMOTE': '1',
13:24:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:15 INFO - 'NO_EM_RESTART': '1',
13:24:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:15 INFO - 'PWD': '/builds/slave/test',
13:24:15 INFO - 'SHELL': '/bin/bash',
13:24:15 INFO - 'SHLVL': '1',
13:24:15 INFO - 'TERM': 'linux',
13:24:15 INFO - 'TMOUT': '86400',
13:24:15 INFO - 'USER': 'cltbld',
13:24:15 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:15 INFO - '_': '/tools/buildbot/bin/python'}
13:24:15 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:15 INFO - Downloading/unpacking psutil>=3.1.1
13:24:15 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
13:24:15 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
13:24:15 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
13:24:15 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
13:24:15 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
13:24:15 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
13:24:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil
13:24:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build'
13:24:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects
...
13:24:17 INFO - Installing collected packages: psutil
13:24:17 INFO - Running setup.py install for psutil
13:24:17 INFO - building 'psutil._psutil_linux' extension
13:24:17 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
13:24:17 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
13:24:17 INFO - building 'psutil._psutil_posix' extension
13:24:17 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
13:24:18 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
13:24:18 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build'
13:24:18 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ...
13:24:18 INFO - Successfully installed psutil
13:24:18 INFO - Cleaning up...
13:24:18 INFO - Return code: 0
13:24:18 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv
13:24:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:18 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:18 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
13:24:18 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
13:24:18 INFO - Using env: {'DISPLAY': ':0',
13:24:18 INFO - 'HOME': '/home/cltbld',
13:24:18 INFO - 'LANG': 'en_US.UTF-8',
13:24:18 INFO - 'LANGUAGE': 'en_US:en',
13:24:18 INFO - 'LOGNAME': 'cltbld',
13:24:18 INFO - 'MAIL': '/var/mail/cltbld',
13:24:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:18 INFO - 'MOZ_NO_REMOTE': '1',
13:24:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:18 INFO - 'NO_EM_RESTART': '1',
13:24:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:18 INFO - 'PWD': '/builds/slave/test',
13:24:18 INFO - 'SHELL': '/bin/bash',
13:24:18 INFO - 'SHLVL': '1',
13:24:18 INFO - 'TERM': 'linux',
13:24:18 INFO - 'TMOUT': '86400',
13:24:18 INFO - 'USER': 'cltbld',
13:24:18 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:18 INFO - '_': '/tools/buildbot/bin/python'}
13:24:18 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:18 INFO - Downloading/unpacking mozsystemmonitor==0.3
13:24:18 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
13:24:18 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
13:24:18 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
13:24:18 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
13:24:18 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
13:24:18 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
13:24:20 INFO - Downloading mozsystemmonitor-0.3.tar.gz
13:24:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor
13:24:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3)
13:24:20 INFO - Installing collected packages: mozsystemmonitor
13:24:20 INFO - Running setup.py install for mozsystemmonitor
13:24:20 INFO - Successfully installed mozsystemmonitor
13:24:20 INFO - Cleaning up...
13:24:20 INFO - Return code: 0
13:24:20 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv
13:24: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')]}
13:24:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24: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')]}
13:24:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24: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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24: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==2.5.1'] in /builds/slave/test/build
13:24: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==2.5.1
13:24:20 INFO - Using env: {'DISPLAY': ':0',
13:24:20 INFO - 'HOME': '/home/cltbld',
13:24:20 INFO - 'LANG': 'en_US.UTF-8',
13:24:20 INFO - 'LANGUAGE': 'en_US:en',
13:24:20 INFO - 'LOGNAME': 'cltbld',
13:24:20 INFO - 'MAIL': '/var/mail/cltbld',
13:24:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:20 INFO - 'MOZ_NO_REMOTE': '1',
13:24:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:20 INFO - 'NO_EM_RESTART': '1',
13:24:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:20 INFO - 'PWD': '/builds/slave/test',
13:24:20 INFO - 'SHELL': '/bin/bash',
13:24:20 INFO - 'SHLVL': '1',
13:24:20 INFO - 'TERM': 'linux',
13:24:20 INFO - 'TMOUT': '86400',
13:24:20 INFO - 'USER': 'cltbld',
13:24:20 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:20 INFO - '_': '/tools/buildbot/bin/python'}
13:24:20 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:20 INFO - Downloading/unpacking jsonschema==2.5.1
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24:22 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl
13:24:22 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1)
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24:23 INFO - Downloading functools32-3.2.3-2.tar.gz
13:24:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32
13:24:23 INFO - warning: no files found matching '*.txt'
13:24:23 INFO - no previously-included directories found matching 'build'
13:24:23 INFO - no previously-included directories found matching 'dist'
13:24:23 INFO - no previously-included directories found matching '.git*'
13:24:23 INFO - Installing collected packages: jsonschema, functools32
13:24:23 INFO - Running setup.py install for functools32
13:24:23 INFO - warning: no files found matching '*.txt'
13:24:23 INFO - no previously-included directories found matching 'build'
13:24:23 INFO - no previously-included directories found matching 'dist'
13:24:23 INFO - no previously-included directories found matching '.git*'
13:24:23 INFO - Successfully installed jsonschema functools32
13:24:23 INFO - Cleaning up...
13:24:23 INFO - Return code: 0
13:24:23 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv
13:24:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:23 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:23 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
13:24:23 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
13:24:23 INFO - Using env: {'DISPLAY': ':0',
13:24:23 INFO - 'HOME': '/home/cltbld',
13:24:23 INFO - 'LANG': 'en_US.UTF-8',
13:24:23 INFO - 'LANGUAGE': 'en_US:en',
13:24:23 INFO - 'LOGNAME': 'cltbld',
13:24:23 INFO - 'MAIL': '/var/mail/cltbld',
13:24:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:23 INFO - 'MOZ_NO_REMOTE': '1',
13:24:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:23 INFO - 'NO_EM_RESTART': '1',
13:24:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:23 INFO - 'PWD': '/builds/slave/test',
13:24:23 INFO - 'SHELL': '/bin/bash',
13:24:23 INFO - 'SHLVL': '1',
13:24:23 INFO - 'TERM': 'linux',
13:24:23 INFO - 'TMOUT': '86400',
13:24:23 INFO - 'USER': 'cltbld',
13:24:23 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:23 INFO - '_': '/tools/buildbot/bin/python'}
13:24:23 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:23 INFO - Downloading/unpacking blobuploader==1.2.4
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24: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
13:24:25 INFO - Downloading blobuploader-1.2.4.tar.gz
13:24:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader
13:24:25 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4)
13:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests
13:24:25 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4)
13:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:26 INFO - Downloading docopt-0.6.1.tar.gz
13:24:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt
13:24:26 INFO - Installing collected packages: blobuploader, requests, docopt
13:24:26 INFO - Running setup.py install for blobuploader
13:24:26 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775
13:24:26 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775
13:24:26 INFO - Running setup.py install for requests
13:24:26 INFO - Running setup.py install for docopt
13:24:26 INFO - Successfully installed blobuploader requests docopt
13:24:26 INFO - Cleaning up...
13:24:26 INFO - Return code: 0
13:24:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv
13:24:26 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')]}
13:24:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:26 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')]}
13:24:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:26 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:26 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
13:24:26 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
13:24:26 INFO - Using env: {'DISPLAY': ':0',
13:24:26 INFO - 'HOME': '/home/cltbld',
13:24:26 INFO - 'LANG': 'en_US.UTF-8',
13:24:26 INFO - 'LANGUAGE': 'en_US:en',
13:24:26 INFO - 'LOGNAME': 'cltbld',
13:24:26 INFO - 'MAIL': '/var/mail/cltbld',
13:24:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:26 INFO - 'MOZ_NO_REMOTE': '1',
13:24:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:26 INFO - 'NO_EM_RESTART': '1',
13:24:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:26 INFO - 'PWD': '/builds/slave/test',
13:24:26 INFO - 'SHELL': '/bin/bash',
13:24:26 INFO - 'SHLVL': '1',
13:24:26 INFO - 'TERM': 'linux',
13:24:26 INFO - 'TMOUT': '86400',
13:24:26 INFO - 'USER': 'cltbld',
13:24:26 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:26 INFO - '_': '/tools/buildbot/bin/python'}
13:24:27 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser
13:24:27 INFO - Running setup.py (path:/tmp/pip-0QEgHC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash
13:24:27 INFO - Running setup.py (path:/tmp/pip-uMflNv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug
13:24:27 INFO - Running setup.py (path:/tmp/pip-9010ZF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice
13:24:27 INFO - Running setup.py (path:/tmp/pip-j0ItBI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile
13:24:27 INFO - Running setup.py (path:/tmp/pip-wVINmK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd
13:24:27 INFO - Running setup.py (path:/tmp/pip-SEZgau-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo
13:24:27 INFO - Running setup.py (path:/tmp/pip-Pz4Wgj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall
13:24:27 INFO - Running setup.py (path:/tmp/pip-CFuzAV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak
13:24:27 INFO - Running setup.py (path:/tmp/pip-cyVX5e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog
13:24:27 INFO - Running setup.py (path:/tmp/pip-GT2Ha1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork
13:24:27 INFO - Running setup.py (path:/tmp/pip-vD9MYy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess
13:24:27 INFO - Running setup.py (path:/tmp/pip-fkqs28-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile
13:24:27 INFO - Running setup.py (path:/tmp/pip-_fpXJ8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile
13:24:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner
13:24:28 INFO - Running setup.py (path:/tmp/pip-APAzCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner
13:24:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot
13:24:28 INFO - Running setup.py (path:/tmp/pip-vzkm2g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot
13:24:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest
13:24:28 INFO - Running setup.py (path:/tmp/pip-Hvlr02-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest
13:24:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion
13:24:28 INFO - Running setup.py (path:/tmp/pip-B4s21Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion
13:24:28 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion
13:24:28 INFO - Running setup.py install for manifestparser
13:24:28 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin
13:24:28 INFO - Running setup.py install for mozcrash
13:24:28 INFO - Running setup.py install for mozdebug
13:24:28 INFO - Running setup.py install for mozdevice
13:24:28 INFO - Installing sutini script to /builds/slave/test/build/venv/bin
13:24:28 INFO - Installing dm script to /builds/slave/test/build/venv/bin
13:24:28 INFO - Running setup.py install for mozfile
13:24:28 INFO - Running setup.py install for mozhttpd
13:24:28 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin
13:24:28 INFO - Running setup.py install for mozinfo
13:24:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for mozInstall
13:24:29 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for mozleak
13:24:29 INFO - Running setup.py install for mozlog
13:24:29 INFO - Installing structlog script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for moznetwork
13:24:29 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for mozprocess
13:24:29 INFO - Running setup.py install for mozprofile
13:24:29 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for mozrunner
13:24:29 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin
13:24:29 INFO - Running setup.py install for mozscreenshot
13:24:29 INFO - Running setup.py install for moztest
13:24:29 INFO - Running setup.py install for mozversion
13:24:30 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin
13:24:30 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion
13:24:30 INFO - Cleaning up...
13:24:30 INFO - Return code: 0
13:24:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv
13:24:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:30 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:30 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
13:24:30 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
13:24:30 INFO - Using env: {'DISPLAY': ':0',
13:24:30 INFO - 'HOME': '/home/cltbld',
13:24:30 INFO - 'LANG': 'en_US.UTF-8',
13:24:30 INFO - 'LANGUAGE': 'en_US:en',
13:24:30 INFO - 'LOGNAME': 'cltbld',
13:24:30 INFO - 'MAIL': '/var/mail/cltbld',
13:24:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:30 INFO - 'MOZ_NO_REMOTE': '1',
13:24:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:30 INFO - 'NO_EM_RESTART': '1',
13:24:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:30 INFO - 'PWD': '/builds/slave/test',
13:24:30 INFO - 'SHELL': '/bin/bash',
13:24:30 INFO - 'SHLVL': '1',
13:24:30 INFO - 'TERM': 'linux',
13:24:30 INFO - 'TMOUT': '86400',
13:24:30 INFO - 'USER': 'cltbld',
13:24:30 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:30 INFO - '_': '/tools/buildbot/bin/python'}
13:24:30 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser
13:24:30 INFO - Running setup.py (path:/tmp/pip-BP26C3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash
13:24:30 INFO - Running setup.py (path:/tmp/pip-89jZTs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug
13:24:30 INFO - Running setup.py (path:/tmp/pip-gKOUuJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice
13:24:30 INFO - Running setup.py (path:/tmp/pip-NKWpTs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile
13:24:30 INFO - Running setup.py (path:/tmp/pip-svROSQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd
13:24:30 INFO - Running setup.py (path:/tmp/pip-63aqXh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo
13:24:30 INFO - Running setup.py (path:/tmp/pip-W5jcVb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall
13:24:30 INFO - Running setup.py (path:/tmp/pip-JEO3ws-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak
13:24:30 INFO - Running setup.py (path:/tmp/pip-yAyaRw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak
13:24:30 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))
13:24:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog
13:24:30 INFO - Running setup.py (path:/tmp/pip-y2Q5PN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork
13:24:31 INFO - Running setup.py (path:/tmp/pip-vofBxz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess
13:24:31 INFO - Running setup.py (path:/tmp/pip-N4V1Nx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile
13:24:31 INFO - Running setup.py (path:/tmp/pip-7wDVcq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner
13:24:31 INFO - Running setup.py (path:/tmp/pip-zGygAV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot
13:24:31 INFO - Running setup.py (path:/tmp/pip-quP9SW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest
13:24:31 INFO - Running setup.py (path:/tmp/pip-pPwC3_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest
13:24:31 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))
13:24:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion
13:24:31 INFO - Running setup.py (path:/tmp/pip-xxNI9a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion
13:24:31 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))
13:24:31 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))
13:24:31 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))
13:24:31 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))
13:24:31 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))
13:24:31 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))
13:24:31 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10))
13:24:31 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
13:24:31 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
13:24:31 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
13:24:31 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
13:24:31 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
13:24:31 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
13:24:33 INFO - Downloading blessings-1.6.tar.gz
13:24:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings
13:24:33 INFO - Installing collected packages: blessings
13:24:33 INFO - Running setup.py install for blessings
13:24:33 INFO - Successfully installed blessings
13:24:33 INFO - Cleaning up...
13:24:33 INFO - Return code: 0
13:24:33 INFO - Done creating virtualenv /builds/slave/test/build/venv.
13:24:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze']
13:24:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze
13:24:33 INFO - Reading from file tmpfile_stdout
13:24:33 INFO - Current package versions:
13:24:33 INFO - argparse == 1.2.1
13:24:33 INFO - blessings == 1.6
13:24:33 INFO - blobuploader == 1.2.4
13:24:33 INFO - docopt == 0.6.1
13:24:33 INFO - functools32 == 3.2.3-2
13:24:33 INFO - jsonschema == 2.5.1
13:24:33 INFO - manifestparser == 1.1
13:24:33 INFO - mozInstall == 1.12
13:24:33 INFO - mozcrash == 0.17
13:24:33 INFO - mozdebug == 0.1
13:24:33 INFO - mozdevice == 0.48
13:24:33 INFO - mozfile == 1.2
13:24:33 INFO - mozhttpd == 0.7
13:24:33 INFO - mozinfo == 0.9
13:24:33 INFO - mozleak == 0.1
13:24:33 INFO - mozlog == 3.2
13:24:33 INFO - moznetwork == 0.27
13:24:33 INFO - mozprocess == 0.22
13:24:33 INFO - mozprofile == 0.28
13:24:33 INFO - mozrunner == 6.11
13:24:33 INFO - mozscreenshot == 0.1
13:24:33 INFO - mozsystemmonitor == 0.3
13:24:33 INFO - moztest == 0.7
13:24:33 INFO - mozversion == 1.4
13:24:33 INFO - psutil == 3.1.1
13:24:33 INFO - requests == 1.2.3
13:24:33 INFO - wsgiref == 0.1.2
13:24:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv
13:24:33 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')]}
13:24:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:33 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')]}
13:24:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:33 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 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:33 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
13:24:33 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
13:24:33 INFO - Using env: {'DISPLAY': ':0',
13:24:33 INFO - 'HOME': '/home/cltbld',
13:24:33 INFO - 'LANG': 'en_US.UTF-8',
13:24:33 INFO - 'LANGUAGE': 'en_US:en',
13:24:33 INFO - 'LOGNAME': 'cltbld',
13:24:33 INFO - 'MAIL': '/var/mail/cltbld',
13:24:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:33 INFO - 'MOZ_NO_REMOTE': '1',
13:24:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:33 INFO - 'NO_EM_RESTART': '1',
13:24:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:33 INFO - 'PWD': '/builds/slave/test',
13:24:33 INFO - 'SHELL': '/bin/bash',
13:24:33 INFO - 'SHLVL': '1',
13:24:33 INFO - 'TERM': 'linux',
13:24:33 INFO - 'TMOUT': '86400',
13:24:33 INFO - 'USER': 'cltbld',
13:24:33 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:33 INFO - '_': '/tools/buildbot/bin/python'}
13:24:34 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 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))
13:24:34 INFO - Cleaning up...
13:24:34 INFO - Return code: 0
13:24:34 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv
13:24:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build
13:24:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema
13:24:34 INFO - Using env: {'DISPLAY': ':0',
13:24:34 INFO - 'HOME': '/home/cltbld',
13:24:34 INFO - 'LANG': 'en_US.UTF-8',
13:24:34 INFO - 'LANGUAGE': 'en_US:en',
13:24:34 INFO - 'LOGNAME': 'cltbld',
13:24:34 INFO - 'MAIL': '/var/mail/cltbld',
13:24:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:34 INFO - 'MOZ_NO_REMOTE': '1',
13:24:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:34 INFO - 'NO_EM_RESTART': '1',
13:24:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:34 INFO - 'PWD': '/builds/slave/test',
13:24:34 INFO - 'SHELL': '/bin/bash',
13:24:34 INFO - 'SHLVL': '1',
13:24:34 INFO - 'TERM': 'linux',
13:24:34 INFO - 'TMOUT': '86400',
13:24:34 INFO - 'USER': 'cltbld',
13:24:34 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:34 INFO - '_': '/tools/buildbot/bin/python'}
13:24:34 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:34 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages
13:24:34 INFO - Cleaning up...
13:24:34 INFO - Return code: 0
13:24:34 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv
13:24:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
13:24:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
13:24:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
13:24:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
13:24:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f12875f6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x185b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1926350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, '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': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458', '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
13:24:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build
13:24:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8
13:24:34 INFO - Using env: {'DISPLAY': ':0',
13:24:34 INFO - 'HOME': '/home/cltbld',
13:24:34 INFO - 'LANG': 'en_US.UTF-8',
13:24:34 INFO - 'LANGUAGE': 'en_US:en',
13:24:34 INFO - 'LOGNAME': 'cltbld',
13:24:34 INFO - 'MAIL': '/var/mail/cltbld',
13:24:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:34 INFO - 'MOZ_NO_REMOTE': '1',
13:24:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:34 INFO - 'NO_EM_RESTART': '1',
13:24:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:34 INFO - 'PWD': '/builds/slave/test',
13:24:34 INFO - 'SHELL': '/bin/bash',
13:24:34 INFO - 'SHLVL': '1',
13:24:34 INFO - 'TERM': 'linux',
13:24:34 INFO - 'TMOUT': '86400',
13:24:34 INFO - 'USER': 'cltbld',
13:24:34 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:34 INFO - '_': '/tools/buildbot/bin/python'}
13:24:34 INFO - Ignoring indexes: https://pypi.python.org/simple/
13:24:34 INFO - Downloading/unpacking flake8
13:24:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl
13:24:36 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8)
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl
13:24:36 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8)
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8)
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
13:24:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
13:24:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
13:24:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8
13:24:37 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs'
13:24:37 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs'
13:24:37 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite'
13:24:37 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite'
13:24:37 INFO - no previously-included directories found matching 'docs/_build'
13:24:37 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8
13:24:37 INFO - Running setup.py install for pep8
13:24:37 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs'
13:24:37 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs'
13:24:37 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite'
13:24:37 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite'
13:24:37 INFO - no previously-included directories found matching 'docs/_build'
13:24:37 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin
13:24:37 INFO - Successfully installed flake8 mccabe pyflakes pep8
13:24:37 INFO - Cleaning up...
13:24:37 INFO - Return code: 0
13:24:37 INFO - Running post-action listener: _resource_record_post_action
13:24:37 INFO - Running post-action listener: _start_resource_monitoring
13:24:37 INFO - Starting resource monitoring.
13:24:37 INFO - #####
13:24:37 INFO - ##### Finished create-virtualenv step (success)
13:24:37 INFO - #####
13:24:37 INFO - #####
13:24:37 INFO - ##### Running install step.
13:24:37 INFO - #####
13:24:37 INFO - Running pre-action listener: _resource_record_pre_action
13:24:37 INFO - Running main action method: install
13:24:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze']
13:24:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze
13:24:37 INFO - Reading from file tmpfile_stdout
13:24:37 INFO - Detecting whether we're running mozinstall >=1.0...
13:24:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h']
13:24:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h
13:24:37 INFO - Reading from file tmpfile_stdout
13:24:37 INFO - Output received:
13:24:37 INFO - Usage: mozinstall [options] installer
13:24:37 INFO - Options:
13:24:37 INFO - -h, --help show this help message and exit
13:24:37 INFO - -d DEST, --destination=DEST
13:24:37 INFO - Directory to install application into. [default:
13:24:37 INFO - "/builds/slave/test"]
13:24:37 INFO - --app=APP Application being installed. [default: firefox]
13:24:37 INFO - mkdir: /builds/slave/test/build/application
13:24:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application']
13:24:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application
13:24:54 INFO - Reading from file tmpfile_stdout
13:24:54 INFO - Output received:
13:24:54 INFO - /builds/slave/test/build/application/firefox/firefox
13:24:54 INFO - Running post-action listener: _resource_record_post_action
13:24:54 INFO - #####
13:24:54 INFO - ##### Finished install step (success)
13:24:54 INFO - #####
13:24:54 INFO - #####
13:24:54 INFO - ##### Running run-tests step.
13:24:54 INFO - #####
13:24:54 INFO - Running pre-action listener: _resource_record_pre_action
13:24:54 INFO - Running main action method: run_tests
13:24:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version']
13:24:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version
13:24:54 INFO - Python 2.7.3
13:24:54 INFO - Return code: 0
13:24:54 INFO - grabbing minidump binary from tooltool
13:24: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')]}
13:24:54 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 0x19b51c0>, '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 0x19b60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19b6550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1
13:24:54 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
13:24:54 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
13:24:54 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
13:24:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache
13:24:54 INFO - Return code: 0
13:24:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755
13:24:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir
13:24:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir
13:24:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk
13:24:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir
13:24:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos']
13:24:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos
13:24:55 INFO - Return code: 0
13:24:55 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/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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
13:24:55 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/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-005 --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
13:24:55 INFO - Using env: {'DISPLAY': ':0',
13:24:55 INFO - 'HOME': '/home/cltbld',
13:24:55 INFO - 'LANG': 'en_US.UTF-8',
13:24:55 INFO - 'LANGUAGE': 'en_US:en',
13:24:55 INFO - 'LOGNAME': 'cltbld',
13:24:55 INFO - 'MAIL': '/var/mail/cltbld',
13:24:55 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir',
13:24:55 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk',
13:24:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
13:24:55 INFO - 'MOZ_NO_REMOTE': '1',
13:24:55 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir',
13:24:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
13:24:55 INFO - 'NO_EM_RESTART': '1',
13:24:55 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
13:24:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json',
13:24:55 INFO - 'PWD': '/builds/slave/test',
13:24:55 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos',
13:24:55 INFO - 'SHELL': '/bin/bash',
13:24:55 INFO - 'SHLVL': '1',
13:24:55 INFO - 'TERM': 'linux',
13:24:55 INFO - 'TMOUT': '86400',
13:24:55 INFO - 'USER': 'cltbld',
13:24:55 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458',
13:24:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
13:24:55 INFO - '_': '/tools/buildbot/bin/python'}
13:24:55 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/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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
13:24:55 INFO - mozversion application_buildid: 20160608103005
13:24:55 INFO - mozversion application_changeset: f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61
13:24:55 INFO - mozversion application_display_name: Nightly
13:24:55 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384}
13:24:55 INFO - mozversion application_name: Firefox
13:24:55 INFO - mozversion application_remotingname: firefox
13:24:55 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound
13:24:55 INFO - mozversion application_vendor: Mozilla
13:24:55 INFO - mozversion application_version: 50.0a1
13:24:55 INFO - mozversion platform_buildid: 20160608103005
13:24:55 INFO - mozversion platform_changeset: f0006e4f551ead7f84b1ba79ec7f39e5c39a6e61
13:24:55 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound
13:24:55 INFO - mozversion platform_version: 50.0a1
13:24:55 INFO - using testdate: 1465417495
13:24:55 INFO - actual date: 1465417495
13:24:55 INFO - starting webserver on 'localhost:54977'
13:24:55 INFO - SUITE-START | Running 2 tests
13:24:55 INFO - TEST-START | dromaeo_css
13:24:55 INFO - operating with platform_type : linux_
13:24:55 INFO - Initialising browser for dromaeo_css test...
13:24:55 INFO - TEST-INFO | started process 6524 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbNNlF1/profile http://localhost:54977/getInfo.html)
13:25:00 INFO - PROCESS | 6524 | __metrics Screen width/height:1600/1200
13:25:00 INFO - PROCESS | 6524 | colorDepth:24
13:25:00 INFO - PROCESS | 6524 | Browser inner width/height: 1024/697
13:25:00 INFO - PROCESS | 6524 | __metrics
13:25:00 ERROR - PROCESS | 6524 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined
13:25:01 INFO - TEST-INFO | 6524: exit 0
13:25:01 INFO - Browser initialized.
13:25:01 INFO - Running cycle 1/1 for dromaeo_css test...
13:25:01 INFO - TEST-INFO | started process 6645 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbNNlF1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1)
13:25:13 INFO - PROCESS | 6645 | RSS: Main: 167010304
13:25:13 INFO - PROCESS | 6645 |
13:26:03 INFO - PROCESS | 6645 | 1465417563212 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]
13:28:10 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54977/tests/dromaeo/cssquery-ext.html)
13:28:11 INFO - PROCESS | 6645 | RSS: Main: 171032576
13:28:11 INFO - PROCESS | 6645 |
13:31:14 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-ext.html (next: http://localhost:54977/tests/dromaeo/cssquery-jquery.html)
13:31:14 INFO - PROCESS | 6645 | RSS: Main: 169750528
13:31:14 INFO - PROCESS | 6645 |
13:34:16 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54977/tests/dromaeo/cssquery-mootools.html)
13:34:17 INFO - PROCESS | 6645 | RSS: Main: 171560960
13:34:17 INFO - PROCESS | 6645 |
13:37:18 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54977/tests/dromaeo/cssquery-prototype.html)
13:37:19 INFO - PROCESS | 6645 | RSS: Main: 168976384
13:37:19 INFO - PROCESS | 6645 |
13:40:21 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54977/tests/dromaeo/cssquery-yui.html)
13:40:22 INFO - PROCESS | 6645 | RSS: Main: 170729472
13:40:22 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | Cycle 1(1): loaded http://localhost:54977/tests/dromaeo/cssquery-yui.html (next: http://localhost:54977/tests/dromaeo/cssquery-dojo.html)
13:43:25 INFO - PROCESS | 6645 | RSS: Main: 172171264
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | __start_tp_report
13:43:25 INFO - PROCESS | 6645 | _x_x_mozilla_page_load
13:43:25 INFO - PROCESS | 6645 | _x_x_mozilla_page_load_details
13:43:25 INFO - PROCESS | 6645 | |i|pagename|runs|
13:43:25 INFO - PROCESS | 6645 | |0;dojo.html;3113.7041981011807;3155.179653290144;3163.161762133034;3177.1421716136642;3182.952255716164;5357.4106848246665;5370.516653501184;5372.811951581695;5415.350157981038;5430.402655707879;5192.454792246816;5348.812791552296;5360.035193665139;5375.75809088591;5449.972750136244;4797.832075877345;4797.952020479795;4943.678660887049;4984.601231901439;5000.824971126011;739.7285013394335;4801.159797035522;4847.612191024709;4889.804407823683;4999.225120106389;4860.902781944359;4871.439784424783;4872.439669438007;4890.853274401774;4911.361523002022;4878.731669758162;4887.657863949525;4897.1674815281485;4899.118158731427;4942.678725882842;4778.856634300976;4790.976045119787;4806.134895718769;4816.903661926777;4824.49342819006;5212.244224587452;5225.581953443715;5247.527722504993;5251.632385733;5254;5485.588580856412;5664.858378540528;5713.028785106542;5714.114312281561;5727.942720572824;5807.970960145172;5853.326867410217;5858.2677165354335;5870.060790273578;5890.70546472679;5463.371712253102;5470.753816078286;5476.534494567966;5481.260029895992;5483.204935284361;5689.857753556194;5799.9130013049835;5948.137520059568;5977.551683623746;5983.551233657493;5609.4390560943575;5638.943610563924;5641.041023026095;5651.802186923438;5695.316562012585;5725.484706376446;5737.85655358611;5743.655380677173;5745.1669507921115;5761.3950535194035;5547.861303467364;5696.917585658712;5706.971465142731;5751;5793;5750.396208398058;5762.049261871744;5764.827055188351;5781.103928891029;5814.186013958049;4343.7176583522605;4382.9342559861625;4388.626966707866;4413.955860441419;4424.955750442455;3836.731428799957;3897.785621790829;3936;3953.6046395360236;3971.9801400993388;5349.5720342372515;5491.450854914477;5516.7517461714315;5526.723663816793;5537.446255374431;5861.120831875252;5861.413858614104;5892.440218179266;5898.174255604219;5911.793087241926;5266;5314.22943673173;5328.387235467893;5469.726513674301;5580.525655319262;4939.827106051271;4951.876203094951;4959.256111583291;4992.2511623256805;5039.84880453587;5973.671448070398;5982.252218472691;5990.430909063632;6009.45914867664;6014.909776353358;5531.1426728857095;5807.506361959281;5808.767649293981;5845.503132233638;5868.972929737364;6095.317435523607;6112.833168314206;6119.045604113885;6119.143319935301;6120.6999641249595;5766.279215098113;5768.971155144198;5769.394213607511;5774.307083150049;5774.94225057744;5554.888902222014;5724.284464441945;5774.971125144348;5804;5850.5904586678525;5609.971950140223;5619.2133101365025;5626.746796394254;5640.464155905182;5653.689047102449;5617.522510586646;5617.634853734494;5619.100943848965;5631.549476041989;5633.887322253614;5399.244105825109;5442.4557544246845;5553.194786755817;5556.749946252509;5621.4659607337235;5675.716214189357;5738.512226460798;5753.338366087954;5758.827235182784;5777.24895763548;5600.35595906476;5603.579731520071;5614.550835933034;5619.297587801525;5621.184928185472
13:43:25 INFO - PROCESS | 6645 | |1;ext.html;581.4911952041963;624.6470744029626;634.7429291137089;654.2704884054281;654.6203202142756;43021.78489107554;44204.115917681665;44441.00030997209;47652.28521572179;47711.52288477114;45007;45317.7734111329;45508.08983820322;45571.31643025349;45754;8794.340424468175;8985.056569060253;9003.5048072356;9025.277977761796;9042.140996605312;8914.73255802327;8988.280937524982;9017.23353514952;9044.23124034458;9045.502497362642;9045.185933266004;9061.637534498612;9065.546722663874;9067;9073.909260907372;8990.775230619221;8991.235744961654;9002.279817614575;9021.052789457079;9056.909430905673;8883.555822208928;8942.776430589221;8961.865572016424;8966.103389660982;8971.775705607346;41952.273102248255;42370.15259694789;42732;42797.57202427967;42853.142937141085;3526.559180102487;3544.131687736521;3681.9447708284397;3773.1887644156363;4100.958990410088;31631.52552711711;31831.204219894455;31992.360152797046;32074;33525.32949341;3993.820278087493;4268.679849011337;4320.049589090395;4331.328644060176;4334.089841133366;211727;213066;213435;213557;213977.93011035002;62367.37632623706;62535.37464625295;62783.37216627866;62976;62991.37008629947;35175.82412087923;35987.4601880972;36324.455133173025;37665.435018474745;37693.81153094217;17202.397916072878;17304.740428893576;17329;17383.391581294847;17389.739153912702;12946;13088.28014459214;13091.08362414641;13176.670583235304;13229.536966206137;19409.2236310546;19590.118444670024;19617.528685348658;19692.21231150738;19741.40775776729;7445.85108297831;7478.140013898363;7478.5138965967035;7555.24447555251;7799.883001754978;1059.9894001060045;1104.1884215101893;1114.7658991611852;1180.8346831443432;1205.0299508895423;32427.51358729621;32774.836125819216;32843.83578082094;32895.342093158004;33232.501512477334;1115.776844631077;1162.203890335123;1206.3666575048169;1230.4893469210178;1306.7778477658821;16635.41776037833;17006;17130.743038854427;17219.741703874453;17415.129243537773;491479;495290;496024;496534;499184;57729.42270577324;57960.71019644959;58206.417935820944;58366.7081664589;58428.707856460445;1345.9865401345862;1383.6540864783803;1391.4990603382976;1398.7132637809225;1411.6682579593787;30604.387912241185;31647.84176079105;31907.36185276328;31935;32468.67531324751;50219;50387.49612503975;50419;50705.239421409446;50811;410835;415208;415898;418515;419500;27705.86147069252;27931.860340698167;27982;28031.299217519725;28180.295492612848;46372.7681361591;47546.762266188445;47562;51593.22610160926;52675.209871851184;41147.58852411557;41747.582524174366;42373.1525369497;42621.78689106535;42682;41058.384124237564;41254.1749165009;41293.38059929164;41407.792961035004;42065.15869682528;36661.633383666885;39729;40662.593374067066;40859.59140408558;42716;35023.47464787979;36653.63346366502;36808;37064;37321;28643.283917901386;28682.856585716938;28839.855800720863;28975.7102428973;29026.564601530572
13:43:25 INFO - PROCESS | 6645 | |2;jquery.html;382.5294887288635;383.7869982159902;390.1611535199322;392.96070392960723;400.3714168755054;17705.291788328468;19466.805331946678;19926.103325350377;19956.900215498903;19973.800261997374;15960.84039159608;16084;16120.274587643555;17335.47993560192;18352.26590936361;5464.590155738336;5513.3108361454815;5704.686242256675;5708.486236238738;5713.114467257582;5570.637908535952;5622.718864056801;5646.322441307049;5672.858178545549;5680;5158.3552055993005;5558.749856256458;5563.833085007456;5583.3300003999375;5605.327360716719;5458.2904222451025;5502.5597952163735;5532.474414930595;5562.082256427685;5590.664560126405;5213.765380557884;5556.111022236463;5600.411956744524;5609.158626206061;5623.606347555673;13214.273214973173;13413.66465838352;13567.45730170792;22764.886175569183;22824.429389265402;2195.549912267997;2225.8664480131083;2257.0971611355426;2369.0810443540786;2415.903363865443;9934.205263578897;10181.694549163536;10203.234757393151;10337.689869303933;10508.579656813718;1894.6021335519558;1930.5849242412808;1940;1958.921643134273;2014.798520147988;62513.687431563005;70410.64794676045;73521;76192.61903690502;80159;10254;10433.061024507831;10442.373457592568;10491.318064325795;10672.679819605424;14462.638434039023;14490.85509144916;14525.854741452662;14555.19946402958;14563.344649490586;8164.306033987177;8164.387670924586;8229.711960081368;8392.538410387488;8421.95789021051;8167.63245653947;8173;8176.305014073751;8265.669373225004;8335.666573337;4211.220924129046;4243.554426785143;4298.290782020994;4491.416115904977;4523.321501774694;1750.4923572164184;1822.4441545328536;1828.515443407498;1885.3220633636074;1908.6278175755594;431.8704388683382;452.19734970427754;453.66655508201444;456.8081405809568;1023.9078482936571;11230.775384492264;11568.074554035657;11807;11844.28934263947;11989;453.0327750253233;460;466.33314360464186;467.22207524472054;473.35859909822386;4449;6236.376362363727;6265.843353916189;6331.303556608769;6412.3267056959285;461187;462244;487574;488490;497331;59473.70263148743;60076.69961650251;60766.69616651889;61550.69224653848;90252.5487372559;438.3381094547193;438.48478038304864;441.5231549926136;442.29674817040416;445.18975464654665;10213.182994857194;10334.379937203792;10353.378797272188;10466.79631842348;10548.472576370998;40313.19373612453;40513.59486405098;40640.59359406368;41031.38452923268;41746.37380439357;59679.403205967385;60191;60558.486037849405;61184.38815611965;61596.38403615906;8185.959070204611;8450.619722112642;8463.534505602005;8604.311655067704;8753.956230218808;11719.88280117222;12720.68198295013;12921;13310.600681979557;13318.200907945555;11609.825852612048;11700.648980530597;11784.469698863742;11819.527218911491;11901.107416943936;11315.603953861575;11436.142289328167;11472.024877885473;11503.137264705349;11526.07791376671;11825.113116516468;11836.82244766312;11846.466908988943;11962.34207118582;11989.460474278503;8098.433109682265;8356.791080223044;8376.371772117238;8730.519821409884;8835;10261.2304077196;11715.355655438692;11792.823107653221;11893.643190704293;11909.344986025852
13:43:25 INFO - PROCESS | 6645 | |3;mootools.html;1514.2958524286205;1536.5851220170553;1656.6024154202994;1803.431918945532;1845.806190350014;8011.399145064114;8589.398742088057;8755.518446485441;9288.628454861806;9295.581698823553;8913.955430222839;8944.105589441053;8993.145651163146;9057.23013543848;9061.365704400678;2291.049214575953;2331.73185083715;2336.906523739048;2349.400902769791;2352.6823878776404;2267.6598510223516;2302.8503147295373;2308.7575804540534;2312.89591968361;2316.1893337331967;2278.043221846828;2287.63397856343;2291.759365266648;2328.138588722175;2335.6730057791924;2268.3308424014954;2286.634138537834;2320.4662927526765;2335.2877372401495;2350.330155905567;2276.2374604507345;2312.8034117100065;2322.837401381904;2327.55776402483;2336.240721765433;8956.552172391355;9013.324000699973;9049.683261085896;9058;9059.547022648841;5285.07511185541;5319.734013299359;5377.542908852753;5389.380221274525;5411.594130440233;3236.9607147497163;3386.9887646023017;3406.3187362527347;3483.372992861284;3492.353914525821;1010.919126469888;1071.3732466507104;1074.4735079810914;1094.0864378244175;1095.2880627592049;12816.615501534969;12834.679133021657;12841.807372889414;12873.227606343557;12898.09713320068;4606.101810146989;4642.048380082075;4752.952470475251;4764.166270902648;4777.331173635694;10718.946405267923;10743.086837618734;10767.83848242277;10781.083607893417;10791.83812242817;5348.117560602457;5450.236966824647;5454.10007348791;5457.399686034533;5470.589705772003;4284.914301713949;4873.926891096637;5004.3494345734825;5020.246962955586;5040.747962601855;4063;4116.065449238853;4123.876283711494;4176.874693759192;4185.832566697298;1294.5727909789746;1315.15829868884;1317.1504379675057;1318.5759379869717;1321.1148530484597;804.4891493901415;889.4440974391006;910.8041771019263;911.3483859040817;915.190056799737;6399.13611662429;6443.7744678936015;6443.935560644333;6451.709673064724;6460.547761656733;439.29054576858783;446.7408902836347;449.42249209765293;453.9636829053668;454.57043094275593;4365.301551751704;4426.867193984185;4496.572825581565;4549.840755573539;4615.100055489147;11259.831102533468;11491.080713542897;11524.078073754079;11616.825747613793;11642.88357116418;11233.10135189183;11364.204505684687;11366.545338186379;11433.371164585862;11442.54229830814;8025.197480251928;8370.832583348421;8371.037330706924;8473.237408633253;8577.142285771497;6353.332900045613;6565.770198043237;6621.735130594722;6627.072209890715;6686.13080299558;10390.948045259725;10577.471126443801;10578.8942110581;10627.787444251226;10632.255742098288;10511.316764410289;10587.153027757915;10818.404987725437;10827.458627068772;10834.133269338276;7151.463640227108;7907.604619768874;8072.273495385443;8124.065732440608;8165.918340816754;8916.86624700643;8978.506182160045;9023.187913087591;9039.774005649648;9059.456432614064;7874.173211812677;8060.1133875274845;8116.553589552631;8161.959190204248;8219.794505137419;7787.92212077872;7869.567173805267;8032.518048917083;8052.476589021695;8058.3150432213915;7222.349988501061;7278.890816637861;7352;7361.852762944604;7385.29839665231;5426.972865135807;5463.808766693147;5573.1918871762555;5604.327480702342;5626.85932851682;5430.239766432782;5510.311211098613;5517.69652669107;5543.722813859372;5656.095024796013
13:43:25 INFO - PROCESS | 6645 | |4;prototype.html;326.89049168528544;328.13209062030927;332.62911853283595;332.9384063948168;334.29630627529053;5571.3314402271735;5628.212050312949;5663.971680141599;5694.316681998161;5711.543076553876;5540.695261760612;5550.833474995747;5579.972100139494;5607.607467477278;5609.775608975647;4034.6368826805583;4179.247735407625;4282.379055037018;4299.763513006784;4341.587549182823;4266.381374700666;4273.38035984782;4288.549702281247;4292.871213863574;4299.6775241856985;4272.359146128075;4298.570142985708;4315.136972605475;4329.913401731979;4334.241507736149;4057.660971879273;4280.357946308048;4283.6439958023275;4286.142771445723;4363.803628836694;3703;3721.3673675475234;3723.2739615774935;3725.8137093145506;3735.364987952055;5372.301600791872;5386.596005299579;5409;5417.6478528895495;5420.891582168374;4602.6548008899135;4899.7550122494085;4919.335889654886;4919.508049195052;4940.25896115582;5873.412658734135;5884.6469211847;5890.234269544974;5892.616979896293;5898.458187195878;4122.91754164915;4128.669706423479;4131.648809851166;4150.771707556083;4168.624823765876;5783.190353350535;6021.36775638556;6034.366391528914;6034.5172386209;6123.632582045091;4158.232751080778;4163.208990291835;4175.10235299406;4185.455890734246;4202.957970420318;4211.389348544444;4215.957840421618;4244.490661120685;4255.829766809355;4259.148170365877;4638.5593368629925;4878.9512104878495;4880.658353915192;4902.436219834764;4914.754262286943;5798.246227990418;5821.970890145522;5833.300003999547;5843.444872737168;5868.178455016301;1437.7124575085024;1446.8553144685657;1460.4158336665419;1470.7573250413775;1472.829100864815;867.418829384314;926.249737712455;946.3517490519016;972.5866506734609;977.6040703515088;5493.835184944458;5594.713215960352;5602.551795856321;5626.76211233528;5626.971865140648;5833.270841144857;5887.293524777054;5920.763169473173;5936.109583562414;5946.672932988728;5381.192821076792;5549.334079910436;5566.66600003993;5586.748596313176;5587.608867379326;3131.123285480069;3171.238902663344;3193.265548923714;3196.6004249468815;3225.870965161414;5996.970015149984;6189.319174890848;6220.34686357935;6240.7503699852405;6305.464035557029;6028.4272994065495;6081.17904082952;6122.683623021072;6130.1724267224245;6141.7543298268465;6124.816255512342;6158.368032471309;6197.380261973766;6241.940159747272;6276.623402595859;5712.942870571241;5970.582059255984;5974.492168165754;5991.161237426677;5994.8501287466415;5904.350521442724;5934.287885453773;5936.673482958478;5942.465178133989;5987.191729116514;5875.706214689163;6120.7551697931585;6138.232720909887;6185.680369861302;6276.466500347522;4157;4163.958360416478;4168.7707176104395;4172.603602657743;4173.9582604173565;5962.25471816023;6001.489873360813;6002;6012.549058820693;6019.337872833898;5492.286002819608;5860.619059761102;5887.8233652990475;5906.493844069735;5961.821145365646;5764.6829424380385;5833.533317334518;5866.325372582037;5891.410858914074;5905.91141132892;5529.364123125892;5625.690587017753;5746.213086653053;5819.428754236248;5820.738066787089;5888.705564721832;5910.4089591042275;5924.52603791687;5945.256842894638;5948.256467941507;5628.227108460822;5772.336181339199;5796.449337312949;5811.622244554091;5845.567835880067
13:43:25 INFO - PROCESS | 6645 | |5;yui.html;744.3858816476405;761.056290200152;769.6151924037981;825.4139560911752;871.9694810681625;13686.657833554154;14446.422143114263;14465.20441375724;14500.492482763093;14810.55568332949;14876.47932322369;14926.552203433886;14934;15007.099574025566;15027.774583381259;788.1094363369384;812.7683610171088;816.4937738602075;821.1460081515218;822.3051521464383;819.0580832043139;820.7209548753423;820.8809722590221;824.9935079203362;825.8183199696057;843.2495079379357;846.8560344741409;850.9489430634181;852.0882655558555;853.8932633420823;832.142892820396;841.6759547574167;843.6498852976008;846.9661213551482;848.0586548930683;607.2136583124864;609.8170548835332;612.7947137708873;613.8404014956099;613.9570230083896;14840.703185936221;14939.551813445614;14980.775288370683;14987.100773953598;15011.324490397848;14893.925530372278;15037.548873533811;15087.773683394758;15117.319720612599;15221.31504082319;12167;12416.379181040911;12448.62654120378;12518.74962500745;13051;3865.091703449687;3947.50656167979;3978.423128646359;3981.024648960994;4103.4870641169855;79391;80093.19906800915;81262;82044.58977705133;82537.58731206365;10910.727231819268;10964.122870170368;11140.851119078887;11169.72075698114;11243.943780281046;19665.213391464466;20346.694799578017;22180.445488862584;22332.106715731188;22332.21837235689;8911.688090916787;8933.776655583533;9007;9016.278697704169;9131.77170570741;4990.251462280615;4997.425296090923;5039.244113382949;5097.566706829961;5194.948050519446;3648.1973965727498;3801;3804.6575808177395;3818.3508803503473;3842.51968503937;679.9354061364163;699.2308460693197;707.3845754193884;712.4122598855964;719.9604021778748;644.3846126948753;692.5152393324693;728.5883475836135;767.1637914672922;774.8450309938034;10202;10420.843687344695;10459.163266938627;10692.893071069346;10706.411147386812;653.859420224654;686.1286166568431;687.9552829066095;708.1749761527865;714.118064190724;4621.445426548836;4929.148444039382;4999.075171093359;5289.18017707256;5564.443555644403;111536;112132;114073;114096;116059;99356;101434.49282753539;102852.48573757234;104307;104648;61389.69305153446;90558;91026.54486727789;92039.53980230055;92667;10238.180945524191;10393.896061039293;10513.9474302628;10524.473776311;10573.312734672221;48863.267050993556;50342;51346.74326628343;51586;52104.47895521148;71091;80761.59619201867;80762;81057.59471202843;81394.59302703448;13440.46238150463;13493.730125397633;13506.72986540244;13666.86333136656;13936.930315348358;13922.651933701738;14043.859561404255;14492.782608261095;15252.542423727306;15461.61345966315;14065.296735162996;14203.786943196066;14340.928295358457;14470.27648617586;14675;13969.511067112602;14281.857181428468;14477.493287734878;14613.123212607277;14613.123212607277;13744.450221991408;13976.301184940916;14245.501407451104;14354.425822966965;14449;11328.32030078198;11440.427978601203;11575.884241157817;11634.36011019402;12173.147879648339;11132.499037543168;11259.437028148395;12309.630711078682;12386.3187524687;12389.690257743629
13:43:25 INFO - PROCESS | 6645 | __end_tp_report
13:43:25 INFO - PROCESS | 6645 | __start_cc_report
13:43:25 INFO - PROCESS | 6645 | _x_x_mozilla_cycle_collect,360
13:43:25 INFO - PROCESS | 6645 | __end_cc_report
13:43:25 INFO - PROCESS | 6645 | __startTimestamp1465418605522__endTimestamp
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | ------- Summary: start -------
13:43:25 INFO - PROCESS | 6645 | Number of tests: 6
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#0] dojo.html Cycles:165 Average:5332.57 Median:5600.36 stddev:715.13 (12.8%) stddev-sans-first:695.81
13:43:25 INFO - PROCESS | 6645 | Values: 3113.7 3155.2 3163.2 3177.1 3183.0 5357.4 5370.5 5372.8 5415.4 5430.4 5192.5 5348.8 5360.0 5375.8 5450.0 4797.8 4798.0 4943.7 4984.6 5000.8 739.7 4801.2 4847.6 4889.8 4999.2 4860.9 4871.4 4872.4 4890.9 4911.4 4878.7 4887.7 4897.2 4899.1 4942.7 4778.9 4791.0 4806.1 4816.9 4824.5 5212.2 5225.6 5247.5 5251.6 5254.0 5485.6 5664.9 5713.0 5714.1 5727.9 5808.0 5853.3 5858.3 5870.1 5890.7 5463.4 5470.8 5476.5 5481.3 5483.2 5689.9 5799.9 5948.1 5977.6 5983.6 5609.4 5638.9 5641.0 5651.8 5695.3 5725.5 5737.9 5743.7 5745.2 5761.4 5547.9 5696.9 5707.0 5751.0 5793.0 5750.4 5762.0 5764.8 5781.1 5814.2 4343.7 4382.9 4388.6 4414.0 4425.0 3836.7 3897.8 3936.0 3953.6 3972.0 5349.6 5491.5 5516.8 5526.7 5537.4 5861.1 5861.4 5892.4 5898.2 5911.8 5266.0 5314.2 5328.4 5469.7 5580.5 4939.8 4951.9 4959.3 4992.3 5039.8 5973.7 5982.3 5990.4 6009.5 6014.9 5531.1 5807.5 5808.8 5845.5 5869.0 6095.3 6112.8 6119.0 6119.1 6120.7 5766.3 5769.0 5769.4 5774.3 5774.9 5554.9 5724.3 5775.0 5804.0 5850.6 5610.0 5619.2 5626.7 5640.5 5653.7 5617.5 5617.6 5619.1 5631.5 5633.9 5399.2 5442.5 5553.2 5556.7 5621.5 5675.7 5738.5 5753.3 5758.8 5777.2 5600.4 5603.6 5614.6 5619.3 5621.2
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#1] ext.html Cycles:180 Average:54475.05 Median:228307.90 stddev:104344.05 (45.7%) stddev-sans-first:104558.31
13:43:25 INFO - PROCESS | 6645 | Values: 581.5 624.6 634.7 654.3 654.6 43021.8 44204.1 44441.0 47652.3 47711.5 45007.0 45317.8 45508.1 45571.3 45754.0 8794.3 8985.1 9003.5 9025.3 9042.1 8914.7 8988.3 9017.2 9044.2 9045.5 9045.2 9061.6 9065.5 9067.0 9073.9 8990.8 8991.2 9002.3 9021.1 9056.9 8883.6 8942.8 8961.9 8966.1 8971.8 41952.3 42370.2 42732.0 42797.6 42853.1 3526.6 3544.1 3681.9 3773.2 4101.0 31631.5 31831.2 31992.4 32074.0 33525.3 3993.8 4268.7 4320.0 4331.3 4334.1 211727.0 213066.0 213435.0 213557.0 213977.9 62367.4 62535.4 62783.4 62976.0 62991.4 35175.8 35987.5 36324.5 37665.4 37693.8 17202.4 17304.7 17329.0 17383.4 17389.7 12946.0 13088.3 13091.1 13176.7 13229.5 19409.2 19590.1 19617.5 19692.2 19741.4 7445.9 7478.1 7478.5 7555.2 7799.9 1060.0 1104.2 1114.8 1180.8 1205.0 32427.5 32774.8 32843.8 32895.3 33232.5 1115.8 1162.2 1206.4 1230.5 1306.8 16635.4 17006.0 17130.7 17219.7 17415.1 491479.0 495290.0 496024.0 496534.0 499184.0 57729.4 57960.7 58206.4 58366.7 58428.7 1346.0 1383.7 1391.5 1398.7 1411.7 30604.4 31647.8 31907.4 31935.0 32468.7 50219.0 50387.5 50419.0 50705.2 50811.0 410835.0 415208.0 415898.0 418515.0 419500.0 27705.9 27931.9 27982.0 28031.3 28180.3 46372.8 47546.8 47562.0 51593.2 52675.2 41147.6 41747.6 42373.2 42621.8 42682.0 41058.4 41254.2 41293.4 41407.8 42065.2 36661.6 39729.0 40662.6 40859.6 42716.0 35023.5 36653.6 36808.0 37064.0 37321.0 28643.3 28682.9 28839.9 28975.7 29026.6
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#2] jquery.html Cycles:180 Average:26927.14 Median:4227.39 stddev:78741.01 (1862.6%) stddev-sans-first:78936.67
13:43:25 INFO - PROCESS | 6645 | Values: 382.5 383.8 390.2 393.0 400.4 17705.3 19466.8 19926.1 19956.9 19973.8 15960.8 16084.0 16120.3 17335.5 18352.3 5464.6 5513.3 5704.7 5708.5 5713.1 5570.6 5622.7 5646.3 5672.9 5680.0 5158.4 5558.7 5563.8 5583.3 5605.3 5458.3 5502.6 5532.5 5562.1 5590.7 5213.8 5556.1 5600.4 5609.2 5623.6 13214.3 13413.7 13567.5 22764.9 22824.4 2195.5 2225.9 2257.1 2369.1 2415.9 9934.2 10181.7 10203.2 10337.7 10508.6 1894.6 1930.6 1940.0 1958.9 2014.8 62513.7 70410.6 73521.0 76192.6 80159.0 10254.0 10433.1 10442.4 10491.3 10672.7 14462.6 14490.9 14525.9 14555.2 14563.3 8164.3 8164.4 8229.7 8392.5 8422.0 8167.6 8173.0 8176.3 8265.7 8335.7 4211.2 4243.6 4298.3 4491.4 4523.3 1750.5 1822.4 1828.5 1885.3 1908.6 431.9 452.2 453.7 456.8 1023.9 11230.8 11568.1 11807.0 11844.3 11989.0 453.0 460.0 466.3 467.2 473.4 4449.0 6236.4 6265.8 6331.3 6412.3 461187.0 462244.0 487574.0 488490.0 497331.0 59473.7 60076.7 60766.7 61550.7 90252.5 438.3 438.5 441.5 442.3 445.2 10213.2 10334.4 10353.4 10466.8 10548.5 40313.2 40513.6 40640.6 41031.4 41746.4 59679.4 60191.0 60558.5 61184.4 61596.4 8186.0 8450.6 8463.5 8604.3 8754.0 11719.9 12720.7 12921.0 13310.6 13318.2 11609.8 11700.6 11784.5 11819.5 11901.1 11315.6 11436.1 11472.0 11503.1 11526.1 11825.1 11836.8 11846.5 11962.3 11989.5 8098.4 8356.8 8376.4 8730.5 8835.0 10261.2 11715.4 11792.8 11893.6 11909.3
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#3] mootools.html Cycles:180 Average:6016.67 Median:4610.60 stddev:3480.21 (75.5%) stddev-sans-first:3473.52
13:43:25 INFO - PROCESS | 6645 | Values: 1514.3 1536.6 1656.6 1803.4 1845.8 8011.4 8589.4 8755.5 9288.6 9295.6 8914.0 8944.1 8993.1 9057.2 9061.4 2291.0 2331.7 2336.9 2349.4 2352.7 2267.7 2302.9 2308.8 2312.9 2316.2 2278.0 2287.6 2291.8 2328.1 2335.7 2268.3 2286.6 2320.5 2335.3 2350.3 2276.2 2312.8 2322.8 2327.6 2336.2 8956.6 9013.3 9049.7 9058.0 9059.5 5285.1 5319.7 5377.5 5389.4 5411.6 3237.0 3387.0 3406.3 3483.4 3492.4 1010.9 1071.4 1074.5 1094.1 1095.3 12816.6 12834.7 12841.8 12873.2 12898.1 4606.1 4642.0 4753.0 4764.2 4777.3 10718.9 10743.1 10767.8 10781.1 10791.8 5348.1 5450.2 5454.1 5457.4 5470.6 4284.9 4873.9 5004.3 5020.2 5040.7 4063.0 4116.1 4123.9 4176.9 4185.8 1294.6 1315.2 1317.2 1318.6 1321.1 804.5 889.4 910.8 911.3 915.2 6399.1 6443.8 6443.9 6451.7 6460.5 439.3 446.7 449.4 454.0 454.6 4365.3 4426.9 4496.6 4549.8 4615.1 11259.8 11491.1 11524.1 11616.8 11642.9 11233.1 11364.2 11366.5 11433.4 11442.5 8025.2 8370.8 8371.0 8473.2 8577.1 6353.3 6565.8 6621.7 6627.1 6686.1 10390.9 10577.5 10578.9 10627.8 10632.3 10511.3 10587.2 10818.4 10827.5 10834.1 7151.5 7907.6 8072.3 8124.1 8165.9 8916.9 8978.5 9023.2 9039.8 9059.5 7874.2 8060.1 8116.6 8162.0 8219.8 7787.9 7869.6 8032.5 8052.5 8058.3 7222.3 7278.9 7352.0 7361.9 7385.3 5427.0 5463.8 5573.2 5604.3 5626.9 5430.2 5510.3 5517.7 5543.7 5656.1
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#4] prototype.html Cycles:180 Average:4890.77 Median:5617.73 stddev:1463.52 (26.1%) stddev-sans-first:1426.98
13:43:25 INFO - PROCESS | 6645 | Values: 326.9 328.1 332.6 332.9 334.3 5571.3 5628.2 5664.0 5694.3 5711.5 5540.7 5550.8 5580.0 5607.6 5609.8 4034.6 4179.2 4282.4 4299.8 4341.6 4266.4 4273.4 4288.5 4292.9 4299.7 4272.4 4298.6 4315.1 4329.9 4334.2 4057.7 4280.4 4283.6 4286.1 4363.8 3703.0 3721.4 3723.3 3725.8 3735.4 5372.3 5386.6 5409.0 5417.6 5420.9 4602.7 4899.8 4919.3 4919.5 4940.3 5873.4 5884.6 5890.2 5892.6 5898.5 4122.9 4128.7 4131.6 4150.8 4168.6 5783.2 6021.4 6034.4 6034.5 6123.6 4158.2 4163.2 4175.1 4185.5 4203.0 4211.4 4216.0 4244.5 4255.8 4259.1 4638.6 4879.0 4880.7 4902.4 4914.8 5798.2 5822.0 5833.3 5843.4 5868.2 1437.7 1446.9 1460.4 1470.8 1472.8 867.4 926.2 946.4 972.6 977.6 5493.8 5594.7 5602.6 5626.8 5627.0 5833.3 5887.3 5920.8 5936.1 5946.7 5381.2 5549.3 5566.7 5586.7 5587.6 3131.1 3171.2 3193.3 3196.6 3225.9 5997.0 6189.3 6220.3 6240.8 6305.5 6028.4 6081.2 6122.7 6130.2 6141.8 6124.8 6158.4 6197.4 6241.9 6276.6 5712.9 5970.6 5974.5 5991.2 5994.9 5904.4 5934.3 5936.7 5942.5 5987.2 5875.7 6120.8 6138.2 6185.7 6276.5 4157.0 4164.0 4168.8 4172.6 4174.0 5962.3 6001.5 6002.0 6012.5 6019.3 5492.3 5860.6 5887.8 5906.5 5961.8 5764.7 5833.5 5866.3 5891.4 5905.9 5529.4 5625.7 5746.2 5819.4 5820.7 5888.7 5910.4 5924.5 5945.3 5948.3 5628.2 5772.3 5796.4 5811.6 5845.6
13:43:25 INFO - PROCESS | 6645 |
13:43:25 INFO - PROCESS | 6645 | [#5] yui.html Cycles:180 Average:21285.02 Median:3802.83 stddev:30492.03 (801.8%) stddev-sans-first:30538.56
13:43:25 INFO - PROCESS | 6645 | Values: 744.4 761.1 769.6 825.4 872.0 13686.7 14446.4 14465.2 14500.5 14810.6 14876.5 14926.6 14934.0 15007.1 15027.8 788.1 812.8 816.5 821.1 822.3 819.1 820.7 820.9 825.0 825.8 843.2 846.9 850.9 852.1 853.9 832.1 841.7 843.6 847.0 848.1 607.2 609.8 612.8 613.8 614.0 14840.7 14939.6 14980.8 14987.1 15011.3 14893.9 15037.5 15087.8 15117.3 15221.3 12167.0 12416.4 12448.6 12518.7 13051.0 3865.1 3947.5 3978.4 3981.0 4103.5 79391.0 80093.2 81262.0 82044.6 82537.6 10910.7 10964.1 11140.9 11169.7 11243.9 19665.2 20346.7 22180.4 22332.1 22332.2 8911.7 8933.8 9007.0 9016.3 9131.8 4990.3 4997.4 5039.2 5097.6 5194.9 3648.2 3801.0 3804.7 3818.4 3842.5 679.9 699.2 707.4 712.4 720.0 644.4 692.5 728.6 767.2 774.8 10202.0 10420.8 10459.2 10692.9 10706.4 653.9 686.1 688.0 708.2 714.1 4621.4 4929.1 4999.1 5289.2 5564.4 111536.0 112132.0 114073.0 114096.0 116059.0 99356.0 101434.5 102852.5 104307.0 104648.0 61389.7 90558.0 91026.5 92039.5 92667.0 10238.2 10393.9 10513.9 10524.5 10573.3 48863.3 50342.0 51346.7 51586.0 52104.5 71091.0 80761.6 80762.0 81057.6 81394.6 13440.5 13493.7 13506.7 13666.9 13936.9 13922.7 14043.9 14492.8 15252.5 15461.6 14065.3 14203.8 14340.9 14470.3 14675.0 13969.5 14281.9 14477.5 14613.1 14613.1 13744.5 13976.3 14245.5 14354.4 14449.0 11328.3 11440.4 11575.9 11634.4 12173.1 11132.5 11259.4 12309.6 12386.3 12389.7
13:43:25 INFO - PROCESS | 6645 | -------- Summary: end --------
13:43:25 INFO - PROCESS | 6645 |
13:43:26 INFO - TEST-INFO | 6645: exit 0
13:43:26 INFO - TEST-OK | dromaeo_css | took 1110393ms
13:43:26 INFO - TEST-START | kraken
13:43:26 INFO - operating with platform_type : linux_
13:43:26 INFO - Initialising browser for kraken test...
13:43:26 INFO - TEST-INFO | started process 6875 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0vHIvw/profile http://localhost:54977/getInfo.html)
13:43:30 INFO - PROCESS | 6875 | __metrics Screen width/height:1600/1200
13:43:30 INFO - PROCESS | 6875 | colorDepth:24
13:43:30 INFO - PROCESS | 6875 | Browser inner width/height: 1024/697
13:43:30 INFO - PROCESS | 6875 | __metrics
13:43:31 ERROR - PROCESS | 6875 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined
13:43:32 INFO - TEST-INFO | 6875: exit 0
13:43:32 INFO - Browser initialized.
13:43:32 INFO - Running cycle 1/1 for kraken test...
13:43:32 INFO - TEST-INFO | started process 6995 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0vHIvw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1)
13:43:43 INFO - PROCESS | 6995 | RSS: Main: 167682048
13:43:43 INFO - PROCESS | 6995 |
13:43:46 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54977/tests/kraken/driver.html?testName=audio-beat-detection)
13:43:47 INFO - PROCESS | 6995 | RSS: Main: 172548096
13:43:47 INFO - PROCESS | 6995 |
13:43:50 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54977/tests/kraken/driver.html?testName=audio-dft)
13:43:50 INFO - PROCESS | 6995 | RSS: Main: 171847680
13:43:50 INFO - PROCESS | 6995 |
13:43:53 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54977/tests/kraken/driver.html?testName=audio-fft)
13:43:54 INFO - PROCESS | 6995 | RSS: Main: 166785024
13:43:54 INFO - PROCESS | 6995 |
13:43:56 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54977/tests/kraken/driver.html?testName=audio-oscillator)
13:43:57 INFO - PROCESS | 6995 | RSS: Main: 167723008
13:43:57 INFO - PROCESS | 6995 |
13:43:59 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54977/tests/kraken/driver.html?testName=imaging-gaussian-blur)
13:43:59 INFO - PROCESS | 6995 | RSS: Main: 167903232
13:43:59 INFO - PROCESS | 6995 |
13:44:03 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54977/tests/kraken/driver.html?testName=imaging-darkroom)
13:44:03 INFO - PROCESS | 6995 | RSS: Main: 168452096
13:44:03 INFO - PROCESS | 6995 |
13:44:07 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54977/tests/kraken/driver.html?testName=imaging-desaturate)
13:44:07 INFO - PROCESS | 6995 | RSS: Main: 165732352
13:44:07 INFO - PROCESS | 6995 |
13:44:10 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54977/tests/kraken/driver.html?testName=json-parse-financial)
13:44:11 INFO - PROCESS | 6995 | RSS: Main: 167329792
13:44:11 INFO - PROCESS | 6995 |
13:44:12 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54977/tests/kraken/driver.html?testName=json-stringify-tinderbox)
13:44:13 INFO - PROCESS | 6995 | RSS: Main: 168022016
13:44:13 INFO - PROCESS | 6995 |
13:44:15 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-aes)
13:44:15 INFO - PROCESS | 6995 | RSS: Main: 168333312
13:44:15 INFO - PROCESS | 6995 |
13:44:17 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-ccm)
13:44:18 INFO - PROCESS | 6995 | RSS: Main: 168460288
13:44:18 INFO - PROCESS | 6995 |
13:44:21 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2)
13:44:21 INFO - PROCESS | 6995 | RSS: Main: 168284160
13:44:21 INFO - PROCESS | 6995 |
13:44:24 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative)
13:44:25 INFO - PROCESS | 6995 | RSS: Main: 168574976
13:44:25 INFO - PROCESS | 6995 |
13:44:26 INFO - PROCESS | 6995 | Cycle 1(1): loaded http://localhost:54977/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54977/tests/kraken/driver.html?testName=ai-astar)
13:44:27 INFO - PROCESS | 6995 | RSS: Main: 169340928
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | __start_tp_report
13:44:27 INFO - PROCESS | 6995 | _x_x_mozilla_page_load
13:44:27 INFO - PROCESS | 6995 | _x_x_mozilla_page_load_details
13:44:27 INFO - PROCESS | 6995 | |i|pagename|runs|
13:44:27 INFO - PROCESS | 6995 | |0;ai-astar;111;107;110;109;111;112;111;110;110;112
13:44:27 INFO - PROCESS | 6995 | |1;audio-beat-detection;163;132;157;179;127;159;152;129;185;127
13:44:27 INFO - PROCESS | 6995 | |2;audio-dft;163;163;164;166;162;167;171;162;161;162
13:44:27 INFO - PROCESS | 6995 | |3;audio-fft;76;77;75;172;75;75;76;75;179;76
13:44:27 INFO - PROCESS | 6995 | |4;audio-oscillator;85;83;142;85;85;86;144;84;85;144
13:44:27 INFO - PROCESS | 6995 | |5;imaging-gaussian-blur;117;119;121;117;118;120;118;118;117;117
13:44:27 INFO - PROCESS | 6995 | |6;imaging-darkroom;147;146;149;151;148;148;147;148;148;147
13:44:27 INFO - PROCESS | 6995 | |7;imaging-desaturate;96;97;95;96;99;96;96;96;96;97
13:44:27 INFO - PROCESS | 6995 | |8;json-parse-financial;55;57;57;56;59;56;57;56;56;60
13:44:27 INFO - PROCESS | 6995 | |9;json-stringify-tinderbox;61;63;62;62;62;62;62;61;61;62
13:44:27 INFO - PROCESS | 6995 | |10;stanford-crypto-aes;84;85;81;81;82;81;80;80;107;81
13:44:27 INFO - PROCESS | 6995 | |11;stanford-crypto-ccm;125;139;125;128;127;126;135;129;145;131
13:44:27 INFO - PROCESS | 6995 | |12;stanford-crypto-pbkdf2;170;164;161;165;163;161;160;160;156;177
13:44:27 INFO - PROCESS | 6995 | |13;stanford-crypto-sha256-iterative;64;63;63;67;64;63;64;63;64;61
13:44:27 INFO - PROCESS | 6995 | __end_tp_report
13:44:27 INFO - PROCESS | 6995 | __start_cc_report
13:44:27 INFO - PROCESS | 6995 | _x_x_mozilla_cycle_collect,850
13:44:27 INFO - PROCESS | 6995 | __end_cc_report
13:44:27 INFO - PROCESS | 6995 | __startTimestamp1465418667138__endTimestamp
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | ------- Summary: start -------
13:44:27 INFO - PROCESS | 6995 | Number of tests: 14
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#0] ai-astar Cycles:10 Average:110.30 Median:111.00 stddev:1.49 (1.3%) stddev-sans-first:1.56
13:44:27 INFO - PROCESS | 6995 | Values: 111.0 107.0 110.0 109.0 111.0 112.0 111.0 110.0 110.0 112.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#1] audio-beat-detection Cycles:10 Average:151.00 Median:158.00 stddev:21.56 (13.6%) stddev-sans-first:22.42
13:44:27 INFO - PROCESS | 6995 | Values: 163.0 132.0 157.0 179.0 127.0 159.0 152.0 129.0 185.0 127.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#2] audio-dft Cycles:10 Average:164.10 Median:163.50 stddev:3.07 (1.9%) stddev-sans-first:3.23
13:44:27 INFO - PROCESS | 6995 | Values: 163.0 163.0 164.0 166.0 162.0 167.0 171.0 162.0 161.0 162.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#3] audio-fft Cycles:10 Average:95.60 Median:75.50 stddev:42.15 (55.8%) stddev-sans-first:44.10
13:44:27 INFO - PROCESS | 6995 | Values: 76.0 77.0 75.0 172.0 75.0 75.0 76.0 75.0 179.0 76.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#4] audio-oscillator Cycles:10 Average:102.30 Median:85.00 stddev:28.33 (33.3%) stddev-sans-first:29.35
13:44:27 INFO - PROCESS | 6995 | Values: 85.0 83.0 142.0 85.0 85.0 86.0 144.0 84.0 85.0 144.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.00 stddev:1.40 (1.2%) stddev-sans-first:1.41
13:44:27 INFO - PROCESS | 6995 | Values: 117.0 119.0 121.0 117.0 118.0 120.0 118.0 118.0 117.0 117.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#6] imaging-darkroom Cycles:10 Average:147.90 Median:148.00 stddev:1.37 (0.9%) stddev-sans-first:1.41
13:44:27 INFO - PROCESS | 6995 | Values: 147.0 146.0 149.0 151.0 148.0 148.0 147.0 148.0 148.0 147.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.07 (1.1%) stddev-sans-first:1.13
13:44:27 INFO - PROCESS | 6995 | Values: 96.0 97.0 95.0 96.0 99.0 96.0 96.0 96.0 96.0 97.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#8] json-parse-financial Cycles:10 Average:56.90 Median:57.00 stddev:1.52 (2.7%) stddev-sans-first:1.45
13:44:27 INFO - PROCESS | 6995 | Values: 55.0 57.0 57.0 56.0 59.0 56.0 57.0 56.0 56.0 60.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#9] json-stringify-tinderbox Cycles:10 Average:61.80 Median:62.00 stddev:0.63 (1.0%) stddev-sans-first:0.60
13:44:27 INFO - PROCESS | 6995 | Values: 61.0 63.0 62.0 62.0 62.0 62.0 62.0 61.0 61.0 62.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#10] stanford-crypto-aes Cycles:10 Average:84.20 Median:81.00 stddev:8.18 (10.1%) stddev-sans-first:8.67
13:44:27 INFO - PROCESS | 6995 | Values: 84.0 85.0 81.0 81.0 82.0 81.0 80.0 80.0 107.0 81.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#11] stanford-crypto-ccm Cycles:10 Average:131.00 Median:130.00 stddev:6.68 (5.1%) stddev-sans-first:6.73
13:44:27 INFO - PROCESS | 6995 | Values: 125.0 139.0 125.0 128.0 127.0 126.0 135.0 129.0 145.0 131.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.70 Median:163.50 stddev:5.96 (3.6%) stddev-sans-first:5.87
13:44:27 INFO - PROCESS | 6995 | Values: 170.0 164.0 161.0 165.0 163.0 161.0 160.0 160.0 156.0 177.0
13:44:27 INFO - PROCESS | 6995 |
13:44:27 INFO - PROCESS | 6995 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.60 Median:64.00 stddev:1.51 (2.4%) stddev-sans-first:1.59
13:44:27 INFO - PROCESS | 6995 | Values: 64.0 63.0 63.0 67.0 64.0 63.0 64.0 63.0 64.0 61.0
13:44:27 INFO - PROCESS | 6995 | -------- Summary: end --------
13:44:27 INFO - PROCESS | 6995 |
13:44:28 INFO - TEST-INFO | 6995: exit 0
13:44:28 INFO - TEST-OK | kraken | took 61915ms
13:44:28 INFO - SUITE-END | took 1172s
13:44:28 INFO - Completed test suite (00:19:32)
13:44:28 INFO - javascript benchmark
13:44:28 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7168.316916266639, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3113.7041981011807, 3155.179653290144, 3163.161762133034, 3177.1421716136642, 3182.952255716164, 5357.4106848246665, 5370.516653501184, 5372.811951581695, 5415.350157981038, 5430.402655707879, 5192.454792246816, 5348.812791552296, 5360.035193665139, 5375.75809088591, 5449.972750136244, 4797.832075877345, 4797.952020479795, 4943.678660887049, 4984.601231901439, 5000.824971126011, 739.7285013394335, 4801.159797035522, 4847.612191024709, 4889.804407823683, 4999.225120106389, 4860.902781944359, 4871.439784424783, 4872.439669438007, 4890.853274401774, 4911.361523002022, 4878.731669758162, 4887.657863949525, 4897.1674815281485, 4899.118158731427, 4942.678725882842, 4778.856634300976, 4790.976045119787, 4806.134895718769, 4816.903661926777, 4824.49342819006, 5212.244224587452, 5225.581953443715, 5247.527722504993, 5251.632385733, 5254.0, 5485.588580856412, 5664.858378540528, 5713.028785106542, 5714.114312281561, 5727.942720572824, 5807.970960145172, 5853.326867410217, 5858.2677165354335, 5870.060790273578, 5890.70546472679, 5463.371712253102, 5470.753816078286, 5476.534494567966, 5481.260029895992, 5483.204935284361, 5689.857753556194, 5799.9130013049835, 5948.137520059568, 5977.551683623746, 5983.551233657493, 5609.4390560943575, 5638.943610563924, 5641.041023026095, 5651.802186923438, 5695.316562012585, 5725.484706376446, 5737.85655358611, 5743.655380677173, 5745.1669507921115, 5761.3950535194035, 5547.861303467364, 5696.917585658712, 5706.971465142731, 5751.0, 5793.0, 5750.396208398058, 5762.049261871744, 5764.827055188351, 5781.103928891029, 5814.186013958049, 4343.7176583522605, 4382.9342559861625, 4388.626966707866, 4413.955860441419, 4424.955750442455, 3836.731428799957, 3897.785621790829, 3936.0, 3953.6046395360236, 3971.9801400993388, 5349.5720342372515, 5491.450854914477, 5516.7517461714315, 5526.723663816793, 5537.446255374431, 5861.120831875252, 5861.413858614104, 5892.440218179266, 5898.174255604219, 5911.793087241926, 5266.0, 5314.22943673173, 5328.387235467893, 5469.726513674301, 5580.525655319262, 4939.827106051271, 4951.876203094951, 4959.256111583291, 4992.2511623256805, 5039.84880453587, 5973.671448070398, 5982.252218472691, 5990.430909063632, 6009.45914867664, 6014.909776353358, 5531.1426728857095, 5807.506361959281, 5808.767649293981, 5845.503132233638, 5868.972929737364, 6095.317435523607, 6112.833168314206, 6119.045604113885, 6119.143319935301, 6120.6999641249595, 5766.279215098113, 5768.971155144198, 5769.394213607511, 5774.307083150049, 5774.94225057744, 5554.888902222014, 5724.284464441945, 5774.971125144348, 5804.0, 5850.5904586678525, 5609.971950140223, 5619.2133101365025, 5626.746796394254, 5640.464155905182, 5653.689047102449, 5617.522510586646, 5617.634853734494, 5619.100943848965, 5631.549476041989, 5633.887322253614, 5399.244105825109, 5442.4557544246845, 5553.194786755817, 5556.749946252509, 5621.4659607337235, 5675.716214189357, 5738.512226460798, 5753.338366087954, 5758.827235182784, 5777.24895763548, 5600.35595906476, 5603.579731520071, 5614.550835933034, 5619.297587801525, 5621.184928185472], "value": 5285.88062389752, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [581.4911952041963, 624.6470744029626, 634.7429291137089, 654.2704884054281, 654.6203202142756, 43021.78489107554, 44204.115917681665, 44441.00030997209, 47652.28521572179, 47711.52288477114, 45007.0, 45317.7734111329, 45508.08983820322, 45571.31643025349, 45754.0, 8794.340424468175, 8985.056569060253, 9003.5048072356, 9025.277977761796, 9042.140996605312, 8914.73255802327, 8988.280937524982, 9017.23353514952, 9044.23124034458, 9045.502497362642, 9045.185933266004, 9061.637534498612, 9065.546722663874, 9067.0, 9073.909260907372, 8990.775230619221, 8991.235744961654, 9002.279817614575, 9021.052789457079, 9056.909430905673, 8883.555822208928, 8942.776430589221, 8961.865572016424, 8966.103389660982, 8971.775705607346, 41952.273102248255, 42370.15259694789, 42732.0, 42797.57202427967, 42853.142937141085, 3526.559180102487, 3544.131687736521, 3681.9447708284397, 3773.1887644156363, 4100.958990410088, 31631.52552711711, 31831.204219894455, 31992.360152797046, 32074.0, 33525.32949341, 3993.820278087493, 4268.679849011337, 4320.049589090395, 4331.328644060176, 4334.089841133366, 211727.0, 213066.0, 213435.0, 213557.0, 213977.93011035002, 62367.37632623706, 62535.37464625295, 62783.37216627866, 62976.0, 62991.37008629947, 35175.82412087923, 35987.4601880972, 36324.455133173025, 37665.435018474745, 37693.81153094217, 17202.397916072878, 17304.740428893576, 17329.0, 17383.391581294847, 17389.739153912702, 12946.0, 13088.28014459214, 13091.08362414641, 13176.670583235304, 13229.536966206137, 19409.2236310546, 19590.118444670024, 19617.528685348658, 19692.21231150738, 19741.40775776729, 7445.85108297831, 7478.140013898363, 7478.5138965967035, 7555.24447555251, 7799.883001754978, 1059.9894001060045, 1104.1884215101893, 1114.7658991611852, 1180.8346831443432, 1205.0299508895423, 32427.51358729621, 32774.836125819216, 32843.83578082094, 32895.342093158004, 33232.501512477334, 1115.776844631077, 1162.203890335123, 1206.3666575048169, 1230.4893469210178, 1306.7778477658821, 16635.41776037833, 17006.0, 17130.743038854427, 17219.741703874453, 17415.129243537773, 491479.0, 495290.0, 496024.0, 496534.0, 499184.0, 57729.42270577324, 57960.71019644959, 58206.417935820944, 58366.7081664589, 58428.707856460445, 1345.9865401345862, 1383.6540864783803, 1391.4990603382976, 1398.7132637809225, 1411.6682579593787, 30604.387912241185, 31647.84176079105, 31907.36185276328, 31935.0, 32468.67531324751, 50219.0, 50387.49612503975, 50419.0, 50705.239421409446, 50811.0, 410835.0, 415208.0, 415898.0, 418515.0, 419500.0, 27705.86147069252, 27931.860340698167, 27982.0, 28031.299217519725, 28180.295492612848, 46372.7681361591, 47546.762266188445, 47562.0, 51593.22610160926, 52675.209871851184, 41147.58852411557, 41747.582524174366, 42373.1525369497, 42621.78689106535, 42682.0, 41058.384124237564, 41254.1749165009, 41293.38059929164, 41407.792961035004, 42065.15869682528, 36661.633383666885, 39729.0, 40662.593374067066, 40859.59140408558, 42716.0, 35023.47464787979, 36653.63346366502, 36808.0, 37064.0, 37321.0, 28643.283917901386, 28682.856585716938, 28839.855800720863, 28975.7102428973, 29026.564601530572], "value": 19893.8433259345, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [382.5294887288635, 383.7869982159902, 390.1611535199322, 392.96070392960723, 400.3714168755054, 17705.291788328468, 19466.805331946678, 19926.103325350377, 19956.900215498903, 19973.800261997374, 15960.84039159608, 16084.0, 16120.274587643555, 17335.47993560192, 18352.26590936361, 5464.590155738336, 5513.3108361454815, 5704.686242256675, 5708.486236238738, 5713.114467257582, 5570.637908535952, 5622.718864056801, 5646.322441307049, 5672.858178545549, 5680.0, 5158.3552055993005, 5558.749856256458, 5563.833085007456, 5583.3300003999375, 5605.327360716719, 5458.2904222451025, 5502.5597952163735, 5532.474414930595, 5562.082256427685, 5590.664560126405, 5213.765380557884, 5556.111022236463, 5600.411956744524, 5609.158626206061, 5623.606347555673, 13214.273214973173, 13413.66465838352, 13567.45730170792, 22764.886175569183, 22824.429389265402, 2195.549912267997, 2225.8664480131083, 2257.0971611355426, 2369.0810443540786, 2415.903363865443, 9934.205263578897, 10181.694549163536, 10203.234757393151, 10337.689869303933, 10508.579656813718, 1894.6021335519558, 1930.5849242412808, 1940.0, 1958.921643134273, 2014.798520147988, 62513.687431563005, 70410.64794676045, 73521.0, 76192.61903690502, 80159.0, 10254.0, 10433.061024507831, 10442.373457592568, 10491.318064325795, 10672.679819605424, 14462.638434039023, 14490.85509144916, 14525.854741452662, 14555.19946402958, 14563.344649490586, 8164.306033987177, 8164.387670924586, 8229.711960081368, 8392.538410387488, 8421.95789021051, 8167.63245653947, 8173.0, 8176.305014073751, 8265.669373225004, 8335.666573337, 4211.220924129046, 4243.554426785143, 4298.290782020994, 4491.416115904977, 4523.321501774694, 1750.4923572164184, 1822.4441545328536, 1828.515443407498, 1885.3220633636074, 1908.6278175755594, 431.8704388683382, 452.19734970427754, 453.66655508201444, 456.8081405809568, 1023.9078482936571, 11230.775384492264, 11568.074554035657, 11807.0, 11844.28934263947, 11989.0, 453.0327750253233, 460.0, 466.33314360464186, 467.22207524472054, 473.35859909822386, 4449.0, 6236.376362363727, 6265.843353916189, 6331.303556608769, 6412.3267056959285, 461187.0, 462244.0, 487574.0, 488490.0, 497331.0, 59473.70263148743, 60076.69961650251, 60766.69616651889, 61550.69224653848, 90252.5487372559, 438.3381094547193, 438.48478038304864, 441.5231549926136, 442.29674817040416, 445.18975464654665, 10213.182994857194, 10334.379937203792, 10353.378797272188, 10466.79631842348, 10548.472576370998, 40313.19373612453, 40513.59486405098, 40640.59359406368, 41031.38452923268, 41746.37380439357, 59679.403205967385, 60191.0, 60558.486037849405, 61184.38815611965, 61596.38403615906, 8185.959070204611, 8450.619722112642, 8463.534505602005, 8604.311655067704, 8753.956230218808, 11719.88280117222, 12720.68198295013, 12921.0, 13310.600681979557, 13318.200907945555, 11609.825852612048, 11700.648980530597, 11784.469698863742, 11819.527218911491, 11901.107416943936, 11315.603953861575, 11436.142289328167, 11472.024877885473, 11503.137264705349, 11526.07791376671, 11825.113116516468, 11836.82244766312, 11846.466908988943, 11962.34207118582, 11989.460474278503, 8098.433109682265, 8356.791080223044, 8376.371772117238, 8730.519821409884, 8835.0, 10261.2304077196, 11715.355655438692, 11792.823107653221, 11893.643190704293, 11909.344986025852], "value": 8021.240984617891, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1514.2958524286205, 1536.5851220170553, 1656.6024154202994, 1803.431918945532, 1845.806190350014, 8011.399145064114, 8589.398742088057, 8755.518446485441, 9288.628454861806, 9295.581698823553, 8913.955430222839, 8944.105589441053, 8993.145651163146, 9057.23013543848, 9061.365704400678, 2291.049214575953, 2331.73185083715, 2336.906523739048, 2349.400902769791, 2352.6823878776404, 2267.6598510223516, 2302.8503147295373, 2308.7575804540534, 2312.89591968361, 2316.1893337331967, 2278.043221846828, 2287.63397856343, 2291.759365266648, 2328.138588722175, 2335.6730057791924, 2268.3308424014954, 2286.634138537834, 2320.4662927526765, 2335.2877372401495, 2350.330155905567, 2276.2374604507345, 2312.8034117100065, 2322.837401381904, 2327.55776402483, 2336.240721765433, 8956.552172391355, 9013.324000699973, 9049.683261085896, 9058.0, 9059.547022648841, 5285.07511185541, 5319.734013299359, 5377.542908852753, 5389.380221274525, 5411.594130440233, 3236.9607147497163, 3386.9887646023017, 3406.3187362527347, 3483.372992861284, 3492.353914525821, 1010.919126469888, 1071.3732466507104, 1074.4735079810914, 1094.0864378244175, 1095.2880627592049, 12816.615501534969, 12834.679133021657, 12841.807372889414, 12873.227606343557, 12898.09713320068, 4606.101810146989, 4642.048380082075, 4752.952470475251, 4764.166270902648, 4777.331173635694, 10718.946405267923, 10743.086837618734, 10767.83848242277, 10781.083607893417, 10791.83812242817, 5348.117560602457, 5450.236966824647, 5454.10007348791, 5457.399686034533, 5470.589705772003, 4284.914301713949, 4873.926891096637, 5004.3494345734825, 5020.246962955586, 5040.747962601855, 4063.0, 4116.065449238853, 4123.876283711494, 4176.874693759192, 4185.832566697298, 1294.5727909789746, 1315.15829868884, 1317.1504379675057, 1318.5759379869717, 1321.1148530484597, 804.4891493901415, 889.4440974391006, 910.8041771019263, 911.3483859040817, 915.190056799737, 6399.13611662429, 6443.7744678936015, 6443.935560644333, 6451.709673064724, 6460.547761656733, 439.29054576858783, 446.7408902836347, 449.42249209765293, 453.9636829053668, 454.57043094275593, 4365.301551751704, 4426.867193984185, 4496.572825581565, 4549.840755573539, 4615.100055489147, 11259.831102533468, 11491.080713542897, 11524.078073754079, 11616.825747613793, 11642.88357116418, 11233.10135189183, 11364.204505684687, 11366.545338186379, 11433.371164585862, 11442.54229830814, 8025.197480251928, 8370.832583348421, 8371.037330706924, 8473.237408633253, 8577.142285771497, 6353.332900045613, 6565.770198043237, 6621.735130594722, 6627.072209890715, 6686.13080299558, 10390.948045259725, 10577.471126443801, 10578.8942110581, 10627.787444251226, 10632.255742098288, 10511.316764410289, 10587.153027757915, 10818.404987725437, 10827.458627068772, 10834.133269338276, 7151.463640227108, 7907.604619768874, 8072.273495385443, 8124.065732440608, 8165.918340816754, 8916.86624700643, 8978.506182160045, 9023.187913087591, 9039.774005649648, 9059.456432614064, 7874.173211812677, 8060.1133875274845, 8116.553589552631, 8161.959190204248, 8219.794505137419, 7787.92212077872, 7869.567173805267, 8032.518048917083, 8052.476589021695, 8058.3150432213915, 7222.349988501061, 7278.890816637861, 7352.0, 7361.852762944604, 7385.29839665231, 5426.972865135807, 5463.808766693147, 5573.1918871762555, 5604.327480702342, 5626.85932851682, 5430.239766432782, 5510.311211098613, 5517.69652669107, 5543.722813859372, 5656.095024796013], "value": 4683.202922184439, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [326.89049168528544, 328.13209062030927, 332.62911853283595, 332.9384063948168, 334.29630627529053, 5571.3314402271735, 5628.212050312949, 5663.971680141599, 5694.316681998161, 5711.543076553876, 5540.695261760612, 5550.833474995747, 5579.972100139494, 5607.607467477278, 5609.775608975647, 4034.6368826805583, 4179.247735407625, 4282.379055037018, 4299.763513006784, 4341.587549182823, 4266.381374700666, 4273.38035984782, 4288.549702281247, 4292.871213863574, 4299.6775241856985, 4272.359146128075, 4298.570142985708, 4315.136972605475, 4329.913401731979, 4334.241507736149, 4057.660971879273, 4280.357946308048, 4283.6439958023275, 4286.142771445723, 4363.803628836694, 3703.0, 3721.3673675475234, 3723.2739615774935, 3725.8137093145506, 3735.364987952055, 5372.301600791872, 5386.596005299579, 5409.0, 5417.6478528895495, 5420.891582168374, 4602.6548008899135, 4899.7550122494085, 4919.335889654886, 4919.508049195052, 4940.25896115582, 5873.412658734135, 5884.6469211847, 5890.234269544974, 5892.616979896293, 5898.458187195878, 4122.91754164915, 4128.669706423479, 4131.648809851166, 4150.771707556083, 4168.624823765876, 5783.190353350535, 6021.36775638556, 6034.366391528914, 6034.5172386209, 6123.632582045091, 4158.232751080778, 4163.208990291835, 4175.10235299406, 4185.455890734246, 4202.957970420318, 4211.389348544444, 4215.957840421618, 4244.490661120685, 4255.829766809355, 4259.148170365877, 4638.5593368629925, 4878.9512104878495, 4880.658353915192, 4902.436219834764, 4914.754262286943, 5798.246227990418, 5821.970890145522, 5833.300003999547, 5843.444872737168, 5868.178455016301, 1437.7124575085024, 1446.8553144685657, 1460.4158336665419, 1470.7573250413775, 1472.829100864815, 867.418829384314, 926.249737712455, 946.3517490519016, 972.5866506734609, 977.6040703515088, 5493.835184944458, 5594.713215960352, 5602.551795856321, 5626.76211233528, 5626.971865140648, 5833.270841144857, 5887.293524777054, 5920.763169473173, 5936.109583562414, 5946.672932988728, 5381.192821076792, 5549.334079910436, 5566.66600003993, 5586.748596313176, 5587.608867379326, 3131.123285480069, 3171.238902663344, 3193.265548923714, 3196.6004249468815, 3225.870965161414, 5996.970015149984, 6189.319174890848, 6220.34686357935, 6240.7503699852405, 6305.464035557029, 6028.4272994065495, 6081.17904082952, 6122.683623021072, 6130.1724267224245, 6141.7543298268465, 6124.816255512342, 6158.368032471309, 6197.380261973766, 6241.940159747272, 6276.623402595859, 5712.942870571241, 5970.582059255984, 5974.492168165754, 5991.161237426677, 5994.8501287466415, 5904.350521442724, 5934.287885453773, 5936.673482958478, 5942.465178133989, 5987.191729116514, 5875.706214689163, 6120.7551697931585, 6138.232720909887, 6185.680369861302, 6276.466500347522, 4157.0, 4163.958360416478, 4168.7707176104395, 4172.603602657743, 4173.9582604173565, 5962.25471816023, 6001.489873360813, 6002.0, 6012.549058820693, 6019.337872833898, 5492.286002819608, 5860.619059761102, 5887.8233652990475, 5906.493844069735, 5961.821145365646, 5764.6829424380385, 5833.533317334518, 5866.325372582037, 5891.410858914074, 5905.91141132892, 5529.364123125892, 5625.690587017753, 5746.213086653053, 5819.428754236248, 5820.738066787089, 5888.705564721832, 5910.4089591042275, 5924.52603791687, 5945.256842894638, 5948.256467941507, 5628.227108460822, 5772.336181339199, 5796.449337312949, 5811.622244554091, 5845.567835880067], "value": 4415.419308982786, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [744.3858816476405, 761.056290200152, 769.6151924037981, 825.4139560911752, 871.9694810681625, 13686.657833554154, 14446.422143114263, 14465.20441375724, 14500.492482763093, 14810.55568332949, 14876.47932322369, 14926.552203433886, 14934.0, 15007.099574025566, 15027.774583381259, 788.1094363369384, 812.7683610171088, 816.4937738602075, 821.1460081515218, 822.3051521464383, 819.0580832043139, 820.7209548753423, 820.8809722590221, 824.9935079203362, 825.8183199696057, 843.2495079379357, 846.8560344741409, 850.9489430634181, 852.0882655558555, 853.8932633420823, 832.142892820396, 841.6759547574167, 843.6498852976008, 846.9661213551482, 848.0586548930683, 607.2136583124864, 609.8170548835332, 612.7947137708873, 613.8404014956099, 613.9570230083896, 14840.703185936221, 14939.551813445614, 14980.775288370683, 14987.100773953598, 15011.324490397848, 14893.925530372278, 15037.548873533811, 15087.773683394758, 15117.319720612599, 15221.31504082319, 12167.0, 12416.379181040911, 12448.62654120378, 12518.74962500745, 13051.0, 3865.091703449687, 3947.50656167979, 3978.423128646359, 3981.024648960994, 4103.4870641169855, 79391.0, 80093.19906800915, 81262.0, 82044.58977705133, 82537.58731206365, 10910.727231819268, 10964.122870170368, 11140.851119078887, 11169.72075698114, 11243.943780281046, 19665.213391464466, 20346.694799578017, 22180.445488862584, 22332.106715731188, 22332.21837235689, 8911.688090916787, 8933.776655583533, 9007.0, 9016.278697704169, 9131.77170570741, 4990.251462280615, 4997.425296090923, 5039.244113382949, 5097.566706829961, 5194.948050519446, 3648.1973965727498, 3801.0, 3804.6575808177395, 3818.3508803503473, 3842.51968503937, 679.9354061364163, 699.2308460693197, 707.3845754193884, 712.4122598855964, 719.9604021778748, 644.3846126948753, 692.5152393324693, 728.5883475836135, 767.1637914672922, 774.8450309938034, 10202.0, 10420.843687344695, 10459.163266938627, 10692.893071069346, 10706.411147386812, 653.859420224654, 686.1286166568431, 687.9552829066095, 708.1749761527865, 714.118064190724, 4621.445426548836, 4929.148444039382, 4999.075171093359, 5289.18017707256, 5564.443555644403, 111536.0, 112132.0, 114073.0, 114096.0, 116059.0, 99356.0, 101434.49282753539, 102852.48573757234, 104307.0, 104648.0, 61389.69305153446, 90558.0, 91026.54486727789, 92039.53980230055, 92667.0, 10238.180945524191, 10393.896061039293, 10513.9474302628, 10524.473776311, 10573.312734672221, 48863.267050993556, 50342.0, 51346.74326628343, 51586.0, 52104.47895521148, 71091.0, 80761.59619201867, 80762.0, 81057.59471202843, 81394.59302703448, 13440.46238150463, 13493.730125397633, 13506.72986540244, 13666.86333136656, 13936.930315348358, 13922.651933701738, 14043.859561404255, 14492.782608261095, 15252.542423727306, 15461.61345966315, 14065.296735162996, 14203.786943196066, 14340.928295358457, 14470.27648617586, 14675.0, 13969.511067112602, 14281.857181428468, 14477.493287734878, 14613.123212607277, 14613.123212607277, 13744.450221991408, 13976.301184940916, 14245.501407451104, 14354.425822966965, 14449.0, 11328.32030078198, 11440.427978601203, 11575.884241157817, 11634.36011019402, 12173.147879648339, 11132.499037543168, 11259.437028148395, 12309.630711078682, 12386.3187524687, 12389.690257743629], "value": 7778.020918912054, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1547.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 107.0, 110.0, 109.0, 111.0, 112.0, 111.0, 110.0, 110.0, 112.0], "value": 110.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 132.0, 157.0, 179.0, 127.0, 159.0, 152.0, 129.0, 185.0, 127.0], "value": 151.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 164.0, 166.0, 162.0, 167.0, 171.0, 162.0, 161.0, 162.0], "value": 164.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 75.0, 172.0, 75.0, 75.0, 76.0, 75.0, 179.0, 76.0], "value": 95.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 142.0, 85.0, 85.0, 86.0, 144.0, 84.0, 85.0, 144.0], "value": 102.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 119.0, 121.0, 117.0, 118.0, 120.0, 118.0, 118.0, 117.0, 117.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 149.0, 151.0, 148.0, 148.0, 147.0, 148.0, 148.0, 147.0], "value": 147.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 97.0, 95.0, 96.0, 99.0, 96.0, 96.0, 96.0, 96.0, 97.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 57.0, 57.0, 56.0, 59.0, 56.0, 57.0, 56.0, 56.0, 60.0], "value": 56.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 63.0, 62.0, 62.0, 62.0, 62.0, 62.0, 61.0, 61.0, 62.0], "value": 61.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 81.0, 81.0, 82.0, 81.0, 80.0, 80.0, 107.0, 81.0], "value": 84.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 139.0, 125.0, 128.0, 127.0, 126.0, 135.0, 129.0, 145.0, 131.0], "value": 131.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 164.0, 161.0, 165.0, 163.0, 161.0, 160.0, 160.0, 156.0, 177.0], "value": 163.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 63.0, 67.0, 64.0, 63.0, 64.0, 63.0, 64.0, 61.0], "value": 63.6, "unit": "score"}]}]}
13:44:28 INFO - Return code: 0
13:44:28 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json
13:44:28 ERROR - # TBPL SUCCESS #
13:44:28 INFO - Running post-action listener: _resource_record_post_action
13:44:28 INFO - #####
13:44:28 INFO - ##### Finished run-tests step (success)
13:44:28 INFO - #####
13:44:28 INFO - Running post-run listener: _resource_record_post_run
13:44:28 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 529309696; Read time: 0; Write time: 399732
13:44:28 INFO - TinderboxPrint: CPU usage
13.4%
13:44:28 INFO - TinderboxPrint: I/O read bytes / time
0 / 0
13:44:28 INFO - TinderboxPrint: I/O write bytes / time
529,309,696 / 399,732
13:44:28 INFO - TinderboxPrint: CPU idle
8,217.5 (86.5%)
13:44:28 INFO - TinderboxPrint: CPU user
1,222.5 (12.9%)
13:44:28 INFO - TinderboxPrint: Swap in / out
0 / 0
13:44:28 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 112685056; Read time: 0; Write time: 140416
13:44:28 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 288251904; Read time: 0; Write time: 184128
13:44:29 INFO - Running post-run listener: _upload_blobber_files
13:44:29 INFO - Blob upload gear active.
13:44:29 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir.
13:44:29 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
13:44:29 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']
13:44:29 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
13:44:29 INFO - (blobuploader) - INFO - Open directory for files ...
13:44:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ...
13:44:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
13:44:29 INFO - (blobuploader) - INFO - Uploading, attempt #1.
13:44:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded
13:44:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
13:44:30 INFO - (blobuploader) - INFO - Done attempting.
13:44:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ...
13:44:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
13:44:30 INFO - (blobuploader) - INFO - Uploading, attempt #1.
13:44:31 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded
13:44:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
13:44:31 INFO - (blobuploader) - INFO - Done attempting.
13:44:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ...
13:44:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
13:44:31 INFO - (blobuploader) - INFO - Uploading, attempt #1.
13:44:34 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded
13:44:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
13:44:34 INFO - (blobuploader) - INFO - Done attempting.
13:44:34 INFO - (blobuploader) - INFO - Iteration through files over.
13:44:34 INFO - Return code: 0
13:44:34 INFO - rmtree: /builds/slave/test/build/uploaded_files.json
13:44:34 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1
13:44:34 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a0fcac6360034d02f70460820b0d371abedb4f5e4c4503d0d2f71cff31129f2043071f6d27d41ab98275ccb66fe6b2cba0030d5675be184c4962bd741e0edd5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/30268c86928e734621c805751151cb1bca0a4d7b4f5d5a549d2bd6523def6ec36febc107e8c821f22ea8cc61c2ae8eb7786fad5330cd8feb18d58acfac87ba56", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/11edb6b80a8d56afcba249f6a2abd58a4a56a38ee26cf75ca9ecd179bff507103d08e3c80e9175b4602cf7143bb548d938b615d96343e19c875cc83d5671b5ff"}
13:44:34 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files
13:44:34 INFO - Writing to file /builds/slave/test/properties/blobber_files
13:44:34 INFO - Contents:
13:44:34 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a0fcac6360034d02f70460820b0d371abedb4f5e4c4503d0d2f71cff31129f2043071f6d27d41ab98275ccb66fe6b2cba0030d5675be184c4962bd741e0edd5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/30268c86928e734621c805751151cb1bca0a4d7b4f5d5a549d2bd6523def6ec36febc107e8c821f22ea8cc61c2ae8eb7786fad5330cd8feb18d58acfac87ba56", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/11edb6b80a8d56afcba249f6a2abd58a4a56a38ee26cf75ca9ecd179bff507103d08e3c80e9175b4602cf7143bb548d938b615d96343e19c875cc83d5671b5ff"}
13:44:34 INFO - Running post-run listener: copy_logs_to_upload_dir
13:44:34 INFO - Copying logs to upload dir...
13:44:34 INFO - mkdir: /builds/slave/test/build/upload/logs
13:44:34 INFO - Copying logs to upload dir...
program finished with exit code 0
elapsedTime=1239.450642
========= master_lag: 0.01 =========
========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-06-08 13:44:34.303154) =========
========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-08 13:44:34.306659) =========
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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
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/9a0fcac6360034d02f70460820b0d371abedb4f5e4c4503d0d2f71cff31129f2043071f6d27d41ab98275ccb66fe6b2cba0030d5675be184c4962bd741e0edd5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/30268c86928e734621c805751151cb1bca0a4d7b4f5d5a549d2bd6523def6ec36febc107e8c821f22ea8cc61c2ae8eb7786fad5330cd8feb18d58acfac87ba56", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/11edb6b80a8d56afcba249f6a2abd58a4a56a38ee26cf75ca9ecd179bff507103d08e3c80e9175b4602cf7143bb548d938b615d96343e19c875cc83d5671b5ff"}
build_url:https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2
program finished with exit code 0
elapsedTime=0.011338
build_url: 'https://queue.taskcluster.net/v1/task/UoEprc7SRLOPpTYcS_WJ5A/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'
blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a0fcac6360034d02f70460820b0d371abedb4f5e4c4503d0d2f71cff31129f2043071f6d27d41ab98275ccb66fe6b2cba0030d5675be184c4962bd741e0edd5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/30268c86928e734621c805751151cb1bca0a4d7b4f5d5a549d2bd6523def6ec36febc107e8c821f22ea8cc61c2ae8eb7786fad5330cd8feb18d58acfac87ba56", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/11edb6b80a8d56afcba249f6a2abd58a4a56a38ee26cf75ca9ecd179bff507103d08e3c80e9175b4602cf7143bb548d938b615d96343e19c875cc83d5671b5ff"}'
========= master_lag: 0.01 =========
========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-08 13:44:34.332136) =========
========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:44:34.332485) =========
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=7fc86f70bae03e018da0b1d8000001c4-1465417433.333873-947031458
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
program finished with exit code 0
elapsedTime=0.004383
========= master_lag: 0.08 =========
========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-08 13:44:34.415216) =========
========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-08 13:44:34.415550) =========
========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-08 13:44:34.415842) =========
========= Total master_lag: 0.17 =========