builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-011 starttime: 1459177751.48 results: success (0) buildid: 20160328053005 builduid: 06cb050353614da7b9d787bb2ce08f8f revision: a0f366bd78a48278208304775a1166396a3daad4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.476511) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.476980) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.477299) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006419 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.515907) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.516214) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.541395) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.541697) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004590 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.597605) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.597915) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.598281) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.598587) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-28 08:09:12-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 224M=0s 2016-03-28 08:09:12 (224 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.155370 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.766237) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.766549) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014063 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:11.817612) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-28 08:09:11.817970) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev a0f366bd78a48278208304775a1166396a3daad4 --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 a0f366bd78a48278208304775a1166396a3daad4 --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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-28 08:09:12,463 truncating revision to first 12 chars 2016-03-28 08:09:12,463 Setting DEBUG logging. 2016-03-28 08:09:12,463 attempt 1/10 2016-03-28 08:09:12,463 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/a0f366bd78a4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-28 08:09:13,285 unpacking tar archive at: fx-team-a0f366bd78a4/testing/mozharness/ program finished with exit code 0 elapsedTime=1.123488 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-28 08:09:12.955959) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:12.956291) ========= echo a0f366bd78a48278208304775a1166396a3daad4 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'a0f366bd78a48278208304775a1166396a3daad4'] 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False a0f366bd78a48278208304775a1166396a3daad4 program finished with exit code 0 elapsedTime=0.004076 script_repo_revision: 'a0f366bd78a48278208304775a1166396a3daad4' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:13.005322) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:13.005637) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-28 08:09:13.015973) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-03-28 08:09:13.016262) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:09:13 INFO - MultiFileLogger online at 20160328 08:09:13 in /builds/slave/test-pgo 08:09:13 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 08:09:13 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 08:09:13 INFO - {'append_to_log': False, 08:09:13 INFO - 'base_work_dir': '/builds/slave/test-pgo', 08:09:13 INFO - 'blob_upload_branch': 'Fx-Team', 08:09:13 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 08:09:13 INFO - 'branch': 'Fx-Team', 08:09:13 INFO - 'buildbot_json_path': 'buildprops.json', 08:09:13 INFO - 'config_files': ('talos/linux_config.py',), 08:09:13 INFO - 'default_actions': ('clobber', 08:09:13 INFO - 'read-buildbot-config', 08:09:13 INFO - 'download-and-extract', 08:09:13 INFO - 'populate-webroot', 08:09:13 INFO - 'create-virtualenv', 08:09:13 INFO - 'install', 08:09:13 INFO - 'run-tests'), 08:09:13 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:09:13 INFO - 'download_minidump_stackwalk': True, 08:09:13 INFO - 'download_symbols': 'ondemand', 08:09:13 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:09:13 INFO - 'tooltool.py': '/tools/tooltool.py', 08:09:13 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:09:13 INFO - '/tools/misc-python/virtualenv.py')}, 08:09:13 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:09:13 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:09:13 INFO - 'installer_path': 'installer.exe', 08:09:13 INFO - 'log_level': 'info', 08:09:13 INFO - 'log_name': 'talos', 08:09:13 INFO - 'log_to_console': True, 08:09:13 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:09:13 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:09:13 INFO - 'opt_config_files': (), 08:09:13 INFO - 'pip_index': False, 08:09:13 INFO - 'sps_profile': False, 08:09:13 INFO - 'sps_profile_interval': 0, 08:09:13 INFO - 'suite': 'dromaeojs', 08:09:13 INFO - 'system_bits': '32', 08:09:13 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:09:13 INFO - 'title': 'talos-linux64-ix-011', 08:09:13 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:09:13 INFO - 'use_talos_json': True, 08:09:13 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 08:09:13 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:09:13 INFO - 'work_dir': 'build'} 08:09:13 INFO - ##### 08:09:13 INFO - ##### Running clobber step. 08:09:13 INFO - ##### 08:09:13 INFO - Running pre-action listener: _resource_record_pre_action 08:09:13 INFO - Running main action method: clobber 08:09:13 INFO - rmtree: /builds/slave/test-pgo/build 08:09:13 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 08:09:14 INFO - Running post-action listener: _resource_record_post_action 08:09:14 INFO - ##### 08:09:14 INFO - ##### Running read-buildbot-config step. 08:09:14 INFO - ##### 08:09:14 INFO - Running pre-action listener: _resource_record_pre_action 08:09:14 INFO - Running main action method: read_buildbot_config 08:09:14 INFO - Using buildbot properties: 08:09:14 INFO - { 08:09:14 INFO - "project": "", 08:09:14 INFO - "product": "firefox", 08:09:14 INFO - "script_repo_revision": "production", 08:09:14 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 08:09:14 INFO - "repository": "", 08:09:14 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 08:09:14 INFO - "buildid": "20160328053005", 08:09:14 INFO - "pgo_build": "True", 08:09:14 INFO - "basedir": "/builds/slave/test-pgo", 08:09:14 INFO - "buildnumber": 1038, 08:09:14 INFO - "slavename": "talos-linux64-ix-011", 08:09:14 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 08:09:14 INFO - "platform": "ubuntu64_hw", 08:09:14 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 08:09:14 INFO - "branch": "fx-team", 08:09:14 INFO - "repo_path": "integration/fx-team", 08:09:14 INFO - "revision": "a0f366bd78a48278208304775a1166396a3daad4", 08:09:14 INFO - "stage_platform": "linux64-pgo", 08:09:14 INFO - "builduid": "06cb050353614da7b9d787bb2ce08f8f", 08:09:14 INFO - "slavebuilddir": "test" 08:09:14 INFO - } 08:09:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 08:09:14 INFO - Running post-action listener: _resource_record_post_action 08:09:14 INFO - ##### 08:09:14 INFO - ##### Running download-and-extract step. 08:09:14 INFO - ##### 08:09:14 INFO - Running pre-action listener: _resource_record_pre_action 08:09:14 INFO - Running main action method: download_and_extract 08:09:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 08: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')]} 08:09:14 INFO - https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:09:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:09:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:09:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:25 INFO - Downloaded 1361 bytes. 08:09:25 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:09:25 INFO - Using the following test package requirements: 08:09:25 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 08:09:25 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:09:25 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:09:25 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'jsshell-linux-x86_64.zip'], 08:09:25 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:09:25 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 08:09:25 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:09:25 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:09:25 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:09:25 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:09:25 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:09:25 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:09:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:25 INFO - https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:09:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:09:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:09:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:32 INFO - Downloaded 23655888 bytes. 08:09:32 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'] 08:09:32 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 08:09:33 INFO - Return code: 0 08:09:33 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 08:09:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:33 INFO - https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:09:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:09:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:09:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:35 INFO - Downloaded 23655888 bytes. 08:09:35 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'] 08:09:35 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 08:09:37 INFO - Return code: 0 08:09:37 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')]} 08:09:37 INFO - https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:09:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 08:09:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 08:09:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:38 INFO - Downloaded 10847531 bytes. 08:09:38 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'] 08:09:38 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 08:09:38 INFO - Return code: 0 08: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')]} 08:09:38 INFO - https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:09:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:09:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:09:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/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 08:09:39 INFO - Downloaded 57722017 bytes. 08:09:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:09:39 INFO - mkdir: /builds/slave/test-pgo/properties 08:09:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 08:09:39 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 08:09:39 INFO - Contents: 08:09:39 INFO - build_url:https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:09:40 INFO - Running post-action listener: _resource_record_post_action 08:09:40 INFO - Running post-action listener: set_extra_try_arguments 08:09:40 INFO - ##### 08:09:40 INFO - ##### Running populate-webroot step. 08:09:40 INFO - ##### 08:09:40 INFO - Running pre-action listener: _resource_record_pre_action 08:09:40 INFO - Running main action method: populate_webroot 08:09:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:09:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:09:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:09:40 INFO - '--tppagecycles', 08:09:40 INFO - '7'], 08:09:40 INFO - 'tests': ['tsvgm']}}, 08:09:40 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:09:40 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:09:40 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 08:09:40 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:09:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:09:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:09:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'tests': ['damp', 'tps']}, 08:09:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['damp', 'tps']}, 08:09:40 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:09:40 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['dromaeo_dom']}, 08:09:40 INFO - 'other': {'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'other_l64': {'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'other_nol64': {'tests': ['a11yr', 08:09:40 INFO - 'ts_paint', 08:09:40 INFO - 'tpaint', 08:09:40 INFO - 'sessionrestore', 08:09:40 INFO - 'sessionrestore_no_auto_restore', 08:09:40 INFO - 'tabpaint']}, 08:09:40 INFO - 'svgr': {'tests': ['tsvgx', 08:09:40 INFO - 'tsvgr_opacity', 08:09:40 INFO - 'tart', 08:09:40 INFO - 'tscrollx', 08:09:40 INFO - 'cart']}, 08:09:40 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['tsvgx', 08:09:40 INFO - 'tsvgr_opacity', 08:09:40 INFO - 'tart', 08:09:40 INFO - 'tscrollx', 08:09:40 INFO - 'cart']}, 08:09:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'tests': ['tp5o']}, 08:09:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'talos_options': ['--e10s'], 08:09:40 INFO - 'tests': ['tp5o']}, 08:09:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'talos_options': ['--xperf_path', 08:09:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:09:40 INFO - 'tests': ['tp5n']}, 08:09:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:09:40 INFO - 'talos_options': ['--e10s', 08:09:40 INFO - '--xperf_path', 08:09:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:09:40 INFO - 'tests': ['tp5n']}}, 08:09:40 INFO - 'talos.zip': {'path': '', 08:09:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:09:40 INFO - Running post-action listener: _resource_record_post_action 08:09:40 INFO - ##### 08:09:40 INFO - ##### Running create-virtualenv step. 08:09:40 INFO - ##### 08:09:40 INFO - Running pre-action listener: _resource_record_pre_action 08:09:40 INFO - Running main action method: create_virtualenv 08:09:40 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 08:09:40 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 08:09:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 08:09:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:09:40 INFO - Using real prefix '/usr' 08:09:40 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 08:09:41 INFO - Installing distribute.............................................................................................................................................................................................done. 08:09:43 INFO - Installing pip.................done. 08:09:43 INFO - Return code: 0 08:09:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 08:09:43 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')]} 08:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 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')]} 08:09:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:43 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 08:09:43 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 08:09:43 INFO - Using env: {'DISPLAY': ':0', 08:09:43 INFO - 'HOME': '/home/cltbld', 08:09:43 INFO - 'LANG': 'en_US.UTF-8', 08:09:43 INFO - 'LANGUAGE': 'en_US:en', 08:09:43 INFO - 'LOGNAME': 'cltbld', 08:09:43 INFO - 'MAIL': '/var/mail/cltbld', 08:09:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:43 INFO - 'MOZ_NO_REMOTE': '1', 08:09:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:43 INFO - 'NO_EM_RESTART': '1', 08:09:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:43 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:43 INFO - 'SHELL': '/bin/bash', 08:09:43 INFO - 'SHLVL': '1', 08:09:43 INFO - 'TERM': 'linux', 08:09:43 INFO - 'TMOUT': '86400', 08:09:43 INFO - 'USER': 'cltbld', 08:09:43 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:43 INFO - '_': '/tools/buildbot/bin/python'} 08:09:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:43 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 08:09:43 INFO - Cleaning up... 08:09:43 INFO - Return code: 0 08:09:43 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 08:09:43 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')]} 08:09:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 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')]} 08:09:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:43 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:43 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 08:09:43 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 08:09:43 INFO - Using env: {'DISPLAY': ':0', 08:09:43 INFO - 'HOME': '/home/cltbld', 08:09:43 INFO - 'LANG': 'en_US.UTF-8', 08:09:43 INFO - 'LANGUAGE': 'en_US:en', 08:09:43 INFO - 'LOGNAME': 'cltbld', 08:09:43 INFO - 'MAIL': '/var/mail/cltbld', 08:09:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:43 INFO - 'MOZ_NO_REMOTE': '1', 08:09:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:43 INFO - 'NO_EM_RESTART': '1', 08:09:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:43 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:43 INFO - 'SHELL': '/bin/bash', 08:09:43 INFO - 'SHLVL': '1', 08:09:43 INFO - 'TERM': 'linux', 08:09:43 INFO - 'TMOUT': '86400', 08:09:43 INFO - 'USER': 'cltbld', 08:09:43 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:43 INFO - '_': '/tools/buildbot/bin/python'} 08:09:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:43 INFO - Downloading/unpacking psutil>=0.7.1 08: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 08: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 08: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 08: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 08: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 08: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 08:09:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 08:09:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:09:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:09:45 INFO - Installing collected packages: psutil 08:09:45 INFO - Running setup.py install for psutil 08:09:45 INFO - building 'psutil._psutil_linux' extension 08:09:45 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 08:09:45 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 08:09:45 INFO - building 'psutil._psutil_posix' extension 08:09:45 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 08:09:45 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 08:09:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:09:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:09:45 INFO - Successfully installed psutil 08:09:45 INFO - Cleaning up... 08:09:45 INFO - Return code: 0 08:09:45 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 08: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')]} 08:09:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08: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')]} 08:09:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:45 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:45 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 08:09:45 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 08:09:45 INFO - Using env: {'DISPLAY': ':0', 08:09:45 INFO - 'HOME': '/home/cltbld', 08:09:45 INFO - 'LANG': 'en_US.UTF-8', 08:09:45 INFO - 'LANGUAGE': 'en_US:en', 08:09:45 INFO - 'LOGNAME': 'cltbld', 08:09:45 INFO - 'MAIL': '/var/mail/cltbld', 08:09:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:45 INFO - 'MOZ_NO_REMOTE': '1', 08:09:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:45 INFO - 'NO_EM_RESTART': '1', 08:09:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:45 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:45 INFO - 'SHELL': '/bin/bash', 08:09:45 INFO - 'SHLVL': '1', 08:09:45 INFO - 'TERM': 'linux', 08:09:45 INFO - 'TMOUT': '86400', 08:09:45 INFO - 'USER': 'cltbld', 08:09:45 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:45 INFO - '_': '/tools/buildbot/bin/python'} 08:09:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:46 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:09:46 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 08:09:46 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 08:09:46 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 08:09:46 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 08:09:46 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 08:09:46 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 08:09:48 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:09:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:09:48 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:09:48 INFO - Installing collected packages: mozsystemmonitor 08:09:48 INFO - Running setup.py install for mozsystemmonitor 08:09:48 INFO - Successfully installed mozsystemmonitor 08:09:48 INFO - Cleaning up... 08:09:48 INFO - Return code: 0 08:09:48 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 08: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')]} 08:09:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08: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')]} 08:09:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:48 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:48 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 08:09:48 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 08:09:48 INFO - Using env: {'DISPLAY': ':0', 08:09:48 INFO - 'HOME': '/home/cltbld', 08:09:48 INFO - 'LANG': 'en_US.UTF-8', 08:09:48 INFO - 'LANGUAGE': 'en_US:en', 08:09:48 INFO - 'LOGNAME': 'cltbld', 08:09:48 INFO - 'MAIL': '/var/mail/cltbld', 08:09:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:48 INFO - 'MOZ_NO_REMOTE': '1', 08:09:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:48 INFO - 'NO_EM_RESTART': '1', 08:09:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:48 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:48 INFO - 'SHELL': '/bin/bash', 08:09:48 INFO - 'SHLVL': '1', 08:09:48 INFO - 'TERM': 'linux', 08:09:48 INFO - 'TMOUT': '86400', 08:09:48 INFO - 'USER': 'cltbld', 08:09:48 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:48 INFO - '_': '/tools/buildbot/bin/python'} 08:09:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:48 INFO - Downloading/unpacking blobuploader==1.2.4 08:09:48 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 08:09:48 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 08:09:48 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 08:09:48 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 08:09:48 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 08:09:48 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 08:09:50 INFO - Downloading blobuploader-1.2.4.tar.gz 08:09:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:09:50 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 08:09:50 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 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 08:09:50 INFO - Downloading docopt-0.6.1.tar.gz 08:09:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 08:09:51 INFO - Installing collected packages: blobuploader, requests, docopt 08:09:51 INFO - Running setup.py install for blobuploader 08:09:51 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:09:51 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 08:09:51 INFO - Running setup.py install for requests 08:09:51 INFO - Running setup.py install for docopt 08:09:51 INFO - Successfully installed blobuploader requests docopt 08:09:51 INFO - Cleaning up... 08:09:51 INFO - Return code: 0 08:09:51 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:09:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:51 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:51 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 08:09:51 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 08:09:51 INFO - Using env: {'DISPLAY': ':0', 08:09:51 INFO - 'HOME': '/home/cltbld', 08:09:51 INFO - 'LANG': 'en_US.UTF-8', 08:09:51 INFO - 'LANGUAGE': 'en_US:en', 08:09:51 INFO - 'LOGNAME': 'cltbld', 08:09:51 INFO - 'MAIL': '/var/mail/cltbld', 08:09:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:51 INFO - 'MOZ_NO_REMOTE': '1', 08:09:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:51 INFO - 'NO_EM_RESTART': '1', 08:09:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:51 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:51 INFO - 'SHELL': '/bin/bash', 08:09:51 INFO - 'SHLVL': '1', 08:09:51 INFO - 'TERM': 'linux', 08:09:51 INFO - 'TMOUT': '86400', 08:09:51 INFO - 'USER': 'cltbld', 08:09:51 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:51 INFO - '_': '/tools/buildbot/bin/python'} 08:09:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:09:51 INFO - Running setup.py (path:/tmp/pip-DwxrKB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:09:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:09:51 INFO - Running setup.py (path:/tmp/pip-gl_9ji-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:09:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:09:52 INFO - Running setup.py (path:/tmp/pip-Qxwxo5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:09:52 INFO - Running setup.py (path:/tmp/pip-Ay7aTg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:09:52 INFO - Running setup.py (path:/tmp/pip-xfKGnG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:09:52 INFO - Running setup.py (path:/tmp/pip-plXO8v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:09:52 INFO - Running setup.py (path:/tmp/pip-6ynRpN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:09:52 INFO - Running setup.py (path:/tmp/pip-rsBBWq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:09:52 INFO - Running setup.py (path:/tmp/pip-YDZrc1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:09:52 INFO - Running setup.py (path:/tmp/pip-eVBZKB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:09:52 INFO - Running setup.py (path:/tmp/pip-OiWKsN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:09:52 INFO - Running setup.py (path:/tmp/pip-2zenq3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:09:52 INFO - Running setup.py (path:/tmp/pip-bI01Gt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:09:52 INFO - Running setup.py (path:/tmp/pip-hjI_Lw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:09:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:09:52 INFO - Running setup.py (path:/tmp/pip-plgGyj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:09:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:09:53 INFO - Running setup.py (path:/tmp/pip-VpLXvQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:09:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:09:53 INFO - Running setup.py (path:/tmp/pip-Cvq45j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:09:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:09:53 INFO - Running setup.py install for manifestparser 08:09:53 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Running setup.py install for mozcrash 08:09:53 INFO - Running setup.py install for mozdebug 08:09:53 INFO - Running setup.py install for mozdevice 08:09:53 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Running setup.py install for mozfile 08:09:53 INFO - Running setup.py install for mozhttpd 08:09:53 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Running setup.py install for mozinfo 08:09:53 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Running setup.py install for mozInstall 08:09:53 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 08:09:53 INFO - Running setup.py install for mozleak 08:09:54 INFO - Running setup.py install for mozlog 08:09:54 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Running setup.py install for moznetwork 08:09:54 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Running setup.py install for mozprocess 08:09:54 INFO - Running setup.py install for mozprofile 08:09:54 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Running setup.py install for mozrunner 08:09:54 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Running setup.py install for mozscreenshot 08:09:54 INFO - Running setup.py install for moztest 08:09:54 INFO - Running setup.py install for mozversion 08:09:54 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 08:09:54 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:09:54 INFO - Cleaning up... 08:09:54 INFO - Return code: 0 08:09:54 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:09:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:09:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:54 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:54 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 08:09:54 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 08:09:54 INFO - Using env: {'DISPLAY': ':0', 08:09:54 INFO - 'HOME': '/home/cltbld', 08:09:54 INFO - 'LANG': 'en_US.UTF-8', 08:09:54 INFO - 'LANGUAGE': 'en_US:en', 08:09:54 INFO - 'LOGNAME': 'cltbld', 08:09:54 INFO - 'MAIL': '/var/mail/cltbld', 08:09:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:54 INFO - 'MOZ_NO_REMOTE': '1', 08:09:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:54 INFO - 'NO_EM_RESTART': '1', 08:09:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:54 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:54 INFO - 'SHELL': '/bin/bash', 08:09:54 INFO - 'SHLVL': '1', 08:09:54 INFO - 'TERM': 'linux', 08:09:54 INFO - 'TMOUT': '86400', 08:09:54 INFO - 'USER': 'cltbld', 08:09:54 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:54 INFO - '_': '/tools/buildbot/bin/python'} 08:09:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:09:55 INFO - Running setup.py (path:/tmp/pip-juvpiR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:09:55 INFO - Running setup.py (path:/tmp/pip-Y7VIVM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:09:55 INFO - Running setup.py (path:/tmp/pip-q5gkud-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:09:55 INFO - Running setup.py (path:/tmp/pip-qQcAEZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:09:55 INFO - Running setup.py (path:/tmp/pip-7ECB4F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:09:55 INFO - Running setup.py (path:/tmp/pip-_uiycs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:09:55 INFO - Running setup.py (path:/tmp/pip-PqUYL9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:09:55 INFO - Running setup.py (path:/tmp/pip-dhLGIh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:09:55 INFO - Running setup.py (path:/tmp/pip-D8s6V4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:09:55 INFO - Running setup.py (path:/tmp/pip-eLzYvM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:09:55 INFO - Running setup.py (path:/tmp/pip-VPnFHp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:09:55 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)) 08:09:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:09:55 INFO - Running setup.py (path:/tmp/pip-B8qhYP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:09:56 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)) 08:09:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:09:56 INFO - Running setup.py (path:/tmp/pip-yEn7Vm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:09:56 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)) 08:09:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:09:56 INFO - Running setup.py (path:/tmp/pip-u9MHJt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:09:56 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)) 08:09:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:09:56 INFO - Running setup.py (path:/tmp/pip-9CBlWp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:09:56 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)) 08:09:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:09:56 INFO - Running setup.py (path:/tmp/pip-fdq0zu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:09:56 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)) 08:09:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:09:56 INFO - Running setup.py (path:/tmp/pip-XyvSnh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:09:56 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)) 08:09:56 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)) 08:09:56 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)) 08:09:56 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)) 08:09:56 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)) 08:09:56 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)) 08:09:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 08:09:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:09:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:09:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:09:58 INFO - Downloading blessings-1.6.tar.gz 08:09:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 08:09:58 INFO - Installing collected packages: blessings 08:09:58 INFO - Running setup.py install for blessings 08:09:58 INFO - Successfully installed blessings 08:09:58 INFO - Cleaning up... 08:09:58 INFO - Return code: 0 08:09:58 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 08:09:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:09:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:09:58 INFO - Reading from file tmpfile_stdout 08:09:58 INFO - Current package versions: 08:09:58 INFO - argparse == 1.2.1 08:09:58 INFO - blessings == 1.6 08:09:58 INFO - blobuploader == 1.2.4 08:09:58 INFO - docopt == 0.6.1 08:09:58 INFO - manifestparser == 1.1 08:09:58 INFO - mozInstall == 1.12 08:09:58 INFO - mozcrash == 0.17 08:09:58 INFO - mozdebug == 0.1 08:09:58 INFO - mozdevice == 0.48 08:09:58 INFO - mozfile == 1.2 08:09:58 INFO - mozhttpd == 0.7 08:09:58 INFO - mozinfo == 0.9 08:09:58 INFO - mozleak == 0.1 08:09:58 INFO - mozlog == 3.1 08:09:58 INFO - moznetwork == 0.27 08:09:58 INFO - mozprocess == 0.22 08:09:58 INFO - mozprofile == 0.28 08:09:58 INFO - mozrunner == 6.11 08:09:58 INFO - mozscreenshot == 0.1 08:09:58 INFO - mozsystemmonitor == 0.0 08:09:58 INFO - moztest == 0.7 08:09:58 INFO - mozversion == 1.4 08:09:58 INFO - psutil == 3.1.1 08:09:58 INFO - requests == 1.2.3 08:09:58 INFO - wsgiref == 0.1.2 08:09:58 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:09:58 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')]} 08:09:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:58 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')]} 08:09:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:58 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:58 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 08:09:58 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 08:09:58 INFO - Using env: {'DISPLAY': ':0', 08:09:58 INFO - 'HOME': '/home/cltbld', 08:09:58 INFO - 'LANG': 'en_US.UTF-8', 08:09:58 INFO - 'LANGUAGE': 'en_US:en', 08:09:58 INFO - 'LOGNAME': 'cltbld', 08:09:58 INFO - 'MAIL': '/var/mail/cltbld', 08:09:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:58 INFO - 'MOZ_NO_REMOTE': '1', 08:09:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:58 INFO - 'NO_EM_RESTART': '1', 08:09:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:58 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:58 INFO - 'SHELL': '/bin/bash', 08:09:58 INFO - 'SHLVL': '1', 08:09:58 INFO - 'TERM': 'linux', 08:09:58 INFO - 'TMOUT': '86400', 08:09:58 INFO - 'USER': 'cltbld', 08:09:58 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:58 INFO - '_': '/tools/buildbot/bin/python'} 08:09:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 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)) 08:09:58 INFO - Cleaning up... 08:09:58 INFO - Return code: 0 08:09:58 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 08:09:58 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')]} 08:09:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:09:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:58 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')]} 08:09:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:09:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:09:58 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:09:58 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 08:09:58 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 08:09:58 INFO - Using env: {'DISPLAY': ':0', 08:09:58 INFO - 'HOME': '/home/cltbld', 08:09:58 INFO - 'LANG': 'en_US.UTF-8', 08:09:58 INFO - 'LANGUAGE': 'en_US:en', 08:09:58 INFO - 'LOGNAME': 'cltbld', 08:09:58 INFO - 'MAIL': '/var/mail/cltbld', 08:09:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:09:58 INFO - 'MOZ_NO_REMOTE': '1', 08:09:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:09:58 INFO - 'NO_EM_RESTART': '1', 08:09:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:09:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:09:58 INFO - 'PWD': '/builds/slave/test-pgo', 08:09:58 INFO - 'SHELL': '/bin/bash', 08:09:58 INFO - 'SHLVL': '1', 08:09:58 INFO - 'TERM': 'linux', 08:09:58 INFO - 'TMOUT': '86400', 08:09:58 INFO - 'USER': 'cltbld', 08:09:58 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:09:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:09:58 INFO - '_': '/tools/buildbot/bin/python'} 08:09:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:09:59 INFO - Downloading/unpacking jsonschema 08:09:59 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 08:09:59 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 08:09:59 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 08:09:59 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 08:09:59 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 08:09:59 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 08:10:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:10:01 INFO - Downloading/unpacking functools32 (from jsonschema) 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 INFO - Downloading functools32-3.2.3-2.tar.gz 08:10:01 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 08:10:01 INFO - warning: no files found matching '*.txt' 08:10:01 INFO - no previously-included directories found matching 'build' 08:10:01 INFO - no previously-included directories found matching 'dist' 08:10:01 INFO - no previously-included directories found matching '.git*' 08:10:01 INFO - Installing collected packages: jsonschema, functools32 08:10:01 INFO - Running setup.py install for functools32 08:10:01 INFO - warning: no files found matching '*.txt' 08:10:01 INFO - no previously-included directories found matching 'build' 08:10:01 INFO - no previously-included directories found matching 'dist' 08:10:01 INFO - no previously-included directories found matching '.git*' 08:10:01 INFO - Successfully installed jsonschema functools32 08:10:01 INFO - Cleaning up... 08:10:01 INFO - Return code: 0 08:10:01 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 08:10:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:10:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:10:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:10:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:10:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:10:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:10:01 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 0x7f0d9af31f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcc78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd946b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, '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': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', '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 08:10:01 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 08:10:01 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 08:10:01 INFO - Using env: {'DISPLAY': ':0', 08:10:01 INFO - 'HOME': '/home/cltbld', 08:10:01 INFO - 'LANG': 'en_US.UTF-8', 08:10:01 INFO - 'LANGUAGE': 'en_US:en', 08:10:01 INFO - 'LOGNAME': 'cltbld', 08:10:01 INFO - 'MAIL': '/var/mail/cltbld', 08:10:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:10:01 INFO - 'MOZ_NO_REMOTE': '1', 08:10:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:10:01 INFO - 'NO_EM_RESTART': '1', 08:10:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:10:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:10:01 INFO - 'PWD': '/builds/slave/test-pgo', 08:10:01 INFO - 'SHELL': '/bin/bash', 08:10:01 INFO - 'SHLVL': '1', 08:10:01 INFO - 'TERM': 'linux', 08:10:01 INFO - 'TMOUT': '86400', 08:10:01 INFO - 'USER': 'cltbld', 08:10:01 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:10:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:10:01 INFO - '_': '/tools/buildbot/bin/python'} 08:10:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:10:01 INFO - Downloading/unpacking flake8 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:01 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 08:10:03 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 08:10:03 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 08:10:03 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:03 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 08:10:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 08:10:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:10:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:10:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:10:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:10:04 INFO - no previously-included directories found matching 'docs/_build' 08:10:04 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 08:10:04 INFO - Running setup.py install for pep8 08:10:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:10:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:10:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:10:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:10:04 INFO - no previously-included directories found matching 'docs/_build' 08:10:04 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 08:10:04 INFO - Successfully installed flake8 mccabe pyflakes pep8 08:10:04 INFO - Cleaning up... 08:10:04 INFO - Return code: 0 08:10:04 INFO - Running post-action listener: _resource_record_post_action 08:10:04 INFO - Running post-action listener: _start_resource_monitoring 08:10:04 INFO - Starting resource monitoring. 08:10:04 INFO - ##### 08:10:04 INFO - ##### Running install step. 08:10:04 INFO - ##### 08:10:04 INFO - Running pre-action listener: _resource_record_pre_action 08:10:04 INFO - Running main action method: install 08:10:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:10:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:10:04 INFO - Reading from file tmpfile_stdout 08:10:04 INFO - Detecting whether we're running mozinstall >=1.0... 08:10:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 08:10:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 08:10:04 INFO - Reading from file tmpfile_stdout 08:10:04 INFO - Output received: 08:10:04 INFO - Usage: mozinstall [options] installer 08:10:04 INFO - Options: 08:10:04 INFO - -h, --help show this help message and exit 08:10:04 INFO - -d DEST, --destination=DEST 08:10:04 INFO - Directory to install application into. [default: 08:10:04 INFO - "/builds/slave/test-pgo"] 08:10:04 INFO - --app=APP Application being installed. [default: firefox] 08:10:04 INFO - mkdir: /builds/slave/test-pgo/build/application 08:10:04 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'] 08:10:04 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 08:10:21 INFO - Reading from file tmpfile_stdout 08:10:21 INFO - Output received: 08:10:21 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 08:10:21 INFO - Running post-action listener: _resource_record_post_action 08:10:21 INFO - ##### 08:10:21 INFO - ##### Running run-tests step. 08:10:21 INFO - ##### 08:10:21 INFO - Running pre-action listener: _resource_record_pre_action 08:10:21 INFO - Running main action method: run_tests 08:10:21 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 08:10:21 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 08:10:21 INFO - Python 2.7.3 08:10:21 INFO - Return code: 0 08:10:21 INFO - grabbing minidump binary from tooltool 08:10:21 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')]} 08:10:21 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 0xd8f1d0>, '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 0xd92750>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd92be0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 08:10:21 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 08:10:21 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 08:10:21 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:10:21 INFO - Return code: 0 08:10:21 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 08:10:21 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 08:10:21 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 08:10:21 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 08:10:21 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 08:10:21 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 08:10:21 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 08:10:22 INFO - Return code: 0 08:10:22 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 08:10:22 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 --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-011 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 08:10:22 INFO - Using env: {'DISPLAY': ':0', 08:10:22 INFO - 'HOME': '/home/cltbld', 08:10:22 INFO - 'LANG': 'en_US.UTF-8', 08:10:22 INFO - 'LANGUAGE': 'en_US:en', 08:10:22 INFO - 'LOGNAME': 'cltbld', 08:10:22 INFO - 'MAIL': '/var/mail/cltbld', 08:10:22 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:10:22 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 08:10:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:10:22 INFO - 'MOZ_NO_REMOTE': '1', 08:10:22 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:10:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:10:22 INFO - 'NO_EM_RESTART': '1', 08:10:22 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:10:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:10:22 INFO - 'PWD': '/builds/slave/test-pgo', 08:10:22 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 08:10:22 INFO - 'SHELL': '/bin/bash', 08:10:22 INFO - 'SHLVL': '1', 08:10:22 INFO - 'TERM': 'linux', 08:10:22 INFO - 'TMOUT': '86400', 08:10:22 INFO - 'USER': 'cltbld', 08:10:22 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953', 08:10:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:10:22 INFO - '_': '/tools/buildbot/bin/python'} 08:10:22 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:10:22 INFO - mozversion application_buildid: 20160328053005 08:10:22 INFO - mozversion application_changeset: a0f366bd78a48278208304775a1166396a3daad4 08:10:22 INFO - mozversion application_display_name: Nightly 08:10:22 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:10:22 INFO - mozversion application_name: Firefox 08:10:22 INFO - mozversion application_remotingname: firefox 08:10:22 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 08:10:22 INFO - mozversion application_vendor: Mozilla 08:10:22 INFO - mozversion application_version: 48.0a1 08:10:22 INFO - mozversion platform_buildid: 20160328053005 08:10:22 INFO - mozversion platform_changeset: a0f366bd78a48278208304775a1166396a3daad4 08:10:22 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 08:10:22 INFO - mozversion platform_version: 48.0a1 08:10:22 INFO - using testdate: 1459177822 08:10:22 INFO - actual date: 1459177822 08:10:22 INFO - starting webserver on 'localhost:39766' 08:10:22 INFO - SUITE-START | Running 2 tests 08:10:22 INFO - TEST-START | dromaeo_css 08:10:22 INFO - operating with platform_type : linux_ 08:10:22 INFO - Initialising browser for dromaeo_css test... 08:10:22 INFO - TEST-INFO | started process 10907 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpX5C89O/profile http://localhost:39766/getInfo.html) 08:10:28 INFO - PROCESS | 10907 | __metrics Screen width/height:1600/1200 08:10:28 INFO - PROCESS | 10907 | colorDepth:24 08:10:28 INFO - PROCESS | 10907 | Browser inner width/height: 1024/697 08:10:28 INFO - PROCESS | 10907 | __metrics 08:10:29 ERROR - PROCESS | 10907 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 08:10:30 INFO - TEST-INFO | 10907: exit 0 08:10:30 INFO - Browser initialized. 08:10:30 INFO - Running cycle 1/1 for dromaeo_css test... 08:10:30 INFO - TEST-INFO | started process 11003 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpX5C89O/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:10:42 INFO - PROCESS | 11003 | RSS: Main: 153272320 08:10:42 INFO - PROCESS | 11003 | 08:11:32 INFO - PROCESS | 11003 | 1459177892913 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] 08:13:41 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39766/tests/dromaeo/cssquery-ext.html) 08:13:42 INFO - PROCESS | 11003 | RSS: Main: 255807488 08:13:42 INFO - PROCESS | 11003 | 08:16:44 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-ext.html (next: http://localhost:39766/tests/dromaeo/cssquery-jquery.html) 08:16:44 INFO - PROCESS | 11003 | RSS: Main: 238587904 08:16:44 INFO - PROCESS | 11003 | 08:19:46 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39766/tests/dromaeo/cssquery-mootools.html) 08:19:47 INFO - PROCESS | 11003 | RSS: Main: 242208768 08:19:47 INFO - PROCESS | 11003 | 08:22:49 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39766/tests/dromaeo/cssquery-prototype.html) 08:22:49 INFO - PROCESS | 11003 | RSS: Main: 220450816 08:22:49 INFO - PROCESS | 11003 | 08:25:52 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39766/tests/dromaeo/cssquery-yui.html) 08:25:52 INFO - PROCESS | 11003 | RSS: Main: 220696576 08:25:52 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | Cycle 1(1): loaded http://localhost:39766/tests/dromaeo/cssquery-yui.html (next: http://localhost:39766/tests/dromaeo/cssquery-dojo.html) 08:28:55 INFO - PROCESS | 11003 | RSS: Main: 264712192 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | __start_tp_report 08:28:55 INFO - PROCESS | 11003 | _x_x_mozilla_page_load 08:28:55 INFO - PROCESS | 11003 | _x_x_mozilla_page_load_details 08:28:55 INFO - PROCESS | 11003 | |i|pagename|runs| 08:28:55 INFO - PROCESS | 11003 | |0;dojo.html;3036.498977668685;3093;3124.750019998399;3130.2487403023283;3168.683131686831;5059.721715305656;5149.40781810092;5182.611304152185;5209.140491818855;5218.1650935850275;5104.438511763703;5197.688138711671;5217.217417387394;5249.8950020999555;5272.499112584308;4684.859454216362;4711.034237981215;4728.503507131753;4736.2895565665085;4834.178189707741;4823.13183626947;4829.975850120744;4831;4838.467768545457;4865.051314993578;4642.605378542811;4740.502247264022;4747.311639812208;4761.166795810736;4806.663533552653;4654.325122857201;4672.789724462407;4702.247640377557;4756.833510827139;4792.496787837262;4663.673542852001;4664.5335466453425;4688.648351373627;4695.436547614308;4741.8103275868925;5075.873103172414;5076.898462030738;5077.416097148801;5131.153359695683;5135.845924622267;5355.518003379676;5420.647657902224;5553.666779993213;5592.972035139839;5596.188552659842;5526.392096869341;5536.252605898233;5540.113581826889;5543.417941116206;5545.195946587723;5086;5168.069747445458;5184.066867963803;5189.6886186828915;5193.246979188034;5600.4959553640365;5685.459881311269;5685.886282274414;5720.885582288331;5740.483356497935;5376.731163441812;5384.865378365572;5393.110136827458;5396.568274538027;5396.892062158735;5395.649282796606;5469.15228139639;5472.042392581282;5512.50387465122;5512.751926163332;5456.154296084034;5489.451054894478;5491.2312276281355;5514.531264842453;5537.086380747212;5487.5884308677005;5491.835244942658;5491.972540137273;5493.587980901449;5494.80768173112;4009;4090.652294554937;4098.7950602469755;4190.748555086705;4238.533761286256;3737.0844143185095;3751.1934933988778;3766.7928263945746;3797.7531460454984;3866.941995870064;5258.894822103536;5260.0531904257605;5263.947360526346;5265.368155821326;5307.946920530822;5546;5558.944410555842;5561.388247292794;5561.610687251854;5618;5122.257272695439;5139.948600513947;5230.320058392461;5236.581073514109;5249.396319423316;4611.308303754464;4651.744154071491;4652.278896771006;4667.533246675373;4669.976650116728;5703.543716502752;5744.253247077853;5746.1093530502;5746.482816546531;5747;5414.945850541444;5519.641223320471;5562.610617256753;5639.971800140973;5655.349634792052;5694.686792226302;5716.857078573069;5718.599698021265;5725.971370143289;5728.570357223141;5405.837824865261;5440.809571664972;5442.6462279951675;5443.646162999393;5452.672839629635;5344.25180474726;5440.292761940922;5532.114861622121;5550.306211723535;5556.972215138899;5280.920786188133;5283.603729720363;5291.629585928948;5308.362996440297;5309.548688361378;5254.5533629641905;5275.868103297448;5279.868003299948;5299.2316114164005;5302.840914772563;5155.716435596079;5202.271681964604;5266.447023062677;5299.046171688979;5315.867103322294;5379.73101344939;5389.865253368697;5392.649477783932;5419.3225846769155;5422.457754224546;5213.45258747826;5315.601329900351;5316.867078323073;5322.414534401135;5378.5966052547 08:28:55 INFO - PROCESS | 11003 | |1;ext.html;553.7554139067491;557.4314199516493;562.8142712904742;567.631039824114;589.6786251492937;39804.601953980455;39981.80009099954;39987.20025599486;40100.39849402254;40200.597994020085;40976;41084.794576027154;41396.79301603488;41425.58574414255;41452.792736036354;8637.611307491146;8832.955835220815;8836.469811811312;8842.33682473817;8843.071477494866;8660.437071590359;8830.646774129027;8833.293336533094;8836.646534138627;8846.823063538724;9008.864867027;9076.410033347844;9099.681511147111;9100.590473428678;9104.726858194264;8955;9018.59416326267;9035.232005279559;9041;9043.547822608909;8877.245434138042;8993.055729148411;8994.460332380013;9017.053209412983;9018.909810901872;41995.58004419947;42224.1555168898;42316;42325.36511952323;42422;3561.679448849616;3788.147666774981;3858.7491813032343;4095.344744840841;4417.845375411877;31497.21256968571;31896.840515797503;32171.356572868644;32399.352012959607;32824.83587582071;4215.241256573816;4215.6720633000505;4266.466691663542;4332.631726303268;4340.305551111838;217476;217901;218758.90620546954;218820;219172;53194.468055318954;59202.11196832051;60236.69881650564;60254;60265.39734602685;49062.77343066452;49376;66505.33494665088;67072.6646366765;67485.6625716878;16658.750118748227;16803.159842008095;16852.24164912582;16853.915730421268;16890.239939202766;12682.873171268353;12784.232946023269;12787;12808.93595532035;12824.743505129845;17709.380171694185;17988.55028624295;20208.898955505127;20622.072006759732;20704;7221.977846202966;7355;7517.661705223169;7545.849083018418;7645.388368930472;1010.782681723433;1011.1910471622673;1070.6038765656601;1087.7212240356441;1136.778328225988;30462.847685761873;32210.19474513156;32329.676703232668;32341;32481.67518324834;1129.593346395297;1130.6551501792032;1141.1612464838338;1150.9021733152777;1176.647005898227;16137.838621613633;16784.748228776578;16876.746848797276;16919.323227070778;17299.827001730075;382587;383952;387530;388786;388929;56654.15018774722;56999.43000570024;57082.7145864268;57137.71431142818;57168.428315717145;1207.7825991321647;1353.5195005773005;1388.2017839742189;1418.680796820707;1420.3679362683713;28956.7104328954;30190.245243869078;30461.847690761406;31032.68967310298;32874.67125328716;47015.76492117518;47016.05967880555;47494;47513.76243118762;47515.762421187675;214449;214466;214684;214869;214949;32043.519347210276;32446;35958.8202058988;36220.913372598865;36236;40673.38989915213;43581.564184357754;46689.76655116703;47796.761016194694;47913.8021549464;38767.22465550729;39127.608723912395;39172.41241381439;39571.77081253674;43262.351064734685;39062.804685976385;40074;40480.797596011835;40521.392179117924;40969.79515102405;40138.44610632801;40277.1944561113;40659.796701016305;41209.38185927273;41391.7930410346;33632.49551256684;36191.63808361988;36372.454413183295;36384.27231455409;36703.265934681694;27920.44159116847;28242;28301;28463.715362846935;28510.42979140364 08:28:55 INFO - PROCESS | 11003 | |2;jquery.html;371.2926874304449;371.708209055891;372.8080038780028;378.08503421719433;381.97326187166874;17417.477475675732;17817.37639182629;18754.437366879;18757.90621046893;18784.812151878476;17892.194851231692;17938.730919036225;18327.17527711253;18338.174782134804;18364.908175459102;5425.294711687485;5648.03983322834;5655.604107712462;5673.659580425167;5683.460071293221;4080.8163632636456;5534.391216966131;6001.06983417571;6236.781712640059;6261.405166509197;6184.8144555663175;6186.350433204516;6212.099245609384;6217.440430361266;6220.751169953196;5873.236479257691;6035.7283922223605;6050.878982420327;6051.062085376751;6052.425019623129;3709.3879509880835;5089.796408143669;5295.338082739658;5422.186671999192;5438.129899216146;21335.573288534142;21347.893260533598;21516.46208844776;21693.783062169492;21711.565768684537;2275.977240227593;2369.312899259213;2447.510497900409;2720.2111387697546;2752.862356882148;13555.457781688721;13614.115082519604;14153.504627337994;14338.56984290473;14704.632384190374;1998.8300994415492;2012.2655230840785;2041.173324803457;2067.3487851326786;2144.571085782834;80419.59790201012;80851.5957420215;82881.58559207225;83088;83613;16197.919010405109;16508;16517.834821651628;16612.335506579602;16803.495895123167;28325.43349133006;28396.148115556567;28621.284467888054;28644.856775716406;28797.568036479468;8997;9458;9520.095590918852;9591.808163836684;9609.423434593808;7982.08206056311;7988.320992715568;8062.7581172564915;8123.837523249502;8149.918500814916;7911.5363657722355;7973;8085.788973384045;8136.80306317291;8319.292860106958;2784.7354501322343;3202.5676533668125;3244.6430892601793;3287.934241315208;3378.172347774811;907.8955920069144;947.9431234125836;991.9355241909398;1041.0890470838017;1043.546057465005;17803;17932.282708691768;18615.25538978453;18784.53038674044;18971;982.7543114221445;1006.4917216805467;1014.2038499777639;1052.4264275969615;1066.8666416697913;10477.738056548495;10604.946975265075;10609.84085238722;10714.624988125379;10731.83902241467;482516;489708;494013;497413;514058;77074.22925770783;81753.59123204346;82376.88115594316;82837.58581207055;83128;1050.5535147562255;1068.58859339155;1103.1450625765096;1112.816385296417;1119.2948442481186;16514.66970660604;16597.253123609225;16729.330826766793;16833.91583042077;16867.578310542336;34503;36326;37198.6280137206;38000.23999520049;38452.42321365238;53381.19928201003;53390.46609533855;53421.46578534165;53546.196807048706;53931;8240.21717936795;8467.578887463193;8512.957435212784;8532.658693652184;8744.475331480131;9439.433633981984;9546.949835518226;9637.22902167839;12329.93835030855;13789.448422063006;11996.340201288664;12013.159078864395;12148.088893332859;12195.268283902995;12221.266723996589;11893.940530297294;11956.402179890796;11993.1005174614;12135.939320303341;12282.75434491323;11553.595624153115;11729.648110556696;11860.22908510944;11913.463894124958;12285.508579656713;8517.616707248064;8685.39202255836;8719.52042637661;8736.301095912439;8789.296856251613;12022.63932082039;12072;12094.213876098025;12120.575779847662;12185.87814121883 08:28:55 INFO - PROCESS | 11003 | |3;mootools.html;1361.2717196299982;1488.851114888511;1500.8874334424918;1620.8784341174407;1786.2587026384042;7730.690772369106;7850.332721718653;7868.331191848685;7872.409569282312;7883.487573307731;7505.061867266591;7657.770266891988;7677.846443071136;7678.155402905676;7684.923150768491;1960.803919608035;2122.8301735861173;2163.2536774812665;2191.736991561011;2214.833887458439;2212.2478357358495;2218.279059305732;2219.4007617943143;2219.844610877239;2220.000999550201;2114.8413868959888;2240.439890027493;2241.7870302321335;2242.2040175737625;2242.7981481666648;2183.2031308572336;2194.47332640166;2196.9890150549227;2263.807576356012;2265.920692775745;2158.3848603148026;2166.360923527563;2176.4450065233423;2179.400664817172;2242.338510139513;8163.469374490639;8179.877301840477;8203.05664848544;8213.301869341114;8219.219174178443;5088.160453525164;5263.763130659129;5277;5277.525022747933;5278;3330.933381332384;3332.7000569948823;3332.950005749916;3433.3476639438427;3483.89548313551;1117.6870476266658;1133.6315697398295;1138.6356365962895;1152.3604399558242;1153.9942300288528;11591.536338546448;11616.303021818718;11619.593314233962;11642.708932276677;11674.124440666985;4605.654575906753;4609.101225261109;4664.230401983703;4684.765761711901;4720.740359280273;9884.901150988542;9896.604135834486;9905.405675659484;9927.354721943195;9943.254255930835;4571.3600095986585;5218.060749065129;5223.320968274176;5223.686578805284;5235.58115350771;4527.981204229022;4560.156371071363;4572.245579479415;4580.198465268565;4608.585227329557;3699.075231192202;3789.6589306962505;3816.7328287020196;3821.4458903458844;3827.13889374894;1234.796258617318;1237.1710953661068;1250.056207563302;1253.9059570532247;1255.1026016398318;1412.8022076909242;1423.160335402097;1435.440178330452;1443.2422977936667;1454.8181477315336;7941.166177551389;7963.800904977306;8006.359491240687;8014.318782903402;8024.317932975646;481.0643298783902;481.67727622493015;488.05561239001935;488.4626910398533;494.25614450252857;6159.722812473449;6160.414760597736;6202.658853763086;6210.378962103844;6212.844678882973;9447.622095116256;9704.514774261399;9748.902510974942;9754.561044753003;9763.511824408894;9398.906010939803;9524.714258572254;9568.378055426376;9570.61717531305;9601.087896649808;7234.493585448968;7320.560766354142;7380.335769780745;7395.778126656101;7409.147947986051;7562.508436951581;7591.772246832604;7695.88456173169;7707.306342429209;7909.209079092045;8744.825103498022;9029.81940361176;9136.132067453582;9140.497272650067;9143.26853851677;9141.542922853698;9145;9284.95357523208;9352.485613291334;9379.671711490066;6611.404973552403;7001.089858318386;7003.404710599452;7080.2919708028785;7297;7688.615569221404;7692.115406728298;7710.460267781202;7772.261635144652;7901.723439679584;6945.930540694731;7040.929590704232;7155.570665760071;7197.244289349543;7256.310650488195;7026.156861176487;7059.929400705927;7122.180949190702;7178.892316615151;7231.3130252625915;7231.349178573953;7433.145188303414;7470.925290747023;7487.363574096263;7494.288042635941;6907.378335949788;6911.654417279216;6943;6943.756968506078;6949;6983.476239282176;7017.228104908558;7031.261717519791;7065.576065435885;7091.432685385053 08:28:55 INFO - PROCESS | 11003 | |4;prototype.html;319.3485290008383;327.7689229093491;332.6573629161964;346.3194822174427;346.42666387129304;5923.407659234074;5937.435943585358;5950.5834591578605;5951.226340575725;5980.1926739890105;5885.646861188321;5901.616394934337;5914.817036592688;5921.052631578948;5950.137230101644;4321.503027151886;4485.618722408599;4543.977280113595;4559.407277053979;4579.358889755437;4564.452265728118;4574.428196475441;4612.561806628365;4623.329617205503;4629.490756016836;4596.057808149338;4599.494055653875;4604.3784089147875;4604.539546045402;4612.146752850716;4345.435093437849;4441.911161776762;4520.864374068783;4530.841420550298;4540.046590216059;3991.1818077294083;3998.1204135090525;4005.559388467266;4009.5990400959963;4015.6988225883174;5712.600117991742;5715.942840571583;5718.142278658234;5719.28508936383;5722.885542289173;5316.255724198615;5321.680699158062;5323.22813192085;5333.759980800874;5341.599380046512;6243.937560624427;6248.750049997994;6249.0938813871735;6255.499560035232;6264.498840092827;4233.597808208216;4337.566243375669;4342.978285108554;4505.5269196734525;4508.211063063951;6447.387498187664;6470.417662410358;6474.773382931622;6493.383128602775;6511.153550038464;4486.730796152176;4492.191405547033;4498.190325741332;4501.909961800746;4508.864734057984;4532.161550113239;4548.47692515365;4552.180607490617;4555.453345598549;4560.087982403533;5254.500822421864;5255.237990491358;5256.947430525723;5257.158854583325;5269.736513174326;6116.17431646722;6294.874102518015;6309.274433440213;6322.936770632235;6328.778492752824;1570.4738912464225;1582.9208539573206;1588.356715530212;1589.5787616281464;1590.8568228859458;959.7408699651195;1046.1212581431635;1046.1264843855313;1047.2773786087728;1061.9628313009162;5943.762249509971;5948.226730525004;5964.284285885635;5965.164876917235;5966.0454327307425;6402.007688808242;6435.485161187094;6439.517036222208;6441.32366101562;6453.096566480696;6025.126356678257;6025.186599809057;6029.246344206974;6029.698515074228;6037.275526936708;3431.4509678451327;3481.216726236627;3483.773554718935;3489.7557170998293;3490.441529355291;6582.308857569982;6664.400203981568;6697.966510167418;6754.527183097136;6838.452923766087;6668.933310666928;6696.06255124283;6700.530962832652;6705.061291419205;6716;6783.18601767791;6784.491163162783;6792.76225332111;6793.048973143863;6800.557963732342;6546.770863019771;6555.2133743951035;6576.572522786004;6581.572197807127;6585.868282634417;6356.968215158895;6494.7077381517;6495.220573531206;6518.902216466851;6535.5425120241125;6792.524523283323;6801.89797153053;6805.3875151236625;6817.079694241214;6821.113255276782;4507.053518761097;4553.225951588304;4560.087982403466;4562.429696287964;4564.360989461412;6563.474922006323;6576.868462630816;6578.736850525926;6585.604863708193;6587.835304117435;6358.936410635834;6362;6366;6369.426751592194;6370.29926708071;6198.81403557894;6385.265694445198;6397.808065758035;6399.904001440075;6402.1357116790505;6239.594426362272;6282.057691346152;6282.1519094921605;6285.748570057147;6296.779612713533;6429.196350456193;6430.549861509649;6431.228252609717;6432.614043157426;6446.29090800021;5989.490893273946;6079.908801368071;6282.560220784501;6284.3087260402235;6291.150694656163 08:28:55 INFO - PROCESS | 11003 | |5;yui.html;819.844229596377;822.1285437436318;863.8401895649301;873.3755364914085;914.391929366971;13954.930225348871;14157;14173.220472873987;14211.928940355298;15335.539933801976;14627.122372657648;14764.704705905875;14794.40822367104;14893.553193404188;14910.329035193416;670.7317073170722;840.4831028917233;841.3605659698612;851.5486792000249;865.3942240431692;849.4733265375445;857.7898414888361;859.9269062129727;861.8534849075672;862.1550880137469;889.6396959231522;893.2630579771682;894;896.256107430834;897.1118592593351;701.9298070192991;867.8437881181385;873.462820365477;874.021096372061;879.9384043116985;637.8245982354844;639.2744235292929;639.3191251317332;639.7217210513442;640.2413140428561;13254.668633284246;13284.667883302898;13314.667133321647;13325.200487970753;13378.929685625126;13697.520586779416;13945.16329020262;14080.859191408057;14446.328498331604;14476.855231447656;10806.459677016197;11281.097512199005;11286.774264514746;11354.48904799286;11553.653390398302;3770.754900931458;3771.6039815819217;3825.6556909878245;3844.711646626486;3927.2341893330813;53977.46022539763;54621.453785462036;54647.18029229604;54656.45343546553;54855.451445485436;9965.950170249247;10141.543630536644;10152.187824973984;10191.082802547806;10392.636257730943;19779.901100494404;19979.400617981482;20008.799912000984;20143.899280503505;20571.8971405142;8414.453060551044;8521;8535.146485351539;8573.914260857437;8610.483370997761;4512.52618475062;4665.370175026396;4671.089137618132;4703.341532185496;4845.685030473008;3439.329330780474;3477.530533378012;3487.075924879909;3487.215376540309;3493.8951831444588;548.5090843694951;598.7126179433897;605.2011345024613;620.5780069552658;632.2097378277153;692.3734020711264;700.394159052416;717.1680850213727;731.0897932074495;794.1383598795256;9367.437953722661;9381.202597779129;9394.295427842939;9469.47917864524;9670.516474176264;623.1805176193292;726.81466226112;748.4536288509419;758.9658465368962;772.0542335638797;4234.174336004449;4507.076049409863;4523.015739540766;4547.727136371828;4566.794494247767;56591.151132733045;58022;58302.4169758297;58471.41528584745;58518;52613.47386526162;53256.20115698268;53373.46626533763;53460.46539534633;53786.15924566808;46084.769576152576;47330.05339893252;47576.76211618989;49190.75404623026;49579.25631115536;8274.503529788231;8394.286485648789;8531.658733650833;8573.871391929002;8730.563471826255;36019.81990090033;36423;36600.45099323459;37061.59099658514;37219.441708374936;44300.556994429644;45212.54787452083;46260;46396.53603463922;46993.29510057283;12066.698332541757;12255.632331030083;12284.324362160167;12305.138640295094;12431.254124752544;12866.421011054712;12960.157589756636;12982.480700771863;13072.673183170496;13095.67260818449;12646.87353126457;12732.427040783372;12983.091183617435;13159.60521184366;13207.207567545978;12525.37373131358;12760.361981901053;12767.489300427878;12895.355232238164;13155.210687358407;11579.42102894835;11688.357140357022;11739.23694959825;12156.635300940987;12437.813432798695;8801.163889430494;8907.153820387053;9079.727608171765;9190.49452280131;9300.348975571645;8620.13798620133;8698.782530436789;8776.385653004229;8795.868061978947;8983.820323593362 08:28:55 INFO - PROCESS | 11003 | __end_tp_report 08:28:55 INFO - PROCESS | 11003 | __start_cc_report 08:28:55 INFO - PROCESS | 11003 | _x_x_mozilla_cycle_collect,760 08:28:55 INFO - PROCESS | 11003 | __end_cc_report 08:28:55 INFO - PROCESS | 11003 | __startTimestamp1459178935358__endTimestamp 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | ------- Summary: start ------- 08:28:55 INFO - PROCESS | 11003 | Number of tests: 6 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#0] dojo.html Cycles:165 Average:5124.73 Median:5283.60 stddev:566.70 (10.7%) stddev-sans-first:544.24 08:28:55 INFO - PROCESS | 11003 | Values: 3036.5 3093.0 3124.8 3130.2 3168.7 5059.7 5149.4 5182.6 5209.1 5218.2 5104.4 5197.7 5217.2 5249.9 5272.5 4684.9 4711.0 4728.5 4736.3 4834.2 4823.1 4830.0 4831.0 4838.5 4865.1 4642.6 4740.5 4747.3 4761.2 4806.7 4654.3 4672.8 4702.2 4756.8 4792.5 4663.7 4664.5 4688.6 4695.4 4741.8 5075.9 5076.9 5077.4 5131.2 5135.8 5355.5 5420.6 5553.7 5593.0 5596.2 5526.4 5536.3 5540.1 5543.4 5545.2 5086.0 5168.1 5184.1 5189.7 5193.2 5600.5 5685.5 5685.9 5720.9 5740.5 5376.7 5384.9 5393.1 5396.6 5396.9 5395.6 5469.2 5472.0 5512.5 5512.8 5456.2 5489.5 5491.2 5514.5 5537.1 5487.6 5491.8 5492.0 5493.6 5494.8 4009.0 4090.7 4098.8 4190.7 4238.5 3737.1 3751.2 3766.8 3797.8 3866.9 5258.9 5260.1 5263.9 5265.4 5307.9 5546.0 5558.9 5561.4 5561.6 5618.0 5122.3 5139.9 5230.3 5236.6 5249.4 4611.3 4651.7 4652.3 4667.5 4670.0 5703.5 5744.3 5746.1 5746.5 5747.0 5414.9 5519.6 5562.6 5640.0 5655.3 5694.7 5716.9 5718.6 5726.0 5728.6 5405.8 5440.8 5442.6 5443.6 5452.7 5344.3 5440.3 5532.1 5550.3 5557.0 5280.9 5283.6 5291.6 5308.4 5309.5 5254.6 5275.9 5279.9 5299.2 5302.8 5155.7 5202.3 5266.4 5299.0 5315.9 5379.7 5389.9 5392.6 5419.3 5422.5 5213.5 5315.6 5316.9 5322.4 5378.6 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#1] ext.html Cycles:180 Average:46000.01 Median:40030.60 stddev:74635.11 (186.4%) stddev-sans-first:74766.48 08:28:55 INFO - PROCESS | 11003 | Values: 553.8 557.4 562.8 567.6 589.7 39804.6 39981.8 39987.2 40100.4 40200.6 40976.0 41084.8 41396.8 41425.6 41452.8 8637.6 8833.0 8836.5 8842.3 8843.1 8660.4 8830.6 8833.3 8836.6 8846.8 9008.9 9076.4 9099.7 9100.6 9104.7 8955.0 9018.6 9035.2 9041.0 9043.5 8877.2 8993.1 8994.5 9017.1 9018.9 41995.6 42224.2 42316.0 42325.4 42422.0 3561.7 3788.1 3858.7 4095.3 4417.8 31497.2 31896.8 32171.4 32399.4 32824.8 4215.2 4215.7 4266.5 4332.6 4340.3 217476.0 217901.0 218758.9 218820.0 219172.0 53194.5 59202.1 60236.7 60254.0 60265.4 49062.8 49376.0 66505.3 67072.7 67485.7 16658.8 16803.2 16852.2 16853.9 16890.2 12682.9 12784.2 12787.0 12808.9 12824.7 17709.4 17988.6 20208.9 20622.1 20704.0 7222.0 7355.0 7517.7 7545.8 7645.4 1010.8 1011.2 1070.6 1087.7 1136.8 30462.8 32210.2 32329.7 32341.0 32481.7 1129.6 1130.7 1141.2 1150.9 1176.6 16137.8 16784.7 16876.7 16919.3 17299.8 382587.0 383952.0 387530.0 388786.0 388929.0 56654.2 56999.4 57082.7 57137.7 57168.4 1207.8 1353.5 1388.2 1418.7 1420.4 28956.7 30190.2 30461.8 31032.7 32874.7 47015.8 47016.1 47494.0 47513.8 47515.8 214449.0 214466.0 214684.0 214869.0 214949.0 32043.5 32446.0 35958.8 36220.9 36236.0 40673.4 43581.6 46689.8 47796.8 47913.8 38767.2 39127.6 39172.4 39571.8 43262.4 39062.8 40074.0 40480.8 40521.4 40969.8 40138.4 40277.2 40659.8 41209.4 41391.8 33632.5 36191.6 36372.5 36384.3 36703.3 27920.4 28242.0 28301.0 28463.7 28510.4 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#2] jquery.html Cycles:180 Average:29278.26 Median:3266.29 stddev:81336.04 (2490.2%) stddev-sans-first:81535.25 08:28:55 INFO - PROCESS | 11003 | Values: 371.3 371.7 372.8 378.1 382.0 17417.5 17817.4 18754.4 18757.9 18784.8 17892.2 17938.7 18327.2 18338.2 18364.9 5425.3 5648.0 5655.6 5673.7 5683.5 4080.8 5534.4 6001.1 6236.8 6261.4 6184.8 6186.4 6212.1 6217.4 6220.8 5873.2 6035.7 6050.9 6051.1 6052.4 3709.4 5089.8 5295.3 5422.2 5438.1 21335.6 21347.9 21516.5 21693.8 21711.6 2276.0 2369.3 2447.5 2720.2 2752.9 13555.5 13614.1 14153.5 14338.6 14704.6 1998.8 2012.3 2041.2 2067.3 2144.6 80419.6 80851.6 82881.6 83088.0 83613.0 16197.9 16508.0 16517.8 16612.3 16803.5 28325.4 28396.1 28621.3 28644.9 28797.6 8997.0 9458.0 9520.1 9591.8 9609.4 7982.1 7988.3 8062.8 8123.8 8149.9 7911.5 7973.0 8085.8 8136.8 8319.3 2784.7 3202.6 3244.6 3287.9 3378.2 907.9 947.9 991.9 1041.1 1043.5 17803.0 17932.3 18615.3 18784.5 18971.0 982.8 1006.5 1014.2 1052.4 1066.9 10477.7 10604.9 10609.8 10714.6 10731.8 482516.0 489708.0 494013.0 497413.0 514058.0 77074.2 81753.6 82376.9 82837.6 83128.0 1050.6 1068.6 1103.1 1112.8 1119.3 16514.7 16597.3 16729.3 16833.9 16867.6 34503.0 36326.0 37198.6 38000.2 38452.4 53381.2 53390.5 53421.5 53546.2 53931.0 8240.2 8467.6 8513.0 8532.7 8744.5 9439.4 9546.9 9637.2 12329.9 13789.4 11996.3 12013.2 12148.1 12195.3 12221.3 11893.9 11956.4 11993.1 12135.9 12282.8 11553.6 11729.6 11860.2 11913.5 12285.5 8517.6 8685.4 8719.5 8736.3 8789.3 12022.6 12072.0 12094.2 12120.6 12185.9 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#3] mootools.html Cycles:180 Average:5719.48 Median:6759.39 stddev:3023.02 (44.7%) stddev-sans-first:3013.75 08:28:55 INFO - PROCESS | 11003 | Values: 1361.3 1488.9 1500.9 1620.9 1786.3 7730.7 7850.3 7868.3 7872.4 7883.5 7505.1 7657.8 7677.8 7678.2 7684.9 1960.8 2122.8 2163.3 2191.7 2214.8 2212.2 2218.3 2219.4 2219.8 2220.0 2114.8 2240.4 2241.8 2242.2 2242.8 2183.2 2194.5 2197.0 2263.8 2265.9 2158.4 2166.4 2176.4 2179.4 2242.3 8163.5 8179.9 8203.1 8213.3 8219.2 5088.2 5263.8 5277.0 5277.5 5278.0 3330.9 3332.7 3333.0 3433.3 3483.9 1117.7 1133.6 1138.6 1152.4 1154.0 11591.5 11616.3 11619.6 11642.7 11674.1 4605.7 4609.1 4664.2 4684.8 4720.7 9884.9 9896.6 9905.4 9927.4 9943.3 4571.4 5218.1 5223.3 5223.7 5235.6 4528.0 4560.2 4572.2 4580.2 4608.6 3699.1 3789.7 3816.7 3821.4 3827.1 1234.8 1237.2 1250.1 1253.9 1255.1 1412.8 1423.2 1435.4 1443.2 1454.8 7941.2 7963.8 8006.4 8014.3 8024.3 481.1 481.7 488.1 488.5 494.3 6159.7 6160.4 6202.7 6210.4 6212.8 9447.6 9704.5 9748.9 9754.6 9763.5 9398.9 9524.7 9568.4 9570.6 9601.1 7234.5 7320.6 7380.3 7395.8 7409.1 7562.5 7591.8 7695.9 7707.3 7909.2 8744.8 9029.8 9136.1 9140.5 9143.3 9141.5 9145.0 9285.0 9352.5 9379.7 6611.4 7001.1 7003.4 7080.3 7297.0 7688.6 7692.1 7710.5 7772.3 7901.7 6945.9 7040.9 7155.6 7197.2 7256.3 7026.2 7059.9 7122.2 7178.9 7231.3 7231.3 7433.1 7470.9 7487.4 7494.3 6907.4 6911.7 6943.0 6943.8 6949.0 6983.5 7017.2 7031.3 7065.6 7091.4 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#4] prototype.html Cycles:180 Average:5289.86 Median:5964.72 stddev:1598.48 (26.8%) stddev-sans-first:1558.82 08:28:55 INFO - PROCESS | 11003 | Values: 319.3 327.8 332.7 346.3 346.4 5923.4 5937.4 5950.6 5951.2 5980.2 5885.6 5901.6 5914.8 5921.1 5950.1 4321.5 4485.6 4544.0 4559.4 4579.4 4564.5 4574.4 4612.6 4623.3 4629.5 4596.1 4599.5 4604.4 4604.5 4612.1 4345.4 4441.9 4520.9 4530.8 4540.0 3991.2 3998.1 4005.6 4009.6 4015.7 5712.6 5715.9 5718.1 5719.3 5722.9 5316.3 5321.7 5323.2 5333.8 5341.6 6243.9 6248.8 6249.1 6255.5 6264.5 4233.6 4337.6 4343.0 4505.5 4508.2 6447.4 6470.4 6474.8 6493.4 6511.2 4486.7 4492.2 4498.2 4501.9 4508.9 4532.2 4548.5 4552.2 4555.5 4560.1 5254.5 5255.2 5256.9 5257.2 5269.7 6116.2 6294.9 6309.3 6322.9 6328.8 1570.5 1582.9 1588.4 1589.6 1590.9 959.7 1046.1 1046.1 1047.3 1062.0 5943.8 5948.2 5964.3 5965.2 5966.0 6402.0 6435.5 6439.5 6441.3 6453.1 6025.1 6025.2 6029.2 6029.7 6037.3 3431.5 3481.2 3483.8 3489.8 3490.4 6582.3 6664.4 6698.0 6754.5 6838.5 6668.9 6696.1 6700.5 6705.1 6716.0 6783.2 6784.5 6792.8 6793.0 6800.6 6546.8 6555.2 6576.6 6581.6 6585.9 6357.0 6494.7 6495.2 6518.9 6535.5 6792.5 6801.9 6805.4 6817.1 6821.1 4507.1 4553.2 4560.1 4562.4 4564.4 6563.5 6576.9 6578.7 6585.6 6587.8 6358.9 6362.0 6366.0 6369.4 6370.3 6198.8 6385.3 6397.8 6399.9 6402.1 6239.6 6282.1 6282.2 6285.7 6296.8 6429.2 6430.5 6431.2 6432.6 6446.3 5989.5 6079.9 6282.6 6284.3 6291.2 08:28:55 INFO - PROCESS | 11003 | 08:28:55 INFO - PROCESS | 11003 | [#5] yui.html Cycles:180 Average:14586.00 Median:26211.22 stddev:16684.12 (63.7%) stddev-sans-first:16698.90 08:28:55 INFO - PROCESS | 11003 | Values: 819.8 822.1 863.8 873.4 914.4 13954.9 14157.0 14173.2 14211.9 15335.5 14627.1 14764.7 14794.4 14893.6 14910.3 670.7 840.5 841.4 851.5 865.4 849.5 857.8 859.9 861.9 862.2 889.6 893.3 894.0 896.3 897.1 701.9 867.8 873.5 874.0 879.9 637.8 639.3 639.3 639.7 640.2 13254.7 13284.7 13314.7 13325.2 13378.9 13697.5 13945.2 14080.9 14446.3 14476.9 10806.5 11281.1 11286.8 11354.5 11553.7 3770.8 3771.6 3825.7 3844.7 3927.2 53977.5 54621.5 54647.2 54656.5 54855.5 9966.0 10141.5 10152.2 10191.1 10392.6 19779.9 19979.4 20008.8 20143.9 20571.9 8414.5 8521.0 8535.1 8573.9 8610.5 4512.5 4665.4 4671.1 4703.3 4845.7 3439.3 3477.5 3487.1 3487.2 3493.9 548.5 598.7 605.2 620.6 632.2 692.4 700.4 717.2 731.1 794.1 9367.4 9381.2 9394.3 9469.5 9670.5 623.2 726.8 748.5 759.0 772.1 4234.2 4507.1 4523.0 4547.7 4566.8 56591.2 58022.0 58302.4 58471.4 58518.0 52613.5 53256.2 53373.5 53460.5 53786.2 46084.8 47330.1 47576.8 49190.8 49579.3 8274.5 8394.3 8531.7 8573.9 8730.6 36019.8 36423.0 36600.5 37061.6 37219.4 44300.6 45212.5 46260.0 46396.5 46993.3 12066.7 12255.6 12284.3 12305.1 12431.3 12866.4 12960.2 12982.5 13072.7 13095.7 12646.9 12732.4 12983.1 13159.6 13207.2 12525.4 12760.4 12767.5 12895.4 13155.2 11579.4 11688.4 11739.2 12156.6 12437.8 8801.2 8907.2 9079.7 9190.5 9300.3 8620.1 8698.8 8776.4 8795.9 8983.8 08:28:55 INFO - PROCESS | 11003 | -------- Summary: end -------- 08:28:55 INFO - PROCESS | 11003 | 08:28:56 INFO - TEST-INFO | 11003: exit 0 08:28:56 INFO - TEST-OK | dromaeo_css | took 1113639ms 08:28:56 INFO - TEST-START | kraken 08:28:56 INFO - operating with platform_type : linux_ 08:28:56 INFO - Initialising browser for kraken test... 08:28:56 INFO - TEST-INFO | started process 11190 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1QUxDJ/profile http://localhost:39766/getInfo.html) 08:29:01 INFO - PROCESS | 11190 | __metrics Screen width/height:1600/1200 08:29:01 INFO - PROCESS | 11190 | colorDepth:24 08:29:01 INFO - PROCESS | 11190 | Browser inner width/height: 1024/697 08:29:01 INFO - PROCESS | 11190 | __metrics 08:29:02 ERROR - PROCESS | 11190 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 08:29:02 INFO - PROCESS | 11190 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 08:29:03 INFO - TEST-INFO | 11190: exit 0 08:29:03 INFO - Browser initialized. 08:29:03 INFO - Running cycle 1/1 for kraken test... 08:29:03 INFO - TEST-INFO | started process 11274 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1QUxDJ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:29:15 INFO - PROCESS | 11274 | RSS: Main: 153202688 08:29:15 INFO - PROCESS | 11274 | 08:29:17 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39766/tests/kraken/driver.html?testName=audio-beat-detection) 08:29:18 INFO - PROCESS | 11274 | RSS: Main: 194641920 08:29:18 INFO - PROCESS | 11274 | 08:29:21 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39766/tests/kraken/driver.html?testName=audio-dft) 08:29:21 INFO - PROCESS | 11274 | RSS: Main: 184156160 08:29:21 INFO - PROCESS | 11274 | 08:29:24 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39766/tests/kraken/driver.html?testName=audio-fft) 08:29:25 INFO - PROCESS | 11274 | RSS: Main: 168869888 08:29:25 INFO - PROCESS | 11274 | 08:29:27 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39766/tests/kraken/driver.html?testName=audio-oscillator) 08:29:27 INFO - PROCESS | 11274 | RSS: Main: 171405312 08:29:27 INFO - PROCESS | 11274 | 08:29:29 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39766/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:29:30 INFO - PROCESS | 11274 | RSS: Main: 173473792 08:29:30 INFO - PROCESS | 11274 | 08:29:33 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39766/tests/kraken/driver.html?testName=imaging-darkroom) 08:29:34 INFO - PROCESS | 11274 | RSS: Main: 173477888 08:29:34 INFO - PROCESS | 11274 | 08:29:37 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39766/tests/kraken/driver.html?testName=imaging-desaturate) 08:29:38 INFO - PROCESS | 11274 | RSS: Main: 174067712 08:29:38 INFO - PROCESS | 11274 | 08:29:40 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39766/tests/kraken/driver.html?testName=json-parse-financial) 08:29:41 INFO - PROCESS | 11274 | RSS: Main: 174329856 08:29:41 INFO - PROCESS | 11274 | 08:29:42 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39766/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:29:43 INFO - PROCESS | 11274 | RSS: Main: 184508416 08:29:43 INFO - PROCESS | 11274 | 08:29:45 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:29:45 INFO - PROCESS | 11274 | RSS: Main: 182939648 08:29:45 INFO - PROCESS | 11274 | 08:29:47 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:29:48 INFO - PROCESS | 11274 | RSS: Main: 195477504 08:29:48 INFO - PROCESS | 11274 | 08:29:50 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:29:51 INFO - PROCESS | 11274 | RSS: Main: 196947968 08:29:51 INFO - PROCESS | 11274 | 08:29:53 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:29:54 INFO - PROCESS | 11274 | RSS: Main: 195989504 08:29:54 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | Cycle 1(1): loaded http://localhost:39766/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39766/tests/kraken/driver.html?testName=ai-astar) 08:29:56 INFO - PROCESS | 11274 | RSS: Main: 258641920 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | __start_tp_report 08:29:56 INFO - PROCESS | 11274 | _x_x_mozilla_page_load 08:29:56 INFO - PROCESS | 11274 | _x_x_mozilla_page_load_details 08:29:56 INFO - PROCESS | 11274 | |i|pagename|runs| 08:29:56 INFO - PROCESS | 11274 | |0;ai-astar;108;110;106;109;110;109;100;110;110;110 08:29:56 INFO - PROCESS | 11274 | |1;audio-beat-detection;150;126;152;168;133;155;153;128;166;131 08:29:56 INFO - PROCESS | 11274 | |2;audio-dft;159;160;161;159;162;161;160;165;163;164 08:29:56 INFO - PROCESS | 11274 | |3;audio-fft;76;72;105;96;73;72;72;127;110;75 08:29:56 INFO - PROCESS | 11274 | |4;audio-oscillator;93;93;138;92;94;93;141;93;92;145 08:29:56 INFO - PROCESS | 11274 | |5;imaging-gaussian-blur;116;117;116;117;118;117;117;118;118;118 08:29:56 INFO - PROCESS | 11274 | |6;imaging-darkroom;146;145;145;145;145;147;145;146;145;146 08:29:56 INFO - PROCESS | 11274 | |7;imaging-desaturate;95;95;94;96;95;95;95;96;95;95 08:29:56 INFO - PROCESS | 11274 | |8;json-parse-financial;56;57;57;56;56;57;58;65;55;55 08:29:56 INFO - PROCESS | 11274 | |9;json-stringify-tinderbox;59;60;60;61;60;60;60;60;60;60 08:29:56 INFO - PROCESS | 11274 | |10;stanford-crypto-aes;78;79;80;77;85;90;85;77;78;79 08:29:56 INFO - PROCESS | 11274 | |11;stanford-crypto-ccm;114;121;113;118;107;118;123;124;113;117 08:29:56 INFO - PROCESS | 11274 | |12;stanford-crypto-pbkdf2;143;143;143;140;141;134;142;140;139;138 08:29:56 INFO - PROCESS | 11274 | |13;stanford-crypto-sha256-iterative;62;62;61;67;61;61;62;63;66;62 08:29:56 INFO - PROCESS | 11274 | __end_tp_report 08:29:56 INFO - PROCESS | 11274 | __start_cc_report 08:29:56 INFO - PROCESS | 11274 | _x_x_mozilla_cycle_collect,1054 08:29:56 INFO - PROCESS | 11274 | __end_cc_report 08:29:56 INFO - PROCESS | 11274 | __startTimestamp1459178996369__endTimestamp 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | ------- Summary: start ------- 08:29:56 INFO - PROCESS | 11274 | Number of tests: 14 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#0] ai-astar Cycles:10 Average:108.20 Median:110.00 stddev:3.16 (2.9%) stddev-sans-first:3.35 08:29:56 INFO - PROCESS | 11274 | Values: 108.0 110.0 106.0 109.0 110.0 109.0 100.0 110.0 110.0 110.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#1] audio-beat-detection Cycles:10 Average:146.20 Median:152.50 stddev:15.58 (10.2%) stddev-sans-first:16.46 08:29:56 INFO - PROCESS | 11274 | Values: 150.0 126.0 152.0 168.0 133.0 155.0 153.0 128.0 166.0 131.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:2.07 (1.3%) stddev-sans-first:2.00 08:29:56 INFO - PROCESS | 11274 | Values: 159.0 160.0 161.0 159.0 162.0 161.0 160.0 165.0 163.0 164.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#3] audio-fft Cycles:10 Average:87.80 Median:72.50 stddev:20.18 (27.8%) stddev-sans-first:20.94 08:29:56 INFO - PROCESS | 11274 | Values: 76.0 72.0 105.0 96.0 73.0 72.0 72.0 127.0 110.0 75.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#4] audio-oscillator Cycles:10 Average:107.40 Median:93.00 stddev:23.48 (25.2%) stddev-sans-first:24.32 08:29:56 INFO - PROCESS | 11274 | Values: 93.0 93.0 138.0 92.0 94.0 93.0 141.0 93.0 92.0 145.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.50 stddev:0.79 (0.7%) stddev-sans-first:0.71 08:29:56 INFO - PROCESS | 11274 | Values: 116.0 117.0 116.0 117.0 118.0 117.0 117.0 118.0 118.0 118.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#6] imaging-darkroom Cycles:10 Average:145.50 Median:145.50 stddev:0.71 (0.5%) stddev-sans-first:0.73 08:29:56 INFO - PROCESS | 11274 | Values: 146.0 145.0 145.0 145.0 145.0 147.0 145.0 146.0 145.0 146.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 08:29:56 INFO - PROCESS | 11274 | Values: 95.0 95.0 94.0 96.0 95.0 95.0 95.0 96.0 95.0 95.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#8] json-parse-financial Cycles:10 Average:57.20 Median:57.00 stddev:2.90 (5.1%) stddev-sans-first:3.04 08:29:56 INFO - PROCESS | 11274 | Values: 56.0 57.0 57.0 56.0 56.0 57.0 58.0 65.0 55.0 55.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#9] json-stringify-tinderbox Cycles:10 Average:60.00 Median:60.00 stddev:0.47 (0.8%) stddev-sans-first:0.33 08:29:56 INFO - PROCESS | 11274 | Values: 59.0 60.0 60.0 61.0 60.0 60.0 60.0 60.0 60.0 60.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#10] stanford-crypto-aes Cycles:10 Average:80.80 Median:79.50 stddev:4.37 (5.5%) stddev-sans-first:4.51 08:29:56 INFO - PROCESS | 11274 | Values: 78.0 79.0 80.0 77.0 85.0 90.0 85.0 77.0 78.0 79.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#11] stanford-crypto-ccm Cycles:10 Average:116.80 Median:118.00 stddev:5.20 (4.4%) stddev-sans-first:5.42 08:29:56 INFO - PROCESS | 11274 | Values: 114.0 121.0 113.0 118.0 107.0 118.0 123.0 124.0 113.0 117.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.30 Median:141.50 stddev:2.83 (2.0%) stddev-sans-first:2.83 08:29:56 INFO - PROCESS | 11274 | Values: 143.0 143.0 143.0 140.0 141.0 134.0 142.0 140.0 139.0 138.0 08:29:56 INFO - PROCESS | 11274 | 08:29:56 INFO - PROCESS | 11274 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.70 Median:62.00 stddev:2.11 (3.4%) stddev-sans-first:2.22 08:29:56 INFO - PROCESS | 11274 | Values: 62.0 62.0 61.0 67.0 61.0 61.0 62.0 63.0 66.0 62.0 08:29:56 INFO - PROCESS | 11274 | -------- Summary: end -------- 08:29:56 INFO - PROCESS | 11274 | 08:29:57 INFO - TEST-INFO | 11274: exit 0 08:29:57 INFO - TEST-OK | kraken | took 61261ms 08:29:57 INFO - SUITE-END | took 1174s 08:29:57 INFO - Completed test suite (00:19:35) 08:29:57 INFO - javascript benchmark 08:29:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3036.498977668685, 3093.0, 3124.750019998399, 3130.2487403023283, 3168.683131686831, 5059.721715305656, 5149.40781810092, 5182.611304152185, 5209.140491818855, 5218.1650935850275, 5104.438511763703, 5197.688138711671, 5217.217417387394, 5249.8950020999555, 5272.499112584308, 4684.859454216362, 4711.034237981215, 4728.503507131753, 4736.2895565665085, 4834.178189707741, 4823.13183626947, 4829.975850120744, 4831.0, 4838.467768545457, 4865.051314993578, 4642.605378542811, 4740.502247264022, 4747.311639812208, 4761.166795810736, 4806.663533552653, 4654.325122857201, 4672.789724462407, 4702.247640377557, 4756.833510827139, 4792.496787837262, 4663.673542852001, 4664.5335466453425, 4688.648351373627, 4695.436547614308, 4741.8103275868925, 5075.873103172414, 5076.898462030738, 5077.416097148801, 5131.153359695683, 5135.845924622267, 5355.518003379676, 5420.647657902224, 5553.666779993213, 5592.972035139839, 5596.188552659842, 5526.392096869341, 5536.252605898233, 5540.113581826889, 5543.417941116206, 5545.195946587723, 5086.0, 5168.069747445458, 5184.066867963803, 5189.6886186828915, 5193.246979188034, 5600.4959553640365, 5685.459881311269, 5685.886282274414, 5720.885582288331, 5740.483356497935, 5376.731163441812, 5384.865378365572, 5393.110136827458, 5396.568274538027, 5396.892062158735, 5395.649282796606, 5469.15228139639, 5472.042392581282, 5512.50387465122, 5512.751926163332, 5456.154296084034, 5489.451054894478, 5491.2312276281355, 5514.531264842453, 5537.086380747212, 5487.5884308677005, 5491.835244942658, 5491.972540137273, 5493.587980901449, 5494.80768173112, 4009.0, 4090.652294554937, 4098.7950602469755, 4190.748555086705, 4238.533761286256, 3737.0844143185095, 3751.1934933988778, 3766.7928263945746, 3797.7531460454984, 3866.941995870064, 5258.894822103536, 5260.0531904257605, 5263.947360526346, 5265.368155821326, 5307.946920530822, 5546.0, 5558.944410555842, 5561.388247292794, 5561.610687251854, 5618.0, 5122.257272695439, 5139.948600513947, 5230.320058392461, 5236.581073514109, 5249.396319423316, 4611.308303754464, 4651.744154071491, 4652.278896771006, 4667.533246675373, 4669.976650116728, 5703.543716502752, 5744.253247077853, 5746.1093530502, 5746.482816546531, 5747.0, 5414.945850541444, 5519.641223320471, 5562.610617256753, 5639.971800140973, 5655.349634792052, 5694.686792226302, 5716.857078573069, 5718.599698021265, 5725.971370143289, 5728.570357223141, 5405.837824865261, 5440.809571664972, 5442.6462279951675, 5443.646162999393, 5452.672839629635, 5344.25180474726, 5440.292761940922, 5532.114861622121, 5550.306211723535, 5556.972215138899, 5280.920786188133, 5283.603729720363, 5291.629585928948, 5308.362996440297, 5309.548688361378, 5254.5533629641905, 5275.868103297448, 5279.868003299948, 5299.2316114164005, 5302.840914772563, 5155.716435596079, 5202.271681964604, 5266.447023062677, 5299.046171688979, 5315.867103322294, 5379.73101344939, 5389.865253368697, 5392.649477783932, 5419.3225846769155, 5422.457754224546, 5213.45258747826, 5315.601329900351, 5316.867078323073, 5322.414534401135, 5378.5966052547], "unit": "score", "name": "dojo.html", "value": 5088.083314999142}, {"lowerIsBetter": false, "replicates": [553.7554139067491, 557.4314199516493, 562.8142712904742, 567.631039824114, 589.6786251492937, 39804.601953980455, 39981.80009099954, 39987.20025599486, 40100.39849402254, 40200.597994020085, 40976.0, 41084.794576027154, 41396.79301603488, 41425.58574414255, 41452.792736036354, 8637.611307491146, 8832.955835220815, 8836.469811811312, 8842.33682473817, 8843.071477494866, 8660.437071590359, 8830.646774129027, 8833.293336533094, 8836.646534138627, 8846.823063538724, 9008.864867027, 9076.410033347844, 9099.681511147111, 9100.590473428678, 9104.726858194264, 8955.0, 9018.59416326267, 9035.232005279559, 9041.0, 9043.547822608909, 8877.245434138042, 8993.055729148411, 8994.460332380013, 9017.053209412983, 9018.909810901872, 41995.58004419947, 42224.1555168898, 42316.0, 42325.36511952323, 42422.0, 3561.679448849616, 3788.147666774981, 3858.7491813032343, 4095.344744840841, 4417.845375411877, 31497.21256968571, 31896.840515797503, 32171.356572868644, 32399.352012959607, 32824.83587582071, 4215.241256573816, 4215.6720633000505, 4266.466691663542, 4332.631726303268, 4340.305551111838, 217476.0, 217901.0, 218758.90620546954, 218820.0, 219172.0, 53194.468055318954, 59202.11196832051, 60236.69881650564, 60254.0, 60265.39734602685, 49062.77343066452, 49376.0, 66505.33494665088, 67072.6646366765, 67485.6625716878, 16658.750118748227, 16803.159842008095, 16852.24164912582, 16853.915730421268, 16890.239939202766, 12682.873171268353, 12784.232946023269, 12787.0, 12808.93595532035, 12824.743505129845, 17709.380171694185, 17988.55028624295, 20208.898955505127, 20622.072006759732, 20704.0, 7221.977846202966, 7355.0, 7517.661705223169, 7545.849083018418, 7645.388368930472, 1010.782681723433, 1011.1910471622673, 1070.6038765656601, 1087.7212240356441, 1136.778328225988, 30462.847685761873, 32210.19474513156, 32329.676703232668, 32341.0, 32481.67518324834, 1129.593346395297, 1130.6551501792032, 1141.1612464838338, 1150.9021733152777, 1176.647005898227, 16137.838621613633, 16784.748228776578, 16876.746848797276, 16919.323227070778, 17299.827001730075, 382587.0, 383952.0, 387530.0, 388786.0, 388929.0, 56654.15018774722, 56999.43000570024, 57082.7145864268, 57137.71431142818, 57168.428315717145, 1207.7825991321647, 1353.5195005773005, 1388.2017839742189, 1418.680796820707, 1420.3679362683713, 28956.7104328954, 30190.245243869078, 30461.847690761406, 31032.68967310298, 32874.67125328716, 47015.76492117518, 47016.05967880555, 47494.0, 47513.76243118762, 47515.762421187675, 214449.0, 214466.0, 214684.0, 214869.0, 214949.0, 32043.519347210276, 32446.0, 35958.8202058988, 36220.913372598865, 36236.0, 40673.38989915213, 43581.564184357754, 46689.76655116703, 47796.761016194694, 47913.8021549464, 38767.22465550729, 39127.608723912395, 39172.41241381439, 39571.77081253674, 43262.351064734685, 39062.804685976385, 40074.0, 40480.797596011835, 40521.392179117924, 40969.79515102405, 40138.44610632801, 40277.1944561113, 40659.796701016305, 41209.38185927273, 41391.7930410346, 33632.49551256684, 36191.63808361988, 36372.454413183295, 36384.27231455409, 36703.265934681694, 27920.44159116847, 28242.0, 28301.0, 28463.715362846935, 28510.42979140364], "unit": "score", "name": "ext.html", "value": 19287.196977394004}, {"lowerIsBetter": false, "replicates": [371.2926874304449, 371.708209055891, 372.8080038780028, 378.08503421719433, 381.97326187166874, 17417.477475675732, 17817.37639182629, 18754.437366879, 18757.90621046893, 18784.812151878476, 17892.194851231692, 17938.730919036225, 18327.17527711253, 18338.174782134804, 18364.908175459102, 5425.294711687485, 5648.03983322834, 5655.604107712462, 5673.659580425167, 5683.460071293221, 4080.8163632636456, 5534.391216966131, 6001.06983417571, 6236.781712640059, 6261.405166509197, 6184.8144555663175, 6186.350433204516, 6212.099245609384, 6217.440430361266, 6220.751169953196, 5873.236479257691, 6035.7283922223605, 6050.878982420327, 6051.062085376751, 6052.425019623129, 3709.3879509880835, 5089.796408143669, 5295.338082739658, 5422.186671999192, 5438.129899216146, 21335.573288534142, 21347.893260533598, 21516.46208844776, 21693.783062169492, 21711.565768684537, 2275.977240227593, 2369.312899259213, 2447.510497900409, 2720.2111387697546, 2752.862356882148, 13555.457781688721, 13614.115082519604, 14153.504627337994, 14338.56984290473, 14704.632384190374, 1998.8300994415492, 2012.2655230840785, 2041.173324803457, 2067.3487851326786, 2144.571085782834, 80419.59790201012, 80851.5957420215, 82881.58559207225, 83088.0, 83613.0, 16197.919010405109, 16508.0, 16517.834821651628, 16612.335506579602, 16803.495895123167, 28325.43349133006, 28396.148115556567, 28621.284467888054, 28644.856775716406, 28797.568036479468, 8997.0, 9458.0, 9520.095590918852, 9591.808163836684, 9609.423434593808, 7982.08206056311, 7988.320992715568, 8062.7581172564915, 8123.837523249502, 8149.918500814916, 7911.5363657722355, 7973.0, 8085.788973384045, 8136.80306317291, 8319.292860106958, 2784.7354501322343, 3202.5676533668125, 3244.6430892601793, 3287.934241315208, 3378.172347774811, 907.8955920069144, 947.9431234125836, 991.9355241909398, 1041.0890470838017, 1043.546057465005, 17803.0, 17932.282708691768, 18615.25538978453, 18784.53038674044, 18971.0, 982.7543114221445, 1006.4917216805467, 1014.2038499777639, 1052.4264275969615, 1066.8666416697913, 10477.738056548495, 10604.946975265075, 10609.84085238722, 10714.624988125379, 10731.83902241467, 482516.0, 489708.0, 494013.0, 497413.0, 514058.0, 77074.22925770783, 81753.59123204346, 82376.88115594316, 82837.58581207055, 83128.0, 1050.5535147562255, 1068.58859339155, 1103.1450625765096, 1112.816385296417, 1119.2948442481186, 16514.66970660604, 16597.253123609225, 16729.330826766793, 16833.91583042077, 16867.578310542336, 34503.0, 36326.0, 37198.6280137206, 38000.23999520049, 38452.42321365238, 53381.19928201003, 53390.46609533855, 53421.46578534165, 53546.196807048706, 53931.0, 8240.21717936795, 8467.578887463193, 8512.957435212784, 8532.658693652184, 8744.475331480131, 9439.433633981984, 9546.949835518226, 9637.22902167839, 12329.93835030855, 13789.448422063006, 11996.340201288664, 12013.159078864395, 12148.088893332859, 12195.268283902995, 12221.266723996589, 11893.940530297294, 11956.402179890796, 11993.1005174614, 12135.939320303341, 12282.75434491323, 11553.595624153115, 11729.648110556696, 11860.22908510944, 11913.463894124958, 12285.508579656713, 8517.616707248064, 8685.39202255836, 8719.52042637661, 8736.301095912439, 8789.296856251613, 12022.63932082039, 12072.0, 12094.213876098025, 12120.575779847662, 12185.87814121883], "unit": "score", "name": "jquery.html", "value": 9765.935341713997}, {"lowerIsBetter": false, "replicates": [1361.2717196299982, 1488.851114888511, 1500.8874334424918, 1620.8784341174407, 1786.2587026384042, 7730.690772369106, 7850.332721718653, 7868.331191848685, 7872.409569282312, 7883.487573307731, 7505.061867266591, 7657.770266891988, 7677.846443071136, 7678.155402905676, 7684.923150768491, 1960.803919608035, 2122.8301735861173, 2163.2536774812665, 2191.736991561011, 2214.833887458439, 2212.2478357358495, 2218.279059305732, 2219.4007617943143, 2219.844610877239, 2220.000999550201, 2114.8413868959888, 2240.439890027493, 2241.7870302321335, 2242.2040175737625, 2242.7981481666648, 2183.2031308572336, 2194.47332640166, 2196.9890150549227, 2263.807576356012, 2265.920692775745, 2158.3848603148026, 2166.360923527563, 2176.4450065233423, 2179.400664817172, 2242.338510139513, 8163.469374490639, 8179.877301840477, 8203.05664848544, 8213.301869341114, 8219.219174178443, 5088.160453525164, 5263.763130659129, 5277.0, 5277.525022747933, 5278.0, 3330.933381332384, 3332.7000569948823, 3332.950005749916, 3433.3476639438427, 3483.89548313551, 1117.6870476266658, 1133.6315697398295, 1138.6356365962895, 1152.3604399558242, 1153.9942300288528, 11591.536338546448, 11616.303021818718, 11619.593314233962, 11642.708932276677, 11674.124440666985, 4605.654575906753, 4609.101225261109, 4664.230401983703, 4684.765761711901, 4720.740359280273, 9884.901150988542, 9896.604135834486, 9905.405675659484, 9927.354721943195, 9943.254255930835, 4571.3600095986585, 5218.060749065129, 5223.320968274176, 5223.686578805284, 5235.58115350771, 4527.981204229022, 4560.156371071363, 4572.245579479415, 4580.198465268565, 4608.585227329557, 3699.075231192202, 3789.6589306962505, 3816.7328287020196, 3821.4458903458844, 3827.13889374894, 1234.796258617318, 1237.1710953661068, 1250.056207563302, 1253.9059570532247, 1255.1026016398318, 1412.8022076909242, 1423.160335402097, 1435.440178330452, 1443.2422977936667, 1454.8181477315336, 7941.166177551389, 7963.800904977306, 8006.359491240687, 8014.318782903402, 8024.317932975646, 481.0643298783902, 481.67727622493015, 488.05561239001935, 488.4626910398533, 494.25614450252857, 6159.722812473449, 6160.414760597736, 6202.658853763086, 6210.378962103844, 6212.844678882973, 9447.622095116256, 9704.514774261399, 9748.902510974942, 9754.561044753003, 9763.511824408894, 9398.906010939803, 9524.714258572254, 9568.378055426376, 9570.61717531305, 9601.087896649808, 7234.493585448968, 7320.560766354142, 7380.335769780745, 7395.778126656101, 7409.147947986051, 7562.508436951581, 7591.772246832604, 7695.88456173169, 7707.306342429209, 7909.209079092045, 8744.825103498022, 9029.81940361176, 9136.132067453582, 9140.497272650067, 9143.26853851677, 9141.542922853698, 9145.0, 9284.95357523208, 9352.485613291334, 9379.671711490066, 6611.404973552403, 7001.089858318386, 7003.404710599452, 7080.2919708028785, 7297.0, 7688.615569221404, 7692.115406728298, 7710.460267781202, 7772.261635144652, 7901.723439679584, 6945.930540694731, 7040.929590704232, 7155.570665760071, 7197.244289349543, 7256.310650488195, 7026.156861176487, 7059.929400705927, 7122.180949190702, 7178.892316615151, 7231.3130252625915, 7231.349178573953, 7433.145188303414, 7470.925290747023, 7487.363574096263, 7494.288042635941, 6907.378335949788, 6911.654417279216, 6943.0, 6943.756968506078, 6949.0, 6983.476239282176, 7017.228104908558, 7031.261717519791, 7065.576065435885, 7091.432685385053], "unit": "score", "name": "mootools.html", "value": 4594.971112112817}, {"lowerIsBetter": false, "replicates": [319.3485290008383, 327.7689229093491, 332.6573629161964, 346.3194822174427, 346.42666387129304, 5923.407659234074, 5937.435943585358, 5950.5834591578605, 5951.226340575725, 5980.1926739890105, 5885.646861188321, 5901.616394934337, 5914.817036592688, 5921.052631578948, 5950.137230101644, 4321.503027151886, 4485.618722408599, 4543.977280113595, 4559.407277053979, 4579.358889755437, 4564.452265728118, 4574.428196475441, 4612.561806628365, 4623.329617205503, 4629.490756016836, 4596.057808149338, 4599.494055653875, 4604.3784089147875, 4604.539546045402, 4612.146752850716, 4345.435093437849, 4441.911161776762, 4520.864374068783, 4530.841420550298, 4540.046590216059, 3991.1818077294083, 3998.1204135090525, 4005.559388467266, 4009.5990400959963, 4015.6988225883174, 5712.600117991742, 5715.942840571583, 5718.142278658234, 5719.28508936383, 5722.885542289173, 5316.255724198615, 5321.680699158062, 5323.22813192085, 5333.759980800874, 5341.599380046512, 6243.937560624427, 6248.750049997994, 6249.0938813871735, 6255.499560035232, 6264.498840092827, 4233.597808208216, 4337.566243375669, 4342.978285108554, 4505.5269196734525, 4508.211063063951, 6447.387498187664, 6470.417662410358, 6474.773382931622, 6493.383128602775, 6511.153550038464, 4486.730796152176, 4492.191405547033, 4498.190325741332, 4501.909961800746, 4508.864734057984, 4532.161550113239, 4548.47692515365, 4552.180607490617, 4555.453345598549, 4560.087982403533, 5254.500822421864, 5255.237990491358, 5256.947430525723, 5257.158854583325, 5269.736513174326, 6116.17431646722, 6294.874102518015, 6309.274433440213, 6322.936770632235, 6328.778492752824, 1570.4738912464225, 1582.9208539573206, 1588.356715530212, 1589.5787616281464, 1590.8568228859458, 959.7408699651195, 1046.1212581431635, 1046.1264843855313, 1047.2773786087728, 1061.9628313009162, 5943.762249509971, 5948.226730525004, 5964.284285885635, 5965.164876917235, 5966.0454327307425, 6402.007688808242, 6435.485161187094, 6439.517036222208, 6441.32366101562, 6453.096566480696, 6025.126356678257, 6025.186599809057, 6029.246344206974, 6029.698515074228, 6037.275526936708, 3431.4509678451327, 3481.216726236627, 3483.773554718935, 3489.7557170998293, 3490.441529355291, 6582.308857569982, 6664.400203981568, 6697.966510167418, 6754.527183097136, 6838.452923766087, 6668.933310666928, 6696.06255124283, 6700.530962832652, 6705.061291419205, 6716.0, 6783.18601767791, 6784.491163162783, 6792.76225332111, 6793.048973143863, 6800.557963732342, 6546.770863019771, 6555.2133743951035, 6576.572522786004, 6581.572197807127, 6585.868282634417, 6356.968215158895, 6494.7077381517, 6495.220573531206, 6518.902216466851, 6535.5425120241125, 6792.524523283323, 6801.89797153053, 6805.3875151236625, 6817.079694241214, 6821.113255276782, 4507.053518761097, 4553.225951588304, 4560.087982403466, 4562.429696287964, 4564.360989461412, 6563.474922006323, 6576.868462630816, 6578.736850525926, 6585.604863708193, 6587.835304117435, 6358.936410635834, 6362.0, 6366.0, 6369.426751592194, 6370.29926708071, 6198.81403557894, 6385.265694445198, 6397.808065758035, 6399.904001440075, 6402.1357116790505, 6239.594426362272, 6282.057691346152, 6282.1519094921605, 6285.748570057147, 6296.779612713533, 6429.196350456193, 6430.549861509649, 6431.228252609717, 6432.614043157426, 6446.29090800021, 5989.490893273946, 6079.908801368071, 6282.560220784501, 6284.3087260402235, 6291.150694656163], "unit": "score", "name": "prototype.html", "value": 4765.786932326027}, {"lowerIsBetter": false, "replicates": [819.844229596377, 822.1285437436318, 863.8401895649301, 873.3755364914085, 914.391929366971, 13954.930225348871, 14157.0, 14173.220472873987, 14211.928940355298, 15335.539933801976, 14627.122372657648, 14764.704705905875, 14794.40822367104, 14893.553193404188, 14910.329035193416, 670.7317073170722, 840.4831028917233, 841.3605659698612, 851.5486792000249, 865.3942240431692, 849.4733265375445, 857.7898414888361, 859.9269062129727, 861.8534849075672, 862.1550880137469, 889.6396959231522, 893.2630579771682, 894.0, 896.256107430834, 897.1118592593351, 701.9298070192991, 867.8437881181385, 873.462820365477, 874.021096372061, 879.9384043116985, 637.8245982354844, 639.2744235292929, 639.3191251317332, 639.7217210513442, 640.2413140428561, 13254.668633284246, 13284.667883302898, 13314.667133321647, 13325.200487970753, 13378.929685625126, 13697.520586779416, 13945.16329020262, 14080.859191408057, 14446.328498331604, 14476.855231447656, 10806.459677016197, 11281.097512199005, 11286.774264514746, 11354.48904799286, 11553.653390398302, 3770.754900931458, 3771.6039815819217, 3825.6556909878245, 3844.711646626486, 3927.2341893330813, 53977.46022539763, 54621.453785462036, 54647.18029229604, 54656.45343546553, 54855.451445485436, 9965.950170249247, 10141.543630536644, 10152.187824973984, 10191.082802547806, 10392.636257730943, 19779.901100494404, 19979.400617981482, 20008.799912000984, 20143.899280503505, 20571.8971405142, 8414.453060551044, 8521.0, 8535.146485351539, 8573.914260857437, 8610.483370997761, 4512.52618475062, 4665.370175026396, 4671.089137618132, 4703.341532185496, 4845.685030473008, 3439.329330780474, 3477.530533378012, 3487.075924879909, 3487.215376540309, 3493.8951831444588, 548.5090843694951, 598.7126179433897, 605.2011345024613, 620.5780069552658, 632.2097378277153, 692.3734020711264, 700.394159052416, 717.1680850213727, 731.0897932074495, 794.1383598795256, 9367.437953722661, 9381.202597779129, 9394.295427842939, 9469.47917864524, 9670.516474176264, 623.1805176193292, 726.81466226112, 748.4536288509419, 758.9658465368962, 772.0542335638797, 4234.174336004449, 4507.076049409863, 4523.015739540766, 4547.727136371828, 4566.794494247767, 56591.151132733045, 58022.0, 58302.4169758297, 58471.41528584745, 58518.0, 52613.47386526162, 53256.20115698268, 53373.46626533763, 53460.46539534633, 53786.15924566808, 46084.769576152576, 47330.05339893252, 47576.76211618989, 49190.75404623026, 49579.25631115536, 8274.503529788231, 8394.286485648789, 8531.658733650833, 8573.871391929002, 8730.563471826255, 36019.81990090033, 36423.0, 36600.45099323459, 37061.59099658514, 37219.441708374936, 44300.556994429644, 45212.54787452083, 46260.0, 46396.53603463922, 46993.29510057283, 12066.698332541757, 12255.632331030083, 12284.324362160167, 12305.138640295094, 12431.254124752544, 12866.421011054712, 12960.157589756636, 12982.480700771863, 13072.673183170496, 13095.67260818449, 12646.87353126457, 12732.427040783372, 12983.091183617435, 13159.60521184366, 13207.207567545978, 12525.37373131358, 12760.361981901053, 12767.489300427878, 12895.355232238164, 13155.210687358407, 11579.42102894835, 11688.357140357022, 11739.23694959825, 12156.635300940987, 12437.813432798695, 8801.163889430494, 8907.153820387053, 9079.727608171765, 9190.49452280131, 9300.348975571645, 8620.13798620133, 8698.782530436789, 8776.385653004229, 8795.868061978947, 8983.820323593362], "unit": "score", "name": "yui.html", "value": 6701.257897549067}], "name": "dromaeo_css", "value": 7211.496442196735}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [108.0, 110.0, 106.0, 109.0, 110.0, 109.0, 100.0, 110.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 108.2}, {"lowerIsBetter": true, "replicates": [150.0, 126.0, 152.0, 168.0, 133.0, 155.0, 153.0, 128.0, 166.0, 131.0], "unit": "score", "name": "audio-beat-detection", "value": 146.2}, {"lowerIsBetter": true, "replicates": [159.0, 160.0, 161.0, 159.0, 162.0, 161.0, 160.0, 165.0, 163.0, 164.0], "unit": "score", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [76.0, 72.0, 105.0, 96.0, 73.0, 72.0, 72.0, 127.0, 110.0, 75.0], "unit": "score", "name": "audio-fft", "value": 87.8}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 138.0, 92.0, 94.0, 93.0, 141.0, 93.0, 92.0, 145.0], "unit": "score", "name": "audio-oscillator", "value": 107.4}, {"lowerIsBetter": true, "replicates": [116.0, 117.0, 116.0, 117.0, 118.0, 117.0, 117.0, 118.0, 118.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.2}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 145.0, 145.0, 145.0, 147.0, 145.0, 146.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.5}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 94.0, 96.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.1}, {"lowerIsBetter": true, "replicates": [56.0, 57.0, 57.0, 56.0, 56.0, 57.0, 58.0, 65.0, 55.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.2}, {"lowerIsBetter": true, "replicates": [59.0, 60.0, 60.0, 61.0, 60.0, 60.0, 60.0, 60.0, 60.0, 60.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 60.0}, {"lowerIsBetter": true, "replicates": [78.0, 79.0, 80.0, 77.0, 85.0, 90.0, 85.0, 77.0, 78.0, 79.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.8}, {"lowerIsBetter": true, "replicates": [114.0, 121.0, 113.0, 118.0, 107.0, 118.0, 123.0, 124.0, 113.0, 117.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.8}, {"lowerIsBetter": true, "replicates": [143.0, 143.0, 143.0, 140.0, 141.0, 134.0, 142.0, 140.0, 139.0, 138.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 140.3}, {"lowerIsBetter": true, "replicates": [62.0, 62.0, 61.0, 67.0, 61.0, 61.0, 62.0, 63.0, 66.0, 62.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 62.7}], "name": "kraken", "value": 1486.6}]} 08:29:57 INFO - Return code: 0 08:29:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 08:29:57 ERROR - # TBPL SUCCESS # 08:29:57 INFO - Running post-action listener: _resource_record_post_action 08:29:57 INFO - Running post-run listener: _resource_record_post_run 08:29:58 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 534380544; Read time: 24; Write time: 1150568 08:29:58 INFO - install - Wall time: 17s; CPU: 16.0%; Read bytes: 0; Write bytes: 243134464; Read time: 0; Write time: 660264 08:29:58 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 4096; Write bytes: 291246080; Read time: 24; Write time: 490304 08:29:58 INFO - Running post-run listener: _upload_blobber_files 08:29:58 INFO - Blob upload gear active. 08:29:58 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 08:29:58 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 08:29:58 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'] 08:29:58 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 08:29:59 INFO - (blobuploader) - INFO - Open directory for files ... 08:29:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 08:29:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:29:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:30:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:30:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:30:00 INFO - (blobuploader) - INFO - Done attempting. 08:30:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:30:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:30:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:30:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:30:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:30:00 INFO - (blobuploader) - INFO - Done attempting. 08:30:00 INFO - (blobuploader) - INFO - Iteration through files over. 08:30:00 INFO - Return code: 0 08:30:00 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 08:30:00 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 08:30:00 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3e6ea6bef11634dac8cc109ccd215a8934c09084323e710b29961ec56f8911b32c10e92839f47bc7738164dc4ef0c607d10afecdab80bb12cb1decc120e65d69", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8dcb0aa2a3662b90c8c9210bc3e08e498f5b594182854587b835447e8fdde17fd2d5a0a02ccd294c73dd48b1a0f2a1d1ffddcdd9858d18e9fd3e32af1dd17d61"} 08:30:00 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 08:30:00 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 08:30:00 INFO - Contents: 08:30:00 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3e6ea6bef11634dac8cc109ccd215a8934c09084323e710b29961ec56f8911b32c10e92839f47bc7738164dc4ef0c607d10afecdab80bb12cb1decc120e65d69", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8dcb0aa2a3662b90c8c9210bc3e08e498f5b594182854587b835447e8fdde17fd2d5a0a02ccd294c73dd48b1a0f2a1d1ffddcdd9858d18e9fd3e32af1dd17d61"} 08:30:00 INFO - Running post-run listener: copy_logs_to_upload_dir 08:30:00 INFO - Copying logs to upload dir... 08:30:00 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 08:30:00 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1247.327044 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2016-03-28 08:30:00.375478) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-28 08:30:00.379503) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3e6ea6bef11634dac8cc109ccd215a8934c09084323e710b29961ec56f8911b32c10e92839f47bc7738164dc4ef0c607d10afecdab80bb12cb1decc120e65d69", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8dcb0aa2a3662b90c8c9210bc3e08e498f5b594182854587b835447e8fdde17fd2d5a0a02ccd294c73dd48b1a0f2a1d1ffddcdd9858d18e9fd3e32af1dd17d61"} build_url:https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011247 build_url: 'https://queue.taskcluster.net/v1/task/TPo2E8_0Qm6FyQDVoB_0wg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3e6ea6bef11634dac8cc109ccd215a8934c09084323e710b29961ec56f8911b32c10e92839f47bc7738164dc4ef0c607d10afecdab80bb12cb1decc120e65d69", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8dcb0aa2a3662b90c8c9210bc3e08e498f5b594182854587b835447e8fdde17fd2d5a0a02ccd294c73dd48b1a0f2a1d1ffddcdd9858d18e9fd3e32af1dd17d61"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-28 08:30:00.407004) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:30:00.407337) ========= 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=5cf47e208febbcd81da23b2e0000026f-1459175823.164156-604224953 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004555 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-28 08:30:00.492429) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-28 08:30:00.493220) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-28 08:30:00.493890) ========= ========= Total master_lag: 0.32 =========