builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-069 starttime: 1459750151.16 results: success (0) buildid: 20160403203111 builduid: 8e5f26f81f1a460cad5284ba02927139 revision: fc4a988ca8d61e809bb30ef635ad50e189f742b3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.158158) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.159016) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.159413) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006337 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.193197) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.193537) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.500161) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.500742) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004519 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.563533) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.563859) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.564285) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.564620) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-03 23:09:11-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 220M=0s 2016-04-03 23:09:12 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.211294 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.795530) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.795879) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016913 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.848366) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:11.848750) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev fc4a988ca8d61e809bb30ef635ad50e189f742b3 --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/fx-team --rev fc4a988ca8d61e809bb30ef635ad50e189f742b3 --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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-03 23:09:12,284 truncating revision to first 12 chars 2016-04-03 23:09:12,284 Setting DEBUG logging. 2016-04-03 23:09:12,284 attempt 1/10 2016-04-03 23:09:12,284 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/fc4a988ca8d6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-03 23:09:12,719 unpacking tar archive at: fx-team-fc4a988ca8d6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.698620 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:12.563017) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:12.563389) ========= echo fc4a988ca8d61e809bb30ef635ad50e189f742b3 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'fc4a988ca8d61e809bb30ef635ad50e189f742b3'] 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False fc4a988ca8d61e809bb30ef635ad50e189f742b3 program finished with exit code 0 elapsedTime=0.004671 script_repo_revision: 'fc4a988ca8d61e809bb30ef635ad50e189f742b3' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:12.614410) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:12.614752) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-03 23:09:12.630203) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-04-03 23:09:12.630520) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:09:13 INFO - MultiFileLogger online at 20160403 23:09:13 in /builds/slave/test-pgo 23:09:13 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 23:09:13 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 23:09:13 INFO - {'append_to_log': False, 23:09:13 INFO - 'base_work_dir': '/builds/slave/test-pgo', 23:09:13 INFO - 'blob_upload_branch': 'Fx-Team', 23:09:13 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 23:09:13 INFO - 'branch': 'Fx-Team', 23:09:13 INFO - 'buildbot_json_path': 'buildprops.json', 23:09:13 INFO - 'config_files': ('talos/linux_config.py',), 23:09:13 INFO - 'default_actions': ('clobber', 23:09:13 INFO - 'read-buildbot-config', 23:09:13 INFO - 'download-and-extract', 23:09:13 INFO - 'populate-webroot', 23:09:13 INFO - 'create-virtualenv', 23:09:13 INFO - 'install', 23:09:13 INFO - 'run-tests'), 23:09:13 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:09:13 INFO - 'download_minidump_stackwalk': True, 23:09:13 INFO - 'download_symbols': 'ondemand', 23:09:13 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:09:13 INFO - 'tooltool.py': '/tools/tooltool.py', 23:09:13 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:09:13 INFO - '/tools/misc-python/virtualenv.py')}, 23:09:13 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:09:13 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:09:13 INFO - 'installer_path': 'installer.exe', 23:09:13 INFO - 'log_level': 'info', 23:09:13 INFO - 'log_name': 'talos', 23:09:13 INFO - 'log_to_console': True, 23:09:13 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:09:13 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:09:13 INFO - 'opt_config_files': (), 23:09:13 INFO - 'pip_index': False, 23:09:13 INFO - 'sps_profile': False, 23:09:13 INFO - 'sps_profile_interval': 0, 23:09:13 INFO - 'suite': 'dromaeojs-e10s', 23:09:13 INFO - 'system_bits': '32', 23:09:13 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:09:13 INFO - 'title': 'talos-linux64-ix-069', 23:09:13 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:09:13 INFO - 'use_talos_json': True, 23:09:13 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 23:09:13 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:09:13 INFO - 'work_dir': 'build'} 23:09:13 INFO - ##### 23:09:13 INFO - ##### Running clobber step. 23:09:13 INFO - ##### 23:09:13 INFO - Running pre-action listener: _resource_record_pre_action 23:09:13 INFO - Running main action method: clobber 23:09:13 INFO - rmtree: /builds/slave/test-pgo/build 23:09:13 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 23:09:14 INFO - Running post-action listener: _resource_record_post_action 23:09:14 INFO - ##### 23:09:14 INFO - ##### Running read-buildbot-config step. 23:09:14 INFO - ##### 23:09:14 INFO - Running pre-action listener: _resource_record_pre_action 23:09:14 INFO - Running main action method: read_buildbot_config 23:09:14 INFO - Using buildbot properties: 23:09:14 INFO - { 23:09:14 INFO - "project": "", 23:09:14 INFO - "product": "firefox", 23:09:14 INFO - "script_repo_revision": "production", 23:09:14 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 23:09:14 INFO - "repository": "", 23:09:14 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 23:09:14 INFO - "buildid": "20160403203111", 23:09:14 INFO - "pgo_build": "True", 23:09:14 INFO - "basedir": "/builds/slave/test-pgo", 23:09:14 INFO - "buildnumber": 611, 23:09:14 INFO - "slavename": "talos-linux64-ix-069", 23:09:14 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 23:09:14 INFO - "platform": "ubuntu64_hw", 23:09:14 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 23:09:14 INFO - "branch": "fx-team", 23:09:14 INFO - "repo_path": "integration/fx-team", 23:09:14 INFO - "revision": "fc4a988ca8d61e809bb30ef635ad50e189f742b3", 23:09:14 INFO - "stage_platform": "linux64-pgo", 23:09:14 INFO - "builduid": "8e5f26f81f1a460cad5284ba02927139", 23:09:14 INFO - "slavebuilddir": "test" 23:09:14 INFO - } 23:09:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 23:09:14 INFO - Running post-action listener: _resource_record_post_action 23:09:14 INFO - ##### 23:09:14 INFO - ##### Running download-and-extract step. 23:09:14 INFO - ##### 23:09:14 INFO - Running pre-action listener: _resource_record_pre_action 23:09:14 INFO - Running main action method: download_and_extract 23:09:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 23:09: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')]} 23:09:14 INFO - https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 23:09:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 23:09:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 23:09:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 23:09:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 23:09:17 INFO - Downloaded 1361 bytes. 23:09:17 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 23:09:17 INFO - Using the following test package requirements: 23:09:17 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 23:09:17 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:09:17 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:09:17 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'jsshell-linux-x86_64.zip'], 23:09:17 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:09:17 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 23:09:17 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:09:17 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:09:17 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:09:17 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 23:09:17 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:09:17 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:09:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:17 INFO - https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:09:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:09:21 INFO - Downloaded 23695911 bytes. 23:09:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:09:21 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:09:22 INFO - Return code: 0 23:09:22 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:09:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:22 INFO - https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:09:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 23:09:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:09:26 INFO - Downloaded 23695911 bytes. 23:09:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:09:26 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:09:27 INFO - Return code: 0 23:09:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:27 INFO - https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:09:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 23:09:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 23:09:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 23:09:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:09:28 INFO - Downloaded 10847584 bytes. 23:09:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:09:28 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 23:09:28 INFO - Return code: 0 23:09:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:28 INFO - https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:09:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 23:09:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 23:09:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 23:09:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:09:30 INFO - Downloaded 57695996 bytes. 23:09:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 23:09:30 INFO - mkdir: /builds/slave/test-pgo/properties 23:09:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 23:09:30 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 23:09:30 INFO - Contents: 23:09:30 INFO - build_url:https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 23:09:31 INFO - Running post-action listener: _resource_record_post_action 23:09:31 INFO - Running post-action listener: set_extra_try_arguments 23:09:31 INFO - ##### 23:09:31 INFO - ##### Running populate-webroot step. 23:09:31 INFO - ##### 23:09:31 INFO - Running pre-action listener: _resource_record_pre_action 23:09:31 INFO - Running main action method: populate_webroot 23:09:31 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:09:31 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:09:31 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:09:31 INFO - '--tppagecycles', 23:09:31 INFO - '7'], 23:09:31 INFO - 'tests': ['tsvgm']}}, 23:09:31 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 23:09:31 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:09:31 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 23:09:31 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:09:31 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:09:31 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:09:31 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'tests': ['damp', 'tps']}, 23:09:31 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['damp', 'tps']}, 23:09:31 INFO - 'g3': {'tests': ['dromaeo_dom']}, 23:09:31 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['dromaeo_dom']}, 23:09:31 INFO - 'other': {'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'other-e10s': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'other_l64': {'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'other_nol64': {'tests': ['a11yr', 23:09:31 INFO - 'ts_paint', 23:09:31 INFO - 'tpaint', 23:09:31 INFO - 'sessionrestore', 23:09:31 INFO - 'sessionrestore_no_auto_restore', 23:09:31 INFO - 'tabpaint']}, 23:09:31 INFO - 'svgr': {'tests': ['tsvgx', 23:09:31 INFO - 'tsvgr_opacity', 23:09:31 INFO - 'tart', 23:09:31 INFO - 'tscrollx', 23:09:31 INFO - 'cart']}, 23:09:31 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['tsvgx', 23:09:31 INFO - 'tsvgr_opacity', 23:09:31 INFO - 'tart', 23:09:31 INFO - 'tscrollx', 23:09:31 INFO - 'cart']}, 23:09:31 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'tests': ['tp5o']}, 23:09:31 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'talos_options': ['--e10s'], 23:09:31 INFO - 'tests': ['tp5o']}, 23:09:31 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'talos_options': ['--xperf_path', 23:09:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:09:31 INFO - 'tests': ['tp5n']}, 23:09:31 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:09:31 INFO - 'talos_options': ['--e10s', 23:09:31 INFO - '--xperf_path', 23:09:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:09:31 INFO - 'tests': ['tp5n']}}, 23:09:31 INFO - 'talos.zip': {'path': '', 23:09:31 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:09:31 INFO - Running post-action listener: _resource_record_post_action 23:09:31 INFO - ##### 23:09:31 INFO - ##### Running create-virtualenv step. 23:09:31 INFO - ##### 23:09:31 INFO - Running pre-action listener: _resource_record_pre_action 23:09:31 INFO - Running main action method: create_virtualenv 23:09:31 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 23:09:31 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 23:09:31 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 23:09:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:09:31 INFO - Using real prefix '/usr' 23:09:31 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 23:09:32 INFO - Installing distribute.............................................................................................................................................................................................done. 23:09:34 INFO - Installing pip.................done. 23:09:34 INFO - Return code: 0 23:09:34 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 23:09:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:34 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:34 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 23:09:34 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 23:09:34 INFO - Using env: {'DISPLAY': ':0', 23:09:34 INFO - 'HOME': '/home/cltbld', 23:09:34 INFO - 'LANG': 'en_US.UTF-8', 23:09:34 INFO - 'LANGUAGE': 'en_US:en', 23:09:34 INFO - 'LOGNAME': 'cltbld', 23:09:34 INFO - 'MAIL': '/var/mail/cltbld', 23:09:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:34 INFO - 'MOZ_NO_REMOTE': '1', 23:09:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:34 INFO - 'NO_EM_RESTART': '1', 23:09:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:34 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:34 INFO - 'SHELL': '/bin/bash', 23:09:34 INFO - 'SHLVL': '1', 23:09:34 INFO - 'TERM': 'linux', 23:09:34 INFO - 'TMOUT': '86400', 23:09:34 INFO - 'USER': 'cltbld', 23:09:34 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:34 INFO - '_': '/tools/buildbot/bin/python'} 23:09:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:34 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 23:09:34 INFO - Cleaning up... 23:09:34 INFO - Return code: 0 23:09:34 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 23:09:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:34 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:34 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 23:09:34 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 23:09:34 INFO - Using env: {'DISPLAY': ':0', 23:09:34 INFO - 'HOME': '/home/cltbld', 23:09:34 INFO - 'LANG': 'en_US.UTF-8', 23:09:34 INFO - 'LANGUAGE': 'en_US:en', 23:09:34 INFO - 'LOGNAME': 'cltbld', 23:09:34 INFO - 'MAIL': '/var/mail/cltbld', 23:09:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:34 INFO - 'MOZ_NO_REMOTE': '1', 23:09:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:34 INFO - 'NO_EM_RESTART': '1', 23:09:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:34 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:34 INFO - 'SHELL': '/bin/bash', 23:09:34 INFO - 'SHLVL': '1', 23:09:34 INFO - 'TERM': 'linux', 23:09:34 INFO - 'TMOUT': '86400', 23:09:34 INFO - 'USER': 'cltbld', 23:09:34 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:34 INFO - '_': '/tools/buildbot/bin/python'} 23:09:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:34 INFO - Downloading/unpacking psutil>=0.7.1 23:09:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:36 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 23:09:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:09:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:09:36 INFO - Installing collected packages: psutil 23:09:36 INFO - Running setup.py install for psutil 23:09:36 INFO - building 'psutil._psutil_linux' extension 23:09:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 23:09:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 23:09:36 INFO - building 'psutil._psutil_posix' extension 23:09:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 23:09:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 23:09:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:09:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:09:37 INFO - Successfully installed psutil 23:09:37 INFO - Cleaning up... 23:09:38 INFO - Return code: 0 23:09:38 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 23:09: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')]} 23:09:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09: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')]} 23:09:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:38 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:38 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 23:09:38 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 23:09:38 INFO - Using env: {'DISPLAY': ':0', 23:09:38 INFO - 'HOME': '/home/cltbld', 23:09:38 INFO - 'LANG': 'en_US.UTF-8', 23:09:38 INFO - 'LANGUAGE': 'en_US:en', 23:09:38 INFO - 'LOGNAME': 'cltbld', 23:09:38 INFO - 'MAIL': '/var/mail/cltbld', 23:09:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:38 INFO - 'MOZ_NO_REMOTE': '1', 23:09:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:38 INFO - 'NO_EM_RESTART': '1', 23:09:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:38 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:38 INFO - 'SHELL': '/bin/bash', 23:09:38 INFO - 'SHLVL': '1', 23:09:38 INFO - 'TERM': 'linux', 23:09:38 INFO - 'TMOUT': '86400', 23:09:38 INFO - 'USER': 'cltbld', 23:09:38 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:38 INFO - '_': '/tools/buildbot/bin/python'} 23:09:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:39 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 23:09:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:40 INFO - Downloading mozsystemmonitor-0.0.tar.gz 23:09:40 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:09:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 23:09:40 INFO - Installing collected packages: mozsystemmonitor 23:09:40 INFO - Running setup.py install for mozsystemmonitor 23:09:41 INFO - Successfully installed mozsystemmonitor 23:09:41 INFO - Cleaning up... 23:09:41 INFO - Return code: 0 23:09:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 23:09:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:41 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 23:09:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:09:41 INFO - Using env: {'DISPLAY': ':0', 23:09:41 INFO - 'HOME': '/home/cltbld', 23:09:41 INFO - 'LANG': 'en_US.UTF-8', 23:09:41 INFO - 'LANGUAGE': 'en_US:en', 23:09:41 INFO - 'LOGNAME': 'cltbld', 23:09:41 INFO - 'MAIL': '/var/mail/cltbld', 23:09:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:41 INFO - 'MOZ_NO_REMOTE': '1', 23:09:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:41 INFO - 'NO_EM_RESTART': '1', 23:09:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:41 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:41 INFO - 'SHELL': '/bin/bash', 23:09:41 INFO - 'SHLVL': '1', 23:09:41 INFO - 'TERM': 'linux', 23:09:41 INFO - 'TMOUT': '86400', 23:09:41 INFO - 'USER': 'cltbld', 23:09:41 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:41 INFO - '_': '/tools/buildbot/bin/python'} 23:09:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:42 INFO - Downloading/unpacking blobuploader==1.2.4 23:09: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 23:09: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 23:09: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 23:09: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 23:09: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 23:09: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 23:09:43 INFO - Downloading blobuploader-1.2.4.tar.gz 23:09:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:09:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 23:09:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:44 INFO - Downloading docopt-0.6.1.tar.gz 23:09:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 23:09:44 INFO - Installing collected packages: blobuploader, requests, docopt 23:09:44 INFO - Running setup.py install for blobuploader 23:09:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:09:44 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 23:09:44 INFO - Running setup.py install for requests 23:09:45 INFO - Running setup.py install for docopt 23:09:45 INFO - Successfully installed blobuploader requests docopt 23:09:45 INFO - Cleaning up... 23:09:45 INFO - Return code: 0 23:09:45 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:09: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')]} 23:09:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09: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')]} 23:09:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:45 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:45 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 23:09:45 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 23:09:45 INFO - Using env: {'DISPLAY': ':0', 23:09:45 INFO - 'HOME': '/home/cltbld', 23:09:45 INFO - 'LANG': 'en_US.UTF-8', 23:09:45 INFO - 'LANGUAGE': 'en_US:en', 23:09:45 INFO - 'LOGNAME': 'cltbld', 23:09:45 INFO - 'MAIL': '/var/mail/cltbld', 23:09:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:45 INFO - 'MOZ_NO_REMOTE': '1', 23:09:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:45 INFO - 'NO_EM_RESTART': '1', 23:09:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:45 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:45 INFO - 'SHELL': '/bin/bash', 23:09:45 INFO - 'SHLVL': '1', 23:09:45 INFO - 'TERM': 'linux', 23:09:45 INFO - 'TMOUT': '86400', 23:09:45 INFO - 'USER': 'cltbld', 23:09:45 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:45 INFO - '_': '/tools/buildbot/bin/python'} 23:09:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:09:45 INFO - Running setup.py (path:/tmp/pip-yrzt6K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:09:45 INFO - Running setup.py (path:/tmp/pip-oocy2P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:09:45 INFO - Running setup.py (path:/tmp/pip-KTb5hM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:09:45 INFO - Running setup.py (path:/tmp/pip-YVMSC_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:09:45 INFO - Running setup.py (path:/tmp/pip-G1YbM9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:09:45 INFO - Running setup.py (path:/tmp/pip-HXeqGk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:09:45 INFO - Running setup.py (path:/tmp/pip-M0_Px3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:09:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:09:45 INFO - Running setup.py (path:/tmp/pip-Cypd6G-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:09:46 INFO - Running setup.py (path:/tmp/pip-LMLM_Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:09:46 INFO - Running setup.py (path:/tmp/pip-AoXePo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:09:46 INFO - Running setup.py (path:/tmp/pip-1zsYWv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:09:46 INFO - Running setup.py (path:/tmp/pip-0xv7xz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:09:46 INFO - Running setup.py (path:/tmp/pip-fhr9pX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:09:46 INFO - Running setup.py (path:/tmp/pip-wilR25-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:09:46 INFO - Running setup.py (path:/tmp/pip-W9qDmy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:09:46 INFO - Running setup.py (path:/tmp/pip-Uy0oLg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:09:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:09:46 INFO - Running setup.py (path:/tmp/pip-VFGIde-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:09:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:09:46 INFO - Running setup.py install for manifestparser 23:09:46 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 23:09:46 INFO - Running setup.py install for mozcrash 23:09:46 INFO - Running setup.py install for mozdebug 23:09:46 INFO - Running setup.py install for mozdevice 23:09:47 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for mozfile 23:09:47 INFO - Running setup.py install for mozhttpd 23:09:47 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for mozinfo 23:09:47 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for mozInstall 23:09:47 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for mozleak 23:09:47 INFO - Running setup.py install for mozlog 23:09:47 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for moznetwork 23:09:47 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 23:09:47 INFO - Running setup.py install for mozprocess 23:09:47 INFO - Running setup.py install for mozprofile 23:09:48 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 23:09:48 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 23:09:48 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 23:09:48 INFO - Running setup.py install for mozrunner 23:09:48 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 23:09:48 INFO - Running setup.py install for mozscreenshot 23:09:48 INFO - Running setup.py install for moztest 23:09:48 INFO - Running setup.py install for mozversion 23:09:48 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 23:09:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:09:48 INFO - Cleaning up... 23:09:48 INFO - Return code: 0 23:09:48 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:09:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 23:09:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 23:09:48 INFO - Using env: {'DISPLAY': ':0', 23:09:48 INFO - 'HOME': '/home/cltbld', 23:09:48 INFO - 'LANG': 'en_US.UTF-8', 23:09:48 INFO - 'LANGUAGE': 'en_US:en', 23:09:48 INFO - 'LOGNAME': 'cltbld', 23:09:48 INFO - 'MAIL': '/var/mail/cltbld', 23:09:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:48 INFO - 'MOZ_NO_REMOTE': '1', 23:09:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:48 INFO - 'NO_EM_RESTART': '1', 23:09:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:48 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:48 INFO - 'SHELL': '/bin/bash', 23:09:48 INFO - 'SHLVL': '1', 23:09:48 INFO - 'TERM': 'linux', 23:09:48 INFO - 'TMOUT': '86400', 23:09:48 INFO - 'USER': 'cltbld', 23:09:48 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:48 INFO - '_': '/tools/buildbot/bin/python'} 23:09:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:09:48 INFO - Running setup.py (path:/tmp/pip-B6_yDo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 23:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:09:48 INFO - Running setup.py (path:/tmp/pip-nueEyb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 23:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:09:48 INFO - Running setup.py (path:/tmp/pip-kHuMQR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 23:09:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:09:48 INFO - Running setup.py (path:/tmp/pip-LqcyKf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:09:49 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)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:09:49 INFO - Running setup.py (path:/tmp/pip-N6PHhY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:09:49 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)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:09:49 INFO - Running setup.py (path:/tmp/pip-qgjudM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:09:49 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)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:09:49 INFO - Running setup.py (path:/tmp/pip-xC36aw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:09:49 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)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:09:49 INFO - Running setup.py (path:/tmp/pip-qRgIDq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:09:49 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)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:09:49 INFO - Running setup.py (path:/tmp/pip-MqO7m_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:09:49 INFO - Running setup.py (path:/tmp/pip-matW19-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:09:49 INFO - Running setup.py (path:/tmp/pip-KrAoMv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:09:49 INFO - Running setup.py (path:/tmp/pip-wi5lOI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:09:49 INFO - Running setup.py (path:/tmp/pip-CpYeLB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:09:49 INFO - Running setup.py (path:/tmp/pip-uHtQD_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:09:49 INFO - Running setup.py (path:/tmp/pip-2CajsN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:09:49 INFO - Running setup.py (path:/tmp/pip-pXt1zs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 23:09:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:09:49 INFO - Running setup.py (path:/tmp/pip-ZgltiT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 23:09:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 23:09:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 23:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:51 INFO - Downloading blessings-1.6.tar.gz 23:09:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 23:09:51 INFO - Installing collected packages: blessings 23:09:51 INFO - Running setup.py install for blessings 23:09:52 INFO - Successfully installed blessings 23:09:52 INFO - Cleaning up... 23:09:52 INFO - Return code: 0 23:09:52 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 23:09:52 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:09:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:09:52 INFO - Reading from file tmpfile_stdout 23:09:52 INFO - Current package versions: 23:09:52 INFO - argparse == 1.2.1 23:09:52 INFO - blessings == 1.6 23:09:52 INFO - blobuploader == 1.2.4 23:09:52 INFO - docopt == 0.6.1 23:09:52 INFO - manifestparser == 1.1 23:09:52 INFO - mozInstall == 1.12 23:09:52 INFO - mozcrash == 0.17 23:09:52 INFO - mozdebug == 0.1 23:09:52 INFO - mozdevice == 0.48 23:09:52 INFO - mozfile == 1.2 23:09:52 INFO - mozhttpd == 0.7 23:09:52 INFO - mozinfo == 0.9 23:09:52 INFO - mozleak == 0.1 23:09:52 INFO - mozlog == 3.1 23:09:52 INFO - moznetwork == 0.27 23:09:52 INFO - mozprocess == 0.22 23:09:52 INFO - mozprofile == 0.28 23:09:52 INFO - mozrunner == 6.11 23:09:52 INFO - mozscreenshot == 0.1 23:09:52 INFO - mozsystemmonitor == 0.0 23:09:52 INFO - moztest == 0.7 23:09:52 INFO - mozversion == 1.4 23:09:52 INFO - psutil == 3.1.1 23:09:52 INFO - requests == 1.2.3 23:09:52 INFO - wsgiref == 0.1.2 23:09:52 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:52 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:52 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 23:09:52 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 23:09:52 INFO - Using env: {'DISPLAY': ':0', 23:09:52 INFO - 'HOME': '/home/cltbld', 23:09:52 INFO - 'LANG': 'en_US.UTF-8', 23:09:52 INFO - 'LANGUAGE': 'en_US:en', 23:09:52 INFO - 'LOGNAME': 'cltbld', 23:09:52 INFO - 'MAIL': '/var/mail/cltbld', 23:09:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:52 INFO - 'MOZ_NO_REMOTE': '1', 23:09:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:52 INFO - 'NO_EM_RESTART': '1', 23:09:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:52 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:52 INFO - 'SHELL': '/bin/bash', 23:09:52 INFO - 'SHLVL': '1', 23:09:52 INFO - 'TERM': 'linux', 23:09:52 INFO - 'TMOUT': '86400', 23:09:52 INFO - 'USER': 'cltbld', 23:09:52 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:52 INFO - '_': '/tools/buildbot/bin/python'} 23:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 23:09:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 23:09:52 INFO - Cleaning up... 23:09:52 INFO - Return code: 0 23:09:52 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 23:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 23:09:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 23:09:52 INFO - Using env: {'DISPLAY': ':0', 23:09:52 INFO - 'HOME': '/home/cltbld', 23:09:52 INFO - 'LANG': 'en_US.UTF-8', 23:09:52 INFO - 'LANGUAGE': 'en_US:en', 23:09:52 INFO - 'LOGNAME': 'cltbld', 23:09:52 INFO - 'MAIL': '/var/mail/cltbld', 23:09:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:52 INFO - 'MOZ_NO_REMOTE': '1', 23:09:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:52 INFO - 'NO_EM_RESTART': '1', 23:09:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:52 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:52 INFO - 'SHELL': '/bin/bash', 23:09:52 INFO - 'SHLVL': '1', 23:09:52 INFO - 'TERM': 'linux', 23:09:52 INFO - 'TMOUT': '86400', 23:09:52 INFO - 'USER': 'cltbld', 23:09:52 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:52 INFO - '_': '/tools/buildbot/bin/python'} 23:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:52 INFO - Downloading/unpacking jsonschema 23:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:54 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:09:54 INFO - Downloading/unpacking functools32 (from jsonschema) 23:09:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:54 INFO - Downloading functools32-3.2.3-2.tar.gz 23:09:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 23:09:54 INFO - warning: no files found matching '*.txt' 23:09:54 INFO - no previously-included directories found matching 'build' 23:09:54 INFO - no previously-included directories found matching 'dist' 23:09:54 INFO - no previously-included directories found matching '.git*' 23:09:54 INFO - Installing collected packages: jsonschema, functools32 23:09:54 INFO - Running setup.py install for functools32 23:09:54 INFO - warning: no files found matching '*.txt' 23:09:54 INFO - no previously-included directories found matching 'build' 23:09:54 INFO - no previously-included directories found matching 'dist' 23:09:54 INFO - no previously-included directories found matching '.git*' 23:09:54 INFO - Successfully installed jsonschema functools32 23:09:54 INFO - Cleaning up... 23:09:55 INFO - Return code: 0 23:09:55 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 23:09:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:09:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:09:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:09:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:09:55 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 0x7ff7473d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a7f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, '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': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', '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 23:09:55 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 23:09:55 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 23:09:55 INFO - Using env: {'DISPLAY': ':0', 23:09:55 INFO - 'HOME': '/home/cltbld', 23:09:55 INFO - 'LANG': 'en_US.UTF-8', 23:09:55 INFO - 'LANGUAGE': 'en_US:en', 23:09:55 INFO - 'LOGNAME': 'cltbld', 23:09:55 INFO - 'MAIL': '/var/mail/cltbld', 23:09:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:09:55 INFO - 'MOZ_NO_REMOTE': '1', 23:09:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:09:55 INFO - 'NO_EM_RESTART': '1', 23:09:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:09:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:09:55 INFO - 'PWD': '/builds/slave/test-pgo', 23:09:55 INFO - 'SHELL': '/bin/bash', 23:09:55 INFO - 'SHLVL': '1', 23:09:55 INFO - 'TERM': 'linux', 23:09:55 INFO - 'TMOUT': '86400', 23:09:55 INFO - 'USER': 'cltbld', 23:09:55 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:09:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:09:55 INFO - '_': '/tools/buildbot/bin/python'} 23:09:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:09:55 INFO - Downloading/unpacking flake8 23:09:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:09:57 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:09:57 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:09:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:09:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 23:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:09:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:09:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:09:57 INFO - no previously-included directories found matching 'docs/_build' 23:09:57 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:09:57 INFO - Running setup.py install for pep8 23:09:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:09:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:09:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:09:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:09:58 INFO - no previously-included directories found matching 'docs/_build' 23:09:58 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 23:09:58 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:09:58 INFO - Cleaning up... 23:09:58 INFO - Return code: 0 23:09:58 INFO - Running post-action listener: _resource_record_post_action 23:09:58 INFO - Running post-action listener: _start_resource_monitoring 23:09:58 INFO - Starting resource monitoring. 23:09:58 INFO - ##### 23:09:58 INFO - ##### Running install step. 23:09:58 INFO - ##### 23:09:58 INFO - Running pre-action listener: _resource_record_pre_action 23:09:58 INFO - Running main action method: install 23:09:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:09:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:09:58 INFO - Reading from file tmpfile_stdout 23:09:58 INFO - Detecting whether we're running mozinstall >=1.0... 23:09:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 23:09:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 23:09:58 INFO - Reading from file tmpfile_stdout 23:09:58 INFO - Output received: 23:09:58 INFO - Usage: mozinstall [options] installer 23:09:58 INFO - Options: 23:09:58 INFO - -h, --help show this help message and exit 23:09:58 INFO - -d DEST, --destination=DEST 23:09:58 INFO - Directory to install application into. [default: 23:09:58 INFO - "/builds/slave/test-pgo"] 23:09:58 INFO - --app=APP Application being installed. [default: firefox] 23:09:58 INFO - mkdir: /builds/slave/test-pgo/build/application 23:09:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 23:09:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 23:10:14 INFO - Reading from file tmpfile_stdout 23:10:14 INFO - Output received: 23:10:14 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 23:10:14 INFO - Running post-action listener: _resource_record_post_action 23:10:14 INFO - ##### 23:10:14 INFO - ##### Running run-tests step. 23:10:14 INFO - ##### 23:10:14 INFO - Running pre-action listener: _resource_record_pre_action 23:10:14 INFO - Running main action method: run_tests 23:10:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 23:10:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 23:10:14 INFO - Python 2.7.3 23:10:14 INFO - Return code: 0 23:10:14 INFO - grabbing minidump binary from tooltool 23:10:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:10:14 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bda8b0>, '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 0x2bdb7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bdbc60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 23:10:14 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 23:10:14 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 23:10:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:10:14 INFO - Return code: 0 23:10:14 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 23:10:14 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 23:10:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 23:10:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 23:10:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 23:10:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 23:10:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 23:10:15 INFO - Return code: 0 23:10:15 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--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 23:10:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-069 --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 23:10:15 INFO - Using env: {'DISPLAY': ':0', 23:10:15 INFO - 'HOME': '/home/cltbld', 23:10:15 INFO - 'LANG': 'en_US.UTF-8', 23:10:15 INFO - 'LANGUAGE': 'en_US:en', 23:10:15 INFO - 'LOGNAME': 'cltbld', 23:10:15 INFO - 'MAIL': '/var/mail/cltbld', 23:10:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:10:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 23:10:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:10:15 INFO - 'MOZ_NO_REMOTE': '1', 23:10:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:10:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:10:15 INFO - 'NO_EM_RESTART': '1', 23:10:15 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:10:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:10:15 INFO - 'PWD': '/builds/slave/test-pgo', 23:10:15 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 23:10:15 INFO - 'SHELL': '/bin/bash', 23:10:15 INFO - 'SHLVL': '1', 23:10:15 INFO - 'TERM': 'linux', 23:10:15 INFO - 'TMOUT': '86400', 23:10:15 INFO - 'USER': 'cltbld', 23:10:15 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566', 23:10:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:10:15 INFO - '_': '/tools/buildbot/bin/python'} 23:10:15 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--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 23:10:16 INFO - mozversion application_buildid: 20160403203111 23:10:16 INFO - mozversion application_changeset: fc4a988ca8d61e809bb30ef635ad50e189f742b3 23:10:16 INFO - mozversion application_display_name: Nightly 23:10:16 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:10:16 INFO - mozversion application_name: Firefox 23:10:16 INFO - mozversion application_remotingname: firefox 23:10:16 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 23:10:16 INFO - mozversion application_vendor: Mozilla 23:10:16 INFO - mozversion application_version: 48.0a1 23:10:16 INFO - mozversion platform_buildid: 20160403203111 23:10:16 INFO - mozversion platform_changeset: fc4a988ca8d61e809bb30ef635ad50e189f742b3 23:10:16 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 23:10:16 INFO - mozversion platform_version: 48.0a1 23:10:16 INFO - using testdate: 1459750216 23:10:16 INFO - actual date: 1459750216 23:10:16 INFO - starting webserver on 'localhost:34165' 23:10:16 INFO - SUITE-START | Running 2 tests 23:10:16 INFO - TEST-START | dromaeo_css 23:10:16 INFO - operating with platform_type : linux_ 23:10:16 INFO - Initialising browser for dromaeo_css test... 23:10:16 INFO - TEST-INFO | started process 10821 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvnqwe4/profile http://localhost:34165/getInfo.html) 23:10:20 INFO - PROCESS | 10821 | 23:10:20 INFO - PROCESS | 10821 | (process:10889): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:10:20 INFO - PROCESS | 10821 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 23:10:21 INFO - PROCESS | 10821 | __metrics Screen width/height:1600/1200 23:10:21 INFO - PROCESS | 10821 | colorDepth:24 23:10:21 INFO - PROCESS | 10821 | Browser inner width/height: 1024/697 23:10:21 INFO - PROCESS | 10821 | __metrics 23:10:22 ERROR - PROCESS | 10821 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 23:10:23 INFO - TEST-INFO | 10821: exit 0 23:10:23 INFO - Browser initialized. 23:10:23 INFO - Running cycle 1/1 for dromaeo_css test... 23:10:23 INFO - TEST-INFO | started process 10940 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvnqwe4/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:10:24 INFO - PROCESS | 10940 | 23:10:24 INFO - PROCESS | 10940 | (process:10999): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:10:34 INFO - PROCESS | 10940 | RSS: Main: 163065856 23:10:34 INFO - PROCESS | 10940 | 23:11:24 INFO - PROCESS | 10940 | 1459750284419 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 23:13:31 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34165/tests/dromaeo/cssquery-ext.html) 23:13:32 INFO - PROCESS | 10940 | RSS: Main: 168591360 23:13:32 INFO - PROCESS | 10940 | 23:16:34 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-ext.html (next: http://localhost:34165/tests/dromaeo/cssquery-jquery.html) 23:16:35 INFO - PROCESS | 10940 | RSS: Main: 165244928 23:16:35 INFO - PROCESS | 10940 | 23:19:36 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34165/tests/dromaeo/cssquery-mootools.html) 23:19:37 INFO - PROCESS | 10940 | RSS: Main: 166543360 23:19:37 INFO - PROCESS | 10940 | 23:22:38 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34165/tests/dromaeo/cssquery-prototype.html) 23:22:39 INFO - PROCESS | 10940 | RSS: Main: 164188160 23:22:39 INFO - PROCESS | 10940 | 23:25:41 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34165/tests/dromaeo/cssquery-yui.html) 23:25:42 INFO - PROCESS | 10940 | RSS: Main: 165179392 23:25:42 INFO - PROCESS | 10940 | 23:28:44 INFO - PROCESS | 10940 | Cycle 1(1): loaded http://localhost:34165/tests/dromaeo/cssquery-yui.html (next: http://localhost:34165/tests/dromaeo/cssquery-dojo.html) 23:28:45 INFO - PROCESS | 10940 | RSS: Main: 167534592 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | __start_tp_report 23:28:45 INFO - PROCESS | 10940 | _x_x_mozilla_page_load 23:28:45 INFO - PROCESS | 10940 | _x_x_mozilla_page_load_details 23:28:45 INFO - PROCESS | 10940 | |i|pagename|runs| 23:28:45 INFO - PROCESS | 10940 | |0;dojo.html;3075.7231849133573;3158.5735925650047;3167.8891238806646;3178.777485576011;3191.489361702128;5357.812476563321;5372.194170874371;5411.188321751739;5432.701201433924;5455.699936503491;5380.838574842751;5444.183372494118;5469;5483.835484935448;5517.862053448665;4761.785719642625;4973.52751488608;5047.520485553867;5205.531502164805;5206.661566998152;5090.05833920724;5107.208382700687;5125.794968201268;5161.535461808437;5176.171812509999;4938.086454006002;5000.199968005102;5011.498850114959;5012.799488020493;5023.221400682882;4980.626453016038;4987.202047672391;4987.5511203991455;5006.2740902569285;5030.773615187289;4903.65674402792;4945.208766597363;4957.454679985199;4971.304017437562;4991.301217829507;5336.332958380202;5404.486573775524;5420.593455490854;5449.972750136264;5463.426340234258;5799.565032622528;5825.776586916752;5832.6792026438525;5837.153612726131;5843.795467158671;5735.713214339308;5882.970585147047;5883.823485295448;5903.439173278532;5933.465988061095;5411.134218525017;5431.158170483582;5435.619506634537;5446.210299506589;5482.479164479368;5893.204417403681;5919.67441790697;5933.792317268875;5964.403559644088;5965.194698715704;5645.745941432645;5699.601027928088;5717.656940583578;5743.195952566561;5752.223449834219;5666.801661941812;5908.261467316585;5941.821745347646;5946.583739138306;5948.464638182498;5791.102379131242;5835.941640583625;5840.1239814027385;5840.269966254218;5846.766129354778;5756.625819321815;5819.88360232793;5879.147523609053;5946.85132871673;5971.910421343683;4424.3142312941545;4424.911501769947;4445.222086134913;4464.6428285737065;4484.68607197493;3918.45141680165;3960.6237407446824;3962.9009274767786;3993.0416699992375;4016.975671203883;5494.09347457665;5603.467670571289;5619.213310136584;5685.857853553694;5692.37383887772;5901.557383196277;5964.105384192319;5966.254218222723;5968.85077873048;5978.133170690226;5605.243292155588;5675.262215911987;5684.204211410406;5686.2039314496005;5688.715564221772;4922.458529561745;5090.160123579642;5117.053345131163;5127.692338459704;5158.174692049254;6097.603655762361;6100.603460775035;6102.938970610237;6103.938960610426;6105.328413874559;5757.6545407274025;5929;5931.406859314034;5932.406759324033;5932.762689492544;6063.060225665029;6067.423594758491;6088.817335479943;6113.786017489367;6128.540359472968;5580.135079062752;5615.410381910004;5643.576731745054;5656.773729050792;5667.206591077335;5670.659760414388;5740.540756739534;5751.309842818889;5783.16144159103;5911.645301281765;5676.744546495335;5719.685417302088;5728.971355143198;5786.42135786418;5830.9416905832095;5695.686737229492;5701.344345400332;5703.372629010722;5703.942960570341;5749.683767392834;5505.394406615349;5597.384287728265;5617.522510586646;5624.803131890364;5627.803026894039;5838.503727183237;5839.15332276809;5845.152452894392;5874.177615133799;5894.911576326444;5628.774849005994;5648.915266270927;5654.660720356792;5657.801976930952;5658.17956396312 23:28:45 INFO - PROCESS | 10940 | |1;ext.html;522.8431470558834;536.2813829468512;560.6720068759776;562.3589108416409;586.2671660424469;29657;38182.61817381826;38362.23275534488;38756.806215968914;38803.22393552127;41643.37534936971;42085.94785130366;42128.36807447891;42171.156576868445;42172.36741448881;8705.564721763918;8826.64693412266;8876.822463550725;8894.688685895962;8911;8612.48325100496;8797.516136612483;8801.251893589053;8803.735887923373;8815.206631403173;8792.208701216889;8877.156670116361;8882.733517994471;8885.333599980027;8898.37711360205;8677.652893884237;8684.696035638723;8753.037165911777;8897.955510222473;8909.420887642282;8842.425242359226;8950.955245223733;8973.685920992733;8980.236679882219;8988.235999940012;41630;42044.78977605123;42097.15805683869;42173;42212;3411.4200585900458;3514.5431093957877;4105.651019663333;4113.45970812183;4206.41110244566;31644.683553164403;31710.365792684246;31804.522932156036;32007;33149.83425082883;3971.4241434991764;3983.920321593581;4018.0758425561994;4021.698372622036;4060.0661847775177;314823;316868;317827.41086294653;318564;318760;47852.521474785506;48255;48492;48718.512814872105;58678.413215868146;46699.76650116728;46751.766241168574;46840;46937;46980.5301946983;15958.281877315549;16212.513624591282;16218.918905405397;16280.837191627932;16302.755458668129;12792.552260670831;12954;12997.350132493337;13000.349982500837;13094.934525327313;15442.922785386001;15472.14903180336;15510.844891551165;15609.453669121527;15940.123293218752;5974;6158.1686472326555;6244.968775156095;6312.968435157886;6328.525360597973;1036.8081904847627;1076.956921723138;1086.3861918016296;1109.8890110988837;1172.5720112159001;30406.239844004078;30446.238844028634;31262.531062034086;31560.210994724857;31693.366132677216;1123.8763735989035;1131.4738646529404;1142.520141540555;1200.4897918384652;1237.5359240284893;15459.63716668248;15977.201139942956;16107.19464026794;16350.75473867893;16377.508674739776;443345;448666;450262;451149;451453;54916;55794;56275.718621407446;56327.155092673645;56350.718246408505;1343.684234204961;1376.5732622886937;1388.2434073430004;1394.3446580107334;1404.557564367221;30563.2359191022;30680.846595766878;31130;31387.372252555277;31724;49236.75381623069;49494.99999999856;49673;49920;50053.24920126274;404169;405597;408608;409245;410845;36456.27087458289;37060.6293937068;37280.62719372771;37297;37469;46249.76875115603;46465.767671161426;46578.767106164254;47415.762921185174;47776.56670299896;38967;39935.60064399319;39952.8002359998;40061.79969100136;40122.79938600288;38601.227975439775;39086.6091339083;39888;40152.1969560613;40304.99237519086;41088.38367424551;41174;43777.34333984929;44252;44719.776401117786;33905.66094339025;35025.64974350326;35346.823265883504;35674.643253567134;35818.462723058656;27657.86171069132;27894.3026424341;28039;28074.2981425466;28306.57540136941 23:28:45 INFO - PROCESS | 10940 | |2;jquery.html;364.9233660931204;365.5795834789991;366.2692927609419;380.51104330934754;382.8028565288877;17246.82753172468;17259.56851078722;17729.113544322798;17761.7335739964;17811;17039.82960170398;17537.824621753778;17748;17923.283068677236;18053.187606557705;5374.844408452182;5683.460071293221;5686.630369026021;5689.203511508392;5691.630044047144;4256.510501292345;5497.890042199154;6052.848678783022;6342.873142537146;6346.238451385841;6259.718312675917;6273;6273.184486016811;6275.592086514384;6298.433141017307;5999.640021598718;6125.326214116488;6161.229846269239;6167.537434692371;6198.2252218472695;5397.568194544467;5423.240746295522;5429.131338985783;5447.700376479292;5449.482299181572;19533.609327813505;20246.797532024637;20375.08312125958;20400;21531.461713457287;2163.7619861815188;2204.9746867706594;2249.403907964391;2352.8235382346393;2545.6563363945816;9426.245900327956;9717.271204659679;9748.31761776676;10086.49567521621;10197.388156710547;1736.9913150434293;1748.591412473284;1796.1917137288272;1811.7191835265555;1907.4849790556473;70077;70147;72843;73922.26077739154;74037;9681.66114186;9918.900810991941;10013.749656258506;10447.791044179074;10896.945515272531;12730.936345318214;12985.155964862253;12987.350632468528;13015.414306356237;13043.152195107288;7504.137024242282;7583.2416758323725;7602;7608.923910760932;7713.65288562016;7717.2282771722375;7745.496542724705;7752.341051010614;7845.882311765328;7943.801404964806;4015.819288132041;4045.211183819186;4078.8368465261055;4100.405441211008;4101.52832424269;1791.8566514678794;1835.1367381216885;1886.8679192456395;1899.5820919397986;1943.4461178564325;900.2482926756101;971.9416834989923;995.2784231432298;1011.726833754882;1012.9566546457161;15632.531024069296;18041;18228.27086916535;18367.17347719356;18585.81414185868;973.9853902191472;981.955936596545;985.8888435225128;1034.8809886862957;1066.4987455895716;10283.897161028444;10300.845487317696;10308.587656493657;10441.164706823587;10443.321184123008;396399;401702;404314;530676;537800;75541;78239;78928.60535697285;79559;80620;1075.8601381820313;1085.0939465546198;1102.6306187427301;1111.8499002634703;1119.238917536067;15817;16002.599935001717;16005.759913601072;16171.514854554382;16495.092769897772;37104.25791484209;37377.62622373742;37556.436653450764;38071;39902.40146397748;53898.461015389345;54697.453025469236;55310.44689553053;55461.44538554563;55716.44283557113;8178.1412951641605;8253.422260441712;8341.582920853813;8358.832823343377;8427.030891447317;11691.824622630496;12344.259344439362;12781.872181278068;13125.212487250414;13260.204387736767;11144.777104458028;11407.372594507382;11694.47374868116;11832.408379580815;11891.881081189424;11359.886401136213;11534.884651153718;11682.591109311134;11931.940340298243;12059.577914773292;7370.078740157481;10100.696979090639;11980.58067967617;11980.880191197977;12042.939785301018;8323.799913075267;8408.36937229698;8427.95786021066;8486.10895855951;8653.61058752345;8989.910100898907;10899.509522071367;11000.449977501254;11713;11814.113941454254 23:28:45 INFO - PROCESS | 10940 | |3;mootools.html;1441.7693169092945;1471.1834931612955;1616.8302328255534;1737.027264731751;1788.061267834386;7026.85946281074;7930;8014.8797768033455;8225;8268.255856972879;7929.405294602899;7976.242256985592;7996.400269979746;8032.357411407088;8039.236272554098;2257.4582100295975;2267.7278726552836;2271.2958982715413;2286.4741109544816;2287.2680742162433;2162.762096169428;2176.81497072749;2197.3847322749657;2217.944551386212;2219.5449932763745;2266.5693518231483;2267.183813827021;2269.6255117905607;2281.543691261746;2292.4039749665126;2205.558888222362;2212.557488502306;2221.466847956487;2230.3754948614333;2232.7097477328007;2171.3268886645033;2172.348295511356;2179.400664817172;2180.4221881201493;2200.4168895242774;8217.79455513611;8309.626066827008;8312.54281014544;8329.583520823995;8337.583120843934;4996.125678006334;5145.3568303962;5147.3051138096625;5161.8193363232485;5167.896642067138;3154.479510880702;3184.6656101109515;3255.511673249008;3273.9508907366408;3274.3287626036604;1032.8863824979246;1054.225144518778;1984.2559040359865;1987.423647142327;2015.5162760937417;11186.552537898475;11188.44057797115;11273.661790146309;11279.097672186206;11291.943540282327;4097.119119389286;4208.6633069354375;4250.936235956463;4262.87211383659;4305.117450922553;9046.773830654287;9081.863772043425;9126.49804260772;9127.041660625671;9140.131687489678;4990.525900039491;5001.624878134155;5005.674631148963;5006.274090256965;5023.522765337287;4120.093579412524;4559.0881823634745;4639.816846704136;4671.462781780071;4673.205555055649;3623.3477973964414;3652.4886515887797;3692.630736926286;3694.649008344203;3730.8321125549414;1088.5754555723274;1089.1885545268826;1091.8034753744403;1094.1356328500556;1108.684025052856;1399.5521433141298;1399.839018512884;1422.1396055386342;1433.6415896025994;1444.1335198880797;7948.364130869517;8002.51984880909;8064.919350806535;8080.9191908080165;8090.7168249111;1064.9467526623637;1137.184745179926;1183.2722875431548;1186.9347185904685;1192.1237890150733;6081.878362432726;6125.479334256549;6148.569600128038;6151.876962460815;6176.505879529627;9562.330636855353;10055.547500362502;10128.848067278997;10143.543540540693;10364.792704145875;9955.253355998184;10131.898681013243;10134.645287414905;10266.332688375232;10283.280170388001;7676.6161691916295;7783.143854176036;7816.218378162138;7835.255650713173;7887.053553573608;7522.398208143445;7557;7589.165191828784;7641;7689.50018248812;8944.731658050268;8957.955210223907;9047.728568142966;9075.546222688707;9089.136532029446;9143.588538515649;9169.724908252496;9240.399374040666;9335.439873607605;9425.575849086945;6169.290531588925;6794.966025170041;6948.478864085113;7099.858002840017;7224.602646854263;7724.227577242231;7777.57223352721;7794.337481314152;7812.296893279632;7826.882596760939;6784.3894049535775;7086.539374940612;7144.214136444883;7210.9278907210255;7318.853622927618;7090.645467726697;7092.893606596009;7120.928790712027;7175.138983322035;7192.42460603161;7478.214787447458;7639.312461878458;7643.273888980538;7645.1972542882195;7667.846643067219;6890.931090689029;6905.861882762417;6937.236903940461;6974.302569742985;6989.091418115612;6853.7943861684225;6916.55042422241;7015.333543313377;7033.507654464139;7034.472414568825 23:28:45 INFO - PROCESS | 10940 | |4;prototype.html;332.86685325869666;332.88016314126924;336.62970732194583;344.9879254226102;346.75726991106245;6359.395857393546;6433.549651524383;6434.549581529289;6457.160569126007;6460.967695161524;6303.7478500860025;6345.841353966153;6347.301796802348;6366.936330636692;6379.17070780799;4669.696469729473;4738.976305118486;4779;4805.303231031498;4860.027994401125;4728.90542189156;4756.500567440421;4758.095961767271;4761.59526440253;4771.403574553181;4702.835400760974;4742.620590352781;4753.310769938357;4754.096721622898;4757.310190022445;4705.058988202356;4721.952780472186;4754.263089221159;4759.357486739281;4765.332853400527;4143.937840932388;4168.416421700964;4169.874903752892;4172.18642364739;4173.624373806341;6120.785772497986;6135.294441139282;6138.7237574309265;6140.539459540508;6147.907781383283;5351.946480535223;5501.752421141058;5530.225768392428;5530.253415788858;5558.166275058733;6590.352411897025;6656.733730650768;6665;6668.7665931692645;6673.0991316172185;4531.501534831166;4535.7732113394195;4538.069695712371;4542.772861356919;4543.250363689987;6976.5814051156585;6988.056612357368;7005.614691191982;7061.1526616805795;7062.717491300342;4524.09518096382;4538.659600529973;4621.491635920046;4622.607078398307;4648.651351148677;4667.066586682677;4668.393108895822;4669.066186762661;4678;4685.20351540239;5429.837104886859;5453.836384908459;5500.58745594082;5520.227168196456;5529.861753456195;6764.222114456802;6782.914733642593;6787.966060169668;6789.694463749143;6797.5581587196675;1609.2597405193742;1626.764119202709;1642.2035312873247;1668.5745134990743;1670.2734310574938;1073.2701762801214;1074.8441475986094;1083.247143235444;1083.8916108389255;1089.7330154112135;6377.0434434834215;6384.840378990562;6462.159919210567;6482.157319548429;6496.707648155844;6838.1794184697155;6882.827929301708;6900.516963812485;6903.964405339239;6931.584104953719;6429.485641148697;6433.4209921106385;6462.838429039311;6472.935270647327;6473.190851143607;3692.9446058309145;3706.6849317808287;3716.479692843004;3742.66316031553;3745.1198968242443;7055.400290975324;7151.213366529678;7182.389496892718;7270.927290727025;7300;7182.461315401366;7188.568685878864;7194.532355396987;7199.496035277481;7210.242924492957;7243.384312333405;7295.234000429985;7304.707811687579;7307.634618269065;7323.633818309063;6957.652117394009;6966.5471744336455;7042.330978557029;7064.198629349483;7079.716811327489;6937.82655433598;6938.514303998873;6947.617881016593;6959.512834101564;6965.328321202976;7198.748043818441;7242.637868106468;7260.310270524292;7275.818104547428;7295.124585049616;4616.44602647671;4639.652026097989;4646.605038571624;4650.86047418578;4664.4869064403565;6985.091938048021;6993.510454268356;7045.11936007999;7052.541584796972;7061.858762824612;6649.534532582867;6906.758263460755;6913.446924245947;6919.550229235084;6925.549839260432;6838.589684618939;6863.313668633096;6865.5537390069485;6870.965645171942;6880.483963702843;6694.330566943267;6738.35985581369;6740.494462915203;6745.190577130776;6753.986901964745;6672.566283191577;6868.416184624363;6894.827629309107;6900.896486552806;6900.965495172492;6694.029365742038;6731.899021514583;6734.831629209309;6777.186737591323;6788.558743681645 23:28:45 INFO - PROCESS | 10940 | |5;yui.html;736.8047467421131;780.0483410239508;800.951942883427;847.1909326593104;851.3870013590213;13615.727685446298;13807.378667959942;13832;13870.375833087497;13920.582382528515;12819.871801281985;12865.807012894815;12929.482820687184;12939.870601293984;12950.352482375867;674.689642764329;797.1072398913225;810.3395732478041;811.5577010529246;813;798.8681867491857;807.2532907060975;810.9432339736221;813.3737022492677;814.5519964019795;840.7687885831384;844.0630899701326;845.0113367360173;845.7927807687095;850.0734199722301;834.6828205282014;841.4824882697159;842.073718909195;842.9536375499345;847.1740053447901;614.5483069943588;619.1857707115129;619.5136817598163;619.7335145887266;620.9720562574695;13438.260895650736;13443.865561344359;13458.528951486749;13470;13495.257760823151;13545.45818167282;13903.235322057282;13971.161730296113;14001.369938352696;14359.497417590333;10643.893561064368;10662.253642245047;10678.78642427155;10787.190960677981;10825;3772.3775577029755;3800.4489349044234;3824.4740605838692;3831.2912111259507;3840.2703486337787;53221.20168197442;53329;53551.464485355034;53648.19527707049;53696.194557081675;10636.361818290927;10689.30519516229;10929.016388525071;10949.343039417661;10989.945050274857;19125.426237212905;19161.808381916002;19234.519137021685;19416;19432.70850937237;7942.880856787153;8136.267735903797;8303.501789892625;8407.201315874981;8413.284870785928;4555.362249285103;4609.516000819865;4612.769361531977;4636.374089497942;4736.976315118402;3332.3835090508333;3342.9498557521656;3356.060303115132;3358.143673363277;3359.714424273964;607.3471018654875;625.0717684238992;626.2985456288894;628.1833616298885;631.0597210156925;637.996810015947;662.595816551903;678.6233640329665;707.1090426063197;709.8296408861836;9478.38390504615;9584.472853992958;9605.087516685904;9622.615095396246;9625.71122866315;616.5653214483779;699.6222040098392;755.6221889055472;756.4969295418595;769.8922150898767;4419.756913369732;4461.866144015685;4469.7318160910445;4507.18870603288;4533.909321813545;66610;66777.66611166912;68020.6598967012;68448.31551684519;69289;59545;60079.39920600825;60141.39858601445;60766.392336076075;60885.91140885876;48990.75504622454;49084.75457622689;49540.50459495503;50967.74516127395;54450.727746361015;9682.515874206403;9799.216062714822;9799.265055120752;9857.654982075594;10038.749031274276;39348.80325598468;40453.1909361817;40469.39295910505;41404.378934315406;41487;47892.521074788805;51955;53926.416254618794;54091.45908540864;54327.72836135794;10951.604565156827;11673.824892626788;12074.154809163274;12375.443105060114;12588.30764307972;12984.415701293654;13183.640260358452;13363.26502042397;13570.525031623845;13910.165390076629;13347.199168049949;13356.532521361705;13448.394822233218;13656.522021729192;14174.645633859236;13097.738045239232;13226.272555009567;13521.729565408834;13622.250776207404;13706.109102908278;12707.809382859079;12864.614061578168;12908.612741617766;12958.28729419891;13002.609921702364;10185.410409789509;10646;10741;10956.068734157687;10977.176711746491;11076.461769115442;11110.666679999613;11368.431578421212;11494;11547.133964952494 23:28:45 INFO - PROCESS | 10940 | __end_tp_report 23:28:45 INFO - PROCESS | 10940 | __start_cc_report 23:28:45 INFO - PROCESS | 10940 | _x_x_mozilla_cycle_collect,327 23:28:45 INFO - PROCESS | 10940 | __end_cc_report 23:28:45 INFO - PROCESS | 10940 | __startTimestamp1459751325054__endTimestamp 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | ------- Summary: start ------- 23:28:45 INFO - PROCESS | 10940 | Number of tests: 6 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#0] dojo.html Cycles:165 Average:5446.34 Median:5657.80 stddev:620.93 (11.0%) stddev-sans-first:594.33 23:28:45 INFO - PROCESS | 10940 | Values: 3075.7 3158.6 3167.9 3178.8 3191.5 5357.8 5372.2 5411.2 5432.7 5455.7 5380.8 5444.2 5469.0 5483.8 5517.9 4761.8 4973.5 5047.5 5205.5 5206.7 5090.1 5107.2 5125.8 5161.5 5176.2 4938.1 5000.2 5011.5 5012.8 5023.2 4980.6 4987.2 4987.6 5006.3 5030.8 4903.7 4945.2 4957.5 4971.3 4991.3 5336.3 5404.5 5420.6 5450.0 5463.4 5799.6 5825.8 5832.7 5837.2 5843.8 5735.7 5883.0 5883.8 5903.4 5933.5 5411.1 5431.2 5435.6 5446.2 5482.5 5893.2 5919.7 5933.8 5964.4 5965.2 5645.7 5699.6 5717.7 5743.2 5752.2 5666.8 5908.3 5941.8 5946.6 5948.5 5791.1 5835.9 5840.1 5840.3 5846.8 5756.6 5819.9 5879.1 5946.9 5971.9 4424.3 4424.9 4445.2 4464.6 4484.7 3918.5 3960.6 3962.9 3993.0 4017.0 5494.1 5603.5 5619.2 5685.9 5692.4 5901.6 5964.1 5966.3 5968.9 5978.1 5605.2 5675.3 5684.2 5686.2 5688.7 4922.5 5090.2 5117.1 5127.7 5158.2 6097.6 6100.6 6102.9 6103.9 6105.3 5757.7 5929.0 5931.4 5932.4 5932.8 6063.1 6067.4 6088.8 6113.8 6128.5 5580.1 5615.4 5643.6 5656.8 5667.2 5670.7 5740.5 5751.3 5783.2 5911.6 5676.7 5719.7 5729.0 5786.4 5830.9 5695.7 5701.3 5703.4 5703.9 5749.7 5505.4 5597.4 5617.5 5624.8 5627.8 5838.5 5839.2 5845.2 5874.2 5894.9 5628.8 5648.9 5654.7 5657.8 5658.2 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#1] ext.html Cycles:180 Average:55133.98 Median:222237.00 stddev:104280.87 (46.9%) stddev-sans-first:104492.80 23:28:45 INFO - PROCESS | 10940 | Values: 522.8 536.3 560.7 562.4 586.3 29657.0 38182.6 38362.2 38756.8 38803.2 41643.4 42085.9 42128.4 42171.2 42172.4 8705.6 8826.6 8876.8 8894.7 8911.0 8612.5 8797.5 8801.3 8803.7 8815.2 8792.2 8877.2 8882.7 8885.3 8898.4 8677.7 8684.7 8753.0 8898.0 8909.4 8842.4 8951.0 8973.7 8980.2 8988.2 41630.0 42044.8 42097.2 42173.0 42212.0 3411.4 3514.5 4105.7 4113.5 4206.4 31644.7 31710.4 31804.5 32007.0 33149.8 3971.4 3983.9 4018.1 4021.7 4060.1 314823.0 316868.0 317827.4 318564.0 318760.0 47852.5 48255.0 48492.0 48718.5 58678.4 46699.8 46751.8 46840.0 46937.0 46980.5 15958.3 16212.5 16218.9 16280.8 16302.8 12792.6 12954.0 12997.4 13000.3 13094.9 15442.9 15472.1 15510.8 15609.5 15940.1 5974.0 6158.2 6245.0 6313.0 6328.5 1036.8 1077.0 1086.4 1109.9 1172.6 30406.2 30446.2 31262.5 31560.2 31693.4 1123.9 1131.5 1142.5 1200.5 1237.5 15459.6 15977.2 16107.2 16350.8 16377.5 443345.0 448666.0 450262.0 451149.0 451453.0 54916.0 55794.0 56275.7 56327.2 56350.7 1343.7 1376.6 1388.2 1394.3 1404.6 30563.2 30680.8 31130.0 31387.4 31724.0 49236.8 49495.0 49673.0 49920.0 50053.2 404169.0 405597.0 408608.0 409245.0 410845.0 36456.3 37060.6 37280.6 37297.0 37469.0 46249.8 46465.8 46578.8 47415.8 47776.6 38967.0 39935.6 39952.8 40061.8 40122.8 38601.2 39086.6 39888.0 40152.2 40305.0 41088.4 41174.0 43777.3 44252.0 44719.8 33905.7 35025.6 35346.8 35674.6 35818.5 27657.9 27894.3 28039.0 28074.3 28306.6 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#2] jquery.html Cycles:180 Average:26755.21 Median:37240.94 stddev:75465.06 (202.6%) stddev-sans-first:75650.74 23:28:45 INFO - PROCESS | 10940 | Values: 364.9 365.6 366.3 380.5 382.8 17246.8 17259.6 17729.1 17761.7 17811.0 17039.8 17537.8 17748.0 17923.3 18053.2 5374.8 5683.5 5686.6 5689.2 5691.6 4256.5 5497.9 6052.8 6342.9 6346.2 6259.7 6273.0 6273.2 6275.6 6298.4 5999.6 6125.3 6161.2 6167.5 6198.2 5397.6 5423.2 5429.1 5447.7 5449.5 19533.6 20246.8 20375.1 20400.0 21531.5 2163.8 2205.0 2249.4 2352.8 2545.7 9426.2 9717.3 9748.3 10086.5 10197.4 1737.0 1748.6 1796.2 1811.7 1907.5 70077.0 70147.0 72843.0 73922.3 74037.0 9681.7 9918.9 10013.7 10447.8 10896.9 12730.9 12985.2 12987.4 13015.4 13043.2 7504.1 7583.2 7602.0 7608.9 7713.7 7717.2 7745.5 7752.3 7845.9 7943.8 4015.8 4045.2 4078.8 4100.4 4101.5 1791.9 1835.1 1886.9 1899.6 1943.4 900.2 971.9 995.3 1011.7 1013.0 15632.5 18041.0 18228.3 18367.2 18585.8 974.0 982.0 985.9 1034.9 1066.5 10283.9 10300.8 10308.6 10441.2 10443.3 396399.0 401702.0 404314.0 530676.0 537800.0 75541.0 78239.0 78928.6 79559.0 80620.0 1075.9 1085.1 1102.6 1111.8 1119.2 15817.0 16002.6 16005.8 16171.5 16495.1 37104.3 37377.6 37556.4 38071.0 39902.4 53898.5 54697.5 55310.4 55461.4 55716.4 8178.1 8253.4 8341.6 8358.8 8427.0 11691.8 12344.3 12781.9 13125.2 13260.2 11144.8 11407.4 11694.5 11832.4 11891.9 11359.9 11534.9 11682.6 11931.9 12059.6 7370.1 10100.7 11980.6 11980.9 12042.9 8323.8 8408.4 8428.0 8486.1 8653.6 8989.9 10899.5 11000.4 11713.0 11814.1 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#3] mootools.html Cycles:180 Average:5745.52 Median:5154.56 stddev:2994.47 (58.1%) stddev-sans-first:2985.39 23:28:45 INFO - PROCESS | 10940 | Values: 1441.8 1471.2 1616.8 1737.0 1788.1 7026.9 7930.0 8014.9 8225.0 8268.3 7929.4 7976.2 7996.4 8032.4 8039.2 2257.5 2267.7 2271.3 2286.5 2287.3 2162.8 2176.8 2197.4 2217.9 2219.5 2266.6 2267.2 2269.6 2281.5 2292.4 2205.6 2212.6 2221.5 2230.4 2232.7 2171.3 2172.3 2179.4 2180.4 2200.4 8217.8 8309.6 8312.5 8329.6 8337.6 4996.1 5145.4 5147.3 5161.8 5167.9 3154.5 3184.7 3255.5 3274.0 3274.3 1032.9 1054.2 1984.3 1987.4 2015.5 11186.6 11188.4 11273.7 11279.1 11291.9 4097.1 4208.7 4250.9 4262.9 4305.1 9046.8 9081.9 9126.5 9127.0 9140.1 4990.5 5001.6 5005.7 5006.3 5023.5 4120.1 4559.1 4639.8 4671.5 4673.2 3623.3 3652.5 3692.6 3694.6 3730.8 1088.6 1089.2 1091.8 1094.1 1108.7 1399.6 1399.8 1422.1 1433.6 1444.1 7948.4 8002.5 8064.9 8080.9 8090.7 1064.9 1137.2 1183.3 1186.9 1192.1 6081.9 6125.5 6148.6 6151.9 6176.5 9562.3 10055.5 10128.8 10143.5 10364.8 9955.3 10131.9 10134.6 10266.3 10283.3 7676.6 7783.1 7816.2 7835.3 7887.1 7522.4 7557.0 7589.2 7641.0 7689.5 8944.7 8958.0 9047.7 9075.5 9089.1 9143.6 9169.7 9240.4 9335.4 9425.6 6169.3 6795.0 6948.5 7099.9 7224.6 7724.2 7777.6 7794.3 7812.3 7826.9 6784.4 7086.5 7144.2 7210.9 7318.9 7090.6 7092.9 7120.9 7175.1 7192.4 7478.2 7639.3 7643.3 7645.2 7667.8 6890.9 6905.9 6937.2 6974.3 6989.1 6853.8 6916.6 7015.3 7033.5 7034.5 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#4] prototype.html Cycles:180 Average:5625.87 Median:6434.05 stddev:1747.11 (27.2%) stddev-sans-first:1706.24 23:28:45 INFO - PROCESS | 10940 | Values: 332.9 332.9 336.6 345.0 346.8 6359.4 6433.5 6434.5 6457.2 6461.0 6303.7 6345.8 6347.3 6366.9 6379.2 4669.7 4739.0 4779.0 4805.3 4860.0 4728.9 4756.5 4758.1 4761.6 4771.4 4702.8 4742.6 4753.3 4754.1 4757.3 4705.1 4722.0 4754.3 4759.4 4765.3 4143.9 4168.4 4169.9 4172.2 4173.6 6120.8 6135.3 6138.7 6140.5 6147.9 5351.9 5501.8 5530.2 5530.3 5558.2 6590.4 6656.7 6665.0 6668.8 6673.1 4531.5 4535.8 4538.1 4542.8 4543.3 6976.6 6988.1 7005.6 7061.2 7062.7 4524.1 4538.7 4621.5 4622.6 4648.7 4667.1 4668.4 4669.1 4678.0 4685.2 5429.8 5453.8 5500.6 5520.2 5529.9 6764.2 6782.9 6788.0 6789.7 6797.6 1609.3 1626.8 1642.2 1668.6 1670.3 1073.3 1074.8 1083.2 1083.9 1089.7 6377.0 6384.8 6462.2 6482.2 6496.7 6838.2 6882.8 6900.5 6904.0 6931.6 6429.5 6433.4 6462.8 6472.9 6473.2 3692.9 3706.7 3716.5 3742.7 3745.1 7055.4 7151.2 7182.4 7270.9 7300.0 7182.5 7188.6 7194.5 7199.5 7210.2 7243.4 7295.2 7304.7 7307.6 7323.6 6957.7 6966.5 7042.3 7064.2 7079.7 6937.8 6938.5 6947.6 6959.5 6965.3 7198.7 7242.6 7260.3 7275.8 7295.1 4616.4 4639.7 4646.6 4650.9 4664.5 6985.1 6993.5 7045.1 7052.5 7061.9 6649.5 6906.8 6913.4 6919.6 6925.5 6838.6 6863.3 6865.6 6871.0 6880.5 6694.3 6738.4 6740.5 6745.2 6754.0 6672.6 6868.4 6894.8 6900.9 6901.0 6694.0 6731.9 6734.8 6777.2 6788.6 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - PROCESS | 10940 | [#5] yui.html Cycles:180 Average:15504.69 Median:4544.64 stddev:18443.99 (405.8%) stddev-sans-first:18462.39 23:28:45 INFO - PROCESS | 10940 | Values: 736.8 780.0 801.0 847.2 851.4 13615.7 13807.4 13832.0 13870.4 13920.6 12819.9 12865.8 12929.5 12939.9 12950.4 674.7 797.1 810.3 811.6 813.0 798.9 807.3 810.9 813.4 814.6 840.8 844.1 845.0 845.8 850.1 834.7 841.5 842.1 843.0 847.2 614.5 619.2 619.5 619.7 621.0 13438.3 13443.9 13458.5 13470.0 13495.3 13545.5 13903.2 13971.2 14001.4 14359.5 10643.9 10662.3 10678.8 10787.2 10825.0 3772.4 3800.4 3824.5 3831.3 3840.3 53221.2 53329.0 53551.5 53648.2 53696.2 10636.4 10689.3 10929.0 10949.3 10989.9 19125.4 19161.8 19234.5 19416.0 19432.7 7942.9 8136.3 8303.5 8407.2 8413.3 4555.4 4609.5 4612.8 4636.4 4737.0 3332.4 3342.9 3356.1 3358.1 3359.7 607.3 625.1 626.3 628.2 631.1 638.0 662.6 678.6 707.1 709.8 9478.4 9584.5 9605.1 9622.6 9625.7 616.6 699.6 755.6 756.5 769.9 4419.8 4461.9 4469.7 4507.2 4533.9 66610.0 66777.7 68020.7 68448.3 69289.0 59545.0 60079.4 60141.4 60766.4 60885.9 48990.8 49084.8 49540.5 50967.7 54450.7 9682.5 9799.2 9799.3 9857.7 10038.7 39348.8 40453.2 40469.4 41404.4 41487.0 47892.5 51955.0 53926.4 54091.5 54327.7 10951.6 11673.8 12074.2 12375.4 12588.3 12984.4 13183.6 13363.3 13570.5 13910.2 13347.2 13356.5 13448.4 13656.5 14174.6 13097.7 13226.3 13521.7 13622.3 13706.1 12707.8 12864.6 12908.6 12958.3 13002.6 10185.4 10646.0 10741.0 10956.1 10977.2 11076.5 11110.7 11368.4 11494.0 11547.1 23:28:45 INFO - PROCESS | 10940 | -------- Summary: end -------- 23:28:45 INFO - PROCESS | 10940 | 23:28:45 INFO - TEST-INFO | 10940: exit 0 23:28:45 INFO - TEST-OK | dromaeo_css | took 1109630ms 23:28:45 INFO - TEST-START | kraken 23:28:45 INFO - operating with platform_type : linux_ 23:28:45 INFO - Initialising browser for kraken test... 23:28:45 INFO - TEST-INFO | started process 11181 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9Zx3tj/profile http://localhost:34165/getInfo.html) 23:28:49 INFO - PROCESS | 11181 | 23:28:49 INFO - PROCESS | 11181 | (process:11249): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:28:49 INFO - PROCESS | 11181 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 23:28:50 INFO - PROCESS | 11181 | __metrics Screen width/height:1600/1200 23:28:50 INFO - PROCESS | 11181 | colorDepth:24 23:28:50 INFO - PROCESS | 11181 | Browser inner width/height: 1024/697 23:28:50 INFO - PROCESS | 11181 | __metrics 23:28:51 ERROR - PROCESS | 11181 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 23:28:52 INFO - TEST-INFO | 11181: exit 0 23:28:52 INFO - Browser initialized. 23:28:52 INFO - Running cycle 1/1 for kraken test... 23:28:52 INFO - TEST-INFO | started process 11300 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9Zx3tj/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:28:54 INFO - PROCESS | 11300 | 23:28:54 INFO - PROCESS | 11300 | (process:11359): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:29:04 INFO - PROCESS | 11300 | RSS: Main: 162922496 23:29:04 INFO - PROCESS | 11300 | 23:29:06 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34165/tests/kraken/driver.html?testName=audio-beat-detection) 23:29:07 INFO - PROCESS | 11300 | RSS: Main: 167641088 23:29:07 INFO - PROCESS | 11300 | 23:29:09 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34165/tests/kraken/driver.html?testName=audio-dft) 23:29:10 INFO - PROCESS | 11300 | RSS: Main: 171102208 23:29:10 INFO - PROCESS | 11300 | 23:29:13 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34165/tests/kraken/driver.html?testName=audio-fft) 23:29:13 INFO - PROCESS | 11300 | RSS: Main: 163254272 23:29:13 INFO - PROCESS | 11300 | 23:29:15 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34165/tests/kraken/driver.html?testName=audio-oscillator) 23:29:16 INFO - PROCESS | 11300 | RSS: Main: 163868672 23:29:16 INFO - PROCESS | 11300 | 23:29:18 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34165/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:29:19 INFO - PROCESS | 11300 | RSS: Main: 164384768 23:29:19 INFO - PROCESS | 11300 | 23:29:22 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34165/tests/kraken/driver.html?testName=imaging-darkroom) 23:29:23 INFO - PROCESS | 11300 | RSS: Main: 164274176 23:29:23 INFO - PROCESS | 11300 | 23:29:26 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34165/tests/kraken/driver.html?testName=imaging-desaturate) 23:29:27 INFO - PROCESS | 11300 | RSS: Main: 164761600 23:29:27 INFO - PROCESS | 11300 | 23:29:29 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34165/tests/kraken/driver.html?testName=json-parse-financial) 23:29:30 INFO - PROCESS | 11300 | RSS: Main: 165298176 23:29:30 INFO - PROCESS | 11300 | 23:29:32 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34165/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:29:32 INFO - PROCESS | 11300 | RSS: Main: 165244928 23:29:32 INFO - PROCESS | 11300 | 23:29:34 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:29:35 INFO - PROCESS | 11300 | RSS: Main: 165425152 23:29:35 INFO - PROCESS | 11300 | 23:29:37 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:29:37 INFO - PROCESS | 11300 | RSS: Main: 165806080 23:29:37 INFO - PROCESS | 11300 | 23:29:40 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:29:40 INFO - PROCESS | 11300 | RSS: Main: 165957632 23:29:40 INFO - PROCESS | 11300 | 23:29:43 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:29:43 INFO - PROCESS | 11300 | RSS: Main: 165695488 23:29:43 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | Cycle 1(1): loaded http://localhost:34165/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34165/tests/kraken/driver.html?testName=ai-astar) 23:29:45 INFO - PROCESS | 11300 | RSS: Main: 167223296 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | __start_tp_report 23:29:45 INFO - PROCESS | 11300 | _x_x_mozilla_page_load 23:29:45 INFO - PROCESS | 11300 | _x_x_mozilla_page_load_details 23:29:45 INFO - PROCESS | 11300 | |i|pagename|runs| 23:29:45 INFO - PROCESS | 11300 | |0;ai-astar;111;104;110;109;111;122;111;111;112;110 23:29:45 INFO - PROCESS | 11300 | |1;audio-beat-detection;162;130;151;167;132;155;160;129;169;129 23:29:45 INFO - PROCESS | 11300 | |2;audio-dft;163;164;163;162;164;162;165;170;171;162 23:29:45 INFO - PROCESS | 11300 | |3;audio-fft;75;77;73;77;74;76;76;74;155;76 23:29:45 INFO - PROCESS | 11300 | |4;audio-oscillator;95;93;142;94;93;93;139;93;93;143 23:29:45 INFO - PROCESS | 11300 | |5;imaging-gaussian-blur;118;118;117;118;117;118;118;117;117;117 23:29:45 INFO - PROCESS | 11300 | |6;imaging-darkroom;147;147;147;146;147;148;146;147;147;147 23:29:45 INFO - PROCESS | 11300 | |7;imaging-desaturate;96;100;96;95;96;96;96;96;97;96 23:29:45 INFO - PROCESS | 11300 | |8;json-parse-financial;58;59;58;64;60;67;63;59;57;56 23:29:45 INFO - PROCESS | 11300 | |9;json-stringify-tinderbox;66;66;61;61;63;63;61;62;62;62 23:29:45 INFO - PROCESS | 11300 | |10;stanford-crypto-aes;78;78;82;79;79;87;79;80;81;79 23:29:45 INFO - PROCESS | 11300 | |11;stanford-crypto-ccm;136;112;120;112;116;121;118;120;125;118 23:29:45 INFO - PROCESS | 11300 | |12;stanford-crypto-pbkdf2;141;141;140;142;146;141;142;141;142;146 23:29:45 INFO - PROCESS | 11300 | |13;stanford-crypto-sha256-iterative;63;67;64;67;63;63;62;61;66;63 23:29:45 INFO - PROCESS | 11300 | __end_tp_report 23:29:45 INFO - PROCESS | 11300 | __start_cc_report 23:29:45 INFO - PROCESS | 11300 | _x_x_mozilla_cycle_collect,853 23:29:45 INFO - PROCESS | 11300 | __end_cc_report 23:29:45 INFO - PROCESS | 11300 | __startTimestamp1459751385693__endTimestamp 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | ------- Summary: start ------- 23:29:45 INFO - PROCESS | 11300 | Number of tests: 14 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#0] ai-astar Cycles:10 Average:111.10 Median:111.00 stddev:4.43 (4.0%) stddev-sans-first:4.70 23:29:45 INFO - PROCESS | 11300 | Values: 111.0 104.0 110.0 109.0 111.0 122.0 111.0 111.0 112.0 110.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#1] audio-beat-detection Cycles:10 Average:148.40 Median:157.50 stddev:16.67 (10.6%) stddev-sans-first:16.94 23:29:45 INFO - PROCESS | 11300 | Values: 162.0 130.0 151.0 167.0 132.0 155.0 160.0 129.0 169.0 129.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#2] audio-dft Cycles:10 Average:164.60 Median:164.00 stddev:3.27 (2.0%) stddev-sans-first:3.42 23:29:45 INFO - PROCESS | 11300 | Values: 163.0 164.0 163.0 162.0 164.0 162.0 165.0 170.0 171.0 162.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#3] audio-fft Cycles:10 Average:83.30 Median:76.00 stddev:25.23 (33.2%) stddev-sans-first:26.58 23:29:45 INFO - PROCESS | 11300 | Values: 75.0 77.0 73.0 77.0 74.0 76.0 76.0 74.0 155.0 76.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#4] audio-oscillator Cycles:10 Average:107.80 Median:93.00 stddev:23.17 (24.9%) stddev-sans-first:24.11 23:29:45 INFO - PROCESS | 11300 | Values: 95.0 93.0 142.0 94.0 93.0 93.0 139.0 93.0 93.0 143.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 23:29:45 INFO - PROCESS | 11300 | Values: 118.0 118.0 117.0 118.0 117.0 118.0 118.0 117.0 117.0 117.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#6] imaging-darkroom Cycles:10 Average:146.90 Median:147.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 23:29:45 INFO - PROCESS | 11300 | Values: 147.0 147.0 147.0 146.0 147.0 148.0 146.0 147.0 147.0 147.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.35 (1.4%) stddev-sans-first:1.42 23:29:45 INFO - PROCESS | 11300 | Values: 96.0 100.0 96.0 95.0 96.0 96.0 96.0 96.0 97.0 96.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#8] json-parse-financial Cycles:10 Average:60.10 Median:59.50 stddev:3.48 (5.8%) stddev-sans-first:3.61 23:29:45 INFO - PROCESS | 11300 | Values: 58.0 59.0 58.0 64.0 60.0 67.0 63.0 59.0 57.0 56.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#9] json-stringify-tinderbox Cycles:10 Average:62.70 Median:62.50 stddev:1.89 (3.0%) stddev-sans-first:1.58 23:29:45 INFO - PROCESS | 11300 | Values: 66.0 66.0 61.0 61.0 63.0 63.0 61.0 62.0 62.0 62.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#10] stanford-crypto-aes Cycles:10 Average:80.20 Median:79.50 stddev:2.70 (3.4%) stddev-sans-first:2.74 23:29:45 INFO - PROCESS | 11300 | Values: 78.0 78.0 82.0 79.0 79.0 87.0 79.0 80.0 81.0 79.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#11] stanford-crypto-ccm Cycles:10 Average:119.80 Median:120.00 stddev:6.94 (5.8%) stddev-sans-first:4.21 23:29:45 INFO - PROCESS | 11300 | Values: 136.0 112.0 120.0 112.0 116.0 121.0 118.0 120.0 125.0 118.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.20 Median:142.00 stddev:2.10 (1.5%) stddev-sans-first:2.18 23:29:45 INFO - PROCESS | 11300 | Values: 141.0 141.0 140.0 142.0 146.0 141.0 142.0 141.0 142.0 146.0 23:29:45 INFO - PROCESS | 11300 | 23:29:45 INFO - PROCESS | 11300 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.90 Median:63.50 stddev:2.08 (3.3%) stddev-sans-first:2.18 23:29:45 INFO - PROCESS | 11300 | Values: 63.0 67.0 64.0 67.0 63.0 63.0 62.0 61.0 66.0 63.0 23:29:45 INFO - PROCESS | 11300 | -------- Summary: end -------- 23:29:45 INFO - PROCESS | 11300 | 23:29:46 INFO - TEST-INFO | 11300: exit 0 23:29:46 INFO - TEST-OK | kraken | took 60874ms 23:29:46 INFO - SUITE-END | took 1170s 23:29:46 INFO - Completed test suite (00:19:30) 23:29:46 INFO - javascript benchmark 23:29:46 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3075.7231849133573, 3158.5735925650047, 3167.8891238806646, 3178.777485576011, 3191.489361702128, 5357.812476563321, 5372.194170874371, 5411.188321751739, 5432.701201433924, 5455.699936503491, 5380.838574842751, 5444.183372494118, 5469.0, 5483.835484935448, 5517.862053448665, 4761.785719642625, 4973.52751488608, 5047.520485553867, 5205.531502164805, 5206.661566998152, 5090.05833920724, 5107.208382700687, 5125.794968201268, 5161.535461808437, 5176.171812509999, 4938.086454006002, 5000.199968005102, 5011.498850114959, 5012.799488020493, 5023.221400682882, 4980.626453016038, 4987.202047672391, 4987.5511203991455, 5006.2740902569285, 5030.773615187289, 4903.65674402792, 4945.208766597363, 4957.454679985199, 4971.304017437562, 4991.301217829507, 5336.332958380202, 5404.486573775524, 5420.593455490854, 5449.972750136264, 5463.426340234258, 5799.565032622528, 5825.776586916752, 5832.6792026438525, 5837.153612726131, 5843.795467158671, 5735.713214339308, 5882.970585147047, 5883.823485295448, 5903.439173278532, 5933.465988061095, 5411.134218525017, 5431.158170483582, 5435.619506634537, 5446.210299506589, 5482.479164479368, 5893.204417403681, 5919.67441790697, 5933.792317268875, 5964.403559644088, 5965.194698715704, 5645.745941432645, 5699.601027928088, 5717.656940583578, 5743.195952566561, 5752.223449834219, 5666.801661941812, 5908.261467316585, 5941.821745347646, 5946.583739138306, 5948.464638182498, 5791.102379131242, 5835.941640583625, 5840.1239814027385, 5840.269966254218, 5846.766129354778, 5756.625819321815, 5819.88360232793, 5879.147523609053, 5946.85132871673, 5971.910421343683, 4424.3142312941545, 4424.911501769947, 4445.222086134913, 4464.6428285737065, 4484.68607197493, 3918.45141680165, 3960.6237407446824, 3962.9009274767786, 3993.0416699992375, 4016.975671203883, 5494.09347457665, 5603.467670571289, 5619.213310136584, 5685.857853553694, 5692.37383887772, 5901.557383196277, 5964.105384192319, 5966.254218222723, 5968.85077873048, 5978.133170690226, 5605.243292155588, 5675.262215911987, 5684.204211410406, 5686.2039314496005, 5688.715564221772, 4922.458529561745, 5090.160123579642, 5117.053345131163, 5127.692338459704, 5158.174692049254, 6097.603655762361, 6100.603460775035, 6102.938970610237, 6103.938960610426, 6105.328413874559, 5757.6545407274025, 5929.0, 5931.406859314034, 5932.406759324033, 5932.762689492544, 6063.060225665029, 6067.423594758491, 6088.817335479943, 6113.786017489367, 6128.540359472968, 5580.135079062752, 5615.410381910004, 5643.576731745054, 5656.773729050792, 5667.206591077335, 5670.659760414388, 5740.540756739534, 5751.309842818889, 5783.16144159103, 5911.645301281765, 5676.744546495335, 5719.685417302088, 5728.971355143198, 5786.42135786418, 5830.9416905832095, 5695.686737229492, 5701.344345400332, 5703.372629010722, 5703.942960570341, 5749.683767392834, 5505.394406615349, 5597.384287728265, 5617.522510586646, 5624.803131890364, 5627.803026894039, 5838.503727183237, 5839.15332276809, 5845.152452894392, 5874.177615133799, 5894.911576326444, 5628.774849005994, 5648.915266270927, 5654.660720356792, 5657.801976930952, 5658.17956396312], "unit": "score", "name": "dojo.html", "value": 5404.06397253119}, {"lowerIsBetter": false, "replicates": [522.8431470558834, 536.2813829468512, 560.6720068759776, 562.3589108416409, 586.2671660424469, 29657.0, 38182.61817381826, 38362.23275534488, 38756.806215968914, 38803.22393552127, 41643.37534936971, 42085.94785130366, 42128.36807447891, 42171.156576868445, 42172.36741448881, 8705.564721763918, 8826.64693412266, 8876.822463550725, 8894.688685895962, 8911.0, 8612.48325100496, 8797.516136612483, 8801.251893589053, 8803.735887923373, 8815.206631403173, 8792.208701216889, 8877.156670116361, 8882.733517994471, 8885.333599980027, 8898.37711360205, 8677.652893884237, 8684.696035638723, 8753.037165911777, 8897.955510222473, 8909.420887642282, 8842.425242359226, 8950.955245223733, 8973.685920992733, 8980.236679882219, 8988.235999940012, 41630.0, 42044.78977605123, 42097.15805683869, 42173.0, 42212.0, 3411.4200585900458, 3514.5431093957877, 4105.651019663333, 4113.45970812183, 4206.41110244566, 31644.683553164403, 31710.365792684246, 31804.522932156036, 32007.0, 33149.83425082883, 3971.4241434991764, 3983.920321593581, 4018.0758425561994, 4021.698372622036, 4060.0661847775177, 314823.0, 316868.0, 317827.41086294653, 318564.0, 318760.0, 47852.521474785506, 48255.0, 48492.0, 48718.512814872105, 58678.413215868146, 46699.76650116728, 46751.766241168574, 46840.0, 46937.0, 46980.5301946983, 15958.281877315549, 16212.513624591282, 16218.918905405397, 16280.837191627932, 16302.755458668129, 12792.552260670831, 12954.0, 12997.350132493337, 13000.349982500837, 13094.934525327313, 15442.922785386001, 15472.14903180336, 15510.844891551165, 15609.453669121527, 15940.123293218752, 5974.0, 6158.1686472326555, 6244.968775156095, 6312.968435157886, 6328.525360597973, 1036.8081904847627, 1076.956921723138, 1086.3861918016296, 1109.8890110988837, 1172.5720112159001, 30406.239844004078, 30446.238844028634, 31262.531062034086, 31560.210994724857, 31693.366132677216, 1123.8763735989035, 1131.4738646529404, 1142.520141540555, 1200.4897918384652, 1237.5359240284893, 15459.63716668248, 15977.201139942956, 16107.19464026794, 16350.75473867893, 16377.508674739776, 443345.0, 448666.0, 450262.0, 451149.0, 451453.0, 54916.0, 55794.0, 56275.718621407446, 56327.155092673645, 56350.718246408505, 1343.684234204961, 1376.5732622886937, 1388.2434073430004, 1394.3446580107334, 1404.557564367221, 30563.2359191022, 30680.846595766878, 31130.0, 31387.372252555277, 31724.0, 49236.75381623069, 49494.99999999856, 49673.0, 49920.0, 50053.24920126274, 404169.0, 405597.0, 408608.0, 409245.0, 410845.0, 36456.27087458289, 37060.6293937068, 37280.62719372771, 37297.0, 37469.0, 46249.76875115603, 46465.767671161426, 46578.767106164254, 47415.762921185174, 47776.56670299896, 38967.0, 39935.60064399319, 39952.8002359998, 40061.79969100136, 40122.79938600288, 38601.227975439775, 39086.6091339083, 39888.0, 40152.1969560613, 40304.99237519086, 41088.38367424551, 41174.0, 43777.34333984929, 44252.0, 44719.776401117786, 33905.66094339025, 35025.64974350326, 35346.823265883504, 35674.643253567134, 35818.462723058656, 27657.86171069132, 27894.3026424341, 28039.0, 28074.2981425466, 28306.57540136941], "unit": "score", "name": "ext.html", "value": 19422.90649834088}, {"lowerIsBetter": false, "replicates": [364.9233660931204, 365.5795834789991, 366.2692927609419, 380.51104330934754, 382.8028565288877, 17246.82753172468, 17259.56851078722, 17729.113544322798, 17761.7335739964, 17811.0, 17039.82960170398, 17537.824621753778, 17748.0, 17923.283068677236, 18053.187606557705, 5374.844408452182, 5683.460071293221, 5686.630369026021, 5689.203511508392, 5691.630044047144, 4256.510501292345, 5497.890042199154, 6052.848678783022, 6342.873142537146, 6346.238451385841, 6259.718312675917, 6273.0, 6273.184486016811, 6275.592086514384, 6298.433141017307, 5999.640021598718, 6125.326214116488, 6161.229846269239, 6167.537434692371, 6198.2252218472695, 5397.568194544467, 5423.240746295522, 5429.131338985783, 5447.700376479292, 5449.482299181572, 19533.609327813505, 20246.797532024637, 20375.08312125958, 20400.0, 21531.461713457287, 2163.7619861815188, 2204.9746867706594, 2249.403907964391, 2352.8235382346393, 2545.6563363945816, 9426.245900327956, 9717.271204659679, 9748.31761776676, 10086.49567521621, 10197.388156710547, 1736.9913150434293, 1748.591412473284, 1796.1917137288272, 1811.7191835265555, 1907.4849790556473, 70077.0, 70147.0, 72843.0, 73922.26077739154, 74037.0, 9681.66114186, 9918.900810991941, 10013.749656258506, 10447.791044179074, 10896.945515272531, 12730.936345318214, 12985.155964862253, 12987.350632468528, 13015.414306356237, 13043.152195107288, 7504.137024242282, 7583.2416758323725, 7602.0, 7608.923910760932, 7713.65288562016, 7717.2282771722375, 7745.496542724705, 7752.341051010614, 7845.882311765328, 7943.801404964806, 4015.819288132041, 4045.211183819186, 4078.8368465261055, 4100.405441211008, 4101.52832424269, 1791.8566514678794, 1835.1367381216885, 1886.8679192456395, 1899.5820919397986, 1943.4461178564325, 900.2482926756101, 971.9416834989923, 995.2784231432298, 1011.726833754882, 1012.9566546457161, 15632.531024069296, 18041.0, 18228.27086916535, 18367.17347719356, 18585.81414185868, 973.9853902191472, 981.955936596545, 985.8888435225128, 1034.8809886862957, 1066.4987455895716, 10283.897161028444, 10300.845487317696, 10308.587656493657, 10441.164706823587, 10443.321184123008, 396399.0, 401702.0, 404314.0, 530676.0, 537800.0, 75541.0, 78239.0, 78928.60535697285, 79559.0, 80620.0, 1075.8601381820313, 1085.0939465546198, 1102.6306187427301, 1111.8499002634703, 1119.238917536067, 15817.0, 16002.599935001717, 16005.759913601072, 16171.514854554382, 16495.092769897772, 37104.25791484209, 37377.62622373742, 37556.436653450764, 38071.0, 39902.40146397748, 53898.461015389345, 54697.453025469236, 55310.44689553053, 55461.44538554563, 55716.44283557113, 8178.1412951641605, 8253.422260441712, 8341.582920853813, 8358.832823343377, 8427.030891447317, 11691.824622630496, 12344.259344439362, 12781.872181278068, 13125.212487250414, 13260.204387736767, 11144.777104458028, 11407.372594507382, 11694.47374868116, 11832.408379580815, 11891.881081189424, 11359.886401136213, 11534.884651153718, 11682.591109311134, 11931.940340298243, 12059.577914773292, 7370.078740157481, 10100.696979090639, 11980.58067967617, 11980.880191197977, 12042.939785301018, 8323.799913075267, 8408.36937229698, 8427.95786021066, 8486.10895855951, 8653.61058752345, 8989.910100898907, 10899.509522071367, 11000.449977501254, 11713.0, 11814.113941454254], "unit": "score", "name": "jquery.html", "value": 8783.641267785264}, {"lowerIsBetter": false, "replicates": [1441.7693169092945, 1471.1834931612955, 1616.8302328255534, 1737.027264731751, 1788.061267834386, 7026.85946281074, 7930.0, 8014.8797768033455, 8225.0, 8268.255856972879, 7929.405294602899, 7976.242256985592, 7996.400269979746, 8032.357411407088, 8039.236272554098, 2257.4582100295975, 2267.7278726552836, 2271.2958982715413, 2286.4741109544816, 2287.2680742162433, 2162.762096169428, 2176.81497072749, 2197.3847322749657, 2217.944551386212, 2219.5449932763745, 2266.5693518231483, 2267.183813827021, 2269.6255117905607, 2281.543691261746, 2292.4039749665126, 2205.558888222362, 2212.557488502306, 2221.466847956487, 2230.3754948614333, 2232.7097477328007, 2171.3268886645033, 2172.348295511356, 2179.400664817172, 2180.4221881201493, 2200.4168895242774, 8217.79455513611, 8309.626066827008, 8312.54281014544, 8329.583520823995, 8337.583120843934, 4996.125678006334, 5145.3568303962, 5147.3051138096625, 5161.8193363232485, 5167.896642067138, 3154.479510880702, 3184.6656101109515, 3255.511673249008, 3273.9508907366408, 3274.3287626036604, 1032.8863824979246, 1054.225144518778, 1984.2559040359865, 1987.423647142327, 2015.5162760937417, 11186.552537898475, 11188.44057797115, 11273.661790146309, 11279.097672186206, 11291.943540282327, 4097.119119389286, 4208.6633069354375, 4250.936235956463, 4262.87211383659, 4305.117450922553, 9046.773830654287, 9081.863772043425, 9126.49804260772, 9127.041660625671, 9140.131687489678, 4990.525900039491, 5001.624878134155, 5005.674631148963, 5006.274090256965, 5023.522765337287, 4120.093579412524, 4559.0881823634745, 4639.816846704136, 4671.462781780071, 4673.205555055649, 3623.3477973964414, 3652.4886515887797, 3692.630736926286, 3694.649008344203, 3730.8321125549414, 1088.5754555723274, 1089.1885545268826, 1091.8034753744403, 1094.1356328500556, 1108.684025052856, 1399.5521433141298, 1399.839018512884, 1422.1396055386342, 1433.6415896025994, 1444.1335198880797, 7948.364130869517, 8002.51984880909, 8064.919350806535, 8080.9191908080165, 8090.7168249111, 1064.9467526623637, 1137.184745179926, 1183.2722875431548, 1186.9347185904685, 1192.1237890150733, 6081.878362432726, 6125.479334256549, 6148.569600128038, 6151.876962460815, 6176.505879529627, 9562.330636855353, 10055.547500362502, 10128.848067278997, 10143.543540540693, 10364.792704145875, 9955.253355998184, 10131.898681013243, 10134.645287414905, 10266.332688375232, 10283.280170388001, 7676.6161691916295, 7783.143854176036, 7816.218378162138, 7835.255650713173, 7887.053553573608, 7522.398208143445, 7557.0, 7589.165191828784, 7641.0, 7689.50018248812, 8944.731658050268, 8957.955210223907, 9047.728568142966, 9075.546222688707, 9089.136532029446, 9143.588538515649, 9169.724908252496, 9240.399374040666, 9335.439873607605, 9425.575849086945, 6169.290531588925, 6794.966025170041, 6948.478864085113, 7099.858002840017, 7224.602646854263, 7724.227577242231, 7777.57223352721, 7794.337481314152, 7812.296893279632, 7826.882596760939, 6784.3894049535775, 7086.539374940612, 7144.214136444883, 7210.9278907210255, 7318.853622927618, 7090.645467726697, 7092.893606596009, 7120.928790712027, 7175.138983322035, 7192.42460603161, 7478.214787447458, 7639.312461878458, 7643.273888980538, 7645.1972542882195, 7667.846643067219, 6890.931090689029, 6905.861882762417, 6937.236903940461, 6974.302569742985, 6989.091418115612, 6853.7943861684225, 6916.55042422241, 7015.333543313377, 7033.507654464139, 7034.472414568825], "unit": "score", "name": "mootools.html", "value": 4731.619968936187}, {"lowerIsBetter": false, "replicates": [332.86685325869666, 332.88016314126924, 336.62970732194583, 344.9879254226102, 346.75726991106245, 6359.395857393546, 6433.549651524383, 6434.549581529289, 6457.160569126007, 6460.967695161524, 6303.7478500860025, 6345.841353966153, 6347.301796802348, 6366.936330636692, 6379.17070780799, 4669.696469729473, 4738.976305118486, 4779.0, 4805.303231031498, 4860.027994401125, 4728.90542189156, 4756.500567440421, 4758.095961767271, 4761.59526440253, 4771.403574553181, 4702.835400760974, 4742.620590352781, 4753.310769938357, 4754.096721622898, 4757.310190022445, 4705.058988202356, 4721.952780472186, 4754.263089221159, 4759.357486739281, 4765.332853400527, 4143.937840932388, 4168.416421700964, 4169.874903752892, 4172.18642364739, 4173.624373806341, 6120.785772497986, 6135.294441139282, 6138.7237574309265, 6140.539459540508, 6147.907781383283, 5351.946480535223, 5501.752421141058, 5530.225768392428, 5530.253415788858, 5558.166275058733, 6590.352411897025, 6656.733730650768, 6665.0, 6668.7665931692645, 6673.0991316172185, 4531.501534831166, 4535.7732113394195, 4538.069695712371, 4542.772861356919, 4543.250363689987, 6976.5814051156585, 6988.056612357368, 7005.614691191982, 7061.1526616805795, 7062.717491300342, 4524.09518096382, 4538.659600529973, 4621.491635920046, 4622.607078398307, 4648.651351148677, 4667.066586682677, 4668.393108895822, 4669.066186762661, 4678.0, 4685.20351540239, 5429.837104886859, 5453.836384908459, 5500.58745594082, 5520.227168196456, 5529.861753456195, 6764.222114456802, 6782.914733642593, 6787.966060169668, 6789.694463749143, 6797.5581587196675, 1609.2597405193742, 1626.764119202709, 1642.2035312873247, 1668.5745134990743, 1670.2734310574938, 1073.2701762801214, 1074.8441475986094, 1083.247143235444, 1083.8916108389255, 1089.7330154112135, 6377.0434434834215, 6384.840378990562, 6462.159919210567, 6482.157319548429, 6496.707648155844, 6838.1794184697155, 6882.827929301708, 6900.516963812485, 6903.964405339239, 6931.584104953719, 6429.485641148697, 6433.4209921106385, 6462.838429039311, 6472.935270647327, 6473.190851143607, 3692.9446058309145, 3706.6849317808287, 3716.479692843004, 3742.66316031553, 3745.1198968242443, 7055.400290975324, 7151.213366529678, 7182.389496892718, 7270.927290727025, 7300.0, 7182.461315401366, 7188.568685878864, 7194.532355396987, 7199.496035277481, 7210.242924492957, 7243.384312333405, 7295.234000429985, 7304.707811687579, 7307.634618269065, 7323.633818309063, 6957.652117394009, 6966.5471744336455, 7042.330978557029, 7064.198629349483, 7079.716811327489, 6937.82655433598, 6938.514303998873, 6947.617881016593, 6959.512834101564, 6965.328321202976, 7198.748043818441, 7242.637868106468, 7260.310270524292, 7275.818104547428, 7295.124585049616, 4616.44602647671, 4639.652026097989, 4646.605038571624, 4650.86047418578, 4664.4869064403565, 6985.091938048021, 6993.510454268356, 7045.11936007999, 7052.541584796972, 7061.858762824612, 6649.534532582867, 6906.758263460755, 6913.446924245947, 6919.550229235084, 6925.549839260432, 6838.589684618939, 6863.313668633096, 6865.5537390069485, 6870.965645171942, 6880.483963702843, 6694.330566943267, 6738.35985581369, 6740.494462915203, 6745.190577130776, 6753.986901964745, 6672.566283191577, 6868.416184624363, 6894.827629309107, 6900.896486552806, 6900.965495172492, 6694.029365742038, 6731.899021514583, 6734.831629209309, 6777.186737591323, 6788.558743681645], "unit": "score", "name": "prototype.html", "value": 5046.776574379404}, {"lowerIsBetter": false, "replicates": [736.8047467421131, 780.0483410239508, 800.951942883427, 847.1909326593104, 851.3870013590213, 13615.727685446298, 13807.378667959942, 13832.0, 13870.375833087497, 13920.582382528515, 12819.871801281985, 12865.807012894815, 12929.482820687184, 12939.870601293984, 12950.352482375867, 674.689642764329, 797.1072398913225, 810.3395732478041, 811.5577010529246, 813.0, 798.8681867491857, 807.2532907060975, 810.9432339736221, 813.3737022492677, 814.5519964019795, 840.7687885831384, 844.0630899701326, 845.0113367360173, 845.7927807687095, 850.0734199722301, 834.6828205282014, 841.4824882697159, 842.073718909195, 842.9536375499345, 847.1740053447901, 614.5483069943588, 619.1857707115129, 619.5136817598163, 619.7335145887266, 620.9720562574695, 13438.260895650736, 13443.865561344359, 13458.528951486749, 13470.0, 13495.257760823151, 13545.45818167282, 13903.235322057282, 13971.161730296113, 14001.369938352696, 14359.497417590333, 10643.893561064368, 10662.253642245047, 10678.78642427155, 10787.190960677981, 10825.0, 3772.3775577029755, 3800.4489349044234, 3824.4740605838692, 3831.2912111259507, 3840.2703486337787, 53221.20168197442, 53329.0, 53551.464485355034, 53648.19527707049, 53696.194557081675, 10636.361818290927, 10689.30519516229, 10929.016388525071, 10949.343039417661, 10989.945050274857, 19125.426237212905, 19161.808381916002, 19234.519137021685, 19416.0, 19432.70850937237, 7942.880856787153, 8136.267735903797, 8303.501789892625, 8407.201315874981, 8413.284870785928, 4555.362249285103, 4609.516000819865, 4612.769361531977, 4636.374089497942, 4736.976315118402, 3332.3835090508333, 3342.9498557521656, 3356.060303115132, 3358.143673363277, 3359.714424273964, 607.3471018654875, 625.0717684238992, 626.2985456288894, 628.1833616298885, 631.0597210156925, 637.996810015947, 662.595816551903, 678.6233640329665, 707.1090426063197, 709.8296408861836, 9478.38390504615, 9584.472853992958, 9605.087516685904, 9622.615095396246, 9625.71122866315, 616.5653214483779, 699.6222040098392, 755.6221889055472, 756.4969295418595, 769.8922150898767, 4419.756913369732, 4461.866144015685, 4469.7318160910445, 4507.18870603288, 4533.909321813545, 66610.0, 66777.66611166912, 68020.6598967012, 68448.31551684519, 69289.0, 59545.0, 60079.39920600825, 60141.39858601445, 60766.392336076075, 60885.91140885876, 48990.75504622454, 49084.75457622689, 49540.50459495503, 50967.74516127395, 54450.727746361015, 9682.515874206403, 9799.216062714822, 9799.265055120752, 9857.654982075594, 10038.749031274276, 39348.80325598468, 40453.1909361817, 40469.39295910505, 41404.378934315406, 41487.0, 47892.521074788805, 51955.0, 53926.416254618794, 54091.45908540864, 54327.72836135794, 10951.604565156827, 11673.824892626788, 12074.154809163274, 12375.443105060114, 12588.30764307972, 12984.415701293654, 13183.640260358452, 13363.26502042397, 13570.525031623845, 13910.165390076629, 13347.199168049949, 13356.532521361705, 13448.394822233218, 13656.522021729192, 14174.645633859236, 13097.738045239232, 13226.272555009567, 13521.729565408834, 13622.250776207404, 13706.109102908278, 12707.809382859079, 12864.614061578168, 12908.612741617766, 12958.28729419891, 13002.609921702364, 10185.410409789509, 10646.0, 10741.0, 10956.068734157687, 10977.176711746491, 11076.461769115442, 11110.666679999613, 11368.431578421212, 11494.0, 11547.133964952494], "unit": "score", "name": "yui.html", "value": 6837.900660989944}], "name": "dromaeo_css", "value": 7293.713672940551}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 104.0, 110.0, 109.0, 111.0, 122.0, 111.0, 111.0, 112.0, 110.0], "unit": "score", "name": "ai-astar", "value": 111.1}, {"lowerIsBetter": true, "replicates": [162.0, 130.0, 151.0, 167.0, 132.0, 155.0, 160.0, 129.0, 169.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 148.4}, {"lowerIsBetter": true, "replicates": [163.0, 164.0, 163.0, 162.0, 164.0, 162.0, 165.0, 170.0, 171.0, 162.0], "unit": "score", "name": "audio-dft", "value": 164.6}, {"lowerIsBetter": true, "replicates": [75.0, 77.0, 73.0, 77.0, 74.0, 76.0, 76.0, 74.0, 155.0, 76.0], "unit": "score", "name": "audio-fft", "value": 83.3}, {"lowerIsBetter": true, "replicates": [95.0, 93.0, 142.0, 94.0, 93.0, 93.0, 139.0, 93.0, 93.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 107.8}, {"lowerIsBetter": true, "replicates": [118.0, 118.0, 117.0, 118.0, 117.0, 118.0, 118.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.5}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 146.0, 147.0, 148.0, 146.0, 147.0, 147.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.9}, {"lowerIsBetter": true, "replicates": [96.0, 100.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [58.0, 59.0, 58.0, 64.0, 60.0, 67.0, 63.0, 59.0, 57.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 60.1}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 61.0, 61.0, 63.0, 63.0, 61.0, 62.0, 62.0, 62.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 62.7}, {"lowerIsBetter": true, "replicates": [78.0, 78.0, 82.0, 79.0, 79.0, 87.0, 79.0, 80.0, 81.0, 79.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.2}, {"lowerIsBetter": true, "replicates": [136.0, 112.0, 120.0, 112.0, 116.0, 121.0, 118.0, 120.0, 125.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.8}, {"lowerIsBetter": true, "replicates": [141.0, 141.0, 140.0, 142.0, 146.0, 141.0, 142.0, 141.0, 142.0, 146.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 142.2}, {"lowerIsBetter": true, "replicates": [63.0, 67.0, 64.0, 67.0, 63.0, 63.0, 62.0, 61.0, 66.0, 63.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 63.9}], "name": "kraken", "value": 1504.9}]} 23:29:46 INFO - Return code: 0 23:29:46 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 23:29:47 ERROR - # TBPL SUCCESS # 23:29:47 INFO - Running post-action listener: _resource_record_post_action 23:29:47 INFO - Running post-run listener: _resource_record_post_run 23:29:48 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 4096; Write bytes: 299520000; Read time: 12; Write time: 373336 23:29:48 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 10440704; Read time: 0; Write time: 1596 23:29:48 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 4096; Write bytes: 289079296; Read time: 12; Write time: 371740 23:29:48 INFO - Running post-run listener: _upload_blobber_files 23:29:48 INFO - Blob upload gear active. 23:29:48 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 23:29:48 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 23:29:48 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', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 23:29:48 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 Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 23:29:48 INFO - (blobuploader) - INFO - Open directory for files ... 23:29:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 23:29:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:29:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:29:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 23:29:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:29:49 INFO - (blobuploader) - INFO - Done attempting. 23:29:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 23:29:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:29:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:29:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 23:29:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:29:50 INFO - (blobuploader) - INFO - Done attempting. 23:29:50 INFO - (blobuploader) - INFO - Iteration through files over. 23:29:50 INFO - Return code: 0 23:29:50 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 23:29:50 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 23:29:50 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59f68fc27106db7fc121017a42619c9bb8f352f6c085b8d4f31585dbfe2bf4eaea9549d50cd15065de2e9e287396a7834944430cdbfeab467174cbb44eca30b3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7af06578d01d8e8e33f4279a8e9dd9d59a9fbe3a4e161f94d27c6ccb2c6b40dd27679c5aa8579eb4ce5cf331f1396cf89103e4cd919ffa8c178c465a83a8aed9"} 23:29:50 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 23:29:50 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 23:29:50 INFO - Contents: 23:29:50 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59f68fc27106db7fc121017a42619c9bb8f352f6c085b8d4f31585dbfe2bf4eaea9549d50cd15065de2e9e287396a7834944430cdbfeab467174cbb44eca30b3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7af06578d01d8e8e33f4279a8e9dd9d59a9fbe3a4e161f94d27c6ccb2c6b40dd27679c5aa8579eb4ce5cf331f1396cf89103e4cd919ffa8c178c465a83a8aed9"} 23:29:50 INFO - Running post-run listener: copy_logs_to_upload_dir 23:29:50 INFO - Copying logs to upload dir... 23:29:50 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 23:29:50 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.051618 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-04-03 23:29:49.690113) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-03 23:29:49.696083) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 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/Fx-Team/sha512/59f68fc27106db7fc121017a42619c9bb8f352f6c085b8d4f31585dbfe2bf4eaea9549d50cd15065de2e9e287396a7834944430cdbfeab467174cbb44eca30b3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7af06578d01d8e8e33f4279a8e9dd9d59a9fbe3a4e161f94d27c6ccb2c6b40dd27679c5aa8579eb4ce5cf331f1396cf89103e4cd919ffa8c178c465a83a8aed9"} build_url:https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011501 build_url: 'https://queue.taskcluster.net/v1/task/Gh5uI_UXRnubBUj8iOpu6A/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/59f68fc27106db7fc121017a42619c9bb8f352f6c085b8d4f31585dbfe2bf4eaea9549d50cd15065de2e9e287396a7834944430cdbfeab467174cbb44eca30b3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7af06578d01d8e8e33f4279a8e9dd9d59a9fbe3a4e161f94d27c6ccb2c6b40dd27679c5aa8579eb4ce5cf331f1396cf89103e4cd919ffa8c178c465a83a8aed9"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-03 23:29:49.725583) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:29:49.726356) ========= 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=1861a34ebfea852630dec091000001fa-1459748472.139611-1728278566 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004445 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-03 23:29:49.809287) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-03 23:29:49.809977) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-03 23:29:49.810296) ========= ========= Total master_lag: 0.31 =========