builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo
slave: talos-linux64-ix-004
starttime: 1454846954.65
results: success (0)
buildid: 20160207013013
builduid: 85ec56b025374d8eaaa7a030f606259f
revision: 69f7ba132363aa783954f185a5c88b16582da924
========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.650624) =========
master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/
========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.651766) =========
========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.652701) =========
bash -c pwd
in dir /builds/slave/test-pgo/. (timeout 1200 secs)
watching logfiles {}
argv: ['bash', '-c', 'pwd']
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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
/builds/slave/test-pgo
program finished with exit code 0
elapsedTime=0.006417
basedir: '/builds/slave/test-pgo'
========= master_lag: 0.06 =========
========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.715521) =========
========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.715846) =========
========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.847494) =========
========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.847780) =========
rm -rf properties
in dir /builds/slave/test-pgo/. (timeout 1200 secs)
watching logfiles {}
argv: ['rm', '-rf', '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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
program finished with exit code 0
elapsedTime=0.004540
========= master_lag: 0.05 =========
========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.903580) =========
========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.904377) =========
script_repo_url: https://hg.mozilla.org/build/mozharness
========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.905104) =========
========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:14.905839) =========
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-pgo/. (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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
--2016-02-07 04:09:15-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py
Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102
Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected.
HTTP request sent, awaiting response... 200 Script output follows
Length: 12141 (12K) [text/x-python]
Saving to: `archiver_client.py'
0K .......... . 100% 83.5M=0s
2016-02-07 04:09:15 (83.5 MB/s) - `archiver_client.py' saved [12141/12141]
program finished with exit code 0
elapsedTime=0.096591
========= master_lag: 0.02 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.019552) =========
========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.019863) =========
rm -rf scripts
in dir /builds/slave/test-pgo/. (timeout 1200 secs)
watching logfiles {}
argv: ['rm', '-rf', 'scripts']
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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
program finished with exit code 0
elapsedTime=0.022099
========= master_lag: 0.03 =========
========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.071927) =========
========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.072427) =========
bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 69f7ba132363aa783954f185a5c88b16582da924 --destination scripts --debug'
in dir /builds/slave/test-pgo/. (timeout 1200 secs)
watching logfiles {}
argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 69f7ba132363aa783954f185a5c88b16582da924 --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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
2016-02-07 04:09:15,659 truncating revision to first 12 chars
2016-02-07 04:09:15,659 Setting DEBUG logging.
2016-02-07 04:09:15,659 attempt 1/10
2016-02-07 04:09:15,659 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/69f7ba132363?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness
2016-02-07 04:09:15,906 unpacking tar archive at: mozilla-inbound-69f7ba132363/testing/mozharness/
program finished with exit code 0
elapsedTime=0.521691
========= master_lag: 0.01 =========
========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.607300) =========
========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.607659) =========
echo 69f7ba132363aa783954f185a5c88b16582da924
in dir /builds/slave/test-pgo/. (timeout 1200 secs)
watching logfiles {}
argv: ['echo', u'69f7ba132363aa783954f185a5c88b16582da924']
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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
69f7ba132363aa783954f185a5c88b16582da924
program finished with exit code 0
elapsedTime=0.004718
script_repo_revision: '69f7ba132363aa783954f185a5c88b16582da924'
========= master_lag: 0.05 =========
========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.658908) =========
========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.659261) =========
========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-07 04:09:15.669818) =========
========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-02-07 04:09:15.670139) =========
/tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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-pgo/. (timeout 3600 secs) (maxTime 7200 secs)
watching logfiles {}
argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--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-pgo/buildprops.json
PWD=/builds/slave/test-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
04:09:16 INFO - MultiFileLogger online at 20160207 04:09:16 in /builds/slave/test-pgo
04:09:16 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound
04:09:16 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json.
04:09:16 INFO - {'append_to_log': False,
04:09:16 INFO - 'base_work_dir': '/builds/slave/test-pgo',
04:09:16 INFO - 'blob_upload_branch': 'Mozilla-Inbound',
04:09:16 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt',
04:09:16 INFO - 'branch': 'Mozilla-Inbound',
04:09:16 INFO - 'buildbot_json_path': 'buildprops.json',
04:09:16 INFO - 'config_files': ('talos/linux_config.py',),
04:09:16 INFO - 'default_actions': ('clobber',
04:09:16 INFO - 'read-buildbot-config',
04:09:16 INFO - 'download-and-extract',
04:09:16 INFO - 'populate-webroot',
04:09:16 INFO - 'create-virtualenv',
04:09:16 INFO - 'install',
04:09:16 INFO - 'run-tests'),
04:09:16 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',),
04:09:16 INFO - 'download_minidump_stackwalk': True,
04:09:16 INFO - 'download_symbols': 'ondemand',
04:09:16 INFO - 'exes': {'python': '/tools/buildbot/bin/python',
04:09:16 INFO - 'tooltool.py': '/tools/tooltool.py',
04:09:16 INFO - 'virtualenv': ('/tools/buildbot/bin/python',
04:09:16 INFO - '/tools/misc-python/virtualenv.py')},
04:09:16 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub',
04:09:16 INFO - 'http://pypi.pub.build.mozilla.org/pub'),
04:09:16 INFO - 'installer_path': 'installer.exe',
04:09:16 INFO - 'log_level': 'info',
04:09:16 INFO - 'log_name': 'talos',
04:09:16 INFO - 'log_to_console': True,
04:09:16 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk',
04:09:16 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest',
04:09:16 INFO - 'opt_config_files': (),
04:09:16 INFO - 'pip_index': False,
04:09:16 INFO - 'sps_profile': False,
04:09:16 INFO - 'sps_profile_interval': 0,
04:09:16 INFO - 'suite': 'dromaeojs',
04:09:16 INFO - 'system_bits': '32',
04:09:16 INFO - 'talos_extra_options': ('--webServer', 'localhost'),
04:09:16 INFO - 'title': 'talos-linux64-ix-004',
04:09:16 INFO - 'tooltool_cache': '/builds/tooltool_cache',
04:09:16 INFO - 'use_talos_json': True,
04:09:16 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv',
04:09:16 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None},
04:09:16 INFO - 'work_dir': 'build'}
04:09:16 INFO - #####
04:09:16 INFO - ##### Running clobber step.
04:09:16 INFO - #####
04:09:16 INFO - Running pre-action listener: _resource_record_pre_action
04:09:16 INFO - Running main action method: clobber
04:09:16 INFO - rmtree: /builds/slave/test-pgo/build
04:09:16 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1
04:09:16 INFO - Running post-action listener: _resource_record_post_action
04:09:16 INFO - #####
04:09:16 INFO - ##### Running read-buildbot-config step.
04:09:16 INFO - #####
04:09:16 INFO - Running pre-action listener: _resource_record_pre_action
04:09:16 INFO - Running main action method: read_buildbot_config
04:09:16 INFO - Using buildbot properties:
04:09:16 INFO - {
04:09:16 INFO - "project": "",
04:09:16 INFO - "product": "firefox",
04:09:16 INFO - "script_repo_revision": "production",
04:09:16 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs",
04:09:16 INFO - "repository": "",
04:09:16 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs",
04:09:16 INFO - "buildid": "20160207013013",
04:09:16 INFO - "pgo_build": "True",
04:09:16 INFO - "basedir": "/builds/slave/test-pgo",
04:09:16 INFO - "buildnumber": 661,
04:09:16 INFO - "slavename": "talos-linux64-ix-004",
04:09:16 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/",
04:09:16 INFO - "platform": "ubuntu64_hw",
04:09:16 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos",
04:09:16 INFO - "branch": "mozilla-inbound",
04:09:16 INFO - "repo_path": "integration/mozilla-inbound",
04:09:16 INFO - "revision": "69f7ba132363aa783954f185a5c88b16582da924",
04:09:16 INFO - "stage_platform": "linux64-pgo",
04:09:16 INFO - "builduid": "85ec56b025374d8eaaa7a030f606259f",
04:09:16 INFO - "slavebuilddir": "test"
04:09:16 INFO - }
04:09:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2.
04:09:16 INFO - Running post-action listener: _resource_record_post_action
04:09:16 INFO - #####
04:09:16 INFO - ##### Running download-and-extract step.
04:09:16 INFO - #####
04:09:16 INFO - Running pre-action listener: _resource_record_pre_action
04:09:16 INFO - Running main action method: download_and_extract
04:09:16 INFO - mkdir: /builds/slave/test-pgo/build/tests
04:09:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:16 INFO - https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net
04:09:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/test_packages.json
04:09:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/test_packages.json
04:09:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json
04:09:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1
04:09:19 INFO - Downloaded 1448 bytes.
04:09:19 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json
04:09:19 INFO - Using the following test package requirements:
04:09:19 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'],
04:09:19 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'],
04:09:19 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'],
04:09:19 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'jsshell-linux-x86_64.zip'],
04:09:19 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'],
04:09:19 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'],
04:09:19 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'],
04:09:19 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'],
04:09:19 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'],
04:09:19 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'],
04:09:19 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip',
04:09:19 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']}
04:09:19 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common
04:09:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:19 INFO - https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net
04:09:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1
04:09:21 INFO - Downloaded 23575263 bytes.
04:09:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests']
04:09:21 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests
04:09:22 INFO - Return code: 0
04:09:22 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos
04:09:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:22 INFO - https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net
04:09:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip
04:09:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1
04:09:24 INFO - Downloaded 23575263 bytes.
04:09:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests']
04:09:24 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests
04:09:25 INFO - Return code: 0
04:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:25 INFO - https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net
04:09:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip
04:09:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip
04:09:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip
04:09:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1
04:09:26 INFO - Downloaded 10706547 bytes.
04:09:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests']
04:09:26 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests
04:09:27 INFO - Return code: 0
04:09:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:27 INFO - https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net
04:09:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
04:09:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
04:09:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
04:09:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1
04:09:33 INFO - Downloaded 56566705 bytes.
04:09:33 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
04:09:33 INFO - mkdir: /builds/slave/test-pgo/properties
04:09:33 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url
04:09:33 INFO - Writing to file /builds/slave/test-pgo/properties/build_url
04:09:33 INFO - Contents:
04:09:33 INFO - build_url:https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
04:09:33 INFO - Running post-action listener: _resource_record_post_action
04:09:33 INFO - Running post-action listener: set_extra_try_arguments
04:09:33 INFO - #####
04:09:33 INFO - ##### Running populate-webroot step.
04:09:33 INFO - #####
04:09:33 INFO - Running pre-action listener: _resource_record_pre_action
04:09:33 INFO - Running main action method: populate_webroot
04:09:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']},
04:09:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']},
04:09:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome',
04:09:33 INFO - '--tppagecycles',
04:09:33 INFO - '7'],
04:09:33 INFO - 'tests': ['tsvgm']}},
04:09:33 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']},
04:09:33 INFO - 'chromez-e10s': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['tresize', 'tcanvasmark']},
04:09:33 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']},
04:09:33 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['dromaeo_css', 'kraken']},
04:09:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']},
04:09:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']},
04:09:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'tests': ['damp', 'tps']},
04:09:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['damp', 'tps']},
04:09:33 INFO - 'g3': {'tests': ['dromaeo_dom']},
04:09:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']},
04:09:33 INFO - 'other': {'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'other-e10s': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'other_l64': {'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'other_nol64': {'tests': ['a11yr',
04:09:33 INFO - 'ts_paint',
04:09:33 INFO - 'tpaint',
04:09:33 INFO - 'sessionrestore',
04:09:33 INFO - 'sessionrestore_no_auto_restore']},
04:09:33 INFO - 'svgr': {'tests': ['tsvgx',
04:09:33 INFO - 'tsvgr_opacity',
04:09:33 INFO - 'tart',
04:09:33 INFO - 'tscrollx',
04:09:33 INFO - 'cart']},
04:09:33 INFO - 'svgr-e10s': {'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['tsvgx',
04:09:33 INFO - 'tsvgr_opacity',
04:09:33 INFO - 'tart',
04:09:33 INFO - 'tscrollx',
04:09:33 INFO - 'cart']},
04:09:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'tests': ['tp5o']},
04:09:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'talos_options': ['--e10s'],
04:09:33 INFO - 'tests': ['tp5o']},
04:09:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'talos_options': ['--xperf_path',
04:09:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
04:09:33 INFO - 'tests': ['tp5n']},
04:09:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip',
04:09:33 INFO - 'talos_options': ['--e10s',
04:09:33 INFO - '--xperf_path',
04:09:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'],
04:09:33 INFO - 'tests': ['tp5n']}},
04:09:33 INFO - 'talos.zip': {'path': '',
04:09:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}}
04:09:33 INFO - Running post-action listener: _resource_record_post_action
04:09:33 INFO - #####
04:09:33 INFO - ##### Running create-virtualenv step.
04:09:33 INFO - #####
04:09:33 INFO - Running pre-action listener: _resource_record_pre_action
04:09:33 INFO - Running main action method: create_virtualenv
04:09:33 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv
04:09:33 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build
04:09:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv
04:09:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior.
04:09:34 INFO - Using real prefix '/usr'
04:09:34 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python
04:09:34 INFO - Installing distribute.............................................................................................................................................................................................done.
04:09:36 INFO - Installing pip.................done.
04:09:36 INFO - Return code: 0
04:09:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv
04:09:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:36 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:36 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build
04:09:36 INFO - Copy/paste: /builds/slave/test-pgo/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
04:09:36 INFO - Using env: {'DISPLAY': ':0',
04:09:36 INFO - 'HOME': '/home/cltbld',
04:09:36 INFO - 'LANG': 'en_US.UTF-8',
04:09:36 INFO - 'LANGUAGE': 'en_US:en',
04:09:36 INFO - 'LOGNAME': 'cltbld',
04:09:36 INFO - 'MAIL': '/var/mail/cltbld',
04:09:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:36 INFO - 'MOZ_NO_REMOTE': '1',
04:09:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:36 INFO - 'NO_EM_RESTART': '1',
04:09:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:36 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:36 INFO - 'SHELL': '/bin/bash',
04:09:36 INFO - 'SHLVL': '1',
04:09:36 INFO - 'TERM': 'linux',
04:09:36 INFO - 'TMOUT': '86400',
04:09:36 INFO - 'USER': 'cltbld',
04:09:36 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:36 INFO - '_': '/tools/buildbot/bin/python'}
04:09:36 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:36 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
04:09:36 INFO - Cleaning up...
04:09:36 INFO - Return code: 0
04:09:36 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv
04:09:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:36 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:36 INFO - Running command: ['/builds/slave/test-pgo/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>=0.7.1'] in /builds/slave/test-pgo/build
04:09:36 INFO - Copy/paste: /builds/slave/test-pgo/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>=0.7.1
04:09:36 INFO - Using env: {'DISPLAY': ':0',
04:09:36 INFO - 'HOME': '/home/cltbld',
04:09:36 INFO - 'LANG': 'en_US.UTF-8',
04:09:36 INFO - 'LANGUAGE': 'en_US:en',
04:09:36 INFO - 'LOGNAME': 'cltbld',
04:09:36 INFO - 'MAIL': '/var/mail/cltbld',
04:09:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:36 INFO - 'MOZ_NO_REMOTE': '1',
04:09:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:36 INFO - 'NO_EM_RESTART': '1',
04:09:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:36 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:36 INFO - 'SHELL': '/bin/bash',
04:09:36 INFO - 'SHLVL': '1',
04:09:36 INFO - 'TERM': 'linux',
04:09:36 INFO - 'TMOUT': '86400',
04:09:36 INFO - 'USER': 'cltbld',
04:09:36 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:36 INFO - '_': '/tools/buildbot/bin/python'}
04:09:36 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:36 INFO - Downloading/unpacking psutil>=0.7.1
04:09: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
04:09: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
04:09: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
04:09: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
04:09: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
04:09: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
04:09:38 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil
04:09:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build'
04:09:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects
...
04:09:38 INFO - Installing collected packages: psutil
04:09:38 INFO - Running setup.py install for psutil
04:09:38 INFO - building 'psutil._psutil_linux' extension
04:09:38 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
04:09:39 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
04:09:39 INFO - building 'psutil._psutil_posix' extension
04:09:39 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
04:09:39 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
04:09:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build'
04:09:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ...
04:09:39 INFO - Successfully installed psutil
04:09:39 INFO - Cleaning up...
04:09:39 INFO - Return code: 0
04:09:39 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv
04:09:39 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')]}
04:09:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:39 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')]}
04:09:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:39 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:39 INFO - Running command: ['/builds/slave/test-pgo/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.0.0'] in /builds/slave/test-pgo/build
04:09:39 INFO - Copy/paste: /builds/slave/test-pgo/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.0.0
04:09:39 INFO - Using env: {'DISPLAY': ':0',
04:09:39 INFO - 'HOME': '/home/cltbld',
04:09:39 INFO - 'LANG': 'en_US.UTF-8',
04:09:39 INFO - 'LANGUAGE': 'en_US:en',
04:09:39 INFO - 'LOGNAME': 'cltbld',
04:09:39 INFO - 'MAIL': '/var/mail/cltbld',
04:09:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:39 INFO - 'MOZ_NO_REMOTE': '1',
04:09:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:39 INFO - 'NO_EM_RESTART': '1',
04:09:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:39 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:39 INFO - 'SHELL': '/bin/bash',
04:09:39 INFO - 'SHLVL': '1',
04:09:39 INFO - 'TERM': 'linux',
04:09:39 INFO - 'TMOUT': '86400',
04:09:39 INFO - 'USER': 'cltbld',
04:09:39 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:39 INFO - '_': '/tools/buildbot/bin/python'}
04:09:39 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:39 INFO - Downloading/unpacking mozsystemmonitor==0.0.0
04:09:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:41 INFO - Downloading mozsystemmonitor-0.0.tar.gz
04:09:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor
04:09:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0)
04:09:41 INFO - Installing collected packages: mozsystemmonitor
04:09:41 INFO - Running setup.py install for mozsystemmonitor
04:09:41 INFO - Successfully installed mozsystemmonitor
04:09:41 INFO - Cleaning up...
04:09:41 INFO - Return code: 0
04:09:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv
04:09:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:41 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:41 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build
04:09:41 INFO - Copy/paste: /builds/slave/test-pgo/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
04:09:41 INFO - Using env: {'DISPLAY': ':0',
04:09:41 INFO - 'HOME': '/home/cltbld',
04:09:41 INFO - 'LANG': 'en_US.UTF-8',
04:09:41 INFO - 'LANGUAGE': 'en_US:en',
04:09:41 INFO - 'LOGNAME': 'cltbld',
04:09:41 INFO - 'MAIL': '/var/mail/cltbld',
04:09:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:41 INFO - 'MOZ_NO_REMOTE': '1',
04:09:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:41 INFO - 'NO_EM_RESTART': '1',
04:09:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:41 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:41 INFO - 'SHELL': '/bin/bash',
04:09:41 INFO - 'SHLVL': '1',
04:09:41 INFO - 'TERM': 'linux',
04:09:41 INFO - 'TMOUT': '86400',
04:09:41 INFO - 'USER': 'cltbld',
04:09:41 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:41 INFO - '_': '/tools/buildbot/bin/python'}
04:09:41 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:41 INFO - Downloading/unpacking blobuploader==1.2.4
04:09:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:43 INFO - Downloading blobuploader-1.2.4.tar.gz
04:09:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader
04:09:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4)
04:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests
04:09:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4)
04:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:44 INFO - Downloading docopt-0.6.1.tar.gz
04:09:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt
04:09:44 INFO - Installing collected packages: blobuploader, requests, docopt
04:09:44 INFO - Running setup.py install for blobuploader
04:09:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775
04:09:44 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775
04:09:44 INFO - Running setup.py install for requests
04:09:44 INFO - Running setup.py install for docopt
04:09:44 INFO - Successfully installed blobuploader requests docopt
04:09:44 INFO - Cleaning up...
04:09:44 INFO - Return code: 0
04:09:44 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv
04:09:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:09:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:44 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config
04:09:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/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
04:09:44 INFO - Using env: {'DISPLAY': ':0',
04:09:44 INFO - 'HOME': '/home/cltbld',
04:09:44 INFO - 'LANG': 'en_US.UTF-8',
04:09:44 INFO - 'LANGUAGE': 'en_US:en',
04:09:44 INFO - 'LOGNAME': 'cltbld',
04:09:44 INFO - 'MAIL': '/var/mail/cltbld',
04:09:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:44 INFO - 'MOZ_NO_REMOTE': '1',
04:09:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:44 INFO - 'NO_EM_RESTART': '1',
04:09:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:44 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:44 INFO - 'SHELL': '/bin/bash',
04:09:44 INFO - 'SHLVL': '1',
04:09:44 INFO - 'TERM': 'linux',
04:09:44 INFO - 'TMOUT': '86400',
04:09:44 INFO - 'USER': 'cltbld',
04:09:44 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:44 INFO - '_': '/tools/buildbot/bin/python'}
04:09:45 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser
04:09:45 INFO - Running setup.py (path:/tmp/pip-_i3JKi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash
04:09:45 INFO - Running setup.py (path:/tmp/pip-Uqreb1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug
04:09:45 INFO - Running setup.py (path:/tmp/pip-l0rRbe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice
04:09:45 INFO - Running setup.py (path:/tmp/pip-_TLLwa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile
04:09:45 INFO - Running setup.py (path:/tmp/pip-iS2piZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd
04:09:45 INFO - Running setup.py (path:/tmp/pip-5XcinI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo
04:09:45 INFO - Running setup.py (path:/tmp/pip-5QjfA5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall
04:09:45 INFO - Running setup.py (path:/tmp/pip-AwQaAQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak
04:09:45 INFO - Running setup.py (path:/tmp/pip-ndDQZ0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog
04:09:45 INFO - Running setup.py (path:/tmp/pip-VNh7Nz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork
04:09:45 INFO - Running setup.py (path:/tmp/pip-9Ts8qi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess
04:09:45 INFO - Running setup.py (path:/tmp/pip-PKf8zt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess
04:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile
04:09:45 INFO - Running setup.py (path:/tmp/pip-VlWoVD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile
04:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner
04:09:46 INFO - Running setup.py (path:/tmp/pip-HJPAbT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner
04:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot
04:09:46 INFO - Running setup.py (path:/tmp/pip-NvnW3t-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot
04:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest
04:09:46 INFO - Running setup.py (path:/tmp/pip-x2Imr1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest
04:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion
04:09:46 INFO - Running setup.py (path:/tmp/pip-kTs1Iq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion
04:09:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion
04:09:46 INFO - Running setup.py install for manifestparser
04:09:46 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin
04:09:46 INFO - Running setup.py install for mozcrash
04:09:46 INFO - Running setup.py install for mozdebug
04:09:46 INFO - Running setup.py install for mozdevice
04:09:46 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin
04:09:46 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin
04:09:46 INFO - Running setup.py install for mozfile
04:09:46 INFO - Running setup.py install for mozhttpd
04:09:46 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin
04:09:46 INFO - Running setup.py install for mozinfo
04:09:47 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for mozInstall
04:09:47 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for mozleak
04:09:47 INFO - Running setup.py install for mozlog
04:09:47 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for moznetwork
04:09:47 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for mozprocess
04:09:47 INFO - Running setup.py install for mozprofile
04:09:47 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for mozrunner
04:09:47 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin
04:09:47 INFO - Running setup.py install for mozscreenshot
04:09:47 INFO - Running setup.py install for moztest
04:09:48 INFO - Running setup.py install for mozversion
04:09:48 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin
04:09:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion
04:09:48 INFO - Cleaning up...
04:09:48 INFO - Return code: 0
04:09:48 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv
04:09:48 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')]}
04:09:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:48 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')]}
04:09:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config
04:09:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/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
04:09:48 INFO - Using env: {'DISPLAY': ':0',
04:09:48 INFO - 'HOME': '/home/cltbld',
04:09:48 INFO - 'LANG': 'en_US.UTF-8',
04:09:48 INFO - 'LANGUAGE': 'en_US:en',
04:09:48 INFO - 'LOGNAME': 'cltbld',
04:09:48 INFO - 'MAIL': '/var/mail/cltbld',
04:09:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:48 INFO - 'MOZ_NO_REMOTE': '1',
04:09:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:48 INFO - 'NO_EM_RESTART': '1',
04:09:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:48 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:48 INFO - 'SHELL': '/bin/bash',
04:09:48 INFO - 'SHLVL': '1',
04:09:48 INFO - 'TERM': 'linux',
04:09:48 INFO - 'TMOUT': '86400',
04:09:48 INFO - 'USER': 'cltbld',
04:09:48 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:48 INFO - '_': '/tools/buildbot/bin/python'}
04:09:48 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser
04:09:48 INFO - Running setup.py (path:/tmp/pip-WZxoRM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash
04:09:48 INFO - Running setup.py (path:/tmp/pip-tdSIgQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug
04:09:48 INFO - Running setup.py (path:/tmp/pip-GniPU6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice
04:09:48 INFO - Running setup.py (path:/tmp/pip-05H0me-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile
04:09:48 INFO - Running setup.py (path:/tmp/pip-fpJXNc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd
04:09:48 INFO - Running setup.py (path:/tmp/pip-HI3BGh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo
04:09:48 INFO - Running setup.py (path:/tmp/pip-thWm1R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall
04:09:48 INFO - Running setup.py (path:/tmp/pip-fqz9bJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall
04:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8))
04:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak
04:09:48 INFO - Running setup.py (path:/tmp/pip-Tkf5yy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog
04:09:49 INFO - Running setup.py (path:/tmp/pip-2hNGYI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork
04:09:49 INFO - Running setup.py (path:/tmp/pip-lCrdtV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess
04:09:49 INFO - Running setup.py (path:/tmp/pip-zO3ew0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile
04:09:49 INFO - Running setup.py (path:/tmp/pip-ahAmcK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner
04:09:49 INFO - Running setup.py (path:/tmp/pip-SAIZob-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot
04:09:49 INFO - Running setup.py (path:/tmp/pip-ceoLIc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest
04:09:49 INFO - Running setup.py (path:/tmp/pip-pdWMtb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16))
04:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion
04:09:49 INFO - Running setup.py (path:/tmp/pip-8a_arP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17))
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2))
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2))
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3))
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4))
04:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4))
04:09:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10))
04:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available
04:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available
04:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available
04:09:51 INFO - Downloading blessings-1.6.tar.gz
04:09:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings
04:09:51 INFO - Installing collected packages: blessings
04:09:51 INFO - Running setup.py install for blessings
04:09:51 INFO - Successfully installed blessings
04:09:51 INFO - Cleaning up...
04:09:51 INFO - Return code: 0
04:09:51 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv.
04:09:51 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze']
04:09:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze
04:09:51 INFO - Reading from file tmpfile_stdout
04:09:51 INFO - Current package versions:
04:09:51 INFO - argparse == 1.2.1
04:09:51 INFO - blessings == 1.6
04:09:51 INFO - blobuploader == 1.2.4
04:09:51 INFO - docopt == 0.6.1
04:09:51 INFO - manifestparser == 1.1
04:09:51 INFO - mozInstall == 1.12
04:09:51 INFO - mozcrash == 0.16
04:09:51 INFO - mozdebug == 0.1
04:09:51 INFO - mozdevice == 0.48
04:09:51 INFO - mozfile == 1.2
04:09:51 INFO - mozhttpd == 0.7
04:09:51 INFO - mozinfo == 0.9
04:09:51 INFO - mozleak == 0.1
04:09:51 INFO - mozlog == 3.1
04:09:51 INFO - moznetwork == 0.27
04:09:51 INFO - mozprocess == 0.22
04:09:51 INFO - mozprofile == 0.28
04:09:51 INFO - mozrunner == 6.11
04:09:51 INFO - mozscreenshot == 0.1
04:09:51 INFO - mozsystemmonitor == 0.0
04:09:51 INFO - moztest == 0.7
04:09:51 INFO - mozversion == 1.4
04:09:51 INFO - psutil == 3.1.1
04:09:51 INFO - requests == 1.2.3
04:09:51 INFO - wsgiref == 0.1.2
04:09:51 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv
04:09:51 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')]}
04:09:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:51 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')]}
04:09:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/talos
04:09:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/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
04:09:51 INFO - Using env: {'DISPLAY': ':0',
04:09:51 INFO - 'HOME': '/home/cltbld',
04:09:51 INFO - 'LANG': 'en_US.UTF-8',
04:09:51 INFO - 'LANGUAGE': 'en_US:en',
04:09:51 INFO - 'LOGNAME': 'cltbld',
04:09:51 INFO - 'MAIL': '/var/mail/cltbld',
04:09:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:51 INFO - 'MOZ_NO_REMOTE': '1',
04:09:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:51 INFO - 'NO_EM_RESTART': '1',
04:09:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:51 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:51 INFO - 'SHELL': '/bin/bash',
04:09:51 INFO - 'SHLVL': '1',
04:09:51 INFO - 'TERM': 'linux',
04:09:51 INFO - 'TMOUT': '86400',
04:09:51 INFO - 'USER': 'cltbld',
04:09:51 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:51 INFO - '_': '/tools/buildbot/bin/python'}
04:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1))
04:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4))
04:09:52 INFO - Cleaning up...
04:09:52 INFO - Return code: 0
04:09:52 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv
04:09:52 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')]}
04:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:52 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')]}
04:09:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:52 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build
04:09:52 INFO - Copy/paste: /builds/slave/test-pgo/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
04:09:52 INFO - Using env: {'DISPLAY': ':0',
04:09:52 INFO - 'HOME': '/home/cltbld',
04:09:52 INFO - 'LANG': 'en_US.UTF-8',
04:09:52 INFO - 'LANGUAGE': 'en_US:en',
04:09:52 INFO - 'LOGNAME': 'cltbld',
04:09:52 INFO - 'MAIL': '/var/mail/cltbld',
04:09:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:52 INFO - 'MOZ_NO_REMOTE': '1',
04:09:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:52 INFO - 'NO_EM_RESTART': '1',
04:09:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:52 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:52 INFO - 'SHELL': '/bin/bash',
04:09:52 INFO - 'SHLVL': '1',
04:09:52 INFO - 'TERM': 'linux',
04:09:52 INFO - 'TMOUT': '86400',
04:09:52 INFO - 'USER': 'cltbld',
04:09:52 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:52 INFO - '_': '/tools/buildbot/bin/python'}
04:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:52 INFO - Downloading/unpacking jsonschema
04:09:52 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
04:09:52 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
04:09:52 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
04:09:52 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
04:09:52 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
04:09:52 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
04:09:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl
04:09:54 INFO - Downloading/unpacking functools32 (from jsonschema)
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 INFO - Downloading functools32-3.2.3-2.tar.gz
04:09:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32
04:09:54 INFO - warning: no files found matching '*.txt'
04:09:54 INFO - no previously-included directories found matching 'build'
04:09:54 INFO - no previously-included directories found matching 'dist'
04:09:54 INFO - no previously-included directories found matching '.git*'
04:09:54 INFO - Installing collected packages: jsonschema, functools32
04:09:54 INFO - Running setup.py install for functools32
04:09:54 INFO - warning: no files found matching '*.txt'
04:09:54 INFO - no previously-included directories found matching 'build'
04:09:54 INFO - no previously-included directories found matching 'dist'
04:09:54 INFO - no previously-included directories found matching '.git*'
04:09:54 INFO - Successfully installed jsonschema functools32
04:09:54 INFO - Cleaning up...
04:09:54 INFO - Return code: 0
04:09:54 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv
04:09: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')]}
04:09:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org
04:09:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09: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')]}
04:09:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org
04:09:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub
04:09:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f5766140f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28758a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2942670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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
04:09:54 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build
04:09:54 INFO - Copy/paste: /builds/slave/test-pgo/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
04:09:54 INFO - Using env: {'DISPLAY': ':0',
04:09:54 INFO - 'HOME': '/home/cltbld',
04:09:54 INFO - 'LANG': 'en_US.UTF-8',
04:09:54 INFO - 'LANGUAGE': 'en_US:en',
04:09:54 INFO - 'LOGNAME': 'cltbld',
04:09:54 INFO - 'MAIL': '/var/mail/cltbld',
04:09:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:09:54 INFO - 'MOZ_NO_REMOTE': '1',
04:09:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:09:54 INFO - 'NO_EM_RESTART': '1',
04:09:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:09:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:09:54 INFO - 'PWD': '/builds/slave/test-pgo',
04:09:54 INFO - 'SHELL': '/bin/bash',
04:09:54 INFO - 'SHLVL': '1',
04:09:54 INFO - 'TERM': 'linux',
04:09:54 INFO - 'TMOUT': '86400',
04:09:54 INFO - 'USER': 'cltbld',
04:09:54 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:09:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:09:54 INFO - '_': '/tools/buildbot/bin/python'}
04:09:54 INFO - Ignoring indexes: https://pypi.python.org/simple/
04:09:54 INFO - Downloading/unpacking flake8
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:54 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
04:09:56 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl
04:09:56 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8)
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl
04:09:56 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8)
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8)
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:56 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
04:09:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8
04:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs'
04:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs'
04:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite'
04:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite'
04:09:57 INFO - no previously-included directories found matching 'docs/_build'
04:09:57 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8
04:09:57 INFO - Running setup.py install for pep8
04:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs'
04:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs'
04:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite'
04:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite'
04:09:57 INFO - no previously-included directories found matching 'docs/_build'
04:09:57 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin
04:09:57 INFO - Successfully installed flake8 mccabe pyflakes pep8
04:09:57 INFO - Cleaning up...
04:09:57 INFO - Return code: 0
04:09:57 INFO - Running post-action listener: _resource_record_post_action
04:09:57 INFO - Running post-action listener: _start_resource_monitoring
04:09:57 INFO - Starting resource monitoring.
04:09:57 INFO - #####
04:09:57 INFO - ##### Running install step.
04:09:57 INFO - #####
04:09:57 INFO - Running pre-action listener: _resource_record_pre_action
04:09:57 INFO - Running main action method: install
04:09:57 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze']
04:09:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze
04:09:57 INFO - Reading from file tmpfile_stdout
04:09:57 INFO - Detecting whether we're running mozinstall >=1.0...
04:09:57 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h']
04:09:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h
04:09:57 INFO - Reading from file tmpfile_stdout
04:09:57 INFO - Output received:
04:09:57 INFO - Usage: mozinstall [options] installer
04:09:57 INFO - Options:
04:09:57 INFO - -h, --help show this help message and exit
04:09:57 INFO - -d DEST, --destination=DEST
04:09:57 INFO - Directory to install application into. [default:
04:09:57 INFO - "/builds/slave/test-pgo"]
04:09:57 INFO - --app=APP Application being installed. [default: firefox]
04:09:57 INFO - mkdir: /builds/slave/test-pgo/build/application
04:09:57 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application']
04:09:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application
04:10:14 INFO - Reading from file tmpfile_stdout
04:10:14 INFO - Output received:
04:10:14 INFO - /builds/slave/test-pgo/build/application/firefox/firefox
04:10:14 INFO - Running post-action listener: _resource_record_post_action
04:10:14 INFO - #####
04:10:14 INFO - ##### Running run-tests step.
04:10:14 INFO - #####
04:10:14 INFO - Running pre-action listener: _resource_record_pre_action
04:10:14 INFO - Running main action method: run_tests
04:10:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version']
04:10:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version
04:10:14 INFO - Python 2.7.3
04:10:14 INFO - Return code: 0
04:10:14 INFO - grabbing minidump binary from tooltool
04:10:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]}
04:10:14 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-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d18c0>, '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 0x29d27c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d2c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1
04:10:14 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build
04:10:14 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache
04:10:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache
04:10:14 INFO - Return code: 0
04:10:14 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755
04:10:14 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir
04:10:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir
04:10:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk
04:10:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir
04:10:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos']
04:10:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos
04:10:15 INFO - Return code: 0
04:10:15 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build
04:10:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-004 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log
04:10:15 INFO - Using env: {'DISPLAY': ':0',
04:10:15 INFO - 'HOME': '/home/cltbld',
04:10:15 INFO - 'LANG': 'en_US.UTF-8',
04:10:15 INFO - 'LANGUAGE': 'en_US:en',
04:10:15 INFO - 'LOGNAME': 'cltbld',
04:10:15 INFO - 'MAIL': '/var/mail/cltbld',
04:10:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir',
04:10:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk',
04:10:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1',
04:10:15 INFO - 'MOZ_NO_REMOTE': '1',
04:10:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir',
04:10:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript',
04:10:15 INFO - 'NO_EM_RESTART': '1',
04:10:15 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games',
04:10:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json',
04:10:15 INFO - 'PWD': '/builds/slave/test-pgo',
04:10:15 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos',
04:10:15 INFO - 'SHELL': '/bin/bash',
04:10:15 INFO - 'SHLVL': '1',
04:10:15 INFO - 'TERM': 'linux',
04:10:15 INFO - 'TMOUT': '86400',
04:10:15 INFO - 'USER': 'cltbld',
04:10:15 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487',
04:10:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn',
04:10:15 INFO - '_': '/tools/buildbot/bin/python'}
04:10:15 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600
04:10:15 INFO - mozversion application_buildid: 20160207013013
04:10:15 INFO - mozversion application_changeset: 69f7ba132363aa783954f185a5c88b16582da924
04:10:15 INFO - mozversion application_display_name: Nightly
04:10:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384}
04:10:15 INFO - mozversion application_name: Firefox
04:10:15 INFO - mozversion application_remotingname: firefox
04:10:15 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound
04:10:15 INFO - mozversion application_vendor: Mozilla
04:10:15 INFO - mozversion application_version: 47.0a1
04:10:15 INFO - mozversion platform_buildid: 20160207013013
04:10:15 INFO - mozversion platform_changeset: 69f7ba132363aa783954f185a5c88b16582da924
04:10:15 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound
04:10:15 INFO - mozversion platform_version: 47.0a1
04:10:15 INFO - using testdate: 1454847015
04:10:15 INFO - actual date: 1454847015
04:10:15 INFO - starting webserver on 'localhost:49291'
04:10:15 INFO - SUITE-START | Running 2 tests
04:10:15 INFO - TEST-START | dromaeo_css
04:10:15 INFO - operating with platform_type : linux_
04:10:15 INFO - Initialising browser for dromaeo_css test...
04:10:15 INFO - TEST-INFO | started process 24400 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpnuveS6/profile http://localhost:49291/getInfo.html)
04:10:20 INFO - PROCESS | 24400 | __metrics Screen width/height:1600/1200
04:10:20 INFO - PROCESS | 24400 | colorDepth:24
04:10:20 INFO - PROCESS | 24400 | Browser inner width/height: 1024/697
04:10:20 INFO - PROCESS | 24400 | __metrics
04:10:20 INFO - PROCESS | 24400 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver]
04:10:21 INFO - TEST-INFO | 24400: exit 0
04:10:21 INFO - Browser initialized.
04:10:21 INFO - Running cycle 1/1 for dromaeo_css test...
04:10:21 INFO - TEST-INFO | started process 24496 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpnuveS6/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1)
04:10:32 INFO - PROCESS | 24496 | RSS: Main: 151207936
04:10:32 INFO - PROCESS | 24496 |
04:11:24 INFO - PROCESS | 24496 | 1454847084181 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]
04:13:32 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49291/tests/dromaeo/cssquery-ext.html)
04:13:33 INFO - PROCESS | 24496 | RSS: Main: 256008192
04:13:33 INFO - PROCESS | 24496 |
04:16:35 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-ext.html (next: http://localhost:49291/tests/dromaeo/cssquery-jquery.html)
04:16:36 INFO - PROCESS | 24496 | RSS: Main: 246525952
04:16:36 INFO - PROCESS | 24496 |
04:19:38 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49291/tests/dromaeo/cssquery-mootools.html)
04:19:38 INFO - PROCESS | 24496 | RSS: Main: 242671616
04:19:38 INFO - PROCESS | 24496 |
04:22:40 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49291/tests/dromaeo/cssquery-prototype.html)
04:22:41 INFO - PROCESS | 24496 | RSS: Main: 217497600
04:22:41 INFO - PROCESS | 24496 |
04:25:43 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49291/tests/dromaeo/cssquery-yui.html)
04:25:44 INFO - PROCESS | 24496 | RSS: Main: 220413952
04:25:44 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | Cycle 1(1): loaded http://localhost:49291/tests/dromaeo/cssquery-yui.html (next: http://localhost:49291/tests/dromaeo/cssquery-dojo.html)
04:28:47 INFO - PROCESS | 24496 | RSS: Main: 271388672
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | __start_tp_report
04:28:47 INFO - PROCESS | 24496 | _x_x_mozilla_page_load
04:28:47 INFO - PROCESS | 24496 | _x_x_mozilla_page_load_details
04:28:47 INFO - PROCESS | 24496 | |i|pagename|runs|
04:28:47 INFO - PROCESS | 24496 | |0;dojo.html;3060.433819743347;3089.4593446146946;3124.250179956811;3130.107919243016;3162.2726772842248;4925.53207445293;5018.397792264925;5075.238714192873;5108.974455127724;5136.049830781308;4940.678855874366;4975.6019518438525;4992.850214493562;4994.97502512487;5092.516210959953;4499.370088187657;4536.500984891659;4560.384348113003;4787.976060119695;4872.951270487303;4558.293464513005;4572.97713511432;4785;4809.230523116302;4856.684315519497;4633.32816741574;4641.675082744209;4669.322948172513;4697.694649847766;4698.624110071186;4669.696469729457;4672.953270467286;4694.694844835075;4696.95303046972;4724.787384567703;4569.634429245652;4615.653825963066;4641.048585040058;4677.228257337535;4704.764761761932;4860.781264843091;4862.07620552094;4878.463369029404;4885.609151267926;4921.704697718148;5350.892982140374;5355.223492593591;5356.839294821161;5362.034833729927;5363.463653634644;5366.570674346043;5397.325334333208;5532.474414930575;5539.944600553983;5554.1946417769195;5129.9743501282255;5130.07658621448;5152.819651312224;5154.664946778485;5159.329287192641;5549.417311182348;5571.303587051619;5578.24693666358;5580.302462192226;5582.190582365534;5253.23828044939;5291.232771248147;5302.70835104073;5369.060414427538;5388.191771234347;5475.972620136953;5504.0643090674685;5506.807261745819;5508.063629183049;5508.862278442991;5322.467753224647;5473.0969390051;5494.587905906993;5502.5597952164535;5548.750306236148;5383.946160538423;5388.73056347189;5428.538574221236;5447.836564903059;5485.6434331768305;4234.894127646833;4236.364545318165;4241.448611680462;4248.086661367821;4277.080427707995;3730.7015438764834;3792.488014118114;3809.980950095232;3844.4233364994916;3848.4419759134767;4980.601551875841;5028.396592408934;5028.84913452597;5034.924476132861;5068.594512438996;5417;5490.368607610096;5497.945020549823;5500.834974950758;5549.278593782782;4939.3084968104495;4943.4809345018975;5016.523430274191;5088.0587091388215;5118.129917913963;4665.6734028617675;4688.531146885284;4689.413823272091;4707.905841883143;4729.929051064237;5640.746166422521;5656.151577263443;5656.1798539212405;5678.5741069419955;5691.8861622768145;5309.973450132879;5405.135178371442;5435.266239057677;5447.1829225616475;5552.972235138798;5584.692841893735;5603.635763675348;5611.607187496836;5613.186088017296;5616;5340.813071542478;5350.1974703793185;5356.062689029326;5356.330458692663;5400.675959442289;5334.439883812144;5375.059364611099;5428.267183930277;5431.022415965164;5458.153986132156;5346.652467589594;5370.650907690988;5372.946270537401;5375.731213439391;5378.919316210338;5244.082285599929;5361.222622719762;5377.569794416516;5384.273123128328;5425.403205647297;5154.871128221825;5168.043911876315;5189.299444574934;5232.058229518723;5249.632525723316;5406.270153529381;5427.294451721251;5440.809571664972;5443.237946687546;5457.945420545744;5114.539691427641;5197.818076367309;5341.893162136813;5344.812931547377;5351.090314646597
04:28:47 INFO - PROCESS | 24496 | |1;ext.html;541.721013677956;544.8774025844183;567.503434494817;568.4230506036373;579.5971799599278;28557.857210713944;29229.561556576667;33831;34014.31971360571;34060;40360;40786.59213407865;40876;40937.59062409375;40967;8485.703000394988;8664.826703465927;8729.956350218272;8744.562771861381;8752.387332886668;8680.609372578248;8818.559072046404;8848.5575721214;8887.822243555158;8888.73333799987;8848.690295839648;8925.375223734341;8931.464112153259;8946.150115738994;8952.194302512773;8793.648254069829;8867.68963086289;8869.18181772735;8874.733757987271;8875.95562022189;8678.739637810813;8862.778430539223;8873.06832782555;8875.201231889096;8876.511791851446;40464;40905.59094409077;40974.79512602447;41017.58982410168;41020.38469422961;3284.983575082133;3301.356235534072;3332.216929021678;3338.6494418085995;3895.7662540247393;29992.400151997055;30503.54244686309;30708.865040132776;31059.68940310613;31555.21111972196;3773.5094437723196;3842.7886466244345;3856.190200057991;3948.6446219840063;3969.0871099647243;195856;196074.99999999857;196602;196737;197281;59047.40952590505;59417.40582594119;59503.107453388235;59549;59625;54308;55475;60881;62765.37234627687;64566.677166614805;15740.921295393679;15816.05103693782;15850.76223856643;15868.92065539688;15941.202939852961;11455.369954652575;12401.317927514074;12408.441620127116;12468.688282793002;12490.188137771016;19513;19785.50536236577;19962.401127965895;19997.400077997685;20125.798742012685;7625;7792.986911701442;7830.33442157423;7850.764477065697;7877.606119693993;1003.4832061488339;1023.6928921323573;1050.3225419604312;1119.1158984402232;1206.2822620540765;30051.849740751157;30070;30438;30453.695463045085;31169.220769480944;1169.9938053274177;1174.3306315400139;1216.4525963316544;1251.956181533642;1278.7506436244844;15821.446249381217;15961.840381596268;15987.60030999211;16185.919070404572;16317.755233671505;439046;444337;445026;445835;446660;51423.22865157026;51706.48293517092;51723.74138129361;51825.48174518206;51914.48085519172;1288.645622453814;1289.361765925854;1308.4962289518414;1311.4885194774047;1318.1827267094463;28970.565441518815;30142.397152056397;30360.240993975327;30485.464070060418;30926.845365773028;43342.133157336044;43745.12509749851;43745.78127109344;43767.56232437635;43833;194734;199784;199891;199962;199986;30729.231769205948;31330.843345783127;31716.524252135776;31966.360672785948;32130.83934580312;38530;38735.806320968215;41572.79213603913;43626.56373436352;44192.77903610461;30339.24151896132;32080.197995050312;39859.402108967806;39985.80007100062;40904.79547602243;36770.63229367672;37010.44484332791;37539;37669.24661506809;37674.43488347732;39077.6092239074;39922.201555969295;40253.79873100616;40311.3953290695;40353;37697.62302377051;38948;39721.80139099286;39887.800560997006;40127.3980890281;27031.86484067567;27898.302542436602;28303.71696283093;29144.562831557967;29408.41183176367
04:28:47 INFO - PROCESS | 24496 | |2;jquery.html;350.23997924503857;371.3816495534935;373.60584583264654;373.97382183247186;374.78195863443807;12684.365781710912;16361.345546178154;17241.827581724196;17526.211320490576;17534.736978945326;16061.437849675263;16401.589960251;17502.562435939108;17617.11914404278;17624.11879406031;4075.531313898895;4201.789910504478;4208.242516347056;5390.380106287788;5575.665460072409;4001.8199181036925;5773.105168698838;5874.471297583216;6021.729022194012;6101.054336577838;5238.711870847102;5442.346918369782;5448.046591846431;5964.88070238595;5987.670678112724;5379.569634429236;5389.218563308337;5403.135498320269;5405.405405405402;5409.918851217235;5124.282600435942;5161.4322424533275;5191.896162076738;5194.246834209019;5201.24581935621;18562.164702588416;19573.21707131713;19899.10454029572;20399.49001274965;20619.5876082479;2008.6183625111182;2035.4504283843428;2155.493459037125;2323.500447403799;2634.7376966714733;9609;9823.902699625987;10041.347312424668;10215.438150901697;12977.156484828456;1769.8053214146562;1839.613681126965;1841.5856432302758;1873.9625207495774;1890.8014658460938;61949.690251548906;62891;63871.36128638701;64445.677771611314;65701.99999999952;9063.456192628331;9764;10157.085862272432;10294.124999375137;10379.325343852626;13210.933945330404;13241;13242.867571324163;13246.337683115806;13249.867501325056;7752.147263800977;7795.922040779633;7808.960955195302;7863.685452581833;7877.7636670899965;7687.730929417444;7696.769096927102;7703.191164927602;7759.301662850257;7767.961160194162;4528.162289976365;4576.725396476222;4595.609373203315;4607.654425918069;4614.700044497097;1813.4287699374654;1834.9541261468303;1842.576207472262;1845.2065611786793;1859.377108668584;780.9740786246906;923.330585325647;972.557486343712;978.5694294510392;1031.8091153136543;15017.699646007019;15477.535673929575;16753.581160471087;16900.492985210465;17225.56936076608;949.6562364254503;979.1725991537139;1022.8619136416637;1030.9278350515542;1056.1867362131115;7434.665440055211;9255.537223138816;9575.425474471554;9675.9032409675;9816.950915245377;375548;523712;534974;539525;541348;67784;68098;68427.65786171037;71113;71124;1203.2419575667448;1203.3141109567462;1228.072805032195;1240.299230934537;1260.1556956838756;10891.292066015683;14299.21354325522;15088.396464141311;15855.127967961873;15973;30822;31791.523127153574;32223.67776322207;32592.51111233286;32731.181720457178;40081.19837603173;40757;40820;41036.79481602573;41194.38208426816;7390.7413240536325;7575.24247575238;7587.165411804807;7641.7707468776025;7700.152983171734;9987;11514.19400641947;11584.362860042778;11841.703957400789;11914.582989595323;9799.216062715108;10067.69796906094;10209.132223761064;10325.122364599094;10548.103411210133;3979.4826672532386;4752.667313288037;8849.69026084084;10432.491549015527;10663.46682665879;10233.539490723084;10370.688879333633;10566.630167944086;10573.62992295266;10885.619003334845;7402.555846649218;7795.337396321376;7801.336886364723;7834.373250139861;7870.84258314819;9396.744781252586;9982.950085249528;10096.165829972268;10440.37357758537;10473.633422830164
04:28:47 INFO - PROCESS | 24496 | |3;mootools.html;1323.8543760186371;1327.522092046863;1356.4777560639154;1461.5469204546591;1819.4632583387909;6742.7640032598865;7404.888926666097;7574.015378000859;7574.848503029936;7620.466567340289;7369.1157061152735;7530.9246907530905;7582.9241707582905;7594.354479869204;7624.199459056802;1975.5555000125;2028.8174064334207;2255.086689890589;2317.385892738426;2353.9882300588474;2284.4859906520983;2288.1305104060516;2290.3815969688176;2297.1270917051497;2297.425643589103;2223.0663121489015;2287.7254729432407;2288.3135059482174;2291.266794625712;2292.3925159832656;2260.7400148982915;2261.0955617752866;2264.29806759905;2278.9658155127686;2296.3684986628728;2260.5139894922504;2261.5589959957815;2276.7267927848598;2282.4522114692522;2286.874221917794;7707.383409327241;7756.883646745303;7767.650455729449;7769.728059517946;7777.844443111106;4658.18481765693;4701.952980470186;4706.670533062687;4739.715617062987;4740.146773580754;2840.957385639217;2879.1794338613604;2910.767138628905;2929.4580502606873;2942.5880376747273;873.0483772687801;894.6421431427481;895.4537731983485;896.171041786345;1787.5977904971407;10315.84526232107;10473.947630261877;10509.31689440184;10521.631742888962;10523.368597884075;4242.533321334712;4323.870283891489;4370.366296886934;4410.4927933287445;4421.137878113737;9173.862392063991;9180.17378435944;9181.127792859668;9189.632414703337;9195.90804091964;4833.226683730586;4848.151573474628;4854.344663470457;4898.044881248194;4935.333729946411;4489.775511224426;4499.370088187657;4500.099980004013;4506.481754598263;4516.435445569304;3396.1339858335964;3509.9122521936647;3530.6822385985383;3530.8234588271;3545.096000519851;1140.6178930058522;1144.1704764046;1145.255583870474;1152.608113241502;1153.405995912106;1298.8766067223598;1310;1313.6256166992362;1319.116192151261;1331.620488160889;7371.078615173104;7432.182459929403;7484.850302994018;7487.47587668858;7489.28851759082;1122.2368789223406;1136.1251836086167;1136.607870284767;1137.056243318044;1153.5674122204173;5553.694546799965;5617;5631.633943793722;5632.887342253132;5637.49262566371;8952.283817294601;9072.95463522678;9256.95371523138;9345.345825792128;9373.812523749622;9194.080591940752;9196.540172991323;9251.583678734472;9262.583183756748;9297.488638124969;6921.688524016431;7053.717851285891;7218.133823941161;7285.307895749789;7365.889511657329;7026.789196324118;7056.576605403692;7071.82320441993;7073.540219885691;7076.32774886385;8096.757097287091;8240.052393974769;8258.42191046621;8348.081711011906;8370.079291278076;8433.777102320251;8546.444481108709;8641.308695304235;8668.393212475066;8696.21734043939;6630.5027122965;6690.665466726741;6705.22889867652;6705.564138330993;6729.192496900403;6481.578697384655;7105.218425973242;7301.269873012656;7301.452391070798;7346.11846578414;6959.4432445405255;7085.6811443486195;7131.103665668752;7135.678894449866;7170.42636589082;7038.085048943604;7046.612436316052;7107.18267399235;7107.466939979418;7224;7071;7090.113735783028;7138.428925685829;7141.428685705027;7147.070880785464;6465.967670161619;6495.805125846232;6497.8700425992165;6506.934930650633;6546.279909209888;6577.6053436793945;6595.604263744191;6605.933940660532;6628.370304821035;6629.502787291069
04:28:47 INFO - PROCESS | 24496 | |4;prototype.html;347.65061113580845;348.95638045244345;350.84387447585834;354.67370019581983;355.8683287183741;5549.084401073818;5708.486236238738;5727.770889164433;5756.51069659079;5767.855803604912;5512.641678290918;5630.577706671996;5637.887242255152;5639.943600563993;5651.7739290428435;4498.055408364247;4500.189965806154;4502.842400515982;4503.549645035495;4506;4277.3156294992805;4366.868993930171;4477.216487114758;4484.4842843072975;4495.235809912323;4437.534058923815;4439.578240067204;4455.84404545841;4461.107778444308;4465.106978604276;4442.600165985061;4455.1089782043555;4456.398386217851;4460.286354183348;4464.218761716719;3944.980275098635;3953.4662820519147;3956.5449973252867;3957.2085582883537;3966.5835087315704;5356.276902618136;5459.563234941195;5473.2063850741415;5490.176473529003;5502.312210973629;5084.51697088776;5095.872603184913;5100.285959965608;5102.770375333082;5103.260027296058;5758.510526605243;6066.96966515169;6069.423404776539;6074.119252708377;6076;4152.1072969311745;4236.6610671146545;4259.488861336628;4286.635635970946;4289.613934745857;6253.781117660906;6301.842453938642;6320.051992201161;6320.241571011462;6321.96839015802;4324.24325743;4364.54172311909;4367.432233809648;4367.825286988548;4373.322135069069;4257.446531950826;4404.559544045634;4416.205083085076;4419.801108950105;4435.401220835211;5077.339945807022;5078.796848126033;5080.237964305384;5086.3133476980875;5089.185730283137;6089.360617135226;6097.939020609826;6103.23709536308;6108.3280839107665;6114.48026917717;1539.2226925402824;1556.6808804195114;1557.2058250292207;1558.586974451771;1559.4541910331293;1048.3447845096814;1052.0636633396284;1054.1724746074294;1055.9208059395576;1080.9567617295377;5776.5089967352405;5783.033768518724;5784.623999440023;5784.768609255582;5785.623934444247;6265.4361107500545;6266.905996410058;6270.561060725797;6276.309605943343;6278.529110316745;5766.826995190151;5776.277965254343;5779.306483222041;5779.624324418984;5782.219400380979;3269.29710112327;3371.5448414463735;3373.3421982713135;3375.392429362689;3380.1211684961595;6497.870042599122;6515.120458738104;6518.380753828379;6519.282878883319;6522.086907832907;6367.172267605274;6379.96810015947;6392.105105285264;6445.2265728112925;6451.161349024596;6312.400321969406;6453.870922581522;6462.838429039311;6465.4827613790785;6506.869862602816;6039.48664363534;6123.142760013513;6233.625982441068;6246.187995560548;6248.312685604671;6080.2399700037495;6113.786017489367;6144.2319710036245;6144.41628045335;6206.286277078013;6531.608103513804;6539.280679125197;6540.444062254572;6575.868482630225;6587.703553340016;4303.763293018914;4360.803763830699;4394.978025109854;4403.471583410012;4408.184485870124;6307;6323.525735569942;6326.620402775849;6329.8734025320155;6337.366263373626;6161.137440758387;6174.413430724074;6175.660338681416;6176.197094377702;6180.042093475518;6041.184440100706;6152.138700582012;6155.846103847261;6163.137160797582;6174.043023331391;6054.182685337423;6057.394260573908;6059.091136329585;6065.757369705162;6067.059605761114;6173.69131543412;6195.760847830362;6205.751769929152;6242.375762423721;6266.655333956676;5887.970560147343;6030.125631783455;6032.969835150971;6050.15297858309;6056.818295451144
04:28:47 INFO - PROCESS | 24496 | |5;yui.html;709.5955305475879;801.7674874286457;810.5976660377543;821.6877586517122;848.2069265237004;13546.661333466656;13721.794173087412;13768.449262029519;13779.44882204713;13783.241921694314;13355.666108347295;13778.379972901219;13794.724105517884;13804.723905521883;13805.171689698625;686.0292685849518;694.4132208284017;832;838.4508147163617;846.8687353460224;838.6729175621513;843.9873401898976;844.543946269017;844.9112843151473;845.6194712379423;883.3242569434387;883.567052144451;885.3536918049828;885.5527958381009;886.45483027938;707.5825263094773;851.7317045130764;871.5859966515854;874.1040433555656;876.6887754847002;643.3180828321994;643.5977514053717;647.6761619190405;647.6858723519136;650.1288273713247;13612.115212511155;13660.726785464334;13709.314534273246;13729.519466818714;13738.793918091236;12385.19496232742;12767.42546585406;12808.23150610957;13064.934675326658;13179.341032948314;10635.840462393071;10735;10826.72933176669;11036.061934735557;11175.552977880876;3514.9297014059575;3580.4629305604108;3608.6932610728118;3676.3382591133586;3682.834272457719;50040.499595003945;50169.498305017216;50636;50693.23960140601;50766.238506422436;9519.381240219363;9878.308518403786;9945.80108397828;9946.801063978824;10145.934676858971;18177.909110454362;18194.727079093824;18216.908915455337;18219.629368566857;18220.81779182191;7538.208488108779;7634;7688.730894418781;7844.215578442224;7954.284114429729;4420.403245561808;4420.425344705168;4420.8673739787855;4483.786397121134;4518.502964673883;3228.3704677588116;3261.7553683473834;3275.836208189581;3285.901422957315;3302.256992176789;550.6530885542082;568.3861429655962;583.1922786940033;585.5227989188797;591.6568390333596;662.844231605582;672.2605134352272;683.8563901580724;701.0990876723386;701.9684114214873;8413.242808147295;8986.910130898606;9170.633174672937;9281.953590232006;9421.199198068241;536.696766327024;566.6911533214408;622.6202016769766;694.3611877073105;706.8709836875927;3966.2265858157957;3990.461287726178;4053.7973101344814;4056.817443215062;4088.7546747195265;58157.4184258152;58166.12750808741;58567.70716146392;58679.70660146672;58756;48912;50029.24956125661;50186.74906625444;50761.238581421305;50906.74546627317;43839.34240986388;44343.556564433944;46197.30704039442;47124.764376177896;48013.5198648016;7987.201279871966;8028.678852845821;8120.309773669304;8177.345812335118;8347.980222964847;33554.32891342208;34053;34084;34366.14084647904;34504.48243276403;41730.374044389966;46295.30557041714;46574.76712616415;46694.53305467038;46736.29895551501;11043.171762117712;11064.612738554111;11139.275947063416;11215.831762523732;11235.213535052468;11851.63749575891;12487.438065286902;12514.937425312815;12632.557860475206;12854.871451285368;12183.269003859798;12265.26408415498;12674.049446291381;12852.357382130669;13032.087753857139;11105.555777768799;11341.26281791681;11416.771664566497;11441.42792860337;11799.469023893773;11840.467178976794;12066.698332541757;12186.025117990717;12496.812547811609;12500.062495312706;9925.156361709336;9989.350692204984;10007.749806254902;10090.09189172978;10127.139193168663;9664.56509457062;10553.208509361675;10603.32171498758;10649.627263046066;10668.83996740034
04:28:47 INFO - PROCESS | 24496 | __end_tp_report
04:28:47 INFO - PROCESS | 24496 | __start_cc_report
04:28:47 INFO - PROCESS | 24496 | _x_x_mozilla_cycle_collect,789
04:28:47 INFO - PROCESS | 24496 | __end_cc_report
04:28:47 INFO - PROCESS | 24496 | __startTimestamp1454848127509__endTimestamp
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | ------- Summary: start -------
04:28:47 INFO - PROCESS | 24496 | Number of tests: 6
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#0] dojo.html Cycles:165 Average:5062.87 Median:5249.63 stddev:544.58 (10.4%) stddev-sans-first:523.10
04:28:47 INFO - PROCESS | 24496 | Values: 3060.4 3089.5 3124.3 3130.1 3162.3 4925.5 5018.4 5075.2 5109.0 5136.0 4940.7 4975.6 4992.9 4995.0 5092.5 4499.4 4536.5 4560.4 4788.0 4873.0 4558.3 4573.0 4785.0 4809.2 4856.7 4633.3 4641.7 4669.3 4697.7 4698.6 4669.7 4673.0 4694.7 4697.0 4724.8 4569.6 4615.7 4641.0 4677.2 4704.8 4860.8 4862.1 4878.5 4885.6 4921.7 5350.9 5355.2 5356.8 5362.0 5363.5 5366.6 5397.3 5532.5 5539.9 5554.2 5130.0 5130.1 5152.8 5154.7 5159.3 5549.4 5571.3 5578.2 5580.3 5582.2 5253.2 5291.2 5302.7 5369.1 5388.2 5476.0 5504.1 5506.8 5508.1 5508.9 5322.5 5473.1 5494.6 5502.6 5548.8 5383.9 5388.7 5428.5 5447.8 5485.6 4234.9 4236.4 4241.4 4248.1 4277.1 3730.7 3792.5 3810.0 3844.4 3848.4 4980.6 5028.4 5028.8 5034.9 5068.6 5417.0 5490.4 5497.9 5500.8 5549.3 4939.3 4943.5 5016.5 5088.1 5118.1 4665.7 4688.5 4689.4 4707.9 4729.9 5640.7 5656.2 5656.2 5678.6 5691.9 5310.0 5405.1 5435.3 5447.2 5553.0 5584.7 5603.6 5611.6 5613.2 5616.0 5340.8 5350.2 5356.1 5356.3 5400.7 5334.4 5375.1 5428.3 5431.0 5458.2 5346.7 5370.7 5372.9 5375.7 5378.9 5244.1 5361.2 5377.6 5384.3 5425.4 5154.9 5168.0 5189.3 5232.1 5249.6 5406.3 5427.3 5440.8 5443.2 5457.9 5114.5 5197.8 5341.9 5344.8 5351.1
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#1] ext.html Cycles:180 Average:45579.48 Median:21296.00 stddev:80234.17 (376.8%) stddev-sans-first:80387.99
04:28:47 INFO - PROCESS | 24496 | Values: 541.7 544.9 567.5 568.4 579.6 28557.9 29229.6 33831.0 34014.3 34060.0 40360.0 40786.6 40876.0 40937.6 40967.0 8485.7 8664.8 8730.0 8744.6 8752.4 8680.6 8818.6 8848.6 8887.8 8888.7 8848.7 8925.4 8931.5 8946.2 8952.2 8793.6 8867.7 8869.2 8874.7 8876.0 8678.7 8862.8 8873.1 8875.2 8876.5 40464.0 40905.6 40974.8 41017.6 41020.4 3285.0 3301.4 3332.2 3338.6 3895.8 29992.4 30503.5 30708.9 31059.7 31555.2 3773.5 3842.8 3856.2 3948.6 3969.1 195856.0 196075.0 196602.0 196737.0 197281.0 59047.4 59417.4 59503.1 59549.0 59625.0 54308.0 55475.0 60881.0 62765.4 64566.7 15740.9 15816.1 15850.8 15868.9 15941.2 11455.4 12401.3 12408.4 12468.7 12490.2 19513.0 19785.5 19962.4 19997.4 20125.8 7625.0 7793.0 7830.3 7850.8 7877.6 1003.5 1023.7 1050.3 1119.1 1206.3 30051.8 30070.0 30438.0 30453.7 31169.2 1170.0 1174.3 1216.5 1252.0 1278.8 15821.4 15961.8 15987.6 16185.9 16317.8 439046.0 444337.0 445026.0 445835.0 446660.0 51423.2 51706.5 51723.7 51825.5 51914.5 1288.6 1289.4 1308.5 1311.5 1318.2 28970.6 30142.4 30360.2 30485.5 30926.8 43342.1 43745.1 43745.8 43767.6 43833.0 194734.0 199784.0 199891.0 199962.0 199986.0 30729.2 31330.8 31716.5 31966.4 32130.8 38530.0 38735.8 41572.8 43626.6 44192.8 30339.2 32080.2 39859.4 39985.8 40904.8 36770.6 37010.4 37539.0 37669.2 37674.4 39077.6 39922.2 40253.8 40311.4 40353.0 37697.6 38948.0 39721.8 39887.8 40127.4 27031.9 27898.3 28303.7 29144.6 29408.4
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#2] jquery.html Cycles:180 Average:26578.30 Median:22041.51 stddev:82910.43 (376.2%) stddev-sans-first:83119.62
04:28:47 INFO - PROCESS | 24496 | Values: 350.2 371.4 373.6 374.0 374.8 12684.4 16361.3 17241.8 17526.2 17534.7 16061.4 16401.6 17502.6 17617.1 17624.1 4075.5 4201.8 4208.2 5390.4 5575.7 4001.8 5773.1 5874.5 6021.7 6101.1 5238.7 5442.3 5448.0 5964.9 5987.7 5379.6 5389.2 5403.1 5405.4 5409.9 5124.3 5161.4 5191.9 5194.2 5201.2 18562.2 19573.2 19899.1 20399.5 20619.6 2008.6 2035.5 2155.5 2323.5 2634.7 9609.0 9823.9 10041.3 10215.4 12977.2 1769.8 1839.6 1841.6 1874.0 1890.8 61949.7 62891.0 63871.4 64445.7 65702.0 9063.5 9764.0 10157.1 10294.1 10379.3 13210.9 13241.0 13242.9 13246.3 13249.9 7752.1 7795.9 7809.0 7863.7 7877.8 7687.7 7696.8 7703.2 7759.3 7768.0 4528.2 4576.7 4595.6 4607.7 4614.7 1813.4 1835.0 1842.6 1845.2 1859.4 781.0 923.3 972.6 978.6 1031.8 15017.7 15477.5 16753.6 16900.5 17225.6 949.7 979.2 1022.9 1030.9 1056.2 7434.7 9255.5 9575.4 9675.9 9817.0 375548.0 523712.0 534974.0 539525.0 541348.0 67784.0 68098.0 68427.7 71113.0 71124.0 1203.2 1203.3 1228.1 1240.3 1260.2 10891.3 14299.2 15088.4 15855.1 15973.0 30822.0 31791.5 32223.7 32592.5 32731.2 40081.2 40757.0 40820.0 41036.8 41194.4 7390.7 7575.2 7587.2 7641.8 7700.2 9987.0 11514.2 11584.4 11841.7 11914.6 9799.2 10067.7 10209.1 10325.1 10548.1 3979.5 4752.7 8849.7 10432.5 10663.5 10233.5 10370.7 10566.6 10573.6 10885.6 7402.6 7795.3 7801.3 7834.4 7870.8 9396.7 9983.0 10096.2 10440.4 10473.6
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#3] mootools.html Cycles:180 Average:5428.54 Median:6526.61 stddev:2783.45 (42.6%) stddev-sans-first:2774.16
04:28:47 INFO - PROCESS | 24496 | Values: 1323.9 1327.5 1356.5 1461.5 1819.5 6742.8 7404.9 7574.0 7574.8 7620.5 7369.1 7530.9 7582.9 7594.4 7624.2 1975.6 2028.8 2255.1 2317.4 2354.0 2284.5 2288.1 2290.4 2297.1 2297.4 2223.1 2287.7 2288.3 2291.3 2292.4 2260.7 2261.1 2264.3 2279.0 2296.4 2260.5 2261.6 2276.7 2282.5 2286.9 7707.4 7756.9 7767.7 7769.7 7777.8 4658.2 4702.0 4706.7 4739.7 4740.1 2841.0 2879.2 2910.8 2929.5 2942.6 873.0 894.6 895.5 896.2 1787.6 10315.8 10473.9 10509.3 10521.6 10523.4 4242.5 4323.9 4370.4 4410.5 4421.1 9173.9 9180.2 9181.1 9189.6 9195.9 4833.2 4848.2 4854.3 4898.0 4935.3 4489.8 4499.4 4500.1 4506.5 4516.4 3396.1 3509.9 3530.7 3530.8 3545.1 1140.6 1144.2 1145.3 1152.6 1153.4 1298.9 1310.0 1313.6 1319.1 1331.6 7371.1 7432.2 7484.9 7487.5 7489.3 1122.2 1136.1 1136.6 1137.1 1153.6 5553.7 5617.0 5631.6 5632.9 5637.5 8952.3 9073.0 9257.0 9345.3 9373.8 9194.1 9196.5 9251.6 9262.6 9297.5 6921.7 7053.7 7218.1 7285.3 7365.9 7026.8 7056.6 7071.8 7073.5 7076.3 8096.8 8240.1 8258.4 8348.1 8370.1 8433.8 8546.4 8641.3 8668.4 8696.2 6630.5 6690.7 6705.2 6705.6 6729.2 6481.6 7105.2 7301.3 7301.5 7346.1 6959.4 7085.7 7131.1 7135.7 7170.4 7038.1 7046.6 7107.2 7107.5 7224.0 7071.0 7090.1 7138.4 7141.4 7147.1 6466.0 6495.8 6497.9 6506.9 6546.3 6577.6 6595.6 6605.9 6628.4 6629.5
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#4] prototype.html Cycles:180 Average:5106.27 Median:5767.34 stddev:1520.57 (26.4%) stddev-sans-first:1482.29
04:28:47 INFO - PROCESS | 24496 | Values: 347.7 349.0 350.8 354.7 355.9 5549.1 5708.5 5727.8 5756.5 5767.9 5512.6 5630.6 5637.9 5639.9 5651.8 4498.1 4500.2 4502.8 4503.5 4506.0 4277.3 4366.9 4477.2 4484.5 4495.2 4437.5 4439.6 4455.8 4461.1 4465.1 4442.6 4455.1 4456.4 4460.3 4464.2 3945.0 3953.5 3956.5 3957.2 3966.6 5356.3 5459.6 5473.2 5490.2 5502.3 5084.5 5095.9 5100.3 5102.8 5103.3 5758.5 6067.0 6069.4 6074.1 6076.0 4152.1 4236.7 4259.5 4286.6 4289.6 6253.8 6301.8 6320.1 6320.2 6322.0 4324.2 4364.5 4367.4 4367.8 4373.3 4257.4 4404.6 4416.2 4419.8 4435.4 5077.3 5078.8 5080.2 5086.3 5089.2 6089.4 6097.9 6103.2 6108.3 6114.5 1539.2 1556.7 1557.2 1558.6 1559.5 1048.3 1052.1 1054.2 1055.9 1081.0 5776.5 5783.0 5784.6 5784.8 5785.6 6265.4 6266.9 6270.6 6276.3 6278.5 5766.8 5776.3 5779.3 5779.6 5782.2 3269.3 3371.5 3373.3 3375.4 3380.1 6497.9 6515.1 6518.4 6519.3 6522.1 6367.2 6380.0 6392.1 6445.2 6451.2 6312.4 6453.9 6462.8 6465.5 6506.9 6039.5 6123.1 6233.6 6246.2 6248.3 6080.2 6113.8 6144.2 6144.4 6206.3 6531.6 6539.3 6540.4 6575.9 6587.7 4303.8 4360.8 4395.0 4403.5 4408.2 6307.0 6323.5 6326.6 6329.9 6337.4 6161.1 6174.4 6175.7 6176.2 6180.0 6041.2 6152.1 6155.8 6163.1 6174.0 6054.2 6057.4 6059.1 6065.8 6067.1 6173.7 6195.8 6205.8 6242.4 6266.7 5888.0 6030.1 6033.0 6050.2 6056.8
04:28:47 INFO - PROCESS | 24496 |
04:28:47 INFO - PROCESS | 24496 | [#5] yui.html Cycles:180 Average:14025.20 Median:25357.91 stddev:16060.26 (63.3%) stddev-sans-first:16074.18
04:28:47 INFO - PROCESS | 24496 | Values: 709.6 801.8 810.6 821.7 848.2 13546.7 13721.8 13768.4 13779.4 13783.2 13355.7 13778.4 13794.7 13804.7 13805.2 686.0 694.4 832.0 838.5 846.9 838.7 844.0 844.5 844.9 845.6 883.3 883.6 885.4 885.6 886.5 707.6 851.7 871.6 874.1 876.7 643.3 643.6 647.7 647.7 650.1 13612.1 13660.7 13709.3 13729.5 13738.8 12385.2 12767.4 12808.2 13064.9 13179.3 10635.8 10735.0 10826.7 11036.1 11175.6 3514.9 3580.5 3608.7 3676.3 3682.8 50040.5 50169.5 50636.0 50693.2 50766.2 9519.4 9878.3 9945.8 9946.8 10145.9 18177.9 18194.7 18216.9 18219.6 18220.8 7538.2 7634.0 7688.7 7844.2 7954.3 4420.4 4420.4 4420.9 4483.8 4518.5 3228.4 3261.8 3275.8 3285.9 3302.3 550.7 568.4 583.2 585.5 591.7 662.8 672.3 683.9 701.1 702.0 8413.2 8986.9 9170.6 9282.0 9421.2 536.7 566.7 622.6 694.4 706.9 3966.2 3990.5 4053.8 4056.8 4088.8 58157.4 58166.1 58567.7 58679.7 58756.0 48912.0 50029.2 50186.7 50761.2 50906.7 43839.3 44343.6 46197.3 47124.8 48013.5 7987.2 8028.7 8120.3 8177.3 8348.0 33554.3 34053.0 34084.0 34366.1 34504.5 41730.4 46295.3 46574.8 46694.5 46736.3 11043.2 11064.6 11139.3 11215.8 11235.2 11851.6 12487.4 12514.9 12632.6 12854.9 12183.3 12265.3 12674.0 12852.4 13032.1 11105.6 11341.3 11416.8 11441.4 11799.5 11840.5 12066.7 12186.0 12496.8 12500.1 9925.2 9989.4 10007.7 10090.1 10127.1 9664.6 10553.2 10603.3 10649.6 10668.8
04:28:47 INFO - PROCESS | 24496 | -------- Summary: end --------
04:28:47 INFO - PROCESS | 24496 |
04:28:48 INFO - TEST-INFO | 24496: exit 0
04:28:48 INFO - TEST-OK | dromaeo_css | took 1112663ms
04:28:48 INFO - TEST-START | kraken
04:28:48 INFO - operating with platform_type : linux_
04:28:48 INFO - Initialising browser for kraken test...
04:28:48 INFO - TEST-INFO | started process 24683 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpB6gHa0/profile http://localhost:49291/getInfo.html)
04:28:52 INFO - PROCESS | 24683 | __metrics Screen width/height:1600/1200
04:28:52 INFO - PROCESS | 24683 | colorDepth:24
04:28:52 INFO - PROCESS | 24683 | Browser inner width/height: 1024/697
04:28:52 INFO - PROCESS | 24683 | __metrics
04:28:52 INFO - PROCESS | 24683 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver]
04:28:53 INFO - TEST-INFO | 24683: exit 0
04:28:53 INFO - Browser initialized.
04:28:53 INFO - Running cycle 1/1 for kraken test...
04:28:53 INFO - TEST-INFO | started process 24764 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpB6gHa0/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1)
04:29:05 INFO - PROCESS | 24764 | RSS: Main: 151728128
04:29:05 INFO - PROCESS | 24764 |
04:29:07 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49291/tests/kraken/driver.html?testName=audio-beat-detection)
04:29:08 INFO - PROCESS | 24764 | RSS: Main: 192471040
04:29:08 INFO - PROCESS | 24764 |
04:29:11 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49291/tests/kraken/driver.html?testName=audio-dft)
04:29:11 INFO - PROCESS | 24764 | RSS: Main: 182550528
04:29:11 INFO - PROCESS | 24764 |
04:29:14 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49291/tests/kraken/driver.html?testName=audio-fft)
04:29:15 INFO - PROCESS | 24764 | RSS: Main: 165982208
04:29:15 INFO - PROCESS | 24764 |
04:29:17 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49291/tests/kraken/driver.html?testName=audio-oscillator)
04:29:17 INFO - PROCESS | 24764 | RSS: Main: 168534016
04:29:17 INFO - PROCESS | 24764 |
04:29:20 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49291/tests/kraken/driver.html?testName=imaging-gaussian-blur)
04:29:20 INFO - PROCESS | 24764 | RSS: Main: 171327488
04:29:20 INFO - PROCESS | 24764 |
04:29:23 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49291/tests/kraken/driver.html?testName=imaging-darkroom)
04:29:24 INFO - PROCESS | 24764 | RSS: Main: 170053632
04:29:24 INFO - PROCESS | 24764 |
04:29:27 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49291/tests/kraken/driver.html?testName=imaging-desaturate)
04:29:28 INFO - PROCESS | 24764 | RSS: Main: 172302336
04:29:28 INFO - PROCESS | 24764 |
04:29:30 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49291/tests/kraken/driver.html?testName=json-parse-financial)
04:29:31 INFO - PROCESS | 24764 | RSS: Main: 170606592
04:29:31 INFO - PROCESS | 24764 |
04:29:33 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49291/tests/kraken/driver.html?testName=json-stringify-tinderbox)
04:29:33 INFO - PROCESS | 24764 | RSS: Main: 181493760
04:29:33 INFO - PROCESS | 24764 |
04:29:35 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-aes)
04:29:36 INFO - PROCESS | 24764 | RSS: Main: 178499584
04:29:36 INFO - PROCESS | 24764 |
04:29:38 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-ccm)
04:29:38 INFO - PROCESS | 24764 | RSS: Main: 188358656
04:29:38 INFO - PROCESS | 24764 |
04:29:41 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2)
04:29:41 INFO - PROCESS | 24764 | RSS: Main: 193187840
04:29:41 INFO - PROCESS | 24764 |
04:29:44 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative)
04:29:44 INFO - PROCESS | 24764 | RSS: Main: 193712128
04:29:44 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | Cycle 1(1): loaded http://localhost:49291/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49291/tests/kraken/driver.html?testName=ai-astar)
04:29:46 INFO - PROCESS | 24764 | RSS: Main: 252547072
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | __start_tp_report
04:29:46 INFO - PROCESS | 24764 | _x_x_mozilla_page_load
04:29:46 INFO - PROCESS | 24764 | _x_x_mozilla_page_load_details
04:29:46 INFO - PROCESS | 24764 | |i|pagename|runs|
04:29:46 INFO - PROCESS | 24764 | |0;ai-astar;110;111;107;112;113;111;102;109;111;111
04:29:46 INFO - PROCESS | 24764 | |1;audio-beat-detection;157;135;149;168;129;148;146;129;170;132
04:29:46 INFO - PROCESS | 24764 | |2;audio-dft;162;161;161;161;161;162;161;163;160;162
04:29:46 INFO - PROCESS | 24764 | |3;audio-fft;72;76;98;99;72;73;72;121;110;75
04:29:46 INFO - PROCESS | 24764 | |4;audio-oscillator;96;96;141;97;95;96;150;97;96;139
04:29:46 INFO - PROCESS | 24764 | |5;imaging-gaussian-blur;119;115;115;116;115;115;114;114;115;114
04:29:46 INFO - PROCESS | 24764 | |6;imaging-darkroom;145;147;146;147;147;147;147;145;145;146
04:29:46 INFO - PROCESS | 24764 | |7;imaging-desaturate;96;95;97;96;96;96;96;96;96;95
04:29:46 INFO - PROCESS | 24764 | |8;json-parse-financial;55;56;57;56;56;57;55;65;53;53
04:29:46 INFO - PROCESS | 24764 | |9;json-stringify-tinderbox;66;69;67;68;69;68;67;67;73;67
04:29:46 INFO - PROCESS | 24764 | |10;stanford-crypto-aes;85;86;86;87;86;86;85;85;86;87
04:29:46 INFO - PROCESS | 24764 | |11;stanford-crypto-ccm;119;117;117;115;123;121;118;130;120;124
04:29:46 INFO - PROCESS | 24764 | |12;stanford-crypto-pbkdf2;162;143;154;153;156;142;165;142;152;154
04:29:46 INFO - PROCESS | 24764 | |13;stanford-crypto-sha256-iterative;79;67;69;69;69;68;67;69;69;69
04:29:46 INFO - PROCESS | 24764 | __end_tp_report
04:29:46 INFO - PROCESS | 24764 | __start_cc_report
04:29:46 INFO - PROCESS | 24764 | _x_x_mozilla_cycle_collect,971
04:29:46 INFO - PROCESS | 24764 | __end_cc_report
04:29:46 INFO - PROCESS | 24764 | __startTimestamp1454848186902__endTimestamp
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | ------- Summary: start -------
04:29:46 INFO - PROCESS | 24764 | Number of tests: 14
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#0] ai-astar Cycles:10 Average:109.70 Median:111.00 stddev:3.16 (2.9%) stddev-sans-first:3.35
04:29:46 INFO - PROCESS | 24764 | Values: 110.0 111.0 107.0 112.0 113.0 111.0 102.0 109.0 111.0 111.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#1] audio-beat-detection Cycles:10 Average:146.30 Median:148.50 stddev:15.23 (10.3%) stddev-sans-first:15.66
04:29:46 INFO - PROCESS | 24764 | Values: 157.0 135.0 149.0 168.0 129.0 148.0 146.0 129.0 170.0 132.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:0.84 (0.5%) stddev-sans-first:0.87
04:29:46 INFO - PROCESS | 24764 | Values: 162.0 161.0 161.0 161.0 161.0 162.0 161.0 163.0 160.0 162.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#3] audio-fft Cycles:10 Average:86.80 Median:74.00 stddev:18.52 (25.0%) stddev-sans-first:18.85
04:29:46 INFO - PROCESS | 24764 | Values: 72.0 76.0 98.0 99.0 72.0 73.0 72.0 121.0 110.0 75.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#4] audio-oscillator Cycles:10 Average:110.30 Median:96.00 stddev:22.97 (23.9%) stddev-sans-first:23.77
04:29:46 INFO - PROCESS | 24764 | Values: 96.0 96.0 141.0 97.0 95.0 96.0 150.0 97.0 96.0 139.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#5] imaging-gaussian-blur Cycles:10 Average:115.20 Median:115.00 stddev:1.48 (1.3%) stddev-sans-first:0.67
04:29:46 INFO - PROCESS | 24764 | Values: 119.0 115.0 115.0 116.0 115.0 115.0 114.0 114.0 115.0 114.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:147.00 stddev:0.92 (0.6%) stddev-sans-first:0.87
04:29:46 INFO - PROCESS | 24764 | Values: 145.0 147.0 146.0 147.0 147.0 147.0 147.0 145.0 145.0 146.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60
04:29:46 INFO - PROCESS | 24764 | Values: 96.0 95.0 97.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#8] json-parse-financial Cycles:10 Average:56.30 Median:56.00 stddev:3.37 (6.0%) stddev-sans-first:3.54
04:29:46 INFO - PROCESS | 24764 | Values: 55.0 56.0 57.0 56.0 56.0 57.0 55.0 65.0 53.0 53.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:68.00 stddev:1.97 (2.9%) stddev-sans-first:1.94
04:29:46 INFO - PROCESS | 24764 | Values: 66.0 69.0 67.0 68.0 69.0 68.0 67.0 67.0 73.0 67.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#10] stanford-crypto-aes Cycles:10 Average:85.90 Median:86.00 stddev:0.74 (0.9%) stddev-sans-first:0.71
04:29:46 INFO - PROCESS | 24764 | Values: 85.0 86.0 86.0 87.0 86.0 86.0 85.0 85.0 86.0 87.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#11] stanford-crypto-ccm Cycles:10 Average:120.40 Median:120.50 stddev:4.38 (3.6%) stddev-sans-first:4.61
04:29:46 INFO - PROCESS | 24764 | Values: 119.0 117.0 117.0 115.0 123.0 121.0 118.0 130.0 120.0 124.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:152.30 Median:154.00 stddev:7.99 (5.2%) stddev-sans-first:7.66
04:29:46 INFO - PROCESS | 24764 | Values: 162.0 143.0 154.0 153.0 156.0 142.0 165.0 142.0 152.0 154.0
04:29:46 INFO - PROCESS | 24764 |
04:29:46 INFO - PROCESS | 24764 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.50 Median:69.00 stddev:3.44 (5.0%) stddev-sans-first:0.88
04:29:46 INFO - PROCESS | 24764 | Values: 79.0 67.0 69.0 69.0 69.0 68.0 67.0 69.0 69.0 69.0
04:29:46 INFO - PROCESS | 24764 | -------- Summary: end --------
04:29:46 INFO - PROCESS | 24764 |
04:29:47 INFO - TEST-INFO | 24764: exit 0
04:29:47 INFO - TEST-OK | kraken | took 59647ms
04:29:47 INFO - SUITE-END | took 1172s
04:29:48 INFO - Completed test suite (00:19:32)
04:29:48 INFO - Working with test: dromaeo_css
04:29:48 INFO - Generating results file: dromaeo_css
04:29:48 INFO - Working with test: kraken
04:29:48 INFO - Generating results file: kraken
04:29:48 INFO - javascript benchmark
04:29:48 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0
04:29:48 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,63,35]]
04:29:48 INFO - process_Request line: dromaeo_css 6848.35 graph.html#tests=[[72,63,35]]
04:29:48 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0
04:29:48 INFO - process_Request line: kraken 1524.30 graph.html#tests=[[232,63,35]]
04:29:48 INFO - RETURN: dromaeo_css: 6848.35
04:29:48 INFO - RETURN: kraken: 1524.30
04:29:48 INFO - javascript benchmark
04:29:48 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3060.433819743347, 3089.4593446146946, 3124.250179956811, 3130.107919243016, 3162.2726772842248, 4925.53207445293, 5018.397792264925, 5075.238714192873, 5108.974455127724, 5136.049830781308, 4940.678855874366, 4975.6019518438525, 4992.850214493562, 4994.97502512487, 5092.516210959953, 4499.370088187657, 4536.500984891659, 4560.384348113003, 4787.976060119695, 4872.951270487303, 4558.293464513005, 4572.97713511432, 4785.0, 4809.230523116302, 4856.684315519497, 4633.32816741574, 4641.675082744209, 4669.322948172513, 4697.694649847766, 4698.624110071186, 4669.696469729457, 4672.953270467286, 4694.694844835075, 4696.95303046972, 4724.787384567703, 4569.634429245652, 4615.653825963066, 4641.048585040058, 4677.228257337535, 4704.764761761932, 4860.781264843091, 4862.07620552094, 4878.463369029404, 4885.609151267926, 4921.704697718148, 5350.892982140374, 5355.223492593591, 5356.839294821161, 5362.034833729927, 5363.463653634644, 5366.570674346043, 5397.325334333208, 5532.474414930575, 5539.944600553983, 5554.1946417769195, 5129.9743501282255, 5130.07658621448, 5152.819651312224, 5154.664946778485, 5159.329287192641, 5549.417311182348, 5571.303587051619, 5578.24693666358, 5580.302462192226, 5582.190582365534, 5253.23828044939, 5291.232771248147, 5302.70835104073, 5369.060414427538, 5388.191771234347, 5475.972620136953, 5504.0643090674685, 5506.807261745819, 5508.063629183049, 5508.862278442991, 5322.467753224647, 5473.0969390051, 5494.587905906993, 5502.5597952164535, 5548.750306236148, 5383.946160538423, 5388.73056347189, 5428.538574221236, 5447.836564903059, 5485.6434331768305, 4234.894127646833, 4236.364545318165, 4241.448611680462, 4248.086661367821, 4277.080427707995, 3730.7015438764834, 3792.488014118114, 3809.980950095232, 3844.4233364994916, 3848.4419759134767, 4980.601551875841, 5028.396592408934, 5028.84913452597, 5034.924476132861, 5068.594512438996, 5417.0, 5490.368607610096, 5497.945020549823, 5500.834974950758, 5549.278593782782, 4939.3084968104495, 4943.4809345018975, 5016.523430274191, 5088.0587091388215, 5118.129917913963, 4665.6734028617675, 4688.531146885284, 4689.413823272091, 4707.905841883143, 4729.929051064237, 5640.746166422521, 5656.151577263443, 5656.1798539212405, 5678.5741069419955, 5691.8861622768145, 5309.973450132879, 5405.135178371442, 5435.266239057677, 5447.1829225616475, 5552.972235138798, 5584.692841893735, 5603.635763675348, 5611.607187496836, 5613.186088017296, 5616.0, 5340.813071542478, 5350.1974703793185, 5356.062689029326, 5356.330458692663, 5400.675959442289, 5334.439883812144, 5375.059364611099, 5428.267183930277, 5431.022415965164, 5458.153986132156, 5346.652467589594, 5370.650907690988, 5372.946270537401, 5375.731213439391, 5378.919316210338, 5244.082285599929, 5361.222622719762, 5377.569794416516, 5384.273123128328, 5425.403205647297, 5154.871128221825, 5168.043911876315, 5189.299444574934, 5232.058229518723, 5249.632525723316, 5406.270153529381, 5427.294451721251, 5440.809571664972, 5443.237946687546, 5457.945420545744, 5114.539691427641, 5197.818076367309, 5341.893162136813, 5344.812931547377, 5351.090314646597], "unit": "score", "name": "dojo.html", "value": 5029.10299326284}, {"lowerIsBetter": false, "replicates": [541.721013677956, 544.8774025844183, 567.503434494817, 568.4230506036373, 579.5971799599278, 28557.857210713944, 29229.561556576667, 33831.0, 34014.31971360571, 34060.0, 40360.0, 40786.59213407865, 40876.0, 40937.59062409375, 40967.0, 8485.703000394988, 8664.826703465927, 8729.956350218272, 8744.562771861381, 8752.387332886668, 8680.609372578248, 8818.559072046404, 8848.5575721214, 8887.822243555158, 8888.73333799987, 8848.690295839648, 8925.375223734341, 8931.464112153259, 8946.150115738994, 8952.194302512773, 8793.648254069829, 8867.68963086289, 8869.18181772735, 8874.733757987271, 8875.95562022189, 8678.739637810813, 8862.778430539223, 8873.06832782555, 8875.201231889096, 8876.511791851446, 40464.0, 40905.59094409077, 40974.79512602447, 41017.58982410168, 41020.38469422961, 3284.983575082133, 3301.356235534072, 3332.216929021678, 3338.6494418085995, 3895.7662540247393, 29992.400151997055, 30503.54244686309, 30708.865040132776, 31059.68940310613, 31555.21111972196, 3773.5094437723196, 3842.7886466244345, 3856.190200057991, 3948.6446219840063, 3969.0871099647243, 195856.0, 196074.99999999857, 196602.0, 196737.0, 197281.0, 59047.40952590505, 59417.40582594119, 59503.107453388235, 59549.0, 59625.0, 54308.0, 55475.0, 60881.0, 62765.37234627687, 64566.677166614805, 15740.921295393679, 15816.05103693782, 15850.76223856643, 15868.92065539688, 15941.202939852961, 11455.369954652575, 12401.317927514074, 12408.441620127116, 12468.688282793002, 12490.188137771016, 19513.0, 19785.50536236577, 19962.401127965895, 19997.400077997685, 20125.798742012685, 7625.0, 7792.986911701442, 7830.33442157423, 7850.764477065697, 7877.606119693993, 1003.4832061488339, 1023.6928921323573, 1050.3225419604312, 1119.1158984402232, 1206.2822620540765, 30051.849740751157, 30070.0, 30438.0, 30453.695463045085, 31169.220769480944, 1169.9938053274177, 1174.3306315400139, 1216.4525963316544, 1251.956181533642, 1278.7506436244844, 15821.446249381217, 15961.840381596268, 15987.60030999211, 16185.919070404572, 16317.755233671505, 439046.0, 444337.0, 445026.0, 445835.0, 446660.0, 51423.22865157026, 51706.48293517092, 51723.74138129361, 51825.48174518206, 51914.48085519172, 1288.645622453814, 1289.361765925854, 1308.4962289518414, 1311.4885194774047, 1318.1827267094463, 28970.565441518815, 30142.397152056397, 30360.240993975327, 30485.464070060418, 30926.845365773028, 43342.133157336044, 43745.12509749851, 43745.78127109344, 43767.56232437635, 43833.0, 194734.0, 199784.0, 199891.0, 199962.0, 199986.0, 30729.231769205948, 31330.843345783127, 31716.524252135776, 31966.360672785948, 32130.83934580312, 38530.0, 38735.806320968215, 41572.79213603913, 43626.56373436352, 44192.77903610461, 30339.24151896132, 32080.197995050312, 39859.402108967806, 39985.80007100062, 40904.79547602243, 36770.63229367672, 37010.44484332791, 37539.0, 37669.24661506809, 37674.43488347732, 39077.6092239074, 39922.201555969295, 40253.79873100616, 40311.3953290695, 40353.0, 37697.62302377051, 38948.0, 39721.80139099286, 39887.800560997006, 40127.3980890281, 27031.86484067567, 27898.302542436602, 28303.71696283093, 29144.562831557967, 29408.41183176367], "unit": "score", "name": "ext.html", "value": 18645.439183602957}, {"lowerIsBetter": false, "replicates": [350.23997924503857, 371.3816495534935, 373.60584583264654, 373.97382183247186, 374.78195863443807, 12684.365781710912, 16361.345546178154, 17241.827581724196, 17526.211320490576, 17534.736978945326, 16061.437849675263, 16401.589960251, 17502.562435939108, 17617.11914404278, 17624.11879406031, 4075.531313898895, 4201.789910504478, 4208.242516347056, 5390.380106287788, 5575.665460072409, 4001.8199181036925, 5773.105168698838, 5874.471297583216, 6021.729022194012, 6101.054336577838, 5238.711870847102, 5442.346918369782, 5448.046591846431, 5964.88070238595, 5987.670678112724, 5379.569634429236, 5389.218563308337, 5403.135498320269, 5405.405405405402, 5409.918851217235, 5124.282600435942, 5161.4322424533275, 5191.896162076738, 5194.246834209019, 5201.24581935621, 18562.164702588416, 19573.21707131713, 19899.10454029572, 20399.49001274965, 20619.5876082479, 2008.6183625111182, 2035.4504283843428, 2155.493459037125, 2323.500447403799, 2634.7376966714733, 9609.0, 9823.902699625987, 10041.347312424668, 10215.438150901697, 12977.156484828456, 1769.8053214146562, 1839.613681126965, 1841.5856432302758, 1873.9625207495774, 1890.8014658460938, 61949.690251548906, 62891.0, 63871.36128638701, 64445.677771611314, 65701.99999999952, 9063.456192628331, 9764.0, 10157.085862272432, 10294.124999375137, 10379.325343852626, 13210.933945330404, 13241.0, 13242.867571324163, 13246.337683115806, 13249.867501325056, 7752.147263800977, 7795.922040779633, 7808.960955195302, 7863.685452581833, 7877.7636670899965, 7687.730929417444, 7696.769096927102, 7703.191164927602, 7759.301662850257, 7767.961160194162, 4528.162289976365, 4576.725396476222, 4595.609373203315, 4607.654425918069, 4614.700044497097, 1813.4287699374654, 1834.9541261468303, 1842.576207472262, 1845.2065611786793, 1859.377108668584, 780.9740786246906, 923.330585325647, 972.557486343712, 978.5694294510392, 1031.8091153136543, 15017.699646007019, 15477.535673929575, 16753.581160471087, 16900.492985210465, 17225.56936076608, 949.6562364254503, 979.1725991537139, 1022.8619136416637, 1030.9278350515542, 1056.1867362131115, 7434.665440055211, 9255.537223138816, 9575.425474471554, 9675.9032409675, 9816.950915245377, 375548.0, 523712.0, 534974.0, 539525.0, 541348.0, 67784.0, 68098.0, 68427.65786171037, 71113.0, 71124.0, 1203.2419575667448, 1203.3141109567462, 1228.072805032195, 1240.299230934537, 1260.1556956838756, 10891.292066015683, 14299.21354325522, 15088.396464141311, 15855.127967961873, 15973.0, 30822.0, 31791.523127153574, 32223.67776322207, 32592.51111233286, 32731.181720457178, 40081.19837603173, 40757.0, 40820.0, 41036.79481602573, 41194.38208426816, 7390.7413240536325, 7575.24247575238, 7587.165411804807, 7641.7707468776025, 7700.152983171734, 9987.0, 11514.19400641947, 11584.362860042778, 11841.703957400789, 11914.582989595323, 9799.216062715108, 10067.69796906094, 10209.132223761064, 10325.122364599094, 10548.103411210133, 3979.4826672532386, 4752.667313288037, 8849.69026084084, 10432.491549015527, 10663.46682665879, 10233.539490723084, 10370.688879333633, 10566.630167944086, 10573.62992295266, 10885.619003334845, 7402.555846649218, 7795.337396321376, 7801.336886364723, 7834.373250139861, 7870.84258314819, 9396.744781252586, 9982.950085249528, 10096.165829972268, 10440.37357758537, 10473.633422830164], "unit": "score", "name": "jquery.html", "value": 8247.965088640249}, {"lowerIsBetter": false, "replicates": [1323.8543760186371, 1327.522092046863, 1356.4777560639154, 1461.5469204546591, 1819.4632583387909, 6742.7640032598865, 7404.888926666097, 7574.015378000859, 7574.848503029936, 7620.466567340289, 7369.1157061152735, 7530.9246907530905, 7582.9241707582905, 7594.354479869204, 7624.199459056802, 1975.5555000125, 2028.8174064334207, 2255.086689890589, 2317.385892738426, 2353.9882300588474, 2284.4859906520983, 2288.1305104060516, 2290.3815969688176, 2297.1270917051497, 2297.425643589103, 2223.0663121489015, 2287.7254729432407, 2288.3135059482174, 2291.266794625712, 2292.3925159832656, 2260.7400148982915, 2261.0955617752866, 2264.29806759905, 2278.9658155127686, 2296.3684986628728, 2260.5139894922504, 2261.5589959957815, 2276.7267927848598, 2282.4522114692522, 2286.874221917794, 7707.383409327241, 7756.883646745303, 7767.650455729449, 7769.728059517946, 7777.844443111106, 4658.18481765693, 4701.952980470186, 4706.670533062687, 4739.715617062987, 4740.146773580754, 2840.957385639217, 2879.1794338613604, 2910.767138628905, 2929.4580502606873, 2942.5880376747273, 873.0483772687801, 894.6421431427481, 895.4537731983485, 896.171041786345, 1787.5977904971407, 10315.84526232107, 10473.947630261877, 10509.31689440184, 10521.631742888962, 10523.368597884075, 4242.533321334712, 4323.870283891489, 4370.366296886934, 4410.4927933287445, 4421.137878113737, 9173.862392063991, 9180.17378435944, 9181.127792859668, 9189.632414703337, 9195.90804091964, 4833.226683730586, 4848.151573474628, 4854.344663470457, 4898.044881248194, 4935.333729946411, 4489.775511224426, 4499.370088187657, 4500.099980004013, 4506.481754598263, 4516.435445569304, 3396.1339858335964, 3509.9122521936647, 3530.6822385985383, 3530.8234588271, 3545.096000519851, 1140.6178930058522, 1144.1704764046, 1145.255583870474, 1152.608113241502, 1153.405995912106, 1298.8766067223598, 1310.0, 1313.6256166992362, 1319.116192151261, 1331.620488160889, 7371.078615173104, 7432.182459929403, 7484.850302994018, 7487.47587668858, 7489.28851759082, 1122.2368789223406, 1136.1251836086167, 1136.607870284767, 1137.056243318044, 1153.5674122204173, 5553.694546799965, 5617.0, 5631.633943793722, 5632.887342253132, 5637.49262566371, 8952.283817294601, 9072.95463522678, 9256.95371523138, 9345.345825792128, 9373.812523749622, 9194.080591940752, 9196.540172991323, 9251.583678734472, 9262.583183756748, 9297.488638124969, 6921.688524016431, 7053.717851285891, 7218.133823941161, 7285.307895749789, 7365.889511657329, 7026.789196324118, 7056.576605403692, 7071.82320441993, 7073.540219885691, 7076.32774886385, 8096.757097287091, 8240.052393974769, 8258.42191046621, 8348.081711011906, 8370.079291278076, 8433.777102320251, 8546.444481108709, 8641.308695304235, 8668.393212475066, 8696.21734043939, 6630.5027122965, 6690.665466726741, 6705.22889867652, 6705.564138330993, 6729.192496900403, 6481.578697384655, 7105.218425973242, 7301.269873012656, 7301.452391070798, 7346.11846578414, 6959.4432445405255, 7085.6811443486195, 7131.103665668752, 7135.678894449866, 7170.42636589082, 7038.085048943604, 7046.612436316052, 7107.18267399235, 7107.466939979418, 7224.0, 7071.0, 7090.113735783028, 7138.428925685829, 7141.428685705027, 7147.070880785464, 6465.967670161619, 6495.805125846232, 6497.8700425992165, 6506.934930650633, 6546.279909209888, 6577.6053436793945, 6595.604263744191, 6605.933940660532, 6628.370304821035, 6629.502787291069], "unit": "score", "name": "mootools.html", "value": 4480.822381490515}, {"lowerIsBetter": false, "replicates": [347.65061113580845, 348.95638045244345, 350.84387447585834, 354.67370019581983, 355.8683287183741, 5549.084401073818, 5708.486236238738, 5727.770889164433, 5756.51069659079, 5767.855803604912, 5512.641678290918, 5630.577706671996, 5637.887242255152, 5639.943600563993, 5651.7739290428435, 4498.055408364247, 4500.189965806154, 4502.842400515982, 4503.549645035495, 4506.0, 4277.3156294992805, 4366.868993930171, 4477.216487114758, 4484.4842843072975, 4495.235809912323, 4437.534058923815, 4439.578240067204, 4455.84404545841, 4461.107778444308, 4465.106978604276, 4442.600165985061, 4455.1089782043555, 4456.398386217851, 4460.286354183348, 4464.218761716719, 3944.980275098635, 3953.4662820519147, 3956.5449973252867, 3957.2085582883537, 3966.5835087315704, 5356.276902618136, 5459.563234941195, 5473.2063850741415, 5490.176473529003, 5502.312210973629, 5084.51697088776, 5095.872603184913, 5100.285959965608, 5102.770375333082, 5103.260027296058, 5758.510526605243, 6066.96966515169, 6069.423404776539, 6074.119252708377, 6076.0, 4152.1072969311745, 4236.6610671146545, 4259.488861336628, 4286.635635970946, 4289.613934745857, 6253.781117660906, 6301.842453938642, 6320.051992201161, 6320.241571011462, 6321.96839015802, 4324.24325743, 4364.54172311909, 4367.432233809648, 4367.825286988548, 4373.322135069069, 4257.446531950826, 4404.559544045634, 4416.205083085076, 4419.801108950105, 4435.401220835211, 5077.339945807022, 5078.796848126033, 5080.237964305384, 5086.3133476980875, 5089.185730283137, 6089.360617135226, 6097.939020609826, 6103.23709536308, 6108.3280839107665, 6114.48026917717, 1539.2226925402824, 1556.6808804195114, 1557.2058250292207, 1558.586974451771, 1559.4541910331293, 1048.3447845096814, 1052.0636633396284, 1054.1724746074294, 1055.9208059395576, 1080.9567617295377, 5776.5089967352405, 5783.033768518724, 5784.623999440023, 5784.768609255582, 5785.623934444247, 6265.4361107500545, 6266.905996410058, 6270.561060725797, 6276.309605943343, 6278.529110316745, 5766.826995190151, 5776.277965254343, 5779.306483222041, 5779.624324418984, 5782.219400380979, 3269.29710112327, 3371.5448414463735, 3373.3421982713135, 3375.392429362689, 3380.1211684961595, 6497.870042599122, 6515.120458738104, 6518.380753828379, 6519.282878883319, 6522.086907832907, 6367.172267605274, 6379.96810015947, 6392.105105285264, 6445.2265728112925, 6451.161349024596, 6312.400321969406, 6453.870922581522, 6462.838429039311, 6465.4827613790785, 6506.869862602816, 6039.48664363534, 6123.142760013513, 6233.625982441068, 6246.187995560548, 6248.312685604671, 6080.2399700037495, 6113.786017489367, 6144.2319710036245, 6144.41628045335, 6206.286277078013, 6531.608103513804, 6539.280679125197, 6540.444062254572, 6575.868482630225, 6587.703553340016, 4303.763293018914, 4360.803763830699, 4394.978025109854, 4403.471583410012, 4408.184485870124, 6307.0, 6323.525735569942, 6326.620402775849, 6329.8734025320155, 6337.366263373626, 6161.137440758387, 6174.413430724074, 6175.660338681416, 6176.197094377702, 6180.042093475518, 6041.184440100706, 6152.138700582012, 6155.846103847261, 6163.137160797582, 6174.043023331391, 6054.182685337423, 6057.394260573908, 6059.091136329585, 6065.757369705162, 6067.059605761114, 6173.69131543412, 6195.760847830362, 6205.751769929152, 6242.375762423721, 6266.655333956676, 5887.970560147343, 6030.125631783455, 6032.969835150971, 6050.15297858309, 6056.818295451144], "unit": "score", "name": "prototype.html", "value": 4621.78686430983}, {"lowerIsBetter": false, "replicates": [709.5955305475879, 801.7674874286457, 810.5976660377543, 821.6877586517122, 848.2069265237004, 13546.661333466656, 13721.794173087412, 13768.449262029519, 13779.44882204713, 13783.241921694314, 13355.666108347295, 13778.379972901219, 13794.724105517884, 13804.723905521883, 13805.171689698625, 686.0292685849518, 694.4132208284017, 832.0, 838.4508147163617, 846.8687353460224, 838.6729175621513, 843.9873401898976, 844.543946269017, 844.9112843151473, 845.6194712379423, 883.3242569434387, 883.567052144451, 885.3536918049828, 885.5527958381009, 886.45483027938, 707.5825263094773, 851.7317045130764, 871.5859966515854, 874.1040433555656, 876.6887754847002, 643.3180828321994, 643.5977514053717, 647.6761619190405, 647.6858723519136, 650.1288273713247, 13612.115212511155, 13660.726785464334, 13709.314534273246, 13729.519466818714, 13738.793918091236, 12385.19496232742, 12767.42546585406, 12808.23150610957, 13064.934675326658, 13179.341032948314, 10635.840462393071, 10735.0, 10826.72933176669, 11036.061934735557, 11175.552977880876, 3514.9297014059575, 3580.4629305604108, 3608.6932610728118, 3676.3382591133586, 3682.834272457719, 50040.499595003945, 50169.498305017216, 50636.0, 50693.23960140601, 50766.238506422436, 9519.381240219363, 9878.308518403786, 9945.80108397828, 9946.801063978824, 10145.934676858971, 18177.909110454362, 18194.727079093824, 18216.908915455337, 18219.629368566857, 18220.81779182191, 7538.208488108779, 7634.0, 7688.730894418781, 7844.215578442224, 7954.284114429729, 4420.403245561808, 4420.425344705168, 4420.8673739787855, 4483.786397121134, 4518.502964673883, 3228.3704677588116, 3261.7553683473834, 3275.836208189581, 3285.901422957315, 3302.256992176789, 550.6530885542082, 568.3861429655962, 583.1922786940033, 585.5227989188797, 591.6568390333596, 662.844231605582, 672.2605134352272, 683.8563901580724, 701.0990876723386, 701.9684114214873, 8413.242808147295, 8986.910130898606, 9170.633174672937, 9281.953590232006, 9421.199198068241, 536.696766327024, 566.6911533214408, 622.6202016769766, 694.3611877073105, 706.8709836875927, 3966.2265858157957, 3990.461287726178, 4053.7973101344814, 4056.817443215062, 4088.7546747195265, 58157.4184258152, 58166.12750808741, 58567.70716146392, 58679.70660146672, 58756.0, 48912.0, 50029.24956125661, 50186.74906625444, 50761.238581421305, 50906.74546627317, 43839.34240986388, 44343.556564433944, 46197.30704039442, 47124.764376177896, 48013.5198648016, 7987.201279871966, 8028.678852845821, 8120.309773669304, 8177.345812335118, 8347.980222964847, 33554.32891342208, 34053.0, 34084.0, 34366.14084647904, 34504.48243276403, 41730.374044389966, 46295.30557041714, 46574.76712616415, 46694.53305467038, 46736.29895551501, 11043.171762117712, 11064.612738554111, 11139.275947063416, 11215.831762523732, 11235.213535052468, 11851.63749575891, 12487.438065286902, 12514.937425312815, 12632.557860475206, 12854.871451285368, 12183.269003859798, 12265.26408415498, 12674.049446291381, 12852.357382130669, 13032.087753857139, 11105.555777768799, 11341.26281791681, 11416.771664566497, 11441.42792860337, 11799.469023893773, 11840.467178976794, 12066.698332541757, 12186.025117990717, 12496.812547811609, 12500.062495312706, 9925.156361709336, 9989.350692204984, 10007.749806254902, 10090.09189172978, 10127.139193168663, 9664.56509457062, 10553.208509361675, 10603.32171498758, 10649.627263046066, 10668.83996740034], "unit": "score", "name": "yui.html", "value": 6440.197340396421}], "name": "dromaeo_css", "value": 6848.353191051857}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 111.0, 107.0, 112.0, 113.0, 111.0, 102.0, 109.0, 111.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.7}, {"lowerIsBetter": true, "replicates": [157.0, 135.0, 149.0, 168.0, 129.0, 148.0, 146.0, 129.0, 170.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 146.3}, {"lowerIsBetter": true, "replicates": [162.0, 161.0, 161.0, 161.0, 161.0, 162.0, 161.0, 163.0, 160.0, 162.0], "unit": "score", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [72.0, 76.0, 98.0, 99.0, 72.0, 73.0, 72.0, 121.0, 110.0, 75.0], "unit": "score", "name": "audio-fft", "value": 86.8}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 141.0, 97.0, 95.0, 96.0, 150.0, 97.0, 96.0, 139.0], "unit": "score", "name": "audio-oscillator", "value": 110.3}, {"lowerIsBetter": true, "replicates": [119.0, 115.0, 115.0, 116.0, 115.0, 115.0, 114.0, 114.0, 115.0, 114.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.2}, {"lowerIsBetter": true, "replicates": [145.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 145.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.2}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [55.0, 56.0, 57.0, 56.0, 56.0, 57.0, 55.0, 65.0, 53.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 56.3}, {"lowerIsBetter": true, "replicates": [66.0, 69.0, 67.0, 68.0, 69.0, 68.0, 67.0, 67.0, 73.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.1}, {"lowerIsBetter": true, "replicates": [85.0, 86.0, 86.0, 87.0, 86.0, 86.0, 85.0, 85.0, 86.0, 87.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.9}, {"lowerIsBetter": true, "replicates": [119.0, 117.0, 117.0, 115.0, 123.0, 121.0, 118.0, 130.0, 120.0, 124.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.4}, {"lowerIsBetter": true, "replicates": [162.0, 143.0, 154.0, 153.0, 156.0, 142.0, 165.0, 142.0, 152.0, 154.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 152.3}, {"lowerIsBetter": true, "replicates": [79.0, 67.0, 69.0, 69.0, 69.0, 68.0, 67.0, 69.0, 69.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.5}], "name": "kraken", "value": 1524.3000000000002}]}
04:29:48 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,35]]", "result": "1524.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,35]]", "result": "6848.35"}}}
04:29:48 INFO - Return code: 0
04:29:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json
04:29:48 INFO - # TBPL SUCCESS #
04:29:48 INFO - Running post-action listener: _resource_record_post_action
04:29:48 INFO - Running post-run listener: _resource_record_post_run
04:29:49 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 405491712; Read time: 52; Write time: 275328
04:29:49 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 106967040; Read time: 52; Write time: 71704
04:29:49 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 298524672; Read time: 0; Write time: 203624
04:29:49 INFO - Running post-run listener: _upload_blobber_files
04:29:49 INFO - Blob upload gear active.
04:29:49 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir.
04:29:49 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com
04:29:49 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json']
04:29:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json
04:29:49 INFO - (blobuploader) - INFO - Open directory for files ...
04:29:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ...
04:29:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
04:29:49 INFO - (blobuploader) - INFO - Uploading, attempt #1.
04:29:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded
04:29:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
04:29:50 INFO - (blobuploader) - INFO - Done attempting.
04:29:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ...
04:29:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com
04:29:50 INFO - (blobuploader) - INFO - Uploading, attempt #1.
04:29:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded
04:29:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded!
04:29:51 INFO - (blobuploader) - INFO - Done attempting.
04:29:51 INFO - (blobuploader) - INFO - Iteration through files over.
04:29:51 INFO - Return code: 0
04:29:51 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json
04:29:51 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1
04:29:51 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/48e0f98857225d62211a248dbcb31e8e9e2349c4843aeb3e7fd7d4e87de69d8f7d4edacd4bc18473a4f6a0894d51021581b8e49ce8e195db0449c07baad1cc9d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/64d0a183bd346f770f67fc6343c5f50289e2d29d0ff06b41847666e59969201b2852d7eea9084c84a5ef595b4bdfba94c536a5f84981656e7558fce6ed0290a3"}
04:29:51 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files
04:29:51 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files
04:29:51 INFO - Contents:
04:29:51 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/48e0f98857225d62211a248dbcb31e8e9e2349c4843aeb3e7fd7d4e87de69d8f7d4edacd4bc18473a4f6a0894d51021581b8e49ce8e195db0449c07baad1cc9d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/64d0a183bd346f770f67fc6343c5f50289e2d29d0ff06b41847666e59969201b2852d7eea9084c84a5ef595b4bdfba94c536a5f84981656e7558fce6ed0290a3"}
04:29:51 INFO - Running post-run listener: copy_logs_to_upload_dir
04:29:51 INFO - Copying logs to upload dir...
04:29:51 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs
04:29:51 INFO - Copying logs to upload dir...
program finished with exit code 0
elapsedTime=1235.161158
========= master_lag: 0.02 =========
========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-02-07 04:29:50.847664) =========
========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-07 04:29:50.851718) =========
bash -c 'for file in `ls -1`; do cat $file; done'
in dir /builds/slave/test-pgo/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-pgo/properties
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/48e0f98857225d62211a248dbcb31e8e9e2349c4843aeb3e7fd7d4e87de69d8f7d4edacd4bc18473a4f6a0894d51021581b8e49ce8e195db0449c07baad1cc9d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/64d0a183bd346f770f67fc6343c5f50289e2d29d0ff06b41847666e59969201b2852d7eea9084c84a5ef595b4bdfba94c536a5f84981656e7558fce6ed0290a3"}
build_url:https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2
program finished with exit code 0
elapsedTime=0.011125
build_url: 'https://queue.taskcluster.net/v1/task/X_ahvcDESFKi9VI-6CogBw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'
blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/48e0f98857225d62211a248dbcb31e8e9e2349c4843aeb3e7fd7d4e87de69d8f7d4edacd4bc18473a4f6a0894d51021581b8e49ce8e195db0449c07baad1cc9d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/64d0a183bd346f770f67fc6343c5f50289e2d29d0ff06b41847666e59969201b2852d7eea9084c84a5ef595b4bdfba94c536a5f84981656e7558fce6ed0290a3"}'
========= master_lag: 0.02 =========
========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-07 04:29:50.880914) =========
========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:29:50.881272) =========
rm -f oauth.txt
in dir /builds/slave/test-pgo/. (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-pgo
SHELL=/bin/bash
SHLVL=1
TERM=linux
TMOUT=86400
USER=cltbld
XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1454844987.676013-173894487
XPCOM_DEBUG_BREAK=warn
_=/tools/buildbot/bin/python
using PTY: False
program finished with exit code 0
elapsedTime=0.004501
========= master_lag: 0.08 =========
========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 04:29:50.963611) =========
========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-07 04:29:50.963991) =========
========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-07 04:29:50.964353) =========
========= Total master_lag: 0.33 =========