builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-038 starttime: 1454359932.73 results: success (0) buildid: 20160201103056 builduid: a954b707f72a4d8dbb12092adf90d462 revision: 45c60b46bab9c109f19325dafd2f6512635903ac ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.732999) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.733650) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.733946) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006472 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.767490) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.767758) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.781999) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.782256) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004614 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.830675) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.831169) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.831547) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.831838) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-01 12:52:13-- 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.6M=0s 2016-02-01 12:52:13 (83.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.097246 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.952462) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:12.952750) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022242 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.041664) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.042224) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 45c60b46bab9c109f19325dafd2f6512635903ac --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 45c60b46bab9c109f19325dafd2f6512635903ac --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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-01 12:52:13,299 truncating revision to first 12 chars 2016-02-01 12:52:13,299 Setting DEBUG logging. 2016-02-01 12:52:13,299 attempt 1/10 2016-02-01 12:52:13,299 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/45c60b46bab9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-01 12:52:13,546 unpacking tar archive at: mozilla-inbound-45c60b46bab9/testing/mozharness/ program finished with exit code 0 elapsedTime=0.546986 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.606294) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.606648) ========= echo 45c60b46bab9c109f19325dafd2f6512635903ac in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'45c60b46bab9c109f19325dafd2f6512635903ac'] 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 45c60b46bab9c109f19325dafd2f6512635903ac program finished with exit code 0 elapsedTime=0.004392 script_repo_revision: '45c60b46bab9c109f19325dafd2f6512635903ac' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.656920) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.657190) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-01 12:52:13.669366) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-02-01 12:52:13.669716) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:52:14 INFO - MultiFileLogger online at 20160201 12:52:14 in /builds/slave/test-pgo 12:52:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 12:52:14 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 12:52:14 INFO - {'append_to_log': False, 12:52:14 INFO - 'base_work_dir': '/builds/slave/test-pgo', 12:52:14 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 12:52:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 12:52:14 INFO - 'branch': 'Mozilla-Inbound', 12:52:14 INFO - 'buildbot_json_path': 'buildprops.json', 12:52:14 INFO - 'config_files': ('talos/linux_config.py',), 12:52:14 INFO - 'default_actions': ('clobber', 12:52:14 INFO - 'read-buildbot-config', 12:52:14 INFO - 'download-and-extract', 12:52:14 INFO - 'populate-webroot', 12:52:14 INFO - 'create-virtualenv', 12:52:14 INFO - 'install', 12:52:14 INFO - 'run-tests'), 12:52:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:52:14 INFO - 'download_minidump_stackwalk': True, 12:52:14 INFO - 'download_symbols': 'ondemand', 12:52:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:52:14 INFO - 'tooltool.py': '/tools/tooltool.py', 12:52:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:52:14 INFO - '/tools/misc-python/virtualenv.py')}, 12:52:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:52:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:52:14 INFO - 'installer_path': 'installer.exe', 12:52:14 INFO - 'log_level': 'info', 12:52:14 INFO - 'log_name': 'talos', 12:52:14 INFO - 'log_to_console': True, 12:52:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:52:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:52:14 INFO - 'opt_config_files': (), 12:52:14 INFO - 'pip_index': False, 12:52:14 INFO - 'sps_profile': False, 12:52:14 INFO - 'sps_profile_interval': 0, 12:52:14 INFO - 'suite': 'dromaeojs-e10s', 12:52:14 INFO - 'system_bits': '32', 12:52:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:52:14 INFO - 'title': 'talos-linux64-ix-038', 12:52:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:52:14 INFO - 'use_talos_json': True, 12:52:14 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 12:52:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:52:14 INFO - 'work_dir': 'build'} 12:52:14 INFO - ##### 12:52:14 INFO - ##### Running clobber step. 12:52:14 INFO - ##### 12:52:14 INFO - Running pre-action listener: _resource_record_pre_action 12:52:14 INFO - Running main action method: clobber 12:52:14 INFO - rmtree: /builds/slave/test-pgo/build 12:52:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 12:52:14 INFO - Running post-action listener: _resource_record_post_action 12:52:14 INFO - ##### 12:52:14 INFO - ##### Running read-buildbot-config step. 12:52:14 INFO - ##### 12:52:14 INFO - Running pre-action listener: _resource_record_pre_action 12:52:14 INFO - Running main action method: read_buildbot_config 12:52:14 INFO - Using buildbot properties: 12:52:14 INFO - { 12:52:14 INFO - "project": "", 12:52:14 INFO - "product": "firefox", 12:52:14 INFO - "script_repo_revision": "production", 12:52:14 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 12:52:14 INFO - "repository": "", 12:52:14 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 12:52:14 INFO - "buildid": "20160201103056", 12:52:14 INFO - "pgo_build": "True", 12:52:14 INFO - "basedir": "/builds/slave/test-pgo", 12:52:14 INFO - "buildnumber": 388, 12:52:14 INFO - "slavename": "talos-linux64-ix-038", 12:52:14 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 12:52:14 INFO - "platform": "ubuntu64_hw", 12:52:14 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 12:52:14 INFO - "branch": "mozilla-inbound", 12:52:14 INFO - "repo_path": "integration/mozilla-inbound", 12:52:14 INFO - "revision": "45c60b46bab9c109f19325dafd2f6512635903ac", 12:52:14 INFO - "stage_platform": "linux64-pgo", 12:52:14 INFO - "builduid": "a954b707f72a4d8dbb12092adf90d462", 12:52:14 INFO - "slavebuilddir": "test" 12:52:14 INFO - } 12:52:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 12:52:14 INFO - Running post-action listener: _resource_record_post_action 12:52:14 INFO - ##### 12:52:14 INFO - ##### Running download-and-extract step. 12:52:14 INFO - ##### 12:52:14 INFO - Running pre-action listener: _resource_record_pre_action 12:52:14 INFO - Running main action method: download_and_extract 12:52:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 12:52: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')]} 12:52:14 INFO - https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 12:52:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/test_packages.json 12:52:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/test_packages.json 12:52:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 12:52:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 12:52:15 INFO - Downloaded 1448 bytes. 12:52:15 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 12:52:15 INFO - Using the following test package requirements: 12:52:15 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 12:52:15 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:52:15 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:52:15 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'jsshell-linux-x86_64.zip'], 12:52:15 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:52:15 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 12:52:15 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:52:15 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:52:15 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:52:15 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 12:52:15 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 12:52:15 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:52:15 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:52:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:15 INFO - https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:52:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 12:52:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 12:52:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:16 INFO - Downloaded 22934638 bytes. 12:52:16 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'] 12:52:16 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 12:52:17 INFO - Return code: 0 12:52:17 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 12:52:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:17 INFO - https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:52:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 12:52:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 12:52:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:18 INFO - Downloaded 22934638 bytes. 12:52:18 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'] 12:52:18 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 12:52:20 INFO - Return code: 0 12:52:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:20 INFO - https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:52:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 12:52:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 12:52:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:21 INFO - Downloaded 10706582 bytes. 12:52:21 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'] 12:52:21 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 12:52:22 INFO - Return code: 0 12:52: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')]} 12:52:22 INFO - https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:52:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 12:52:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 12:52:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CX-4ajWrRimOQIvk4krLrA/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 12:52:24 INFO - Downloaded 56113144 bytes. 12:52:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 12:52:24 INFO - mkdir: /builds/slave/test-pgo/properties 12:52:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 12:52:24 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 12:52:24 INFO - Contents: 12:52:24 INFO - build_url:https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 12:52:24 INFO - Running post-action listener: _resource_record_post_action 12:52:24 INFO - Running post-action listener: set_extra_try_arguments 12:52:24 INFO - ##### 12:52:24 INFO - ##### Running populate-webroot step. 12:52:24 INFO - ##### 12:52:24 INFO - Running pre-action listener: _resource_record_pre_action 12:52:24 INFO - Running main action method: populate_webroot 12:52:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:52:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:52:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:52:24 INFO - '--tppagecycles', 12:52:24 INFO - '7'], 12:52:24 INFO - 'tests': ['tsvgm']}}, 12:52:24 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 12:52:24 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:52:24 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 12:52:24 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:52:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:52:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:52:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'tests': ['damp', 'tps']}, 12:52:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['damp', 'tps']}, 12:52:24 INFO - 'g3': {'tests': ['dromaeo_dom']}, 12:52:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:52:24 INFO - 'other': {'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'other-e10s': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'other_l64': {'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'other_nol64': {'tests': ['a11yr', 12:52:24 INFO - 'ts_paint', 12:52:24 INFO - 'tpaint', 12:52:24 INFO - 'sessionrestore', 12:52:24 INFO - 'sessionrestore_no_auto_restore']}, 12:52:24 INFO - 'svgr': {'tests': ['tsvgx', 12:52:24 INFO - 'tsvgr_opacity', 12:52:24 INFO - 'tart', 12:52:24 INFO - 'tscrollx', 12:52:24 INFO - 'cart']}, 12:52:24 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['tsvgx', 12:52:24 INFO - 'tsvgr_opacity', 12:52:24 INFO - 'tart', 12:52:24 INFO - 'tscrollx', 12:52:24 INFO - 'cart']}, 12:52:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'tests': ['tp5o']}, 12:52:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'talos_options': ['--e10s'], 12:52:24 INFO - 'tests': ['tp5o']}, 12:52:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'talos_options': ['--xperf_path', 12:52:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:52:24 INFO - 'tests': ['tp5n']}, 12:52:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:52:24 INFO - 'talos_options': ['--e10s', 12:52:24 INFO - '--xperf_path', 12:52:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:52:24 INFO - 'tests': ['tp5n']}}, 12:52:24 INFO - 'talos.zip': {'path': '', 12:52:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:52:24 INFO - Running post-action listener: _resource_record_post_action 12:52:24 INFO - ##### 12:52:24 INFO - ##### Running create-virtualenv step. 12:52:24 INFO - ##### 12:52:24 INFO - Running pre-action listener: _resource_record_pre_action 12:52:24 INFO - Running main action method: create_virtualenv 12:52:24 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 12:52:24 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 12:52:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 12:52:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:52:24 INFO - Using real prefix '/usr' 12:52:24 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 12:52:25 INFO - Installing distribute.............................................................................................................................................................................................done. 12:52:27 INFO - Installing pip.................done. 12:52:27 INFO - Return code: 0 12:52:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 12:52: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')]} 12:52:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52: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')]} 12:52:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:27 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:27 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 12:52:27 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 12:52:27 INFO - Using env: {'DISPLAY': ':0', 12:52:27 INFO - 'HOME': '/home/cltbld', 12:52:27 INFO - 'LANG': 'en_US.UTF-8', 12:52:27 INFO - 'LANGUAGE': 'en_US:en', 12:52:27 INFO - 'LOGNAME': 'cltbld', 12:52:27 INFO - 'MAIL': '/var/mail/cltbld', 12:52:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:27 INFO - 'MOZ_NO_REMOTE': '1', 12:52:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:27 INFO - 'NO_EM_RESTART': '1', 12:52:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:27 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:27 INFO - 'SHELL': '/bin/bash', 12:52:27 INFO - 'SHLVL': '1', 12:52:27 INFO - 'TERM': 'linux', 12:52:27 INFO - 'TMOUT': '86400', 12:52:27 INFO - 'USER': 'cltbld', 12:52:27 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:27 INFO - '_': '/tools/buildbot/bin/python'} 12:52:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:27 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 12:52:27 INFO - Cleaning up... 12:52:27 INFO - Return code: 0 12:52:27 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 12:52: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')]} 12:52:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52: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')]} 12:52:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:27 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:27 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 12:52:27 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 12:52:27 INFO - Using env: {'DISPLAY': ':0', 12:52:27 INFO - 'HOME': '/home/cltbld', 12:52:27 INFO - 'LANG': 'en_US.UTF-8', 12:52:27 INFO - 'LANGUAGE': 'en_US:en', 12:52:27 INFO - 'LOGNAME': 'cltbld', 12:52:27 INFO - 'MAIL': '/var/mail/cltbld', 12:52:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:27 INFO - 'MOZ_NO_REMOTE': '1', 12:52:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:27 INFO - 'NO_EM_RESTART': '1', 12:52:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:27 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:27 INFO - 'SHELL': '/bin/bash', 12:52:27 INFO - 'SHLVL': '1', 12:52:27 INFO - 'TERM': 'linux', 12:52:27 INFO - 'TMOUT': '86400', 12:52:27 INFO - 'USER': 'cltbld', 12:52:27 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:27 INFO - '_': '/tools/buildbot/bin/python'} 12:52:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:27 INFO - Downloading/unpacking psutil>=0.7.1 12:52:27 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 12:52:27 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 12:52:27 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 12:52:27 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 12:52:27 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 12:52:27 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 12:52:29 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 12:52:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:52:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:52:29 INFO - Installing collected packages: psutil 12:52:29 INFO - Running setup.py install for psutil 12:52:29 INFO - building 'psutil._psutil_linux' extension 12:52:29 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 12:52:29 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 12:52:29 INFO - building 'psutil._psutil_posix' extension 12:52:29 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 12:52:29 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 12:52:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:52:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:52:30 INFO - Successfully installed psutil 12:52:30 INFO - Cleaning up... 12:52:30 INFO - Return code: 0 12:52:30 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 12:52:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:30 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:30 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 12:52:30 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 12:52:30 INFO - Using env: {'DISPLAY': ':0', 12:52:30 INFO - 'HOME': '/home/cltbld', 12:52:30 INFO - 'LANG': 'en_US.UTF-8', 12:52:30 INFO - 'LANGUAGE': 'en_US:en', 12:52:30 INFO - 'LOGNAME': 'cltbld', 12:52:30 INFO - 'MAIL': '/var/mail/cltbld', 12:52:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:30 INFO - 'MOZ_NO_REMOTE': '1', 12:52:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:30 INFO - 'NO_EM_RESTART': '1', 12:52:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:30 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:30 INFO - 'SHELL': '/bin/bash', 12:52:30 INFO - 'SHLVL': '1', 12:52:30 INFO - 'TERM': 'linux', 12:52:30 INFO - 'TMOUT': '86400', 12:52:30 INFO - 'USER': 'cltbld', 12:52:30 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:30 INFO - '_': '/tools/buildbot/bin/python'} 12:52:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:30 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 12:52:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:32 INFO - Downloading mozsystemmonitor-0.0.tar.gz 12:52:32 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:52:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 12:52:32 INFO - Installing collected packages: mozsystemmonitor 12:52:32 INFO - Running setup.py install for mozsystemmonitor 12:52:32 INFO - Successfully installed mozsystemmonitor 12:52:32 INFO - Cleaning up... 12:52:32 INFO - Return code: 0 12:52:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 12:52:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:52:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:32 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:32 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 12:52:32 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 12:52:32 INFO - Using env: {'DISPLAY': ':0', 12:52:32 INFO - 'HOME': '/home/cltbld', 12:52:32 INFO - 'LANG': 'en_US.UTF-8', 12:52:32 INFO - 'LANGUAGE': 'en_US:en', 12:52:32 INFO - 'LOGNAME': 'cltbld', 12:52:32 INFO - 'MAIL': '/var/mail/cltbld', 12:52:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:32 INFO - 'MOZ_NO_REMOTE': '1', 12:52:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:32 INFO - 'NO_EM_RESTART': '1', 12:52:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:32 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:32 INFO - 'SHELL': '/bin/bash', 12:52:32 INFO - 'SHLVL': '1', 12:52:32 INFO - 'TERM': 'linux', 12:52:32 INFO - 'TMOUT': '86400', 12:52:32 INFO - 'USER': 'cltbld', 12:52:32 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:32 INFO - '_': '/tools/buildbot/bin/python'} 12:52:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:32 INFO - Downloading/unpacking blobuploader==1.2.4 12:52:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:34 INFO - Downloading blobuploader-1.2.4.tar.gz 12:52:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:52:34 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:52:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 12:52:34 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:52:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:34 INFO - Downloading docopt-0.6.1.tar.gz 12:52:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 12:52:34 INFO - Installing collected packages: blobuploader, requests, docopt 12:52:34 INFO - Running setup.py install for blobuploader 12:52:35 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:52:35 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 12:52:35 INFO - Running setup.py install for requests 12:52:35 INFO - Running setup.py install for docopt 12:52:35 INFO - Successfully installed blobuploader requests docopt 12:52:35 INFO - Cleaning up... 12:52:35 INFO - Return code: 0 12:52:35 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 12:52:35 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')]} 12:52:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:35 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')]} 12:52:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:35 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:35 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 12:52:35 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 12:52:35 INFO - Using env: {'DISPLAY': ':0', 12:52:35 INFO - 'HOME': '/home/cltbld', 12:52:35 INFO - 'LANG': 'en_US.UTF-8', 12:52:35 INFO - 'LANGUAGE': 'en_US:en', 12:52:35 INFO - 'LOGNAME': 'cltbld', 12:52:35 INFO - 'MAIL': '/var/mail/cltbld', 12:52:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:35 INFO - 'MOZ_NO_REMOTE': '1', 12:52:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:35 INFO - 'NO_EM_RESTART': '1', 12:52:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:35 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:35 INFO - 'SHELL': '/bin/bash', 12:52:35 INFO - 'SHLVL': '1', 12:52:35 INFO - 'TERM': 'linux', 12:52:35 INFO - 'TMOUT': '86400', 12:52:35 INFO - 'USER': 'cltbld', 12:52:35 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:35 INFO - '_': '/tools/buildbot/bin/python'} 12:52:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 12:52:35 INFO - Running setup.py (path:/tmp/pip-2r6ZOq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 12:52:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 12:52:35 INFO - Running setup.py (path:/tmp/pip-PrehR4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 12:52:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 12:52:35 INFO - Running setup.py (path:/tmp/pip-fNdFBY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 12:52:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 12:52:35 INFO - Running setup.py (path:/tmp/pip-eHC7EH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 12:52:36 INFO - Running setup.py (path:/tmp/pip-pVD42N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 12:52:36 INFO - Running setup.py (path:/tmp/pip-OQbxTK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 12:52:36 INFO - Running setup.py (path:/tmp/pip-Kz5u3R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 12:52:36 INFO - Running setup.py (path:/tmp/pip-MlxLvn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 12:52:36 INFO - Running setup.py (path:/tmp/pip-YBzz7h-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 12:52:36 INFO - Running setup.py (path:/tmp/pip-H7fYeO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 12:52:36 INFO - Running setup.py (path:/tmp/pip-16HnEJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 12:52:36 INFO - Running setup.py (path:/tmp/pip-PgbyH8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 12:52:36 INFO - Running setup.py (path:/tmp/pip-a78MLf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 12:52:36 INFO - Running setup.py (path:/tmp/pip-9yedt4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 12:52:36 INFO - Running setup.py (path:/tmp/pip-lEoWlB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 12:52:36 INFO - Running setup.py (path:/tmp/pip-er_Lrz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 12:52:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 12:52:36 INFO - Running setup.py (path:/tmp/pip-DiHYg5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 12:52:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:52:36 INFO - Running setup.py install for manifestparser 12:52:37 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Running setup.py install for mozcrash 12:52:37 INFO - Running setup.py install for mozdebug 12:52:37 INFO - Running setup.py install for mozdevice 12:52:37 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Running setup.py install for mozfile 12:52:37 INFO - Running setup.py install for mozhttpd 12:52:37 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Running setup.py install for mozinfo 12:52:37 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Running setup.py install for mozInstall 12:52:37 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 12:52:37 INFO - Running setup.py install for mozleak 12:52:37 INFO - Running setup.py install for mozlog 12:52:37 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Running setup.py install for moznetwork 12:52:38 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Running setup.py install for mozprocess 12:52:38 INFO - Running setup.py install for mozprofile 12:52:38 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Running setup.py install for mozrunner 12:52:38 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Running setup.py install for mozscreenshot 12:52:38 INFO - Running setup.py install for moztest 12:52:38 INFO - Running setup.py install for mozversion 12:52:38 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 12:52:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:52:38 INFO - Cleaning up... 12:52:38 INFO - Return code: 0 12:52:38 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 12:52:38 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')]} 12:52:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:38 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')]} 12:52:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:38 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:38 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 12:52:38 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 12:52:38 INFO - Using env: {'DISPLAY': ':0', 12:52:38 INFO - 'HOME': '/home/cltbld', 12:52:38 INFO - 'LANG': 'en_US.UTF-8', 12:52:38 INFO - 'LANGUAGE': 'en_US:en', 12:52:38 INFO - 'LOGNAME': 'cltbld', 12:52:38 INFO - 'MAIL': '/var/mail/cltbld', 12:52:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:38 INFO - 'MOZ_NO_REMOTE': '1', 12:52:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:38 INFO - 'NO_EM_RESTART': '1', 12:52:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:38 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:38 INFO - 'SHELL': '/bin/bash', 12:52:38 INFO - 'SHLVL': '1', 12:52:38 INFO - 'TERM': 'linux', 12:52:38 INFO - 'TMOUT': '86400', 12:52:38 INFO - 'USER': 'cltbld', 12:52:38 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:38 INFO - '_': '/tools/buildbot/bin/python'} 12:52:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 12:52:38 INFO - Running setup.py (path:/tmp/pip-OtHglA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 12:52:39 INFO - Running setup.py (path:/tmp/pip-2q2P74-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 12:52:39 INFO - Running setup.py (path:/tmp/pip-INO_V4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 12:52:39 INFO - Running setup.py (path:/tmp/pip-_IwW1S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 12:52:39 INFO - Running setup.py (path:/tmp/pip-Mms0Ia-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 12:52:39 INFO - Running setup.py (path:/tmp/pip-8WMDxa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 12:52:39 INFO - Running setup.py (path:/tmp/pip-xbNnk0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 12:52:39 INFO - Running setup.py (path:/tmp/pip-gD0FaU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 12:52:39 INFO - Running setup.py (path:/tmp/pip-IZH54t-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 12:52:39 INFO - Running setup.py (path:/tmp/pip-pCEm81-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 12:52:39 INFO - Running setup.py (path:/tmp/pip-kz8EiU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 12:52:39 INFO - Running setup.py (path:/tmp/pip-UxpgoB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 12:52:39 INFO - Running setup.py (path:/tmp/pip-5GLzvO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 12:52:39 INFO - Running setup.py (path:/tmp/pip-2QVrCM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 12:52:39 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)) 12:52:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 12:52:39 INFO - Running setup.py (path:/tmp/pip-EPvtOs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 12:52:40 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)) 12:52:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 12:52:40 INFO - Running setup.py (path:/tmp/pip-n74ypU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 12:52:40 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)) 12:52:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 12:52:40 INFO - Running setup.py (path:/tmp/pip-Z5snIB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 12:52:40 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)) 12:52:40 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)) 12:52:40 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)) 12:52:40 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)) 12:52:40 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)) 12:52:40 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)) 12:52:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 12:52:40 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 12:52:40 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 12:52:40 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 12:52:40 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 12:52:40 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 12:52:40 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 12:52:41 INFO - Downloading blessings-1.6.tar.gz 12:52:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 12:52:42 INFO - Installing collected packages: blessings 12:52:42 INFO - Running setup.py install for blessings 12:52:42 INFO - Successfully installed blessings 12:52:42 INFO - Cleaning up... 12:52:42 INFO - Return code: 0 12:52:42 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 12:52:42 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 12:52:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 12:52:42 INFO - Reading from file tmpfile_stdout 12:52:42 INFO - Current package versions: 12:52:42 INFO - argparse == 1.2.1 12:52:42 INFO - blessings == 1.6 12:52:42 INFO - blobuploader == 1.2.4 12:52:42 INFO - docopt == 0.6.1 12:52:42 INFO - manifestparser == 1.1 12:52:42 INFO - mozInstall == 1.12 12:52:42 INFO - mozcrash == 0.16 12:52:42 INFO - mozdebug == 0.1 12:52:42 INFO - mozdevice == 0.48 12:52:42 INFO - mozfile == 1.2 12:52:42 INFO - mozhttpd == 0.7 12:52:42 INFO - mozinfo == 0.9 12:52:42 INFO - mozleak == 0.1 12:52:42 INFO - mozlog == 3.1 12:52:42 INFO - moznetwork == 0.27 12:52:42 INFO - mozprocess == 0.22 12:52:42 INFO - mozprofile == 0.28 12:52:42 INFO - mozrunner == 6.11 12:52:42 INFO - mozscreenshot == 0.1 12:52:42 INFO - mozsystemmonitor == 0.0 12:52:42 INFO - moztest == 0.7 12:52:42 INFO - mozversion == 1.4 12:52:42 INFO - psutil == 3.1.1 12:52:42 INFO - requests == 1.2.3 12:52:42 INFO - wsgiref == 0.1.2 12:52:42 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 12:52:42 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')]} 12:52:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:42 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')]} 12:52:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:42 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:42 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 12:52:42 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 12:52:42 INFO - Using env: {'DISPLAY': ':0', 12:52:42 INFO - 'HOME': '/home/cltbld', 12:52:42 INFO - 'LANG': 'en_US.UTF-8', 12:52:42 INFO - 'LANGUAGE': 'en_US:en', 12:52:42 INFO - 'LOGNAME': 'cltbld', 12:52:42 INFO - 'MAIL': '/var/mail/cltbld', 12:52:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:42 INFO - 'MOZ_NO_REMOTE': '1', 12:52:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:42 INFO - 'NO_EM_RESTART': '1', 12:52:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:42 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:42 INFO - 'SHELL': '/bin/bash', 12:52:42 INFO - 'SHLVL': '1', 12:52:42 INFO - 'TERM': 'linux', 12:52:42 INFO - 'TMOUT': '86400', 12:52:42 INFO - 'USER': 'cltbld', 12:52:42 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:42 INFO - '_': '/tools/buildbot/bin/python'} 12:52:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 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)) 12:52:42 INFO - Cleaning up... 12:52:42 INFO - Return code: 0 12:52:42 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 12:52:42 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')]} 12:52:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:42 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')]} 12:52:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:42 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:42 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 12:52:42 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 12:52:42 INFO - Using env: {'DISPLAY': ':0', 12:52:42 INFO - 'HOME': '/home/cltbld', 12:52:42 INFO - 'LANG': 'en_US.UTF-8', 12:52:42 INFO - 'LANGUAGE': 'en_US:en', 12:52:42 INFO - 'LOGNAME': 'cltbld', 12:52:42 INFO - 'MAIL': '/var/mail/cltbld', 12:52:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:42 INFO - 'MOZ_NO_REMOTE': '1', 12:52:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:42 INFO - 'NO_EM_RESTART': '1', 12:52:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:42 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:42 INFO - 'SHELL': '/bin/bash', 12:52:42 INFO - 'SHLVL': '1', 12:52:42 INFO - 'TERM': 'linux', 12:52:42 INFO - 'TMOUT': '86400', 12:52:42 INFO - 'USER': 'cltbld', 12:52:42 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:42 INFO - '_': '/tools/buildbot/bin/python'} 12:52:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:42 INFO - Downloading/unpacking jsonschema 12:52:42 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 12:52:42 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 12:52:42 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 12:52:42 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 12:52:42 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 12:52:42 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 12:52:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:52:44 INFO - Downloading/unpacking functools32 (from jsonschema) 12:52: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 12:52: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 12:52: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 12:52: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 12:52: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 12:52: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 12:52:44 INFO - Downloading functools32-3.2.3-2.tar.gz 12:52:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 12:52:44 INFO - warning: no files found matching '*.txt' 12:52:44 INFO - no previously-included directories found matching 'build' 12:52:44 INFO - no previously-included directories found matching 'dist' 12:52:44 INFO - no previously-included directories found matching '.git*' 12:52:44 INFO - Installing collected packages: jsonschema, functools32 12:52:44 INFO - Running setup.py install for functools32 12:52:45 INFO - warning: no files found matching '*.txt' 12:52:45 INFO - no previously-included directories found matching 'build' 12:52:45 INFO - no previously-included directories found matching 'dist' 12:52:45 INFO - no previously-included directories found matching '.git*' 12:52:45 INFO - Successfully installed jsonschema functools32 12:52:45 INFO - Cleaning up... 12:52:45 INFO - Return code: 0 12:52:45 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 12:52:45 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')]} 12:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:52:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:45 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')]} 12:52:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:52:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:52:45 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 0x7fd876b14f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13d58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a4230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, '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': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', '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 12:52:45 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 12:52:45 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 12:52:45 INFO - Using env: {'DISPLAY': ':0', 12:52:45 INFO - 'HOME': '/home/cltbld', 12:52:45 INFO - 'LANG': 'en_US.UTF-8', 12:52:45 INFO - 'LANGUAGE': 'en_US:en', 12:52:45 INFO - 'LOGNAME': 'cltbld', 12:52:45 INFO - 'MAIL': '/var/mail/cltbld', 12:52:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:52:45 INFO - 'MOZ_NO_REMOTE': '1', 12:52:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:52:45 INFO - 'NO_EM_RESTART': '1', 12:52:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:52:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:52:45 INFO - 'PWD': '/builds/slave/test-pgo', 12:52:45 INFO - 'SHELL': '/bin/bash', 12:52:45 INFO - 'SHLVL': '1', 12:52:45 INFO - 'TERM': 'linux', 12:52:45 INFO - 'TMOUT': '86400', 12:52:45 INFO - 'USER': 'cltbld', 12:52:45 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:52:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:52:45 INFO - '_': '/tools/buildbot/bin/python'} 12:52:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:52:45 INFO - Downloading/unpacking flake8 12:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:52:47 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 12:52:47 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 12:52:47 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 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 12:52:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 12:52:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:52:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:52:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:52:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:52:47 INFO - no previously-included directories found matching 'docs/_build' 12:52:47 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 12:52:47 INFO - Running setup.py install for pep8 12:52:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:52:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:52:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:52:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:52:47 INFO - no previously-included directories found matching 'docs/_build' 12:52:47 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 12:52:47 INFO - Successfully installed flake8 mccabe pyflakes pep8 12:52:47 INFO - Cleaning up... 12:52:47 INFO - Return code: 0 12:52:47 INFO - Running post-action listener: _resource_record_post_action 12:52:47 INFO - Running post-action listener: _start_resource_monitoring 12:52:47 INFO - Starting resource monitoring. 12:52:47 INFO - ##### 12:52:47 INFO - ##### Running install step. 12:52:47 INFO - ##### 12:52:47 INFO - Running pre-action listener: _resource_record_pre_action 12:52:47 INFO - Running main action method: install 12:52:47 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 12:52:47 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 12:52:48 INFO - Reading from file tmpfile_stdout 12:52:48 INFO - Detecting whether we're running mozinstall >=1.0... 12:52:48 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 12:52:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 12:52:48 INFO - Reading from file tmpfile_stdout 12:52:48 INFO - Output received: 12:52:48 INFO - Usage: mozinstall [options] installer 12:52:48 INFO - Options: 12:52:48 INFO - -h, --help show this help message and exit 12:52:48 INFO - -d DEST, --destination=DEST 12:52:48 INFO - Directory to install application into. [default: 12:52:48 INFO - "/builds/slave/test-pgo"] 12:52:48 INFO - --app=APP Application being installed. [default: firefox] 12:52:48 INFO - mkdir: /builds/slave/test-pgo/build/application 12:52:48 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'] 12:52:48 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 12:53:07 INFO - Reading from file tmpfile_stdout 12:53:07 INFO - Output received: 12:53:07 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 12:53:07 INFO - Running post-action listener: _resource_record_post_action 12:53:07 INFO - ##### 12:53:07 INFO - ##### Running run-tests step. 12:53:07 INFO - ##### 12:53:07 INFO - Running pre-action listener: _resource_record_pre_action 12:53:07 INFO - Running main action method: run_tests 12:53:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 12:53:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 12:53:07 INFO - Python 2.7.3 12:53:07 INFO - Return code: 0 12:53:07 INFO - grabbing minidump binary from tooltool 12:53:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:53:07 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-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 0x15367f0>, '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 0x14a22d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14a2760>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 12:53:07 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 12:53:07 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 12:53:07 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:53:07 INFO - Return code: 0 12:53:07 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 12:53:07 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 12:53:07 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 12:53:07 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 12:53:07 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 12:53:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 12:53:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 12:53:08 INFO - Return code: 0 12:53:08 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 12:53:08 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-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-038 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 12:53:08 INFO - Using env: {'DISPLAY': ':0', 12:53:08 INFO - 'HOME': '/home/cltbld', 12:53:08 INFO - 'LANG': 'en_US.UTF-8', 12:53:08 INFO - 'LANGUAGE': 'en_US:en', 12:53:08 INFO - 'LOGNAME': 'cltbld', 12:53:08 INFO - 'MAIL': '/var/mail/cltbld', 12:53:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 12:53:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 12:53:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:53:08 INFO - 'MOZ_NO_REMOTE': '1', 12:53:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 12:53:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:53:08 INFO - 'NO_EM_RESTART': '1', 12:53:08 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:53:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 12:53:08 INFO - 'PWD': '/builds/slave/test-pgo', 12:53:08 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 12:53:08 INFO - 'SHELL': '/bin/bash', 12:53:08 INFO - 'SHLVL': '1', 12:53:08 INFO - 'TERM': 'linux', 12:53:08 INFO - 'TMOUT': '86400', 12:53:08 INFO - 'USER': 'cltbld', 12:53:08 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044', 12:53:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:53:08 INFO - '_': '/tools/buildbot/bin/python'} 12:53:08 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 12:53:08 INFO - mozversion application_buildid: 20160201103056 12:53:08 INFO - mozversion application_changeset: 45c60b46bab9c109f19325dafd2f6512635903ac 12:53:08 INFO - mozversion application_display_name: Nightly 12:53:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:53:08 INFO - mozversion application_name: Firefox 12:53:08 INFO - mozversion application_remotingname: firefox 12:53:08 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 12:53:08 INFO - mozversion application_vendor: Mozilla 12:53:08 INFO - mozversion application_version: 47.0a1 12:53:08 INFO - mozversion platform_buildid: 20160201103056 12:53:08 INFO - mozversion platform_changeset: 45c60b46bab9c109f19325dafd2f6512635903ac 12:53:08 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 12:53:08 INFO - mozversion platform_version: 47.0a1 12:53:08 INFO - using testdate: 1454359988 12:53:08 INFO - actual date: 1454359988 12:53:08 INFO - starting webserver on 'localhost:54735' 12:53:08 INFO - SUITE-START | Running 2 tests 12:53:08 INFO - TEST-START | dromaeo_css 12:53:08 INFO - operating with platform_type : linux_ 12:53:08 INFO - Initialising browser for dromaeo_css test... 12:53:08 INFO - TEST-INFO | started process 7394 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpkhKEcI/profile http://localhost:54735/getInfo.html) 12:53:08 INFO - PROCESS | 7394 | JavaScript warning: resource://gre/modules/AddonManager.jsm, line 692: Proxy.create and Proxy.createFunction are deprecated, use new Proxy instead 12:53:12 INFO - PROCESS | 7394 | 12:53:12 INFO - PROCESS | 7394 | (process:7482): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:53:13 INFO - PROCESS | 7394 | __metrics Screen width/height:1600/1200 12:53:13 INFO - PROCESS | 7394 | colorDepth:24 12:53:13 INFO - PROCESS | 7394 | Browser inner width/height: 1024/697 12:53:13 INFO - PROCESS | 7394 | __metrics 12:53:13 INFO - PROCESS | 7394 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 12:53:14 INFO - TEST-INFO | 7394: exit 0 12:53:14 INFO - Browser initialized. 12:53:14 INFO - Running cycle 1/1 for dromaeo_css test... 12:53:14 INFO - TEST-INFO | started process 7531 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpkhKEcI/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:53:15 INFO - PROCESS | 7531 | 12:53:15 INFO - PROCESS | 7531 | (process:7587): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:53:26 INFO - PROCESS | 7531 | RSS: Main: 152911872 12:53:26 INFO - PROCESS | 7531 | 12:54:15 INFO - PROCESS | 7531 | 1454360055842 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] 12:56:24 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54735/tests/dromaeo/cssquery-ext.html) 12:56:25 INFO - PROCESS | 7531 | RSS: Main: 161255424 12:56:25 INFO - PROCESS | 7531 | 12:59:27 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-ext.html (next: http://localhost:54735/tests/dromaeo/cssquery-jquery.html) 12:59:28 INFO - PROCESS | 7531 | RSS: Main: 156917760 12:59:28 INFO - PROCESS | 7531 | 13:02:30 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54735/tests/dromaeo/cssquery-mootools.html) 13:02:30 INFO - PROCESS | 7531 | RSS: Main: 156241920 13:02:30 INFO - PROCESS | 7531 | 13:05:32 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54735/tests/dromaeo/cssquery-prototype.html) 13:05:33 INFO - PROCESS | 7531 | RSS: Main: 154734592 13:05:33 INFO - PROCESS | 7531 | 13:08:35 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54735/tests/dromaeo/cssquery-yui.html) 13:08:36 INFO - PROCESS | 7531 | RSS: Main: 155045888 13:08:36 INFO - PROCESS | 7531 | 13:11:38 INFO - PROCESS | 7531 | Cycle 1(1): loaded http://localhost:54735/tests/dromaeo/cssquery-yui.html (next: http://localhost:54735/tests/dromaeo/cssquery-dojo.html) 13:11:38 INFO - PROCESS | 7531 | RSS: Main: 158994432 13:11:38 INFO - PROCESS | 7531 | 13:11:38 INFO - PROCESS | 7531 | __start_tp_report 13:11:38 INFO - PROCESS | 7531 | _x_x_mozilla_page_load 13:11:38 INFO - PROCESS | 7531 | _x_x_mozilla_page_load_details 13:11:38 INFO - PROCESS | 7531 | |i|pagename|runs| 13:11:38 INFO - PROCESS | 7531 | |0;dojo.html;3220.3398303347817;3238.724708399786;3265.6244531878842;3285.983570082149;3294.9341013179737;5233.319668443107;5261.105612045952;5276.947230527693;5301.973490132554;5316.867078323044;5180.352455943007;5213.478652134785;5239;5297;5305.575553955684;4824.348712923763;4839.298301746245;4852.708837469745;4933.580645645125;4953.529414705616;4492.438445194351;4912.140375434303;4915.606751459874;4930.260460930853;4985.950140498603;4754;4791.041791641651;4822.61419086474;4887.120318342697;4917.286993385939;4850.102730994778;4860.9513904861205;4870.805167793284;4873.780679869415;4891.241857512091;4708.646851486153;4884.535969082932;4900.6569540132205;4909.189983652693;4928.33467481889;5123.129068058439;5126.102931986925;5182.119039763249;5205.479452054802;5213.582913366921;5786.971065144689;5787.218725472049;5798.159266906275;5799.217105690762;5800.390958949291;5716.971415142898;5807.157962095514;5826.271716035496;5837.970810145965;5841.970790146022;5269.341332333458;5292.788288468495;5293.497117773805;5307.52232299095;5323.600729945269;5817;5828.970855145782;5895.764169433174;5926.348101708809;5955.34491205967;5610.382857885629;5636.549076073904;5650.886982260414;5654;5654.858628534237;5662.348829884533;5734;5750.166225897305;5769.0192667246665;5788.421157884262;5669.206311116447;5684.516816070598;5709.600327977002;5719.914201286984;5744.224529688522;5594.384617692051;5625.634333768292;5638.126090455986;5649.6327738696855;5691.459311365414;4332.545082766327;4384.101259241847;4385.451818522684;4417.933730993974;4459.576340247671;3913.373860182357;3917.3144699678014;3947.1513624570857;3947.4276229947072;3955.0705584187695;5299.8410047698635;5341.839744807662;5341.893162136736;5346.385165705916;5371.221172929903;5655.1517272409465;5674.233978412862;5706.857328566819;5734.05388110957;5766.654000759884;5333.306670132858;5338.225957236179;5347;5349.598780091431;5389.0299746046085;4831.396075490564;4840.10458065252;4844.273358996179;4857.53853383928;4869.123557759637;5847.181394604759;5847.970760146172;5914.319853216849;5935.109733540004;6010.429009244115;5719.685417302088;5735.311762588516;5737.885242295214;5739.9139012915675;5769.8557536061935;5867.706614669335;5883.764649413975;5919.052951527735;5928.79249226275;5932.851678708067;5550.97224513891;5588.41321661236;5668.829935101953;5678.20505129274;5751.194832723506;5696.658200507817;5707.571932105192;5726.883257764696;5749.13762935563;5767.480926716616;5556.388797232382;5567.331920169606;5597.04850175463;5602.719864006865;5603.1875378069135;5472.151816468454;5510.476504732204;5573.609847310811;5574.08027675429;5615.522680572197;5491.588130890119;5494.423085575957;5514;5515.200295957144;5518.696471694096;5491.341039075336;5569.331680198402;5578.051731205786;5618.157276408571;5669.234653321749;5385.246065550904;5448.318960129984;5454.263674403905;5464.617476776588;5514.5864060196445 13:11:38 INFO - PROCESS | 7531 | |1;ext.html;521.3951815893562;544.18915815435;556.3685217278388;560.728046897255;594.274984518887;35765.642343576554;36232.45651315226;36360.27279454409;36513.08717282066;36545.08637284066;39420.60579394212;39860;40009.19981600366;40080.59919400805;40193.799031004804;8420.157984201576;8600.913990860074;8617.224449799516;8634.438761480515;8645.95677021614;8591.656333746643;8736.781580460476;8740.606672699743;8766.430182038179;8785.209331160195;8711.12888711127;8827.64689412426;8837.911620883773;8871.068537803534;8879.689210877621;8736.257418119467;8741.038485766561;8808.427452215585;8822.161894620001;8827.735167945004;8452.81660567521;8662.52356120413;8687.391882568223;8688.218060374596;8701.347398945105;40073.79963100195;40101.79949100265;40217.19565608671;40319.7984010081;40630.79684601558;3167.9841600791847;3299.5710557627594;3316.9170770730925;3408.1309266137223;3467.9479807802904;30875.691243087505;31274.687253127406;31773.841130794197;32245.35509289801;32391.676083239337;3827.234553089393;3973.860914867995;3986.1031267964768;4033.334499807528;4166.437530933315;265571;270273;270640;270904;272130;52657.473425265256;53577;54170;60209.39790602038;61301.693491532256;53311.73344133332;53793.73103134459;54039.45960540344;54100;54144;15487.84512154864;15653.686926261638;15680.451184208727;15777.368905243891;15805.288762005737;11418.771624567462;11426;11539.538418463335;11585;11738.295702257892;20367.592648146954;20647.793522064887;20694.482637934172;20713.58572828535;20757.169713211304;8052.879206811903;8150.38872084596;8202.917970820336;8229.711960081368;8381.706640267561;954.206092546009;956.9617215311449;958.3291695812959;972.397113789455;1043.175891046065;28299;28557.286067848054;28870.566941495894;28917.56623650647;29326.413471730444;975.8438649815995;1024.7694268789462;1051.0172988256006;1066.632011955874;1090.095220966596;14950.40198392074;14965.176915269547;14984.250787460802;15029;15135.470258540898;320624;322447;322967;324290;325963;50252;50698.49301507012;50939;50970.49029509732;51089.233661495105;1325.337331334333;1346.5152545083565;1349.7030653256268;1350.2033800058014;1356.125299182022;27199.45601088007;28455.857720711265;28569.571456427755;28683.42633147367;28721;45550.54449455463;45716.085678285584;45937.31094033659;46045.30932035955;46057.76971115123;289242;291492;292478;292824;293337;32332.191695207806;42439.57560424356;42952.78523607362;42973.355399668406;43685;45200.09599808051;46135;46226.53773462357;46494;46799.76600116977;33756.66243337633;33763.32473350568;33767;34183.487247690806;34209;33279;33848.830755846066;34217.828910855285;34246.828765856015;34441.82779086089;32727.509087364186;33351.666483334855;33387.33225335431;33442.49836252409;35959.82020089883;30593.388132236785;31653.366932660756;32638.184045399055;32831;33732.15669608279;24861.254162374433;25364.74635253624;25464;25658;27920.441591167655 13:11:38 INFO - PROCESS | 7531 | |2;jquery.html;366.69197873786015;366.72129181821816;372.40787148433986;374.419649543208;376.63466437555576;10983.066439352655;11302.886971130287;11389.829152562717;11724;15991.280392382341;16640.251188696508;16875;17169.141542922865;17182.82817171831;17191.656166876655;5437.945620543804;5816.185733997244;5850.3564607893095;5855;5885;5733.856653583652;5789;5923.229980102602;5939.732712027969;5940.57426217709;5939.643621382709;5953.107033944922;6182.474489668383;6383.616982981012;6388.872222555546;6334.87330253397;6342.682865856688;6368.395002474757;6648.667566621698;6675.566088204251;6170.413810687977;6325.588836725598;6342.6511541865175;6345;6535.379138981789;21291.467713307135;21828.781712182994;21939.890300548395;21957.231496897533;22036.228731994463;2139.914403423861;2145.2062736787334;2267.195145723261;2427.9393015174587;2911.941761164786;13058.673533161653;13812.309384530834;14052.508162214375;14173.645658858508;14373.568792936228;1871.7660292463443;1954.5113721569608;1963.980360196394;1974.3484650065589;1980.2475059477451;66835.66582167058;67047.66476167589;67860.32139678589;68968;69965;14350.856491434952;15020.248987550578;15427.92286038585;15495.690086198212;15500.147491887828;23158.536829263656;23318.417039574146;23442.7655723444;23670.64494032591;23762.88118559396;8520.403571749917;9181.77045573866;9302.395344302598;9307.72076837696;9320.20778233844;8103.878441823377;8166.7958301042945;8175.386845986456;8209.425340226246;8218.835623287501;7465.104187497535;7480.663370148356;7641.2740789624895;7655.425843061793;7660.885086723703;1800.6038671492252;1865.216609024213;1880.7178923161634;2973.3012742005612;3029.3947205403338;848.5757121439281;888.9422187557788;892.9508877011826;946.3517490518879;991.8313886639289;15747.527574172793;16180.110093944946;16327.918360408123;16458.765592580367;16604.750928736077;916.0061333453278;932.8320902237663;937.4937533731709;942.3168203052869;985.2019863910256;8612.440191387665;9523.90476095244;9546.093121153479;9565.330426870052;9703.708888733208;357469;360654;363993;524438;529637;61214.69392653097;62309;63395.36604633987;64442.677786611705;64762;1119.3339962722168;1132.088668621751;1163.7963356412595;1170.0230307693002;1190.9166358354832;13923.443062277396;14238.501652442115;14722.263886805831;14840.62898427548;15083.773743393638;25189.87405062963;28197.872085117186;31439.37121257608;31882.36235275328;32586.837065814518;36381.27237455289;37249.44125838169;40031.19937601173;40481;40768.592314077665;7296.379807716191;7478.6260686966525;7529.171791103084;7536.3970882328185;7632.542047477169;10471.162307015267;10859.185561082792;11350.375729334635;11423.828642570534;11443.313401195956;9218.354715169873;9659.565319560777;9728.562214700498;9964.800703985735;10264.897351026395;9690.176335011603;9842.311038227255;10044.648437304659;10102.24233182529;10113.29206955506;9652.131308182297;10018.849717254392;10202.285839991426;10275.486225688835;10381.792364152523;7716.8456630868195;7924.088729796147;7926.167752385916;7941.6029198541;7963.323117534843;9799.85300220483;10530.57877684884;10542.631007914686;10545.683629491128;10668.83996740034 13:11:38 INFO - PROCESS | 7531 | |3;mootools.html;1487.576040828364;1489.7765335199722;1625.3011205181774;1768.018749593975;1794.1477798045921;7648.579328136951;7787.493812902165;7810.843783124341;7883.1328553859175;8007.319377852889;8024.077231118423;8060.63727132279;8103.432759706808;8148.388870834697;8166;2300.827437942157;2326.6510023496444;2331;2344.5779759643256;2345.2846881701075;2373.0270589058405;2393.0427828868505;2417.9153729619466;2442.072012635205;2444.4744379958306;2284.760100189481;2346.6128088865316;2357.834951553392;2368.0409434179187;2381.047580967618;2335.0426325206668;2361.2680069178523;2363.444590521226;2367.881605919697;2374.9881250593808;2322.036354912709;2323.407531079564;2345.1205797825814;2353.811695064408;2362.870042147681;7881.881771773428;7904.486208396494;7915.406344524126;7935.682572697086;7994.520328780233;4765.642576806718;4911.435184953741;4923.064617722621;4924.261360795874;4924.950750492485;2922.4593450211564;3149.2599239178776;3176.65056843747;3185.601799775028;3187.42626327261;900.4552245891273;901.693424235763;911.3802614222326;921.4747593871496;941.4727752458645;11082.445877706163;11082.667519974413;11145.777084458347;11155.442227888654;11181.608643697431;4287.914241715211;4356.607905288539;4423.314386270134;4426.0483995940385;4429.778511074498;8909.866352004725;8911.019787823334;8911.197992180734;8967.058458861857;8985.955070224738;4849.175640141185;4868.269759536098;4882.096812089775;4887.0714564232685;4908.165611845923;4464.397306363664;4472.865814025585;4486.64106871456;4492.887677808081;4532.32015197723;3477;3517.613062563116;3528.1885166411357;3529.6823285904393;3542.5217595624777;1033.8914413986574;1051.7580956380075;1056.0548309263168;1058.1323314881722;1067.5462928255615;876.4872549558452;905.4160066756905;977.2426369563645;1020.6529779874729;1202.7654607351483;7176.461765367619;7294.635268236567;7299.343059124704;7305.598192099379;7323.304286092813;762.5500954436909;1214.2107630040543;1222.0712258683463;1222.712662524306;1230.615557497815;5709.371969083398;5799.39106393831;5815.680137592473;5817.156512305692;5831.096180092092;9338.906610933804;9380;9809.558569864374;9888;10002.549885255181;9685.806283874424;9742.95128524353;9826.115649591571;9828.4102953823;9843.114119729258;7516.849663006709;7575.583342916192;7577.734779282699;7600.695972161052;7643.5796031218815;6916.688749006206;6931.896021559782;7019.894701579378;7026.1217347831525;7042.471814613822;8317.168283171635;8449.408541402288;8630.741077767678;8755.212030917248;8758.737237882873;8696.17386348296;8828.690995815115;8838.469691818511;8900.643974240958;8966.68616598416;6816.7614133505085;6833.248342682202;6855.828604284933;6870.175578930561;6885.827854303482;7447.813804654927;7509.549427034395;7516.549007059594;7524;7525;7026.718931242693;7112.928870711226;7237.240089790496;7345.192028876712;7454.9935758674055;6919.169699635874;7048.859022819617;7136.250693677297;7137.857242855218;7150.678219480032;6931.09895713554;6989.720411183699;7004.299570042955;7024.1571011478945;7039.648017599202;6156.846078847885;6183.319834818257;6193.597416167935;6205.913965056006;6218.06728990655;6099.329073801967;6221.191245138103;6232;6240.53196010292;6315.210598675166 13:11:38 INFO - PROCESS | 7531 | |4;prototype.html;332.84023668639054;343.19520723902457;343.99656003439975;351.5605493133583;358.17262124492424;6127.877442451148;6135.29444113927;6167.475764560012;6197.845053873655;6343.777967771129;6025.789097381593;6197.5041996640275;6201.3178550359535;6202.131701561785;6236.438720515152;4811.59101476375;4818.566329030386;4825.276208568707;4831.130396528623;4850.975745121269;4827.8310259140935;4845.709257444564;4852.636052296092;4853.126437241295;4860.416749990006;4726.456457507396;4784.473707892146;4787.976060119695;4799.040191961604;4799.520047995207;4772.069446457942;4786.664933454659;4793.400824896888;4797.424309082932;4799.712017278975;4184.623383895434;4196.307609244471;4199.895002624929;4211.873643790691;4230.069384735353;5914.349421563625;5917.171595976567;5924.97037514814;5941.346451890288;5953.166556682068;5463.672179669193;5591.4688104629995;5591.9720401398135;5592.748326325325;5619.016672082369;6638;6647.235567909655;6649.800505984828;6653.700583473756;6654.168228971379;4681.719096854165;4684.1334353144775;4692.835750748707;4697.78859951303;4699.154152252593;6735.090762747015;6837.179538455417;6946.652667366662;6954.40887524556;6962.477814163907;4714.66997310185;4752.358431611758;4757.619390448755;4758.78585463655;4768.785404656729;4798.448178459522;4804.159272127434;4811.061842940593;4811.927821082687;4828.203346447867;5518.558515318765;5533.667979921218;5544.140658197985;5544.306961629796;5554.91667624986;6523.249826269945;6653.833654158685;6675.9332406676285;6720.092787473628;6742.393184613408;1634.689409012284;1676.9748453773202;1683.3350826423493;1685.2247965935562;1707.0440553290198;1074.3285446595878;1089.0634054712941;1109.5007246738999;1117.793208256475;1120.165476719849;6124.234470691164;6142.846428839315;6146.4775494082605;6181.134641150243;6246.312905580383;6774;6799.558028728117;6815.386615204656;6815.488838337144;6822.795316140524;6085.574009819358;6140.078988151813;6184.196054512974;6212.192414986023;6215.12988181655;3685.8341374638208;3696.0226278941177;3700.889733080065;3712.443133529938;3719.386301260262;7034;7107.147142342952;7110.893336599956;7115.288471152843;7118.216996130422;6924.169099708067;6940.479464040217;6942.06282151903;6951.548149370275;6975.686094125776;7242.891356629655;7253.963730181315;7255.419566434673;7263.927360726325;7266.854662906818;6934;6940.410065144318;6984.930150698428;6993.30066993317;7010.824729381602;6780.186377634715;6862.142232220973;6864.279250678607;6906;6917.792466226021;7239.4932354734665;7258.782236532912;7269.3094156055095;7277.708891644275;7282.308180722823;4656.883577910444;4660;4665.4168228971375;4674.953250467588;4691.953080469289;6855.108835851507;6920.031195632515;6961.825954351182;6970.268121847133;7031.261717519586;6740.191177058588;6781.864362712619;6797;6798.660066996532;6834.248232694499;6723.327667233238;6752.155980502437;6752.898706519308;6774.491913106438;6790.913453847361;6555.901661474986;6642.667866606554;6681.832954176184;6685.832854178684;6706.295838936841;6791;6794.844876371128;6817.216020157547;6828.931710682829;6832.829179270558;6539.051837483443;6569.835754105994;6584.637844918576;6618.933810661832;6621.33786621334 13:11:38 INFO - PROCESS | 7531 | |5;yui.html;661.4576047640936;669.7655820462842;793.2186796005934;801.8917446144773;807.9232472915074;15418.92290538547;15598.064116153038;15719.214039298033;15721;15787.447439339625;13729.176249425042;13755.862441375608;13822.585322440318;13851.030427870053;13854.861451385508;805.1304591041661;809.295912556077;819.4796304346753;819.737683941139;823.1398188892591;823.7611092783086;828.056016141599;831.1978940322588;831.7255305749119;835.0980940584154;850.5577099908076;851.7700220940343;852.799592095857;857.2113655436982;857.2713193785264;846.9195426434449;851.9233269005788;851.9872201916976;855.285836326668;856.4005196362509;628.7673560782493;632.8576070384173;633.6039975015615;633.8288662061263;634.1502386801661;13617.455301787917;13957.581272561738;14021.369038393195;14043.578692639136;14050.36773345202;12956.09307348486;13165.210087394787;13332.600021999258;13523.256220907846;13613.727725445435;10389.79220415595;10552.630657926935;10596.735081623021;10606.363618182933;10765.892341076567;3551.254236610315;3563.6970857477145;3596.496490491333;3634.0551456621206;3647.689946354563;47055.5294447058;47094.529054709354;48464.27303590449;48637.02725945497;49062.50937490615;9794.853077203848;10148.391096534231;10161.54273057714;10310.690679279634;10319.48402579868;18338.908305458386;18469.168887400097;18496.982665953234;18583.163757630668;18585.628287434174;7687.769366919001;7735.61321933901;7881.330086942559;7899.091604465445;8120.918790812017;4400.251957167226;4429.955700443019;4550.88622784433;4555.886102847389;4564.7717614119165;3052.084374687585;3084.506478963355;3087.382523495265;3122.5784519090084;3123.047470521513;569.4675478427683;585.1836687820552;592.4726992976255;601.1313651773233;609.7713357490941;595.9612625179436;597.7238595598428;603.414687752879;649.3247023096021;661.163628010567;7915.762527124196;7993.280604745601;8005.759827205193;8284.544350060683;8325;584.2638275772557;614.6066517428849;657.2671471309455;666.8218951415142;668.7659319238228;3512.5784905811465;3697.815109244581;3727.1241258304276;3742.3263812513464;3744.307303148926;56283.71858140765;56948;57132.42867571271;57153.428465715646;57654;49404;49933.500664992884;49964.25053624198;50239.24641130386;50320.74839625778;44966.55033449689;44978.325325120146;45191.77404112958;45362.31956520655;45591.77204113958;7163.391111755559;7251.23861994483;7288.161861386008;7376.299251571092;8432.494050356998;32634.83682581572;33906.49140262849;34409.13977150491;35005.299894001466;35179.64820351764;43044;43669.78165109154;44110.11779764451;45181.77409113065;45232;11067.446627668745;11075.944620276847;11191.72020699489;11229.49467273991;11473.598424055119;11396.145289103184;12126.211796233216;12179.39103044862;12201.572944946884;12532.436040378023;10363.481825908524;10700.678979630624;10704.732381690521;10957.945210273898;11085.94457027742;11321.094312455149;11365.374904380007;11461.598844040753;11993.760124797629;12001;9918.752031199278;10531.73670658209;10848.891511085103;10936.56253749841;11258.549658013588;8517.701880434155;9197.402168859002;9295.72112836616;9478.52607369615;9729.027097290498;8105.878411823709;8298.95801639035;8477.788055298666;8581.442206256574;8794.560271986504 13:11:38 INFO - PROCESS | 7531 | __end_tp_report 13:11:38 INFO - PROCESS | 7531 | __start_cc_report 13:11:38 INFO - PROCESS | 7531 | _x_x_mozilla_cycle_collect,317 13:11:38 INFO - PROCESS | 7531 | __end_cc_report 13:11:38 INFO - PROCESS | 7531 | __startTimestamp1454361098985__endTimestamp 13:11:38 INFO - PROCESS | 7531 | 13:11:38 INFO - PROCESS | 7531 | ------- Summary: start ------- 13:11:38 INFO - PROCESS | 7531 | Number of tests: 6 13:11:38 INFO - PROCESS | 7531 | 13:11:38 INFO - PROCESS | 7531 | [#0] dojo.html Cycles:165 Average:5301.78 Median:5494.42 stddev:585.60 (10.7%) stddev-sans-first:564.17 13:11:38 INFO - PROCESS | 7531 | Values: 3220.3 3238.7 3265.6 3286.0 3294.9 5233.3 5261.1 5276.9 5302.0 5316.9 5180.4 5213.5 5239.0 5297.0 5305.6 4824.3 4839.3 4852.7 4933.6 4953.5 4492.4 4912.1 4915.6 4930.3 4986.0 4754.0 4791.0 4822.6 4887.1 4917.3 4850.1 4861.0 4870.8 4873.8 4891.2 4708.6 4884.5 4900.7 4909.2 4928.3 5123.1 5126.1 5182.1 5205.5 5213.6 5787.0 5787.2 5798.2 5799.2 5800.4 5717.0 5807.2 5826.3 5838.0 5842.0 5269.3 5292.8 5293.5 5307.5 5323.6 5817.0 5829.0 5895.8 5926.3 5955.3 5610.4 5636.5 5650.9 5654.0 5654.9 5662.3 5734.0 5750.2 5769.0 5788.4 5669.2 5684.5 5709.6 5719.9 5744.2 5594.4 5625.6 5638.1 5649.6 5691.5 4332.5 4384.1 4385.5 4417.9 4459.6 3913.4 3917.3 3947.2 3947.4 3955.1 5299.8 5341.8 5341.9 5346.4 5371.2 5655.2 5674.2 5706.9 5734.1 5766.7 5333.3 5338.2 5347.0 5349.6 5389.0 4831.4 4840.1 4844.3 4857.5 4869.1 5847.2 5848.0 5914.3 5935.1 6010.4 5719.7 5735.3 5737.9 5739.9 5769.9 5867.7 5883.8 5919.1 5928.8 5932.9 5551.0 5588.4 5668.8 5678.2 5751.2 5696.7 5707.6 5726.9 5749.1 5767.5 5556.4 5567.3 5597.0 5602.7 5603.2 5472.2 5510.5 5573.6 5574.1 5615.5 5491.6 5494.4 5514.0 5515.2 5518.7 5491.3 5569.3 5578.1 5618.2 5669.2 5385.2 5448.3 5454.3 5464.6 5514.6 13:11:38 INFO - PROCESS | 7531 | 13:11:39 INFO - PROCESS | 7531 | [#1] ext.html Cycles:180 Average:46389.89 Median:35862.73 stddev:77227.24 (215.3%) stddev-sans-first:77367.09 13:11:39 INFO - PROCESS | 7531 | Values: 521.4 544.2 556.4 560.7 594.3 35765.6 36232.5 36360.3 36513.1 36545.1 39420.6 39860.0 40009.2 40080.6 40193.8 8420.2 8600.9 8617.2 8634.4 8646.0 8591.7 8736.8 8740.6 8766.4 8785.2 8711.1 8827.6 8837.9 8871.1 8879.7 8736.3 8741.0 8808.4 8822.2 8827.7 8452.8 8662.5 8687.4 8688.2 8701.3 40073.8 40101.8 40217.2 40319.8 40630.8 3168.0 3299.6 3316.9 3408.1 3467.9 30875.7 31274.7 31773.8 32245.4 32391.7 3827.2 3973.9 3986.1 4033.3 4166.4 265571.0 270273.0 270640.0 270904.0 272130.0 52657.5 53577.0 54170.0 60209.4 61301.7 53311.7 53793.7 54039.5 54100.0 54144.0 15487.8 15653.7 15680.5 15777.4 15805.3 11418.8 11426.0 11539.5 11585.0 11738.3 20367.6 20647.8 20694.5 20713.6 20757.2 8052.9 8150.4 8202.9 8229.7 8381.7 954.2 957.0 958.3 972.4 1043.2 28299.0 28557.3 28870.6 28917.6 29326.4 975.8 1024.8 1051.0 1066.6 1090.1 14950.4 14965.2 14984.3 15029.0 15135.5 320624.0 322447.0 322967.0 324290.0 325963.0 50252.0 50698.5 50939.0 50970.5 51089.2 1325.3 1346.5 1349.7 1350.2 1356.1 27199.5 28455.9 28569.6 28683.4 28721.0 45550.5 45716.1 45937.3 46045.3 46057.8 289242.0 291492.0 292478.0 292824.0 293337.0 32332.2 42439.6 42952.8 42973.4 43685.0 45200.1 46135.0 46226.5 46494.0 46799.8 33756.7 33763.3 33767.0 34183.5 34209.0 33279.0 33848.8 34217.8 34246.8 34441.8 32727.5 33351.7 33387.3 33442.5 35959.8 30593.4 31653.4 32638.2 32831.0 33732.2 24861.3 25364.7 25464.0 25658.0 27920.4 13:11:39 INFO - PROCESS | 7531 | 13:11:39 INFO - PROCESS | 7531 | [#2] jquery.html Cycles:180 Average:25098.67 Median:375.53 stddev:71121.71 (18939.2%) stddev-sans-first:71296.98 13:11:39 INFO - PROCESS | 7531 | Values: 366.7 366.7 372.4 374.4 376.6 10983.1 11302.9 11389.8 11724.0 15991.3 16640.3 16875.0 17169.1 17182.8 17191.7 5437.9 5816.2 5850.4 5855.0 5885.0 5733.9 5789.0 5923.2 5939.7 5940.6 5939.6 5953.1 6182.5 6383.6 6388.9 6334.9 6342.7 6368.4 6648.7 6675.6 6170.4 6325.6 6342.7 6345.0 6535.4 21291.5 21828.8 21939.9 21957.2 22036.2 2139.9 2145.2 2267.2 2427.9 2911.9 13058.7 13812.3 14052.5 14173.6 14373.6 1871.8 1954.5 1964.0 1974.3 1980.2 66835.7 67047.7 67860.3 68968.0 69965.0 14350.9 15020.2 15427.9 15495.7 15500.1 23158.5 23318.4 23442.8 23670.6 23762.9 8520.4 9181.8 9302.4 9307.7 9320.2 8103.9 8166.8 8175.4 8209.4 8218.8 7465.1 7480.7 7641.3 7655.4 7660.9 1800.6 1865.2 1880.7 2973.3 3029.4 848.6 888.9 893.0 946.4 991.8 15747.5 16180.1 16327.9 16458.8 16604.8 916.0 932.8 937.5 942.3 985.2 8612.4 9523.9 9546.1 9565.3 9703.7 357469.0 360654.0 363993.0 524438.0 529637.0 61214.7 62309.0 63395.4 64442.7 64762.0 1119.3 1132.1 1163.8 1170.0 1190.9 13923.4 14238.5 14722.3 14840.6 15083.8 25189.9 28197.9 31439.4 31882.4 32586.8 36381.3 37249.4 40031.2 40481.0 40768.6 7296.4 7478.6 7529.2 7536.4 7632.5 10471.2 10859.2 11350.4 11423.8 11443.3 9218.4 9659.6 9728.6 9964.8 10264.9 9690.2 9842.3 10044.6 10102.2 10113.3 9652.1 10018.8 10202.3 10275.5 10381.8 7716.8 7924.1 7926.2 7941.6 7963.3 9799.9 10530.6 10542.6 10545.7 10668.8 13:11:39 INFO - PROCESS | 7531 | 13:11:39 INFO - PROCESS | 7531 | [#3] mootools.html Cycles:180 Average:5537.61 Median:6277.87 stddev:2893.89 (46.1%) stddev-sans-first:2886.00 13:11:39 INFO - PROCESS | 7531 | Values: 1487.6 1489.8 1625.3 1768.0 1794.1 7648.6 7787.5 7810.8 7883.1 8007.3 8024.1 8060.6 8103.4 8148.4 8166.0 2300.8 2326.7 2331.0 2344.6 2345.3 2373.0 2393.0 2417.9 2442.1 2444.5 2284.8 2346.6 2357.8 2368.0 2381.0 2335.0 2361.3 2363.4 2367.9 2375.0 2322.0 2323.4 2345.1 2353.8 2362.9 7881.9 7904.5 7915.4 7935.7 7994.5 4765.6 4911.4 4923.1 4924.3 4925.0 2922.5 3149.3 3176.7 3185.6 3187.4 900.5 901.7 911.4 921.5 941.5 11082.4 11082.7 11145.8 11155.4 11181.6 4287.9 4356.6 4423.3 4426.0 4429.8 8909.9 8911.0 8911.2 8967.1 8986.0 4849.2 4868.3 4882.1 4887.1 4908.2 4464.4 4472.9 4486.6 4492.9 4532.3 3477.0 3517.6 3528.2 3529.7 3542.5 1033.9 1051.8 1056.1 1058.1 1067.5 876.5 905.4 977.2 1020.7 1202.8 7176.5 7294.6 7299.3 7305.6 7323.3 762.6 1214.2 1222.1 1222.7 1230.6 5709.4 5799.4 5815.7 5817.2 5831.1 9338.9 9380.0 9809.6 9888.0 10002.5 9685.8 9743.0 9826.1 9828.4 9843.1 7516.8 7575.6 7577.7 7600.7 7643.6 6916.7 6931.9 7019.9 7026.1 7042.5 8317.2 8449.4 8630.7 8755.2 8758.7 8696.2 8828.7 8838.5 8900.6 8966.7 6816.8 6833.2 6855.8 6870.2 6885.8 7447.8 7509.5 7516.5 7524.0 7525.0 7026.7 7112.9 7237.2 7345.2 7455.0 6919.2 7048.9 7136.3 7137.9 7150.7 6931.1 6989.7 7004.3 7024.2 7039.6 6156.8 6183.3 6193.6 6205.9 6218.1 6099.3 6221.2 6232.0 6240.5 6315.2 13:11:39 INFO - PROCESS | 7531 | 13:11:39 INFO - PROCESS | 7531 | [#4] prototype.html Cycles:180 Average:5580.67 Median:6190.85 stddev:1690.47 (27.3%) stddev-sans-first:1648.69 13:11:39 INFO - PROCESS | 7531 | Values: 332.8 343.2 344.0 351.6 358.2 6127.9 6135.3 6167.5 6197.8 6343.8 6025.8 6197.5 6201.3 6202.1 6236.4 4811.6 4818.6 4825.3 4831.1 4851.0 4827.8 4845.7 4852.6 4853.1 4860.4 4726.5 4784.5 4788.0 4799.0 4799.5 4772.1 4786.7 4793.4 4797.4 4799.7 4184.6 4196.3 4199.9 4211.9 4230.1 5914.3 5917.2 5925.0 5941.3 5953.2 5463.7 5591.5 5592.0 5592.7 5619.0 6638.0 6647.2 6649.8 6653.7 6654.2 4681.7 4684.1 4692.8 4697.8 4699.2 6735.1 6837.2 6946.7 6954.4 6962.5 4714.7 4752.4 4757.6 4758.8 4768.8 4798.4 4804.2 4811.1 4811.9 4828.2 5518.6 5533.7 5544.1 5544.3 5554.9 6523.2 6653.8 6675.9 6720.1 6742.4 1634.7 1677.0 1683.3 1685.2 1707.0 1074.3 1089.1 1109.5 1117.8 1120.2 6124.2 6142.8 6146.5 6181.1 6246.3 6774.0 6799.6 6815.4 6815.5 6822.8 6085.6 6140.1 6184.2 6212.2 6215.1 3685.8 3696.0 3700.9 3712.4 3719.4 7034.0 7107.1 7110.9 7115.3 7118.2 6924.2 6940.5 6942.1 6951.5 6975.7 7242.9 7254.0 7255.4 7263.9 7266.9 6934.0 6940.4 6984.9 6993.3 7010.8 6780.2 6862.1 6864.3 6906.0 6917.8 7239.5 7258.8 7269.3 7277.7 7282.3 4656.9 4660.0 4665.4 4675.0 4692.0 6855.1 6920.0 6961.8 6970.3 7031.3 6740.2 6781.9 6797.0 6798.7 6834.2 6723.3 6752.2 6752.9 6774.5 6790.9 6555.9 6642.7 6681.8 6685.8 6706.3 6791.0 6794.8 6817.2 6828.9 6832.8 6539.1 6569.8 6584.6 6618.9 6621.3 13:11:39 INFO - PROCESS | 7531 | 13:11:39 INFO - PROCESS | 7531 | [#5] yui.html Cycles:180 Average:13714.08 Median:25073.83 stddev:15741.03 (62.8%) stddev-sans-first:15754.67 13:11:39 INFO - PROCESS | 7531 | Values: 661.5 669.8 793.2 801.9 807.9 15418.9 15598.1 15719.2 15721.0 15787.4 13729.2 13755.9 13822.6 13851.0 13854.9 805.1 809.3 819.5 819.7 823.1 823.8 828.1 831.2 831.7 835.1 850.6 851.8 852.8 857.2 857.3 846.9 851.9 852.0 855.3 856.4 628.8 632.9 633.6 633.8 634.2 13617.5 13957.6 14021.4 14043.6 14050.4 12956.1 13165.2 13332.6 13523.3 13613.7 10389.8 10552.6 10596.7 10606.4 10765.9 3551.3 3563.7 3596.5 3634.1 3647.7 47055.5 47094.5 48464.3 48637.0 49062.5 9794.9 10148.4 10161.5 10310.7 10319.5 18338.9 18469.2 18497.0 18583.2 18585.6 7687.8 7735.6 7881.3 7899.1 8120.9 4400.3 4430.0 4550.9 4555.9 4564.8 3052.1 3084.5 3087.4 3122.6 3123.0 569.5 585.2 592.5 601.1 609.8 596.0 597.7 603.4 649.3 661.2 7915.8 7993.3 8005.8 8284.5 8325.0 584.3 614.6 657.3 666.8 668.8 3512.6 3697.8 3727.1 3742.3 3744.3 56283.7 56948.0 57132.4 57153.4 57654.0 49404.0 49933.5 49964.3 50239.2 50320.7 44966.6 44978.3 45191.8 45362.3 45591.8 7163.4 7251.2 7288.2 7376.3 8432.5 32634.8 33906.5 34409.1 35005.3 35179.6 43044.0 43669.8 44110.1 45181.8 45232.0 11067.4 11075.9 11191.7 11229.5 11473.6 11396.1 12126.2 12179.4 12201.6 12532.4 10363.5 10700.7 10704.7 10957.9 11085.9 11321.1 11365.4 11461.6 11993.8 12001.0 9918.8 10531.7 10848.9 10936.6 11258.5 8517.7 9197.4 9295.7 9478.5 9729.0 8105.9 8299.0 8477.8 8581.4 8794.6 13:11:39 INFO - PROCESS | 7531 | -------- Summary: end -------- 13:11:39 INFO - PROCESS | 7531 | 13:11:39 INFO - TEST-INFO | 7531: exit 0 13:11:39 INFO - TEST-OK | dromaeo_css | took 1111288ms 13:11:39 INFO - TEST-START | kraken 13:11:39 INFO - operating with platform_type : linux_ 13:11:39 INFO - Initialising browser for kraken test... 13:11:39 INFO - TEST-INFO | started process 7763 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpmB8Zl0/profile http://localhost:54735/getInfo.html) 13:11:40 INFO - PROCESS | 7763 | JavaScript warning: resource://gre/modules/AddonManager.jsm, line 692: Proxy.create and Proxy.createFunction are deprecated, use new Proxy instead 13:11:43 INFO - PROCESS | 7763 | 13:11:43 INFO - PROCESS | 7763 | (process:7835): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:11:44 INFO - PROCESS | 7763 | __metrics Screen width/height:1600/1200 13:11:44 INFO - PROCESS | 7763 | colorDepth:24 13:11:44 INFO - PROCESS | 7763 | Browser inner width/height: 1024/697 13:11:44 INFO - PROCESS | 7763 | __metrics 13:11:45 INFO - PROCESS | 7763 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 13:11:45 INFO - PROCESS | 7763 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 13:11:45 INFO - TEST-INFO | 7763: exit 0 13:11:45 INFO - Browser initialized. 13:11:45 INFO - Running cycle 1/1 for kraken test... 13:11:45 INFO - TEST-INFO | started process 7884 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpmB8Zl0/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:11:47 INFO - PROCESS | 7884 | 13:11:47 INFO - PROCESS | 7884 | (process:7942): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:11:57 INFO - PROCESS | 7884 | RSS: Main: 151937024 13:11:57 INFO - PROCESS | 7884 | 13:12:00 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54735/tests/kraken/driver.html?testName=audio-beat-detection) 13:12:00 INFO - PROCESS | 7884 | RSS: Main: 156323840 13:12:00 INFO - PROCESS | 7884 | 13:12:03 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54735/tests/kraken/driver.html?testName=audio-dft) 13:12:04 INFO - PROCESS | 7884 | RSS: Main: 160043008 13:12:04 INFO - PROCESS | 7884 | 13:12:07 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54735/tests/kraken/driver.html?testName=audio-fft) 13:12:07 INFO - PROCESS | 7884 | RSS: Main: 151855104 13:12:07 INFO - PROCESS | 7884 | 13:12:09 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54735/tests/kraken/driver.html?testName=audio-oscillator) 13:12:10 INFO - PROCESS | 7884 | RSS: Main: 150544384 13:12:10 INFO - PROCESS | 7884 | 13:12:12 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54735/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:12:13 INFO - PROCESS | 7884 | RSS: Main: 152412160 13:12:13 INFO - PROCESS | 7884 | 13:12:16 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54735/tests/kraken/driver.html?testName=imaging-darkroom) 13:12:16 INFO - PROCESS | 7884 | RSS: Main: 153464832 13:12:16 INFO - PROCESS | 7884 | 13:12:20 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54735/tests/kraken/driver.html?testName=imaging-desaturate) 13:12:20 INFO - PROCESS | 7884 | RSS: Main: 154165248 13:12:20 INFO - PROCESS | 7884 | 13:12:23 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54735/tests/kraken/driver.html?testName=json-parse-financial) 13:12:24 INFO - PROCESS | 7884 | RSS: Main: 154804224 13:12:24 INFO - PROCESS | 7884 | 13:12:25 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54735/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:12:26 INFO - PROCESS | 7884 | RSS: Main: 155742208 13:12:26 INFO - PROCESS | 7884 | 13:12:28 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:12:28 INFO - PROCESS | 7884 | RSS: Main: 155017216 13:12:28 INFO - PROCESS | 7884 | 13:12:31 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:12:31 INFO - PROCESS | 7884 | RSS: Main: 155660288 13:12:31 INFO - PROCESS | 7884 | 13:12:34 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:12:34 INFO - PROCESS | 7884 | RSS: Main: 154505216 13:12:34 INFO - PROCESS | 7884 | 13:12:37 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:12:37 INFO - PROCESS | 7884 | RSS: Main: 155676672 13:12:37 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | Cycle 1(1): loaded http://localhost:54735/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54735/tests/kraken/driver.html?testName=ai-astar) 13:12:39 INFO - PROCESS | 7884 | RSS: Main: 155815936 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | __start_tp_report 13:12:39 INFO - PROCESS | 7884 | _x_x_mozilla_page_load 13:12:39 INFO - PROCESS | 7884 | _x_x_mozilla_page_load_details 13:12:39 INFO - PROCESS | 7884 | |i|pagename|runs| 13:12:39 INFO - PROCESS | 7884 | |0;ai-astar;113;106;112;111;111;123;111;111;112;111 13:12:39 INFO - PROCESS | 7884 | |1;audio-beat-detection;154;128;156;166;133;172;167;130;165;128 13:12:39 INFO - PROCESS | 7884 | |2;audio-dft;162;163;162;163;162;161;163;166;166;163 13:12:39 INFO - PROCESS | 7884 | |3;audio-fft;76;77;73;74;74;75;73;148;74;73 13:12:39 INFO - PROCESS | 7884 | |4;audio-oscillator;95;96;150;95;96;96;140;96;96;142 13:12:39 INFO - PROCESS | 7884 | |5;imaging-gaussian-blur;119;116;116;117;116;115;115;115;115;115 13:12:39 INFO - PROCESS | 7884 | |6;imaging-darkroom;148;146;146;145;146;147;146;146;146;147 13:12:39 INFO - PROCESS | 7884 | |7;imaging-desaturate;98;96;96;98;97;97;97;96;96;96 13:12:39 INFO - PROCESS | 7884 | |8;json-parse-financial;60;60;59;59;59;60;59;60;57;57 13:12:39 INFO - PROCESS | 7884 | |9;json-stringify-tinderbox;68;68;66;67;67;68;67;67;68;68 13:12:39 INFO - PROCESS | 7884 | |10;stanford-crypto-aes;84;83;85;85;85;83;84;83;84;82 13:12:39 INFO - PROCESS | 7884 | |11;stanford-crypto-ccm;115;116;120;119;115;131;127;127;117;114 13:12:39 INFO - PROCESS | 7884 | |12;stanford-crypto-pbkdf2;142;165;151;156;158;142;152;152;153;146 13:12:39 INFO - PROCESS | 7884 | |13;stanford-crypto-sha256-iterative;68;74;73;69;69;67;68;68;67;76 13:12:39 INFO - PROCESS | 7884 | __end_tp_report 13:12:39 INFO - PROCESS | 7884 | __start_cc_report 13:12:39 INFO - PROCESS | 7884 | _x_x_mozilla_cycle_collect,737 13:12:39 INFO - PROCESS | 7884 | __end_cc_report 13:12:39 INFO - PROCESS | 7884 | __startTimestamp1454361159797__endTimestamp 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | ------- Summary: start ------- 13:12:39 INFO - PROCESS | 7884 | Number of tests: 14 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#0] ai-astar Cycles:10 Average:112.10 Median:111.50 stddev:4.25 (3.8%) stddev-sans-first:4.50 13:12:39 INFO - PROCESS | 7884 | Values: 113.0 106.0 112.0 111.0 111.0 123.0 111.0 111.0 112.0 111.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#1] audio-beat-detection Cycles:10 Average:149.90 Median:160.50 stddev:18.14 (11.3%) stddev-sans-first:19.18 13:12:39 INFO - PROCESS | 7884 | Values: 154.0 128.0 156.0 166.0 133.0 172.0 167.0 130.0 165.0 128.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#2] audio-dft Cycles:10 Average:163.10 Median:163.00 stddev:1.66 (1.0%) stddev-sans-first:1.72 13:12:39 INFO - PROCESS | 7884 | Values: 162.0 163.0 162.0 163.0 162.0 161.0 163.0 166.0 166.0 163.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#3] audio-fft Cycles:10 Average:81.70 Median:74.00 stddev:23.33 (31.5%) stddev-sans-first:24.66 13:12:39 INFO - PROCESS | 7884 | Values: 76.0 77.0 73.0 74.0 74.0 75.0 73.0 148.0 74.0 73.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#4] audio-oscillator Cycles:10 Average:110.20 Median:96.00 stddev:23.46 (24.4%) stddev-sans-first:24.23 13:12:39 INFO - PROCESS | 7884 | Values: 95.0 96.0 150.0 95.0 96.0 96.0 140.0 96.0 96.0 142.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#5] imaging-gaussian-blur Cycles:10 Average:115.90 Median:116.00 stddev:1.29 (1.1%) stddev-sans-first:0.73 13:12:39 INFO - PROCESS | 7884 | Values: 119.0 116.0 116.0 117.0 116.0 115.0 115.0 115.0 115.0 115.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.00 stddev:0.82 (0.6%) stddev-sans-first:0.60 13:12:39 INFO - PROCESS | 7884 | Values: 148.0 146.0 146.0 145.0 146.0 147.0 146.0 146.0 146.0 147.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#7] imaging-desaturate Cycles:10 Average:96.70 Median:97.00 stddev:0.82 (0.8%) stddev-sans-first:0.73 13:12:39 INFO - PROCESS | 7884 | Values: 98.0 96.0 96.0 98.0 97.0 97.0 97.0 96.0 96.0 96.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#8] json-parse-financial Cycles:10 Average:59.00 Median:59.50 stddev:1.15 (1.9%) stddev-sans-first:1.17 13:12:39 INFO - PROCESS | 7884 | Values: 60.0 60.0 59.0 59.0 59.0 60.0 59.0 60.0 57.0 57.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:68.00 stddev:0.70 (1.0%) stddev-sans-first:0.71 13:12:39 INFO - PROCESS | 7884 | Values: 68.0 68.0 66.0 67.0 67.0 68.0 67.0 67.0 68.0 68.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#10] stanford-crypto-aes Cycles:10 Average:83.80 Median:84.00 stddev:1.03 (1.2%) stddev-sans-first:1.09 13:12:39 INFO - PROCESS | 7884 | Values: 84.0 83.0 85.0 85.0 85.0 83.0 84.0 83.0 84.0 82.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#11] stanford-crypto-ccm Cycles:10 Average:120.10 Median:119.50 stddev:6.06 (5.1%) stddev-sans-first:6.14 13:12:39 INFO - PROCESS | 7884 | Values: 115.0 116.0 120.0 119.0 115.0 131.0 127.0 127.0 117.0 114.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.70 Median:152.50 stddev:7.13 (4.7%) stddev-sans-first:6.65 13:12:39 INFO - PROCESS | 7884 | Values: 142.0 165.0 151.0 156.0 158.0 142.0 152.0 152.0 153.0 146.0 13:12:39 INFO - PROCESS | 7884 | 13:12:39 INFO - PROCESS | 7884 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.90 Median:69.00 stddev:3.21 (4.7%) stddev-sans-first:3.33 13:12:39 INFO - PROCESS | 7884 | Values: 68.0 74.0 73.0 69.0 69.0 67.0 68.0 68.0 67.0 76.0 13:12:39 INFO - PROCESS | 7884 | -------- Summary: end -------- 13:12:39 INFO - PROCESS | 7884 | 13:12:40 INFO - TEST-INFO | 7884: exit 0 13:12:40 INFO - TEST-OK | kraken | took 61005ms 13:12:40 INFO - SUITE-END | took 1172s 13:12:40 INFO - Completed test suite (00:19:32) 13:12:40 INFO - Working with test: dromaeo_css 13:12:40 INFO - Generating results file: dromaeo_css 13:12:40 INFO - Working with test: kraken 13:12:40 INFO - Generating results file: kraken 13:12:40 INFO - javascript benchmark 13:12:40 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 13:12:41 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,63,43]] 13:12:41 INFO - process_Request line: dromaeo_css 7052.85 graph.html#tests=[[72,63,43]] 13:12:41 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 13:12:41 INFO - process_Request line: kraken 1527.80 graph.html#tests=[[232,63,43]] 13:12:41 INFO - RETURN: dromaeo_css: 7052.85 13:12:41 INFO - RETURN: kraken: 1527.80 13:12:41 INFO - javascript benchmark 13:12:41 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3220.3398303347817, 3238.724708399786, 3265.6244531878842, 3285.983570082149, 3294.9341013179737, 5233.319668443107, 5261.105612045952, 5276.947230527693, 5301.973490132554, 5316.867078323044, 5180.352455943007, 5213.478652134785, 5239.0, 5297.0, 5305.575553955684, 4824.348712923763, 4839.298301746245, 4852.708837469745, 4933.580645645125, 4953.529414705616, 4492.438445194351, 4912.140375434303, 4915.606751459874, 4930.260460930853, 4985.950140498603, 4754.0, 4791.041791641651, 4822.61419086474, 4887.120318342697, 4917.286993385939, 4850.102730994778, 4860.9513904861205, 4870.805167793284, 4873.780679869415, 4891.241857512091, 4708.646851486153, 4884.535969082932, 4900.6569540132205, 4909.189983652693, 4928.33467481889, 5123.129068058439, 5126.102931986925, 5182.119039763249, 5205.479452054802, 5213.582913366921, 5786.971065144689, 5787.218725472049, 5798.159266906275, 5799.217105690762, 5800.390958949291, 5716.971415142898, 5807.157962095514, 5826.271716035496, 5837.970810145965, 5841.970790146022, 5269.341332333458, 5292.788288468495, 5293.497117773805, 5307.52232299095, 5323.600729945269, 5817.0, 5828.970855145782, 5895.764169433174, 5926.348101708809, 5955.34491205967, 5610.382857885629, 5636.549076073904, 5650.886982260414, 5654.0, 5654.858628534237, 5662.348829884533, 5734.0, 5750.166225897305, 5769.0192667246665, 5788.421157884262, 5669.206311116447, 5684.516816070598, 5709.600327977002, 5719.914201286984, 5744.224529688522, 5594.384617692051, 5625.634333768292, 5638.126090455986, 5649.6327738696855, 5691.459311365414, 4332.545082766327, 4384.101259241847, 4385.451818522684, 4417.933730993974, 4459.576340247671, 3913.373860182357, 3917.3144699678014, 3947.1513624570857, 3947.4276229947072, 3955.0705584187695, 5299.8410047698635, 5341.839744807662, 5341.893162136736, 5346.385165705916, 5371.221172929903, 5655.1517272409465, 5674.233978412862, 5706.857328566819, 5734.05388110957, 5766.654000759884, 5333.306670132858, 5338.225957236179, 5347.0, 5349.598780091431, 5389.0299746046085, 4831.396075490564, 4840.10458065252, 4844.273358996179, 4857.53853383928, 4869.123557759637, 5847.181394604759, 5847.970760146172, 5914.319853216849, 5935.109733540004, 6010.429009244115, 5719.685417302088, 5735.311762588516, 5737.885242295214, 5739.9139012915675, 5769.8557536061935, 5867.706614669335, 5883.764649413975, 5919.052951527735, 5928.79249226275, 5932.851678708067, 5550.97224513891, 5588.41321661236, 5668.829935101953, 5678.20505129274, 5751.194832723506, 5696.658200507817, 5707.571932105192, 5726.883257764696, 5749.13762935563, 5767.480926716616, 5556.388797232382, 5567.331920169606, 5597.04850175463, 5602.719864006865, 5603.1875378069135, 5472.151816468454, 5510.476504732204, 5573.609847310811, 5574.08027675429, 5615.522680572197, 5491.588130890119, 5494.423085575957, 5514.0, 5515.200295957144, 5518.696471694096, 5491.341039075336, 5569.331680198402, 5578.051731205786, 5618.157276408571, 5669.234653321749, 5385.246065550904, 5448.318960129984, 5454.263674403905, 5464.617476776588, 5514.5864060196445], "unit": "score", "name": "dojo.html", "value": 5264.5216232508255}, {"lowerIsBetter": false, "replicates": [521.3951815893562, 544.18915815435, 556.3685217278388, 560.728046897255, 594.274984518887, 35765.642343576554, 36232.45651315226, 36360.27279454409, 36513.08717282066, 36545.08637284066, 39420.60579394212, 39860.0, 40009.19981600366, 40080.59919400805, 40193.799031004804, 8420.157984201576, 8600.913990860074, 8617.224449799516, 8634.438761480515, 8645.95677021614, 8591.656333746643, 8736.781580460476, 8740.606672699743, 8766.430182038179, 8785.209331160195, 8711.12888711127, 8827.64689412426, 8837.911620883773, 8871.068537803534, 8879.689210877621, 8736.257418119467, 8741.038485766561, 8808.427452215585, 8822.161894620001, 8827.735167945004, 8452.81660567521, 8662.52356120413, 8687.391882568223, 8688.218060374596, 8701.347398945105, 40073.79963100195, 40101.79949100265, 40217.19565608671, 40319.7984010081, 40630.79684601558, 3167.9841600791847, 3299.5710557627594, 3316.9170770730925, 3408.1309266137223, 3467.9479807802904, 30875.691243087505, 31274.687253127406, 31773.841130794197, 32245.35509289801, 32391.676083239337, 3827.234553089393, 3973.860914867995, 3986.1031267964768, 4033.334499807528, 4166.437530933315, 265571.0, 270273.0, 270640.0, 270904.0, 272130.0, 52657.473425265256, 53577.0, 54170.0, 60209.39790602038, 61301.693491532256, 53311.73344133332, 53793.73103134459, 54039.45960540344, 54100.0, 54144.0, 15487.84512154864, 15653.686926261638, 15680.451184208727, 15777.368905243891, 15805.288762005737, 11418.771624567462, 11426.0, 11539.538418463335, 11585.0, 11738.295702257892, 20367.592648146954, 20647.793522064887, 20694.482637934172, 20713.58572828535, 20757.169713211304, 8052.879206811903, 8150.38872084596, 8202.917970820336, 8229.711960081368, 8381.706640267561, 954.206092546009, 956.9617215311449, 958.3291695812959, 972.397113789455, 1043.175891046065, 28299.0, 28557.286067848054, 28870.566941495894, 28917.56623650647, 29326.413471730444, 975.8438649815995, 1024.7694268789462, 1051.0172988256006, 1066.632011955874, 1090.095220966596, 14950.40198392074, 14965.176915269547, 14984.250787460802, 15029.0, 15135.470258540898, 320624.0, 322447.0, 322967.0, 324290.0, 325963.0, 50252.0, 50698.49301507012, 50939.0, 50970.49029509732, 51089.233661495105, 1325.337331334333, 1346.5152545083565, 1349.7030653256268, 1350.2033800058014, 1356.125299182022, 27199.45601088007, 28455.857720711265, 28569.571456427755, 28683.42633147367, 28721.0, 45550.54449455463, 45716.085678285584, 45937.31094033659, 46045.30932035955, 46057.76971115123, 289242.0, 291492.0, 292478.0, 292824.0, 293337.0, 32332.191695207806, 42439.57560424356, 42952.78523607362, 42973.355399668406, 43685.0, 45200.09599808051, 46135.0, 46226.53773462357, 46494.0, 46799.76600116977, 33756.66243337633, 33763.32473350568, 33767.0, 34183.487247690806, 34209.0, 33279.0, 33848.830755846066, 34217.828910855285, 34246.828765856015, 34441.82779086089, 32727.509087364186, 33351.666483334855, 33387.33225335431, 33442.49836252409, 35959.82020089883, 30593.388132236785, 31653.366932660756, 32638.184045399055, 32831.0, 33732.15669608279, 24861.254162374433, 25364.74635253624, 25464.0, 25658.0, 27920.441591167655], "unit": "score", "name": "ext.html", "value": 18470.506534546545}, {"lowerIsBetter": false, "replicates": [366.69197873786015, 366.72129181821816, 372.40787148433986, 374.419649543208, 376.63466437555576, 10983.066439352655, 11302.886971130287, 11389.829152562717, 11724.0, 15991.280392382341, 16640.251188696508, 16875.0, 17169.141542922865, 17182.82817171831, 17191.656166876655, 5437.945620543804, 5816.185733997244, 5850.3564607893095, 5855.0, 5885.0, 5733.856653583652, 5789.0, 5923.229980102602, 5939.732712027969, 5940.57426217709, 5939.643621382709, 5953.107033944922, 6182.474489668383, 6383.616982981012, 6388.872222555546, 6334.87330253397, 6342.682865856688, 6368.395002474757, 6648.667566621698, 6675.566088204251, 6170.413810687977, 6325.588836725598, 6342.6511541865175, 6345.0, 6535.379138981789, 21291.467713307135, 21828.781712182994, 21939.890300548395, 21957.231496897533, 22036.228731994463, 2139.914403423861, 2145.2062736787334, 2267.195145723261, 2427.9393015174587, 2911.941761164786, 13058.673533161653, 13812.309384530834, 14052.508162214375, 14173.645658858508, 14373.568792936228, 1871.7660292463443, 1954.5113721569608, 1963.980360196394, 1974.3484650065589, 1980.2475059477451, 66835.66582167058, 67047.66476167589, 67860.32139678589, 68968.0, 69965.0, 14350.856491434952, 15020.248987550578, 15427.92286038585, 15495.690086198212, 15500.147491887828, 23158.536829263656, 23318.417039574146, 23442.7655723444, 23670.64494032591, 23762.88118559396, 8520.403571749917, 9181.77045573866, 9302.395344302598, 9307.72076837696, 9320.20778233844, 8103.878441823377, 8166.7958301042945, 8175.386845986456, 8209.425340226246, 8218.835623287501, 7465.104187497535, 7480.663370148356, 7641.2740789624895, 7655.425843061793, 7660.885086723703, 1800.6038671492252, 1865.216609024213, 1880.7178923161634, 2973.3012742005612, 3029.3947205403338, 848.5757121439281, 888.9422187557788, 892.9508877011826, 946.3517490518879, 991.8313886639289, 15747.527574172793, 16180.110093944946, 16327.918360408123, 16458.765592580367, 16604.750928736077, 916.0061333453278, 932.8320902237663, 937.4937533731709, 942.3168203052869, 985.2019863910256, 8612.440191387665, 9523.90476095244, 9546.093121153479, 9565.330426870052, 9703.708888733208, 357469.0, 360654.0, 363993.0, 524438.0, 529637.0, 61214.69392653097, 62309.0, 63395.36604633987, 64442.677786611705, 64762.0, 1119.3339962722168, 1132.088668621751, 1163.7963356412595, 1170.0230307693002, 1190.9166358354832, 13923.443062277396, 14238.501652442115, 14722.263886805831, 14840.62898427548, 15083.773743393638, 25189.87405062963, 28197.872085117186, 31439.37121257608, 31882.36235275328, 32586.837065814518, 36381.27237455289, 37249.44125838169, 40031.19937601173, 40481.0, 40768.592314077665, 7296.379807716191, 7478.6260686966525, 7529.171791103084, 7536.3970882328185, 7632.542047477169, 10471.162307015267, 10859.185561082792, 11350.375729334635, 11423.828642570534, 11443.313401195956, 9218.354715169873, 9659.565319560777, 9728.562214700498, 9964.800703985735, 10264.897351026395, 9690.176335011603, 9842.311038227255, 10044.648437304659, 10102.24233182529, 10113.29206955506, 9652.131308182297, 10018.849717254392, 10202.285839991426, 10275.486225688835, 10381.792364152523, 7716.8456630868195, 7924.088729796147, 7926.167752385916, 7941.6029198541, 7963.323117534843, 9799.85300220483, 10530.57877684884, 10542.631007914686, 10545.683629491128, 10668.83996740034], "unit": "score", "name": "jquery.html", "value": 8880.725525061429}, {"lowerIsBetter": false, "replicates": [1487.576040828364, 1489.7765335199722, 1625.3011205181774, 1768.018749593975, 1794.1477798045921, 7648.579328136951, 7787.493812902165, 7810.843783124341, 7883.1328553859175, 8007.319377852889, 8024.077231118423, 8060.63727132279, 8103.432759706808, 8148.388870834697, 8166.0, 2300.827437942157, 2326.6510023496444, 2331.0, 2344.5779759643256, 2345.2846881701075, 2373.0270589058405, 2393.0427828868505, 2417.9153729619466, 2442.072012635205, 2444.4744379958306, 2284.760100189481, 2346.6128088865316, 2357.834951553392, 2368.0409434179187, 2381.047580967618, 2335.0426325206668, 2361.2680069178523, 2363.444590521226, 2367.881605919697, 2374.9881250593808, 2322.036354912709, 2323.407531079564, 2345.1205797825814, 2353.811695064408, 2362.870042147681, 7881.881771773428, 7904.486208396494, 7915.406344524126, 7935.682572697086, 7994.520328780233, 4765.642576806718, 4911.435184953741, 4923.064617722621, 4924.261360795874, 4924.950750492485, 2922.4593450211564, 3149.2599239178776, 3176.65056843747, 3185.601799775028, 3187.42626327261, 900.4552245891273, 901.693424235763, 911.3802614222326, 921.4747593871496, 941.4727752458645, 11082.445877706163, 11082.667519974413, 11145.777084458347, 11155.442227888654, 11181.608643697431, 4287.914241715211, 4356.607905288539, 4423.314386270134, 4426.0483995940385, 4429.778511074498, 8909.866352004725, 8911.019787823334, 8911.197992180734, 8967.058458861857, 8985.955070224738, 4849.175640141185, 4868.269759536098, 4882.096812089775, 4887.0714564232685, 4908.165611845923, 4464.397306363664, 4472.865814025585, 4486.64106871456, 4492.887677808081, 4532.32015197723, 3477.0, 3517.613062563116, 3528.1885166411357, 3529.6823285904393, 3542.5217595624777, 1033.8914413986574, 1051.7580956380075, 1056.0548309263168, 1058.1323314881722, 1067.5462928255615, 876.4872549558452, 905.4160066756905, 977.2426369563645, 1020.6529779874729, 1202.7654607351483, 7176.461765367619, 7294.635268236567, 7299.343059124704, 7305.598192099379, 7323.304286092813, 762.5500954436909, 1214.2107630040543, 1222.0712258683463, 1222.712662524306, 1230.615557497815, 5709.371969083398, 5799.39106393831, 5815.680137592473, 5817.156512305692, 5831.096180092092, 9338.906610933804, 9380.0, 9809.558569864374, 9888.0, 10002.549885255181, 9685.806283874424, 9742.95128524353, 9826.115649591571, 9828.4102953823, 9843.114119729258, 7516.849663006709, 7575.583342916192, 7577.734779282699, 7600.695972161052, 7643.5796031218815, 6916.688749006206, 6931.896021559782, 7019.894701579378, 7026.1217347831525, 7042.471814613822, 8317.168283171635, 8449.408541402288, 8630.741077767678, 8755.212030917248, 8758.737237882873, 8696.17386348296, 8828.690995815115, 8838.469691818511, 8900.643974240958, 8966.68616598416, 6816.7614133505085, 6833.248342682202, 6855.828604284933, 6870.175578930561, 6885.827854303482, 7447.813804654927, 7509.549427034395, 7516.549007059594, 7524.0, 7525.0, 7026.718931242693, 7112.928870711226, 7237.240089790496, 7345.192028876712, 7454.9935758674055, 6919.169699635874, 7048.859022819617, 7136.250693677297, 7137.857242855218, 7150.678219480032, 6931.09895713554, 6989.720411183699, 7004.299570042955, 7024.1571011478945, 7039.648017599202, 6156.846078847885, 6183.319834818257, 6193.597416167935, 6205.913965056006, 6218.06728990655, 6099.329073801967, 6221.191245138103, 6232.0, 6240.53196010292, 6315.210598675166], "unit": "score", "name": "mootools.html", "value": 4519.3206043331165}, {"lowerIsBetter": false, "replicates": [332.84023668639054, 343.19520723902457, 343.99656003439975, 351.5605493133583, 358.17262124492424, 6127.877442451148, 6135.29444113927, 6167.475764560012, 6197.845053873655, 6343.777967771129, 6025.789097381593, 6197.5041996640275, 6201.3178550359535, 6202.131701561785, 6236.438720515152, 4811.59101476375, 4818.566329030386, 4825.276208568707, 4831.130396528623, 4850.975745121269, 4827.8310259140935, 4845.709257444564, 4852.636052296092, 4853.126437241295, 4860.416749990006, 4726.456457507396, 4784.473707892146, 4787.976060119695, 4799.040191961604, 4799.520047995207, 4772.069446457942, 4786.664933454659, 4793.400824896888, 4797.424309082932, 4799.712017278975, 4184.623383895434, 4196.307609244471, 4199.895002624929, 4211.873643790691, 4230.069384735353, 5914.349421563625, 5917.171595976567, 5924.97037514814, 5941.346451890288, 5953.166556682068, 5463.672179669193, 5591.4688104629995, 5591.9720401398135, 5592.748326325325, 5619.016672082369, 6638.0, 6647.235567909655, 6649.800505984828, 6653.700583473756, 6654.168228971379, 4681.719096854165, 4684.1334353144775, 4692.835750748707, 4697.78859951303, 4699.154152252593, 6735.090762747015, 6837.179538455417, 6946.652667366662, 6954.40887524556, 6962.477814163907, 4714.66997310185, 4752.358431611758, 4757.619390448755, 4758.78585463655, 4768.785404656729, 4798.448178459522, 4804.159272127434, 4811.061842940593, 4811.927821082687, 4828.203346447867, 5518.558515318765, 5533.667979921218, 5544.140658197985, 5544.306961629796, 5554.91667624986, 6523.249826269945, 6653.833654158685, 6675.9332406676285, 6720.092787473628, 6742.393184613408, 1634.689409012284, 1676.9748453773202, 1683.3350826423493, 1685.2247965935562, 1707.0440553290198, 1074.3285446595878, 1089.0634054712941, 1109.5007246738999, 1117.793208256475, 1120.165476719849, 6124.234470691164, 6142.846428839315, 6146.4775494082605, 6181.134641150243, 6246.312905580383, 6774.0, 6799.558028728117, 6815.386615204656, 6815.488838337144, 6822.795316140524, 6085.574009819358, 6140.078988151813, 6184.196054512974, 6212.192414986023, 6215.12988181655, 3685.8341374638208, 3696.0226278941177, 3700.889733080065, 3712.443133529938, 3719.386301260262, 7034.0, 7107.147142342952, 7110.893336599956, 7115.288471152843, 7118.216996130422, 6924.169099708067, 6940.479464040217, 6942.06282151903, 6951.548149370275, 6975.686094125776, 7242.891356629655, 7253.963730181315, 7255.419566434673, 7263.927360726325, 7266.854662906818, 6934.0, 6940.410065144318, 6984.930150698428, 6993.30066993317, 7010.824729381602, 6780.186377634715, 6862.142232220973, 6864.279250678607, 6906.0, 6917.792466226021, 7239.4932354734665, 7258.782236532912, 7269.3094156055095, 7277.708891644275, 7282.308180722823, 4656.883577910444, 4660.0, 4665.4168228971375, 4674.953250467588, 4691.953080469289, 6855.108835851507, 6920.031195632515, 6961.825954351182, 6970.268121847133, 7031.261717519586, 6740.191177058588, 6781.864362712619, 6797.0, 6798.660066996532, 6834.248232694499, 6723.327667233238, 6752.155980502437, 6752.898706519308, 6774.491913106438, 6790.913453847361, 6555.901661474986, 6642.667866606554, 6681.832954176184, 6685.832854178684, 6706.295838936841, 6791.0, 6794.844876371128, 6817.216020157547, 6828.931710682829, 6832.829179270558, 6539.051837483443, 6569.835754105994, 6584.637844918576, 6618.933810661832, 6621.33786621334], "unit": "score", "name": "prototype.html", "value": 5026.062553479923}, {"lowerIsBetter": false, "replicates": [661.4576047640936, 669.7655820462842, 793.2186796005934, 801.8917446144773, 807.9232472915074, 15418.92290538547, 15598.064116153038, 15719.214039298033, 15721.0, 15787.447439339625, 13729.176249425042, 13755.862441375608, 13822.585322440318, 13851.030427870053, 13854.861451385508, 805.1304591041661, 809.295912556077, 819.4796304346753, 819.737683941139, 823.1398188892591, 823.7611092783086, 828.056016141599, 831.1978940322588, 831.7255305749119, 835.0980940584154, 850.5577099908076, 851.7700220940343, 852.799592095857, 857.2113655436982, 857.2713193785264, 846.9195426434449, 851.9233269005788, 851.9872201916976, 855.285836326668, 856.4005196362509, 628.7673560782493, 632.8576070384173, 633.6039975015615, 633.8288662061263, 634.1502386801661, 13617.455301787917, 13957.581272561738, 14021.369038393195, 14043.578692639136, 14050.36773345202, 12956.09307348486, 13165.210087394787, 13332.600021999258, 13523.256220907846, 13613.727725445435, 10389.79220415595, 10552.630657926935, 10596.735081623021, 10606.363618182933, 10765.892341076567, 3551.254236610315, 3563.6970857477145, 3596.496490491333, 3634.0551456621206, 3647.689946354563, 47055.5294447058, 47094.529054709354, 48464.27303590449, 48637.02725945497, 49062.50937490615, 9794.853077203848, 10148.391096534231, 10161.54273057714, 10310.690679279634, 10319.48402579868, 18338.908305458386, 18469.168887400097, 18496.982665953234, 18583.163757630668, 18585.628287434174, 7687.769366919001, 7735.61321933901, 7881.330086942559, 7899.091604465445, 8120.918790812017, 4400.251957167226, 4429.955700443019, 4550.88622784433, 4555.886102847389, 4564.7717614119165, 3052.084374687585, 3084.506478963355, 3087.382523495265, 3122.5784519090084, 3123.047470521513, 569.4675478427683, 585.1836687820552, 592.4726992976255, 601.1313651773233, 609.7713357490941, 595.9612625179436, 597.7238595598428, 603.414687752879, 649.3247023096021, 661.163628010567, 7915.762527124196, 7993.280604745601, 8005.759827205193, 8284.544350060683, 8325.0, 584.2638275772557, 614.6066517428849, 657.2671471309455, 666.8218951415142, 668.7659319238228, 3512.5784905811465, 3697.815109244581, 3727.1241258304276, 3742.3263812513464, 3744.307303148926, 56283.71858140765, 56948.0, 57132.42867571271, 57153.428465715646, 57654.0, 49404.0, 49933.500664992884, 49964.25053624198, 50239.24641130386, 50320.74839625778, 44966.55033449689, 44978.325325120146, 45191.77404112958, 45362.31956520655, 45591.77204113958, 7163.391111755559, 7251.23861994483, 7288.161861386008, 7376.299251571092, 8432.494050356998, 32634.83682581572, 33906.49140262849, 34409.13977150491, 35005.299894001466, 35179.64820351764, 43044.0, 43669.78165109154, 44110.11779764451, 45181.77409113065, 45232.0, 11067.446627668745, 11075.944620276847, 11191.72020699489, 11229.49467273991, 11473.598424055119, 11396.145289103184, 12126.211796233216, 12179.39103044862, 12201.572944946884, 12532.436040378023, 10363.481825908524, 10700.678979630624, 10704.732381690521, 10957.945210273898, 11085.94457027742, 11321.094312455149, 11365.374904380007, 11461.598844040753, 11993.760124797629, 12001.0, 9918.752031199278, 10531.73670658209, 10848.891511085103, 10936.56253749841, 11258.549658013588, 8517.701880434155, 9197.402168859002, 9295.72112836616, 9478.52607369615, 9729.027097290498, 8105.878411823709, 8298.95801639035, 8477.788055298666, 8581.442206256574, 8794.560271986504], "unit": "score", "name": "yui.html", "value": 6274.280841182385}], "name": "dromaeo_css", "value": 7052.851190635585}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 106.0, 112.0, 111.0, 111.0, 123.0, 111.0, 111.0, 112.0, 111.0], "unit": "score", "name": "ai-astar", "value": 112.1}, {"lowerIsBetter": true, "replicates": [154.0, 128.0, 156.0, 166.0, 133.0, 172.0, 167.0, 130.0, 165.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 149.9}, {"lowerIsBetter": true, "replicates": [162.0, 163.0, 162.0, 163.0, 162.0, 161.0, 163.0, 166.0, 166.0, 163.0], "unit": "score", "name": "audio-dft", "value": 163.1}, {"lowerIsBetter": true, "replicates": [76.0, 77.0, 73.0, 74.0, 74.0, 75.0, 73.0, 148.0, 74.0, 73.0], "unit": "score", "name": "audio-fft", "value": 81.7}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 150.0, 95.0, 96.0, 96.0, 140.0, 96.0, 96.0, 142.0], "unit": "score", "name": "audio-oscillator", "value": 110.2}, {"lowerIsBetter": true, "replicates": [119.0, 116.0, 116.0, 117.0, 116.0, 115.0, 115.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.9}, {"lowerIsBetter": true, "replicates": [148.0, 146.0, 146.0, 145.0, 146.0, 147.0, 146.0, 146.0, 146.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.3}, {"lowerIsBetter": true, "replicates": [98.0, 96.0, 96.0, 98.0, 97.0, 97.0, 97.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.7}, {"lowerIsBetter": true, "replicates": [60.0, 60.0, 59.0, 59.0, 59.0, 60.0, 59.0, 60.0, 57.0, 57.0], "unit": "score", "name": "json-parse-financial", "value": 59.0}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 66.0, 67.0, 67.0, 68.0, 67.0, 67.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.4}, {"lowerIsBetter": true, "replicates": [84.0, 83.0, 85.0, 85.0, 85.0, 83.0, 84.0, 83.0, 84.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.8}, {"lowerIsBetter": true, "replicates": [115.0, 116.0, 120.0, 119.0, 115.0, 131.0, 127.0, 127.0, 117.0, 114.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.1}, {"lowerIsBetter": true, "replicates": [142.0, 165.0, 151.0, 156.0, 158.0, 142.0, 152.0, 152.0, 153.0, 146.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 151.7}, {"lowerIsBetter": true, "replicates": [68.0, 74.0, 73.0, 69.0, 69.0, 67.0, 68.0, 68.0, 67.0, 76.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.9}], "name": "kraken", "value": 1527.8000000000002}]} 13:12:41 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,43]]", "result": "1527.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,43]]", "result": "7052.85"}}} 13:12:41 INFO - Return code: 0 13:12:41 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 13:12:41 INFO - # TBPL SUCCESS # 13:12:41 INFO - Running post-action listener: _resource_record_post_action 13:12:41 INFO - Running post-run listener: _resource_record_post_run 13:12:42 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 0; Write bytes: 539389952; Read time: 0; Write time: 1550252 13:12:42 INFO - install - Wall time: 19s; CPU: 18.0%; Read bytes: 0; Write bytes: 247582720; Read time: 0; Write time: 1106596 13:12:42 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 291807232; Read time: 0; Write time: 443656 13:12:42 INFO - Running post-run listener: _upload_blobber_files 13:12:42 INFO - Blob upload gear active. 13:12:42 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 13:12:42 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 13:12:42 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'] 13:12:42 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 13:12:42 INFO - (blobuploader) - INFO - Open directory for files ... 13:12:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:12:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:12:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:12:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:12:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:12:43 INFO - (blobuploader) - INFO - Done attempting. 13:12:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:12:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:12:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:12:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:12:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:12:44 INFO - (blobuploader) - INFO - Done attempting. 13:12:44 INFO - (blobuploader) - INFO - Iteration through files over. 13:12:44 INFO - Return code: 0 13:12:44 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 13:12:44 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 13:12:44 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6a7e12e42ca4cfbcd7fcaaa303f74a7688374ba5272565b0c1235fc5bf708caefb9d0ae422c4b068b5f88a5bb28aa2ede00c96ee1bf02ba05b26821e45b5cbb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a963371571e9cb692d52d0ec62b9faa5b776c9204411a4392bb832f8121ca191338e630521659884fd71d36ecbf48bfd69e19dcf010f8283765b39f1136dd30"} 13:12:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 13:12:44 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 13:12:44 INFO - Contents: 13:12:44 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6a7e12e42ca4cfbcd7fcaaa303f74a7688374ba5272565b0c1235fc5bf708caefb9d0ae422c4b068b5f88a5bb28aa2ede00c96ee1bf02ba05b26821e45b5cbb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a963371571e9cb692d52d0ec62b9faa5b776c9204411a4392bb832f8121ca191338e630521659884fd71d36ecbf48bfd69e19dcf010f8283765b39f1136dd30"} 13:12:44 INFO - Running post-run listener: copy_logs_to_upload_dir 13:12:44 INFO - Copying logs to upload dir... 13:12:44 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 13:12:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.654675 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-02-01 13:12:44.343791) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-01 13:12:44.347250) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6a7e12e42ca4cfbcd7fcaaa303f74a7688374ba5272565b0c1235fc5bf708caefb9d0ae422c4b068b5f88a5bb28aa2ede00c96ee1bf02ba05b26821e45b5cbb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a963371571e9cb692d52d0ec62b9faa5b776c9204411a4392bb832f8121ca191338e630521659884fd71d36ecbf48bfd69e19dcf010f8283765b39f1136dd30"} build_url:https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011121 build_url: 'https://queue.taskcluster.net/v1/task/CX-4ajWrRimOQIvk4krLrA/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6a7e12e42ca4cfbcd7fcaaa303f74a7688374ba5272565b0c1235fc5bf708caefb9d0ae422c4b068b5f88a5bb28aa2ede00c96ee1bf02ba05b26821e45b5cbb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/9a963371571e9cb692d52d0ec62b9faa5b776c9204411a4392bb832f8121ca191338e630521659884fd71d36ecbf48bfd69e19dcf010f8283765b39f1136dd30"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-01 13:12:44.371960) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 13:12:44.372286) ========= 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=8783db0840cc980e80bb0bd400000236-1454357102.317245-585442044 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004544 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 13:12:44.455573) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-01 13:12:44.455892) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-01 13:12:44.456183) ========= ========= Total master_lag: 0.34 =========