builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-041 starttime: 1458784518.5 results: success (0) buildid: 20160323161905 builduid: cd8cc63e0ba74a188afd341f8b113ce8 revision: 4b14e550e7d8dc76f51b929a296d6391a884585f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.504121) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.504634) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.504947) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006476 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.531260) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.531548) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.544913) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.545193) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004590 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.594510) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.594840) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.595575) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.595894) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-23 18:55:18-- 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% 96.3M=0s 2016-03-23 18:55:18 (96.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.103628 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.715225) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.715499) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022022 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.764735) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:18.765049) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4b14e550e7d8dc76f51b929a296d6391a884585f --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4b14e550e7d8dc76f51b929a296d6391a884585f --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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-23 18:55:18,858 truncating revision to first 12 chars 2016-03-23 18:55:18,859 Setting DEBUG logging. 2016-03-23 18:55:18,859 attempt 1/10 2016-03-23 18:55:18,859 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/4b14e550e7d8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-23 18:55:19,155 unpacking tar archive at: mozilla-aurora-4b14e550e7d8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.568063 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:19.346255) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:19.346670) ========= echo 4b14e550e7d8dc76f51b929a296d6391a884585f in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'4b14e550e7d8dc76f51b929a296d6391a884585f'] 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 4b14e550e7d8dc76f51b929a296d6391a884585f program finished with exit code 0 elapsedTime=0.003439 script_repo_revision: '4b14e550e7d8dc76f51b929a296d6391a884585f' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:19.401236) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:19.401570) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-23 18:55:19.421685) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-03-23 18:55:19.421949) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:55:19 INFO - MultiFileLogger online at 20160323 18:55:19 in /builds/slave/test-pgo 18:55:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 18:55:19 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 18:55:19 INFO - {'append_to_log': False, 18:55:19 INFO - 'base_work_dir': '/builds/slave/test-pgo', 18:55:19 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 18:55:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 18:55:19 INFO - 'branch': 'Mozilla-Aurora', 18:55:19 INFO - 'buildbot_json_path': 'buildprops.json', 18:55:19 INFO - 'config_files': ('talos/linux_config.py',), 18:55:19 INFO - 'default_actions': ('clobber', 18:55:19 INFO - 'read-buildbot-config', 18:55:19 INFO - 'download-and-extract', 18:55:19 INFO - 'populate-webroot', 18:55:19 INFO - 'create-virtualenv', 18:55:19 INFO - 'install', 18:55:19 INFO - 'run-tests'), 18:55:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:55:19 INFO - 'download_minidump_stackwalk': True, 18:55:19 INFO - 'download_symbols': 'ondemand', 18:55:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:55:19 INFO - 'tooltool.py': '/tools/tooltool.py', 18:55:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:55:19 INFO - '/tools/misc-python/virtualenv.py')}, 18:55:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:55:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:55:19 INFO - 'installer_path': 'installer.exe', 18:55:19 INFO - 'log_level': 'info', 18:55:19 INFO - 'log_name': 'talos', 18:55:19 INFO - 'log_to_console': True, 18:55:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:55:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:55:19 INFO - 'opt_config_files': (), 18:55:19 INFO - 'pip_index': False, 18:55:19 INFO - 'sps_profile': False, 18:55:19 INFO - 'sps_profile_interval': 0, 18:55:19 INFO - 'suite': 'dromaeojs', 18:55:19 INFO - 'system_bits': '32', 18:55:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:55:19 INFO - 'title': 'talos-linux64-ix-041', 18:55:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:55:19 INFO - 'use_talos_json': True, 18:55:19 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 18:55:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:55:19 INFO - 'work_dir': 'build'} 18:55:19 INFO - ##### 18:55:19 INFO - ##### Running clobber step. 18:55:19 INFO - ##### 18:55:19 INFO - Running pre-action listener: _resource_record_pre_action 18:55:19 INFO - Running main action method: clobber 18:55:19 INFO - rmtree: /builds/slave/test-pgo/build 18:55:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 18:55:20 INFO - Running post-action listener: _resource_record_post_action 18:55:20 INFO - ##### 18:55:20 INFO - ##### Running read-buildbot-config step. 18:55:20 INFO - ##### 18:55:20 INFO - Running pre-action listener: _resource_record_pre_action 18:55:20 INFO - Running main action method: read_buildbot_config 18:55:20 INFO - Using buildbot properties: 18:55:20 INFO - { 18:55:20 INFO - "project": "", 18:55:20 INFO - "product": "firefox", 18:55:20 INFO - "script_repo_revision": "production", 18:55:20 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 18:55:20 INFO - "repository": "", 18:55:20 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 18:55:20 INFO - "buildid": "20160323161905", 18:55:20 INFO - "pgo_build": "True", 18:55:20 INFO - "basedir": "/builds/slave/test-pgo", 18:55:20 INFO - "buildnumber": 243, 18:55:20 INFO - "slavename": "talos-linux64-ix-041", 18:55:20 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 18:55:20 INFO - "platform": "ubuntu64_hw", 18:55:20 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 18:55:20 INFO - "branch": "mozilla-aurora", 18:55:20 INFO - "repo_path": "releases/mozilla-aurora", 18:55:20 INFO - "revision": "4b14e550e7d8dc76f51b929a296d6391a884585f", 18:55:20 INFO - "stage_platform": "linux64-pgo", 18:55:20 INFO - "builduid": "cd8cc63e0ba74a188afd341f8b113ce8", 18:55:20 INFO - "slavebuilddir": "test" 18:55:20 INFO - } 18:55:20 INFO - Found installer url https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 18:55:20 INFO - Running post-action listener: _resource_record_post_action 18:55:20 INFO - ##### 18:55:20 INFO - ##### Running download-and-extract step. 18:55:20 INFO - ##### 18:55:20 INFO - Running pre-action listener: _resource_record_pre_action 18:55:20 INFO - Running main action method: download_and_extract 18:55:20 INFO - mkdir: /builds/slave/test-pgo/build/tests 18:55:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:20 INFO - https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 18:55:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 18:55:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 18:55:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 18:55:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 18:55:22 INFO - Downloaded 1448 bytes. 18:55:22 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 18:55:22 INFO - Using the following test package requirements: 18:55:22 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 18:55:22 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 18:55:22 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 18:55:22 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'jsshell-linux-x86_64.zip'], 18:55:22 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 18:55:22 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 18:55:22 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 18:55:22 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 18:55:22 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 18:55:22 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 18:55:22 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 18:55:22 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 18:55:22 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:55:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:22 INFO - https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:55:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:55:26 INFO - Downloaded 23310740 bytes. 18:55:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:55:26 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 18:55:27 INFO - Return code: 0 18:55:27 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:55:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:27 INFO - https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:55:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 18:55:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:55:33 INFO - Downloaded 23310740 bytes. 18:55:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:55:33 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 18:55:34 INFO - Return code: 0 18:55:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:34 INFO - https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:55:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 18:55:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 18:55:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 18:55:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:55:35 INFO - Downloaded 10845161 bytes. 18:55:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:55:35 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 18:55:35 INFO - Return code: 0 18:55:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:35 INFO - https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:55:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 18:55:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 18:55:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 18:55:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:55:37 INFO - Downloaded 60445941 bytes. 18:55:37 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 18:55:37 INFO - mkdir: /builds/slave/test-pgo/properties 18:55:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 18:55:37 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 18:55:37 INFO - Contents: 18:55:37 INFO - build_url:https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 18:55:38 INFO - Running post-action listener: _resource_record_post_action 18:55:38 INFO - Running post-action listener: set_extra_try_arguments 18:55:38 INFO - ##### 18:55:38 INFO - ##### Running populate-webroot step. 18:55:38 INFO - ##### 18:55:38 INFO - Running pre-action listener: _resource_record_pre_action 18:55:38 INFO - Running main action method: populate_webroot 18:55:38 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:55:38 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:55:38 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:55:38 INFO - '--tppagecycles', 18:55:38 INFO - '7'], 18:55:38 INFO - 'tests': ['tsvgm']}}, 18:55:38 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:55:38 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:55:38 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 18:55:38 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:55:38 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:55:38 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:55:38 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'tests': ['damp', 'tps']}, 18:55:38 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['damp', 'tps']}, 18:55:38 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:55:38 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:55:38 INFO - 'other': {'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'other_l64': {'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'other_nol64': {'tests': ['a11yr', 18:55:38 INFO - 'ts_paint', 18:55:38 INFO - 'tpaint', 18:55:38 INFO - 'sessionrestore', 18:55:38 INFO - 'sessionrestore_no_auto_restore', 18:55:38 INFO - 'tabpaint']}, 18:55:38 INFO - 'svgr': {'tests': ['tsvgx', 18:55:38 INFO - 'tsvgr_opacity', 18:55:38 INFO - 'tart', 18:55:38 INFO - 'tscrollx', 18:55:38 INFO - 'cart']}, 18:55:38 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['tsvgx', 18:55:38 INFO - 'tsvgr_opacity', 18:55:38 INFO - 'tart', 18:55:38 INFO - 'tscrollx', 18:55:38 INFO - 'cart']}, 18:55:38 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'tests': ['tp5o']}, 18:55:38 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'talos_options': ['--e10s'], 18:55:38 INFO - 'tests': ['tp5o']}, 18:55:38 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'talos_options': ['--xperf_path', 18:55:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:55:38 INFO - 'tests': ['tp5n']}, 18:55:38 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:55:38 INFO - 'talos_options': ['--e10s', 18:55:38 INFO - '--xperf_path', 18:55:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:55:38 INFO - 'tests': ['tp5n']}}, 18:55:38 INFO - 'talos.zip': {'path': '', 18:55:38 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:55:38 INFO - Running post-action listener: _resource_record_post_action 18:55:38 INFO - ##### 18:55:38 INFO - ##### Running create-virtualenv step. 18:55:38 INFO - ##### 18:55:38 INFO - Running pre-action listener: _resource_record_pre_action 18:55:38 INFO - Running main action method: create_virtualenv 18:55:38 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 18:55:38 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 18:55:38 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 18:55:38 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:55:38 INFO - Using real prefix '/usr' 18:55:38 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 18:55:38 INFO - Installing distribute.............................................................................................................................................................................................done. 18:55:40 INFO - Installing pip.................done. 18:55:40 INFO - Return code: 0 18:55:40 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 18:55:40 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')]} 18:55:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:40 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')]} 18:55:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:40 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:40 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 18:55:40 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 18:55:40 INFO - Using env: {'DISPLAY': ':0', 18:55:40 INFO - 'HOME': '/home/cltbld', 18:55:40 INFO - 'LANG': 'en_US.UTF-8', 18:55:40 INFO - 'LANGUAGE': 'en_US:en', 18:55:40 INFO - 'LOGNAME': 'cltbld', 18:55:40 INFO - 'MAIL': '/var/mail/cltbld', 18:55:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:40 INFO - 'MOZ_NO_REMOTE': '1', 18:55:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:40 INFO - 'NO_EM_RESTART': '1', 18:55:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:40 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:40 INFO - 'SHELL': '/bin/bash', 18:55:40 INFO - 'SHLVL': '1', 18:55:40 INFO - 'TERM': 'linux', 18:55:40 INFO - 'TMOUT': '86400', 18:55:40 INFO - 'USER': 'cltbld', 18:55:40 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:40 INFO - '_': '/tools/buildbot/bin/python'} 18:55:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:41 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 18:55:41 INFO - Cleaning up... 18:55:41 INFO - Return code: 0 18:55:41 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 18:55:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:41 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 18:55:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 18:55:41 INFO - Using env: {'DISPLAY': ':0', 18:55:41 INFO - 'HOME': '/home/cltbld', 18:55:41 INFO - 'LANG': 'en_US.UTF-8', 18:55:41 INFO - 'LANGUAGE': 'en_US:en', 18:55:41 INFO - 'LOGNAME': 'cltbld', 18:55:41 INFO - 'MAIL': '/var/mail/cltbld', 18:55:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:41 INFO - 'MOZ_NO_REMOTE': '1', 18:55:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:41 INFO - 'NO_EM_RESTART': '1', 18:55:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:41 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:41 INFO - 'SHELL': '/bin/bash', 18:55:41 INFO - 'SHLVL': '1', 18:55:41 INFO - 'TERM': 'linux', 18:55:41 INFO - 'TMOUT': '86400', 18:55:41 INFO - 'USER': 'cltbld', 18:55:41 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:41 INFO - '_': '/tools/buildbot/bin/python'} 18:55:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:41 INFO - Downloading/unpacking psutil>=0.7.1 18:55:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 18:55:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:55:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:55:43 INFO - Installing collected packages: psutil 18:55:43 INFO - Running setup.py install for psutil 18:55:43 INFO - building 'psutil._psutil_linux' extension 18:55:43 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 18:55:43 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 18:55:43 INFO - building 'psutil._psutil_posix' extension 18:55:43 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 18:55:43 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 18:55:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:55:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:55:43 INFO - Successfully installed psutil 18:55:43 INFO - Cleaning up... 18:55:43 INFO - Return code: 0 18:55:43 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 18:55: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')]} 18:55:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55: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')]} 18:55:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55: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', '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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 18:55: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 mozsystemmonitor==0.0.0 18:55:43 INFO - Using env: {'DISPLAY': ':0', 18:55:43 INFO - 'HOME': '/home/cltbld', 18:55:43 INFO - 'LANG': 'en_US.UTF-8', 18:55:43 INFO - 'LANGUAGE': 'en_US:en', 18:55:43 INFO - 'LOGNAME': 'cltbld', 18:55:43 INFO - 'MAIL': '/var/mail/cltbld', 18:55:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:43 INFO - 'MOZ_NO_REMOTE': '1', 18:55:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:43 INFO - 'NO_EM_RESTART': '1', 18:55:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:43 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:43 INFO - 'SHELL': '/bin/bash', 18:55:43 INFO - 'SHLVL': '1', 18:55:43 INFO - 'TERM': 'linux', 18:55:43 INFO - 'TMOUT': '86400', 18:55:43 INFO - 'USER': 'cltbld', 18:55:43 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:43 INFO - '_': '/tools/buildbot/bin/python'} 18:55:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:44 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:55:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:45 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:55:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:55:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:55:45 INFO - Installing collected packages: mozsystemmonitor 18:55:45 INFO - Running setup.py install for mozsystemmonitor 18:55:46 INFO - Successfully installed mozsystemmonitor 18:55:46 INFO - Cleaning up... 18:55:46 INFO - Return code: 0 18:55:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 18:55:46 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')]} 18:55:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:46 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')]} 18:55:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:46 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:46 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 18:55:46 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 18:55:46 INFO - Using env: {'DISPLAY': ':0', 18:55:46 INFO - 'HOME': '/home/cltbld', 18:55:46 INFO - 'LANG': 'en_US.UTF-8', 18:55:46 INFO - 'LANGUAGE': 'en_US:en', 18:55:46 INFO - 'LOGNAME': 'cltbld', 18:55:46 INFO - 'MAIL': '/var/mail/cltbld', 18:55:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:46 INFO - 'MOZ_NO_REMOTE': '1', 18:55:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:46 INFO - 'NO_EM_RESTART': '1', 18:55:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:46 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:46 INFO - 'SHELL': '/bin/bash', 18:55:46 INFO - 'SHLVL': '1', 18:55:46 INFO - 'TERM': 'linux', 18:55:46 INFO - 'TMOUT': '86400', 18:55:46 INFO - 'USER': 'cltbld', 18:55:46 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:46 INFO - '_': '/tools/buildbot/bin/python'} 18:55:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:46 INFO - Downloading/unpacking blobuploader==1.2.4 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55:48 INFO - Downloading blobuploader-1.2.4.tar.gz 18:55:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:55:48 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 18:55:48 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55:48 INFO - Downloading docopt-0.6.1.tar.gz 18:55:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 18:55:48 INFO - Installing collected packages: blobuploader, requests, docopt 18:55:48 INFO - Running setup.py install for blobuploader 18:55:49 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:55:49 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 18:55:49 INFO - Running setup.py install for requests 18:55:49 INFO - Running setup.py install for docopt 18:55:49 INFO - Successfully installed blobuploader requests docopt 18:55:49 INFO - Cleaning up... 18:55:49 INFO - Return code: 0 18:55:49 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:55:49 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')]} 18:55:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:49 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')]} 18:55:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:49 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:49 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 18:55:49 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 18:55:49 INFO - Using env: {'DISPLAY': ':0', 18:55:49 INFO - 'HOME': '/home/cltbld', 18:55:49 INFO - 'LANG': 'en_US.UTF-8', 18:55:49 INFO - 'LANGUAGE': 'en_US:en', 18:55:49 INFO - 'LOGNAME': 'cltbld', 18:55:49 INFO - 'MAIL': '/var/mail/cltbld', 18:55:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:49 INFO - 'MOZ_NO_REMOTE': '1', 18:55:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:49 INFO - 'NO_EM_RESTART': '1', 18:55:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:49 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:49 INFO - 'SHELL': '/bin/bash', 18:55:49 INFO - 'SHLVL': '1', 18:55:49 INFO - 'TERM': 'linux', 18:55:49 INFO - 'TMOUT': '86400', 18:55:49 INFO - 'USER': 'cltbld', 18:55:49 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:49 INFO - '_': '/tools/buildbot/bin/python'} 18:55:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:55:49 INFO - Running setup.py (path:/tmp/pip-BXYElm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:55:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:55:49 INFO - Running setup.py (path:/tmp/pip-qOQZxD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:55:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:55:49 INFO - Running setup.py (path:/tmp/pip-yX5gt7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:55:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:55:49 INFO - Running setup.py (path:/tmp/pip-Gexlog-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 18:55:50 INFO - Running setup.py (path:/tmp/pip-BNU5nx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:55:50 INFO - Running setup.py (path:/tmp/pip-yYmcR5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:55:50 INFO - Running setup.py (path:/tmp/pip-HuWFRR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:55:50 INFO - Running setup.py (path:/tmp/pip-1qF6ZN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 18:55:50 INFO - Running setup.py (path:/tmp/pip-kvLww_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 18:55:50 INFO - Running setup.py (path:/tmp/pip-gsWN5H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:55:50 INFO - Running setup.py (path:/tmp/pip-H9PZkS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:55:50 INFO - Running setup.py (path:/tmp/pip-sO4vTK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:55:50 INFO - Running setup.py (path:/tmp/pip-yWX5ic-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:55:50 INFO - Running setup.py (path:/tmp/pip-OCj21a-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:55:50 INFO - Running setup.py (path:/tmp/pip-NM8h0C-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 18:55:50 INFO - Running setup.py (path:/tmp/pip-AUsrLJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 18:55:50 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 18:55:50 INFO - Running setup.py (path:/tmp/pip-dfqmzH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 18:55:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:55:50 INFO - Running setup.py install for manifestparser 18:55:51 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Running setup.py install for mozcrash 18:55:51 INFO - Running setup.py install for mozdebug 18:55:51 INFO - Running setup.py install for mozdevice 18:55:51 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Running setup.py install for mozfile 18:55:51 INFO - Running setup.py install for mozhttpd 18:55:51 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Running setup.py install for mozinfo 18:55:51 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Running setup.py install for mozInstall 18:55:51 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 18:55:51 INFO - Running setup.py install for mozleak 18:55:51 INFO - Running setup.py install for mozlog 18:55:51 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Running setup.py install for moznetwork 18:55:52 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Running setup.py install for mozprocess 18:55:52 INFO - Running setup.py install for mozprofile 18:55:52 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Running setup.py install for mozrunner 18:55:52 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Running setup.py install for mozscreenshot 18:55:52 INFO - Running setup.py install for moztest 18:55:52 INFO - Running setup.py install for mozversion 18:55:52 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 18:55:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:55:52 INFO - Cleaning up... 18:55:52 INFO - Return code: 0 18:55:52 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:55:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:52 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 18:55:52 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 18:55:52 INFO - Using env: {'DISPLAY': ':0', 18:55:52 INFO - 'HOME': '/home/cltbld', 18:55:52 INFO - 'LANG': 'en_US.UTF-8', 18:55:52 INFO - 'LANGUAGE': 'en_US:en', 18:55:52 INFO - 'LOGNAME': 'cltbld', 18:55:52 INFO - 'MAIL': '/var/mail/cltbld', 18:55:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:52 INFO - 'MOZ_NO_REMOTE': '1', 18:55:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:52 INFO - 'NO_EM_RESTART': '1', 18:55:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:52 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:52 INFO - 'SHELL': '/bin/bash', 18:55:52 INFO - 'SHLVL': '1', 18:55:52 INFO - 'TERM': 'linux', 18:55:52 INFO - 'TMOUT': '86400', 18:55:52 INFO - 'USER': 'cltbld', 18:55:52 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:52 INFO - '_': '/tools/buildbot/bin/python'} 18:55:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:55:52 INFO - Running setup.py (path:/tmp/pip-6Tmks1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:55:53 INFO - Running setup.py (path:/tmp/pip-xeIzNJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:55:53 INFO - Running setup.py (path:/tmp/pip-55IP54-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:55:53 INFO - Running setup.py (path:/tmp/pip-Y4df_y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 18:55:53 INFO - Running setup.py (path:/tmp/pip-nUqq9Z-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:55:53 INFO - Running setup.py (path:/tmp/pip-WrsZDq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:55:53 INFO - Running setup.py (path:/tmp/pip-nLYieq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:55:53 INFO - Running setup.py (path:/tmp/pip-6dzLgn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 18:55:53 INFO - Running setup.py (path:/tmp/pip-LMFvqI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 18:55:53 INFO - Running setup.py (path:/tmp/pip-fD7xi7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:55:53 INFO - Running setup.py (path:/tmp/pip-nsE7Pb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:55:53 INFO - Running setup.py (path:/tmp/pip-D5bR30-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:55:53 INFO - Running setup.py (path:/tmp/pip-YsfFCI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:55:53 INFO - Running setup.py (path:/tmp/pip-Q1Kd0G-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:55:53 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)) 18:55:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:55:53 INFO - Running setup.py (path:/tmp/pip-EWBawt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:55:54 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)) 18:55:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 18:55:54 INFO - Running setup.py (path:/tmp/pip-JU1NZk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 18:55:54 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)) 18:55:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 18:55:54 INFO - Running setup.py (path:/tmp/pip-mlI6u5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 18:55:54 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)) 18:55:54 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)) 18:55:54 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)) 18:55:54 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)) 18:55:54 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)) 18:55:54 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)) 18:55:54 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 18:55:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:56 INFO - Downloading blessings-1.6.tar.gz 18:55:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 18:55:56 INFO - Installing collected packages: blessings 18:55:56 INFO - Running setup.py install for blessings 18:55:56 INFO - Successfully installed blessings 18:55:56 INFO - Cleaning up... 18:55:56 INFO - Return code: 0 18:55:56 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 18:55:56 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 18:55:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 18:55:56 INFO - Reading from file tmpfile_stdout 18:55:56 INFO - Current package versions: 18:55:56 INFO - argparse == 1.2.1 18:55:56 INFO - blessings == 1.6 18:55:56 INFO - blobuploader == 1.2.4 18:55:56 INFO - docopt == 0.6.1 18:55:56 INFO - manifestparser == 1.1 18:55:56 INFO - mozInstall == 1.12 18:55:56 INFO - mozcrash == 0.17 18:55:56 INFO - mozdebug == 0.1 18:55:56 INFO - mozdevice == 0.48 18:55:56 INFO - mozfile == 1.2 18:55:56 INFO - mozhttpd == 0.7 18:55:56 INFO - mozinfo == 0.9 18:55:56 INFO - mozleak == 0.1 18:55:56 INFO - mozlog == 3.1 18:55:56 INFO - moznetwork == 0.27 18:55:56 INFO - mozprocess == 0.22 18:55:56 INFO - mozprofile == 0.28 18:55:56 INFO - mozrunner == 6.11 18:55:56 INFO - mozscreenshot == 0.1 18:55:56 INFO - mozsystemmonitor == 0.0 18:55:56 INFO - moztest == 0.7 18:55:56 INFO - mozversion == 1.4 18:55:56 INFO - psutil == 3.1.1 18:55:56 INFO - requests == 1.2.3 18:55:56 INFO - wsgiref == 0.1.2 18:55:56 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:55:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:56 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:56 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 18:55:56 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 18:55:56 INFO - Using env: {'DISPLAY': ':0', 18:55:56 INFO - 'HOME': '/home/cltbld', 18:55:56 INFO - 'LANG': 'en_US.UTF-8', 18:55:56 INFO - 'LANGUAGE': 'en_US:en', 18:55:56 INFO - 'LOGNAME': 'cltbld', 18:55:56 INFO - 'MAIL': '/var/mail/cltbld', 18:55:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:56 INFO - 'MOZ_NO_REMOTE': '1', 18:55:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:56 INFO - 'NO_EM_RESTART': '1', 18:55:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:56 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:56 INFO - 'SHELL': '/bin/bash', 18:55:56 INFO - 'SHLVL': '1', 18:55:56 INFO - 'TERM': 'linux', 18:55:56 INFO - 'TMOUT': '86400', 18:55:56 INFO - 'USER': 'cltbld', 18:55:56 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:56 INFO - '_': '/tools/buildbot/bin/python'} 18:55:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55:56 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)) 18:55: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 mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 18:55:56 INFO - Cleaning up... 18:55:56 INFO - Return code: 0 18:55:56 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 18:55:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:55:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:56 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:56 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 18:55:56 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 18:55:56 INFO - Using env: {'DISPLAY': ':0', 18:55:56 INFO - 'HOME': '/home/cltbld', 18:55:56 INFO - 'LANG': 'en_US.UTF-8', 18:55:56 INFO - 'LANGUAGE': 'en_US:en', 18:55:56 INFO - 'LOGNAME': 'cltbld', 18:55:56 INFO - 'MAIL': '/var/mail/cltbld', 18:55:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:56 INFO - 'MOZ_NO_REMOTE': '1', 18:55:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:56 INFO - 'NO_EM_RESTART': '1', 18:55:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:56 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:56 INFO - 'SHELL': '/bin/bash', 18:55:56 INFO - 'SHLVL': '1', 18:55:56 INFO - 'TERM': 'linux', 18:55:56 INFO - 'TMOUT': '86400', 18:55:56 INFO - 'USER': 'cltbld', 18:55:56 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:56 INFO - '_': '/tools/buildbot/bin/python'} 18:55:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:57 INFO - Downloading/unpacking jsonschema 18:55:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:55:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:55:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:55:58 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:55:58 INFO - Downloading/unpacking functools32 (from jsonschema) 18:55:58 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 18:55:58 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 18:55:58 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 18:55:58 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 18:55:58 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 18:55:58 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 18:55:59 INFO - Downloading functools32-3.2.3-2.tar.gz 18:55:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 18:55:59 INFO - warning: no files found matching '*.txt' 18:55:59 INFO - no previously-included directories found matching 'build' 18:55:59 INFO - no previously-included directories found matching 'dist' 18:55:59 INFO - no previously-included directories found matching '.git*' 18:55:59 INFO - Installing collected packages: jsonschema, functools32 18:55:59 INFO - Running setup.py install for functools32 18:55:59 INFO - warning: no files found matching '*.txt' 18:55:59 INFO - no previously-included directories found matching 'build' 18:55:59 INFO - no previously-included directories found matching 'dist' 18:55:59 INFO - no previously-included directories found matching '.git*' 18:55:59 INFO - Successfully installed jsonschema functools32 18:55:59 INFO - Cleaning up... 18:55:59 INFO - Return code: 0 18:55:59 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 18:55:59 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')]} 18:55:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:55:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:59 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')]} 18:55:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:55:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:55:59 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 0x7f354e90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1be58a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1cb26d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, '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': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', '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 18:55:59 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 18:55:59 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 18:55:59 INFO - Using env: {'DISPLAY': ':0', 18:55:59 INFO - 'HOME': '/home/cltbld', 18:55:59 INFO - 'LANG': 'en_US.UTF-8', 18:55:59 INFO - 'LANGUAGE': 'en_US:en', 18:55:59 INFO - 'LOGNAME': 'cltbld', 18:55:59 INFO - 'MAIL': '/var/mail/cltbld', 18:55:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:55:59 INFO - 'MOZ_NO_REMOTE': '1', 18:55:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:55:59 INFO - 'NO_EM_RESTART': '1', 18:55:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:55:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:55:59 INFO - 'PWD': '/builds/slave/test-pgo', 18:55:59 INFO - 'SHELL': '/bin/bash', 18:55:59 INFO - 'SHLVL': '1', 18:55:59 INFO - 'TERM': 'linux', 18:55:59 INFO - 'TMOUT': '86400', 18:55:59 INFO - 'USER': 'cltbld', 18:55:59 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:55:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:55:59 INFO - '_': '/tools/buildbot/bin/python'} 18:55:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:55:59 INFO - Downloading/unpacking flake8 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:55: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 18:56:01 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 18:56:01 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56:01 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 18:56:01 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56: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 18:56:02 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 18:56:02 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 18:56:02 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 18:56:02 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 18:56:02 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 18:56:02 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 18:56:02 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 18:56:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 18:56:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:56:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:56:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:56:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:56:02 INFO - no previously-included directories found matching 'docs/_build' 18:56:02 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 18:56:02 INFO - Running setup.py install for pep8 18:56:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:56:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:56:02 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:56:02 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:56:02 INFO - no previously-included directories found matching 'docs/_build' 18:56:02 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 18:56:02 INFO - Successfully installed flake8 mccabe pyflakes pep8 18:56:02 INFO - Cleaning up... 18:56:02 INFO - Return code: 0 18:56:02 INFO - Running post-action listener: _resource_record_post_action 18:56:02 INFO - Running post-action listener: _start_resource_monitoring 18:56:02 INFO - Starting resource monitoring. 18:56:02 INFO - ##### 18:56:02 INFO - ##### Running install step. 18:56:02 INFO - ##### 18:56:02 INFO - Running pre-action listener: _resource_record_pre_action 18:56:02 INFO - Running main action method: install 18:56:02 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 18:56:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 18:56:02 INFO - Reading from file tmpfile_stdout 18:56:02 INFO - Detecting whether we're running mozinstall >=1.0... 18:56:02 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 18:56:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 18:56:02 INFO - Reading from file tmpfile_stdout 18:56:02 INFO - Output received: 18:56:02 INFO - Usage: mozinstall [options] installer 18:56:02 INFO - Options: 18:56:02 INFO - -h, --help show this help message and exit 18:56:02 INFO - -d DEST, --destination=DEST 18:56:02 INFO - Directory to install application into. [default: 18:56:02 INFO - "/builds/slave/test-pgo"] 18:56:02 INFO - --app=APP Application being installed. [default: firefox] 18:56:02 INFO - mkdir: /builds/slave/test-pgo/build/application 18:56:02 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 18:56:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 18:56:18 INFO - Reading from file tmpfile_stdout 18:56:18 INFO - Output received: 18:56:18 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 18:56:18 INFO - Running post-action listener: _resource_record_post_action 18:56:18 INFO - ##### 18:56:18 INFO - ##### Running run-tests step. 18:56:18 INFO - ##### 18:56:18 INFO - Running pre-action listener: _resource_record_pre_action 18:56:18 INFO - Running main action method: run_tests 18:56:18 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 18:56:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 18:56:18 INFO - Python 2.7.3 18:56:18 INFO - Return code: 0 18:56:18 INFO - grabbing minidump binary from tooltool 18:56:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:56:18 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 0x1d41920>, '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 0x1d42820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d42cb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 18:56:18 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 18:56:18 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 18:56:18 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:56:18 INFO - Return code: 0 18:56:18 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 18:56:18 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 18:56:18 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 18:56:18 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 18:56:18 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 18:56:18 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 18:56:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 18:56:19 INFO - Return code: 0 18:56:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-041', '--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 18:56:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-041 --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 18:56:19 INFO - Using env: {'DISPLAY': ':0', 18:56:19 INFO - 'HOME': '/home/cltbld', 18:56:19 INFO - 'LANG': 'en_US.UTF-8', 18:56:19 INFO - 'LANGUAGE': 'en_US:en', 18:56:19 INFO - 'LOGNAME': 'cltbld', 18:56:19 INFO - 'MAIL': '/var/mail/cltbld', 18:56:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 18:56:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 18:56:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:56:19 INFO - 'MOZ_NO_REMOTE': '1', 18:56:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 18:56:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:56:19 INFO - 'NO_EM_RESTART': '1', 18:56:19 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:56:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:56:19 INFO - 'PWD': '/builds/slave/test-pgo', 18:56:19 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 18:56:19 INFO - 'SHELL': '/bin/bash', 18:56:19 INFO - 'SHLVL': '1', 18:56:19 INFO - 'TERM': 'linux', 18:56:19 INFO - 'TMOUT': '86400', 18:56:19 INFO - 'USER': 'cltbld', 18:56:19 INFO - 'XDG_SESSION_COOKIE': '8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189', 18:56:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:56:19 INFO - '_': '/tools/buildbot/bin/python'} 18:56:19 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-041', '--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 18:56:19 INFO - mozversion application_buildid: 20160323161905 18:56:19 INFO - mozversion application_changeset: 4b14e550e7d8dc76f51b929a296d6391a884585f 18:56:19 INFO - mozversion application_display_name: FirefoxDeveloperEdition 18:56:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:56:19 INFO - mozversion application_name: Firefox 18:56:19 INFO - mozversion application_remotingname: firefox-dev 18:56:19 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 18:56:19 INFO - mozversion application_vendor: Mozilla 18:56:19 INFO - mozversion application_version: 47.0a2 18:56:19 INFO - mozversion platform_buildid: 20160323161905 18:56:19 INFO - mozversion platform_changeset: 4b14e550e7d8dc76f51b929a296d6391a884585f 18:56:19 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 18:56:19 INFO - mozversion platform_version: 47.0a2 18:56:19 INFO - using testdate: 1458784579 18:56:19 INFO - actual date: 1458784579 18:56:19 INFO - starting webserver on 'localhost:49687' 18:56:19 INFO - SUITE-START | Running 2 tests 18:56:19 INFO - TEST-START | dromaeo_css 18:56:19 INFO - operating with platform_type : linux_ 18:56:19 INFO - Initialising browser for dromaeo_css test... 18:56:19 INFO - TEST-INFO | started process 11485 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpTMTVLA/profile http://localhost:49687/getInfo.html) 18:56:23 INFO - PROCESS | 11485 | __metrics Screen width/height:1600/1200 18:56:23 INFO - PROCESS | 11485 | colorDepth:24 18:56:23 INFO - PROCESS | 11485 | Browser inner width/height: 1024/697 18:56:23 INFO - PROCESS | 11485 | __metrics 18:56:24 INFO - PROCESS | 11485 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:56:25 INFO - TEST-INFO | 11485: exit 0 18:56:25 INFO - Browser initialized. 18:56:25 INFO - Running cycle 1/1 for dromaeo_css test... 18:56:25 INFO - TEST-INFO | started process 11575 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpTMTVLA/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:56:37 INFO - PROCESS | 11575 | RSS: Main: 144273408 18:56:37 INFO - PROCESS | 11575 | 18:57:28 INFO - PROCESS | 11575 | 1458784648583 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] 18:59:36 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49687/tests/dromaeo/cssquery-ext.html) 18:59:37 INFO - PROCESS | 11575 | RSS: Main: 254578688 18:59:37 INFO - PROCESS | 11575 | 19:02:39 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-ext.html (next: http://localhost:49687/tests/dromaeo/cssquery-jquery.html) 19:02:39 INFO - PROCESS | 11575 | RSS: Main: 228782080 19:02:39 INFO - PROCESS | 11575 | 19:05:41 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49687/tests/dromaeo/cssquery-mootools.html) 19:05:42 INFO - PROCESS | 11575 | RSS: Main: 228667392 19:05:42 INFO - PROCESS | 11575 | 19:08:44 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49687/tests/dromaeo/cssquery-prototype.html) 19:08:44 INFO - PROCESS | 11575 | RSS: Main: 201465856 19:08:44 INFO - PROCESS | 11575 | 19:11:47 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49687/tests/dromaeo/cssquery-yui.html) 19:11:47 INFO - PROCESS | 11575 | RSS: Main: 216125440 19:11:47 INFO - PROCESS | 11575 | 19:14:49 INFO - PROCESS | 11575 | Cycle 1(1): loaded http://localhost:49687/tests/dromaeo/cssquery-yui.html (next: http://localhost:49687/tests/dromaeo/cssquery-dojo.html) 19:14:50 INFO - PROCESS | 11575 | RSS: Main: 262651904 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | __start_tp_report 19:14:50 INFO - PROCESS | 11575 | _x_x_mozilla_page_load 19:14:50 INFO - PROCESS | 11575 | _x_x_mozilla_page_load_details 19:14:50 INFO - PROCESS | 11575 | |i|pagename|runs| 19:14:50 INFO - PROCESS | 11575 | |0;dojo.html;3247.8538465769047;3278.6229583597865;3294.7528935329856;3295.9782467435098;3335.716464100552;5303.496167864051;5312.4687531246855;5317.494837990394;5327.147656374981;5373.865653358663;5334.5999050071305;5359.115745901931;5361.839144825652;5366.677999320043;5372.650777699447;4854.8300809471675;4872.7563621818945;4889.8777530561665;4922.0402021605805;4952.653314268003;4950.232713929347;5031.371078615173;5033.068882256776;5034.748262586874;5036.571891389236;4941.555260026596;4985.875353116165;4986.252062190682;4998.450170481262;5012.799488020493;5003.47463516331;5024.62315326352;5049.4950504949575;5049.570786483153;5080.949190508085;4791.784369703371;4878.682885612424;4902.28916807061;4906.337644418029;4923.532264434873;5258.684478931238;5287.101192797195;5292.947070529284;5299.364076310829;5326;5806.1000544915605;5808.332041815203;5876.030454974924;5878.50032747217;5886.264216972879;5873.412658734135;5907.02534081876;5907.261592300963;5932.436418540232;5933.139694744281;5523.392426833045;5530.917036244459;5531.170324451325;5535.225068490415;5537.0863807471715;5838.386969368155;5990.73041713124;6038.305594856648;6054.485368743618;6057.545684073624;5785.190073389729;5786.392428795;5790.218320526675;5791.247137872134;5799.768009279666;5870.295564532198;5874.265716785402;5884.646921184657;5889.941100589025;5890.882182356415;5709;5765.538756899438;5834.183214349994;5835.649861008353;5835.79574714883;5782.595218334676;5818.44724751148;5819.79630712923;5820.417958204231;5830.883382332329;4430.911381772346;4461.977690111528;4462.665300102505;4468.754218518013;4495.865124046284;3905.414187871842;3914.4715463412645;3970.7021973352116;3985.5815139410524;4011.6590089842107;5580.35825880029;5591.3569939456665;5595.104783234663;5595.356533998561;5596.608237423423;5902.2622172228475;5909.615874968199;5911.320198177179;5912.526997840162;5913.9112913306335;5486.835394938158;5523.392426833045;5562.638428502134;5570.025245582007;5610.4670056344585;5039.395272567315;5052.242163675478;5055.51972562606;5065.493450654905;5083.542481176638;5905.793297234576;6095.6952152392205;6121.143039974407;6121.877562448726;6125.693715314216;5887.20522729426;5911.113333000085;5940.049592065248;5947.434993675594;5954.4343287389365;5903.203067585992;5937;5938.346781854079;5960.1357803117435;6067.24159480065;5694.686792226467;5763.567732420001;5772.134179873053;5775.8556036099435;5784.190213370216;5783.248177736868;5814.883702326015;5818.185454036354;5822.184894114743;5848.824535263949;5595.412481689526;5646.7458964347525;5652.886942261214;5655.575831812548;5672.716364181857;5650.26546548946;5671.120976248688;5672.12082127271;5766.423357664368;5786.508146807569;5672.5461963042035;5696.54427645779;5704.857378565569;5706.828795136153;5715.199872017838;5735;5767.9134812977;5796.246487956539;5799.449052340021;5804.3905389935135;5560.91658625129;5647.0964645656495;5688.658680479184;5690.118031705092;5733.397993210653 19:14:50 INFO - PROCESS | 11575 | |1;ext.html;550.7411516587205;563.0737436916276;569.3822202909844;575.002370886512;582.839719077254;31570.368592628132;40171;40467.59532404675;40497.59502404975;40504.797476012616;46592.30111548329;47002.294965575544;47155.52844471554;47262.52737472624;47362.52637473624;9257;9454.527273636326;9470.952645236765;9476.478793666345;9487.098725621056;9174.724758257264;9289.581968811386;9301.44191348518;9308.301877359192;9309.953450232739;9290.396124251936;9370.85943710845;9373.437593744364;9389.248860091177;9392.48341341226;9280.675176368828;9340.112689294507;9352.719418417459;9359.064093590654;9369.718908432758;9161.954190229006;9287.953560232156;9294.628214871396;9301.162895339385;9309.255259579217;42936.57063429388;43453.565464345585;43511;43522.347164792554;43554.12891742179;3523.330567192251;3534.416821224495;3703.777773333609;4185.811638476276;4358.5205627380965;31351.529727054112;32343;32790.180245493815;32931.50602740961;32993.19557837587;4279.828806847722;4297.226499230137;4360.738355698637;4365.5416181300825;4370.519242883281;227855;229270;229320;229505;230422;64309.356906431276;65190;65421.345786541526;65471.345286547476;65537.67231163813;71196;71436;75880.24119758731;76252;76715;16457.753133703005;16617.08606026656;16666.50000499987;16669.583260418585;16677.91661041687;12419.379031048593;12459;12482.188657737219;12488.875111248954;12508.49966001368;22022.88988555079;22044.88977555102;22056.33830985073;22091;22229.666555001688;8433.831323373499;8670.349723770742;8787.912120878837;8799.29605631548;8839.32052909945;1103.2938919091787;1150.8503894493663;1153.4694040741185;1154.5319613097367;1205.2647884790447;31363.686363136076;32018;32322.515162272586;32736.181595460304;33096.83451582775;1128.7234627516148;1146.827975803636;1166.4984056855465;1178.9823152652716;1217.7442737025146;16032;17297.048662323443;17767.46697599074;18069.909650451664;18106.642001849916;441179;442123;442649;446872;448156;61764;63045.68477157585;63062;63100.684496577225;63205.683971580766;1419.9148051116758;1462.612407711957;1498.8501149885142;1508.8264849542225;1517.9165145917302;28429.715702843536;28779.712202877705;28858.134255972356;29162;29203.707962920947;44532.77733611311;45081.774591126836;45222.54777452183;45240;45256.77371613121;211216;212048;212081;212288;213181;31159.844200779757;35058.298834022666;35138;35537.466937995436;35767;50764;51407.485925141766;51855;52111;52204.73897630488;35899.28201436009;36298.4555231677;36737.44893826648;36863.262734745695;37214.44178337381;38218.808905955295;38252.426213607374;39192.804035979636;39597.40603891001;39788.602113978486;39043.2191356177;39564;39785.403218951156;39827.80086099551;40149;34140.31719365549;35303.62917714783;35858.28283434369;36042.27915441624;36271.27457450889;26741.33146671271;27563.173104806887;27793.861030694716;28103.297417564725;28108.594570271813 19:14:50 INFO - PROCESS | 11575 | |2;jquery.html;364.7865998390941;391.95296564412257;393.25085711719186;397.8766582359469;406.790502891011;15161.469348572802;17250.39623613174;18300.908495457537;19052;19138;18160.636787264248;18329.90835045823;18619.44141675752;18622.627547449043;18695.41089007436;5396.43337449568;5554.361248456439;5781.768729250846;5793.855153621172;5816.505597024258;5649.209110724481;5688.089905615102;5689.089745640698;5695.288088988877;5706.315242170925;5484.149956756709;5664.773409063653;5668.829935101933;5676.687782171979;5723.198752174699;5674.517665998395;5680.857978550549;5701.287339082614;5721.799737009184;5723.627964182336;4930.778114984834;5107.591392688613;5127.077126117298;5130.102232109366;5147.845564633029;22006;22223.777762222333;22411;22436.887815560982;22736.77263227363;2392.916247931314;2394.3535245483795;2481.702195736505;2486.66430031947;2629.0929629277866;13906.443742250298;13978.860211397858;13984.93007534966;14095.083819551697;14150.150990940474;1942.417274817549;1953.4139758072522;2039.2454791727007;2096.0777258006583;2103.779103194158;60621;61488.38511614871;62612.68693656548;62836.37163628351;63429.68285158591;10707;10838.891611083789;11097.778044439066;11099.056580190774;11192.608258710907;13341.799873001914;14521.273936303143;14649.901257405738;14657.413703451955;14667;7654.545636329191;7763.689452421952;7766.650500727481;7810.29707326332;8249.752507424786;7970.322522585529;8052.315553177928;8069.3544516439715;8235;8281.8343633127;6592.143021407186;6844.486663500257;6846.691898864563;6869.793906182823;6884.449244060464;1947.3476385410763;1956.923691969411;1974.2497850816599;2002.609491149241;2041.1835265893762;993.8211121997965;1041.4896700616644;1114.2478826792046;1156.5200441816721;1159.6984783956232;18864.245430182913;19466.902665486865;19552;19611.803881961285;19752.802471975097;1016.4815943868532;1022.1414012229762;1038.7299302181486;1078.9892101079047;1084.208527774713;11014.50434730439;11091.223614346918;11233.269837460539;11299.265547739371;11341.376224307578;420975;429269;431820;436768;438405;75962.62018689871;77289.61355193188;79293.20706792858;79724;80882.59558702286;1060.4273692206123;1062.150279776176;1097.2757979733497;1104.282216559243;1104.8729396119388;15642.062184957736;15914.363425462852;16298.266578004255;16331.59171020734;16602.83397166013;28229.71770282271;28364.858175709815;32043.67956320407;33256.1685957853;36442;44540.55459445364;44649;44955;44989.77505112453;47089;8351.498910065415;8368.83262334762;8451.45065570736;8464;8530.232279094911;12708.30104344233;13227.537036204072;13279.468821247428;13405.798913016117;13411.32943352809;11139;11201.71995700114;11321.660350189508;11559.133065019989;11656.475458604213;5221.556167725786;8711.21599056088;10886.836697449702;11388.715282117682;11595.768084638092;11847;11936.641900742992;11963.102767292661;11998.520059197534;12082.879171208528;8577.528235947082;8580.528070956158;8674.306055515417;8686.478811271343;8729.650813967624;9413.964463909102;11690.941545292219;11858.407079646156;12066.457009434422;12164.574239901562 19:14:50 INFO - PROCESS | 11575 | |3;mootools.html;1424.1597457500086;1582.4303250829703;1598.2727858824237;1816.3370369815023;1922.567422329976;8404.45371050882;8672.34957378196;8676.436031657939;8683.652653893845;8695.087015863339;8536.359773017033;8702.651893924236;8716.60775265113;8723.91276087239;8729.825403491943;2182.6398644223764;2239.193890199527;2410.783029527342;2454.067454367338;2479.0579579759665;2452.7792498675117;2495.3761559610098;2495.9376015599573;2498.6252062190724;2499.237732491589;2460.3972026853444;2495.189063554343;2506.385935445818;2507.5862482690336;2511.4223728542447;2408.614621660535;2427.2111563741764;2434.1480481831395;2449.191766716979;2457.0785955266774;2479.3429741118616;2503.499300139961;2505.260948020338;2510.3724068982756;2523.608840629687;8662.263707584863;8715.694950676696;8739.126087391274;8745.47527148373;8764.25503832175;5152.458991805844;5293.444188360205;5295.629305948585;5296.099663057251;5298.81454149103;3307.9173020674434;3343.3981883261004;3397.8980630581123;3468.479728040789;3487.930241395183;1067.3489171605315;1068.5458680061022;1077.8221593437074;1101.014591940217;1101.438266484099;12383.133180677356;12536.623901282976;12570.811437828439;12592.874071259354;12593.559225427067;4707.293905914072;4826.698356110107;4840.903181936342;4864.756762161948;4888.804447822118;10539.42033188182;10545.367277963347;10608.628697995533;10611.31026483276;10630.574777008987;5351;5355.384130825005;5363.946360536423;5397.919031214535;5399.676019438768;4284.014676624394;4595.747233902168;4634.513376095529;4658;4706.435227772689;4167.333226683716;4167.874963751093;4190.727602705814;4204.096119334296;4205.76868272248;1301.3038024656764;1336.0580790542645;1345.6837643153851;1346.7777816660337;1349.2713934475273;1424.893133015028;1438.0940007795023;1451.7894905238682;1453.4622189789845;1457.5845883923032;8198.467099638505;8278.503289802511;8302.128276530999;8309.418340716213;8316.417850750511;507.14039702703565;510.1149505607768;514.3313692200124;518.5048278893723;524.4991033562939;6032.185654936615;6035.30593981689;6038.969805151034;6095.4818840398175;6107.786227482017;10230.744231394274;10356.326838755456;10449.216308776871;10467.738306542398;10487.05616494504;10020.34867733595;10296.948515257525;10306.587736490606;10321.535530901128;10343.689689309333;8089.110197878229;8207.671693132328;8249.010118785784;8293.543855087908;8308.12764659714;8015.919840801751;8021.879671804811;8115.553644549606;8124.715634952749;8196.836063278583;9434.764130896783;9521.61913523479;9620.663276785279;9677.70966870995;9955.950220248853;9985.60057597717;10020;10024.849627255451;10083.798324033332;10250.436226007343;6821.386075253251;7321.450891183289;7463.179050304354;7759.418043646862;7886.566238856918;8266.049404318339;8267.131951145044;8281.751547453345;8311.750647480585;8330.333573314;7305.269473052865;7320.707171713072;7483.8503229934;7582.203868593939;7597.126330471845;7386.630668466448;7420.851582968418;7422.443316751157;7527.322540971119;7546.622668866645;7819.335356494534;7830.92169078302;7851.254130857559;7862.52824830512;7871.33093687043;7043.049188359506;7070.929290707027;7113.679884405317;7147.928520714934;7170;7262.164851042197;7283.162436319679;7296.379807716191;7356.66894989716;7396.3343299103335 19:14:50 INFO - PROCESS | 11575 | |4;prototype.html;353.74176850898857;363.9799811010395;364.4114754671205;368.35353953811057;372.73163322407856;6041.667708276049;6093.451589356957;6096.35988221237;6117.327094019654;6121.969390153048;5984.1921340619;5994.910076348859;6005.579609427342;6009.128676341938;6012.789552365668;4483.820647174109;4498.910021799562;4542.15970045541;4618.561236682526;4634.606058485025;4619.076184763044;4646.674732768707;4650.767461626922;4654.534546545336;4664.580187783099;4601.930971035437;4615.353850460938;4621.930671039937;4622.375979242793;4635.049814787961;4462;4522.140793249288;4646.047560250141;4650.627949764011;4667.766611669437;4123.195976784528;4125.23683118624;4134.710570260083;4142.647874930634;4147.170565886835;5731.340895796995;5744.4829965303325;5754.798582049608;5761.884762304772;5765.654060756368;5473.28847249859;5473.75368108436;5477.835664930059;5482.259894914176;5483.424240454775;6377.457916077139;6388.744450221986;6400.935990640127;6402.551821372505;6403.103565500834;4365.80353884076;4468.597826195658;4469.843555475542;4471.217536931056;4595.839145629887;6494.285628580852;6588.637624930627;6684.465242780566;6686.665666716644;6688.7324507019175;4608.815647374135;4615.515370886009;4619.9769001155455;4621.930671039937;4626.7223966562115;4667.719936803803;4682.648801339913;4684;4685.976570117127;4688.203005489075;5346.973265133727;5362.142057270896;5391.9460805391445;5392.595555333366;5392.784288628411;6303.968480157661;6421.775237866652;6430.164078669743;6436.645984470899;6452.9677351612945;1636.9508914732578;1637.0668718830152;1643.1619873864415;1644.3587001069593;1661.3852874436295;1070.4112737994228;1102.1458369763336;1105.2815669814686;1129.1136457880525;1131.112077019552;6080.422359875804;6130.509559235251;6135.32511423743;6139.355367686418;6146.569740118238;6574.342565743387;6581.638009909405;6582.670866456658;6592.340765923369;6593.86812263752;6205.727825795701;6206.937930620727;6210.627362358273;6214.689265536705;6224.844378890473;3538.274653695986;3561.679448849616;3568.803715795656;3569.37535931211;3572.5712914450432;6637.46900247979;6787.626680532618;6806.897896531556;6813.693383797741;6814.795556133324;6708.530402871752;6728.058071869942;6733.192016957996;6739.865202695919;6742.325767423316;6758.831029224309;6762.932370676231;6778.254392016875;6845.041694162821;6850.554713943478;6571.57284776488;6575.24384695747;6579.440747536513;6580.5064620154635;6583.111279977142;6295.842603934938;6449.645574429423;6460.612363258219;6466.030095485715;6476.417122459001;6762.357576030269;6782.694778735067;6783;6794.490413219127;6813;4592.839250626212;4601.815927362868;4603.700759450625;4606.262997920317;4612.976935115303;6560;6575.934240657532;6576.177977752781;6581.473482121514;6593.340665933369;6262.279837818709;6387.105805187184;6393.2647745508;6398.456131228898;6402.423781859655;6385.68071596409;6400.51996100285;6407.10300557913;6413.16628838248;6413.198350206224;6296.5592408530965;6303.747850085945;6313.96843015782;6314.463270622048;6367;6419.2938776735455;6422.550421470452;6430.131932189094;6433.394475237536;6434.131392261985;6011.128386384037;6116.694165291807;6282.465990390868;6286.214223222098;6309.148264984168 19:14:50 INFO - PROCESS | 11575 | |5;yui.html;900.5452246615461;906.6464079009188;909.022800489474;924.2236521322088;932.6595792535727;14126.858731412683;14304.642383940407;14391.136531808099;14407.855921440796;14420.49528266511;13181.868181318185;13345.599632011032;13401.865981340183;13411.396487158101;13415.12801667891;897.2732087009526;921.5023887100991;922.8154369126169;922.8246633139715;922.9939366090993;939.3847030195199;956.4691596164126;958.018031517693;958.8274110660078;958.832204364237;987.4667679453087;996.1234113979688;997.1972562087517;997.5560875410446;997.8104160209573;988.3032462114193;988.990110098897;989.1493315748451;989.3816364772017;990.9108180263775;731.228553875661;731.5976213082783;731.7073170731696;732.0593037946213;732.9780106596811;12146.939265303705;12193.085518586142;12200;12236.143469957107;12252.509899604005;11576.652700419001;11870.169088163831;12181.208221465666;13725;13848.238346890917;11333.659990200307;11408.54365825366;11438.313701177956;11529.365884876328;11777.470013849397;3863.1114843586133;3911.8239679214503;3914.706397020235;3914.823832927525;3970.404439334123;53191.73404132993;54075.45924540744;54283.45716542863;54363.99999999961;54472;10829.079528240189;10952.890471095347;11051.889481105247;11052.778944421067;11341.886581134084;19128.234870605298;19205.80794192068;19242;19271.22915083381;19280.32518861833;8348.248657620721;8444.746657600283;8460.788480288042;8527.957360213159;8580.570971451403;4501.234790085693;4654.511276315938;4896.290037944478;4998.375203099613;5124.948750512522;3428.211511352353;3493.94759078614;3499.2126771476214;3503.702185314277;3509.824508774551;619.2445216835454;643.4980715042275;651.1697585578426;665.4277321503503;699.9685014174374;684.5755631508497;691.1740470138137;745.5377665847101;746.8394295226552;758.7761610324967;8098.149694282133;8312.8753068704;8362.331013518904;8705;8906.777330566658;580.2920437066772;696.7178292791427;708.9184743754431;719.2447929673822;728.3990707666196;3827.6937844972335;4144.001038997382;4155.023569461174;4171.207470580641;4181.916361672749;58331.41668583345;59345.70327148337;59503;59772;59891.70054149701;48813.511864881606;51469;54339.45660543423;54710.45289547133;61827.6908615454;47946.280805787945;48044.9999999993;48724.5127548727;49080.50919490831;49100.263496047584;9030.45817250967;9041.412308199946;9221.216196623362;9239.72280831576;9254.629814807333;34654;34682.13294667654;34957.82521087378;35037.9488615342;35876;40536.59463405328;41744.79127604343;44211.77894110509;44922.77538612286;45498.772506137255;11683.824742628698;11732.882671173178;11893.821592675944;11903.940480297542;12165;12432.254064756144;12515.436805343963;12593.307368094842;12706.936465317614;12723.872761272269;11660;12044.096692748255;12211.694707632025;12211.816822747489;12283.324417157142;11436.370999595103;11496.827547586625;11503.884961150616;11779.234349767237;11887.049036077266;10653.360798352123;11006.229563930448;11418.429078546205;11652.766944661229;12666.87333126657;10071.395716257048;10356.17150627963;10377.636782712569;10584.153267738717;10641.255112142077;9879.604815807288;10217.795644086927;10281.588736450458;10310.536025878704;10360.792784144425 19:14:50 INFO - PROCESS | 11575 | __end_tp_report 19:14:50 INFO - PROCESS | 11575 | __start_cc_report 19:14:50 INFO - PROCESS | 11575 | _x_x_mozilla_cycle_collect,877 19:14:50 INFO - PROCESS | 11575 | __end_cc_report 19:14:50 INFO - PROCESS | 11575 | __startTimestamp1458785690185__endTimestamp 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | ------- Summary: start ------- 19:14:50 INFO - PROCESS | 11575 | Number of tests: 6 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#0] dojo.html Cycles:165 Average:5431.33 Median:5671.12 stddev:609.90 (10.8%) stddev-sans-first:587.23 19:14:50 INFO - PROCESS | 11575 | Values: 3247.9 3278.6 3294.8 3296.0 3335.7 5303.5 5312.5 5317.5 5327.1 5373.9 5334.6 5359.1 5361.8 5366.7 5372.7 4854.8 4872.8 4889.9 4922.0 4952.7 4950.2 5031.4 5033.1 5034.7 5036.6 4941.6 4985.9 4986.3 4998.5 5012.8 5003.5 5024.6 5049.5 5049.6 5080.9 4791.8 4878.7 4902.3 4906.3 4923.5 5258.7 5287.1 5292.9 5299.4 5326.0 5806.1 5808.3 5876.0 5878.5 5886.3 5873.4 5907.0 5907.3 5932.4 5933.1 5523.4 5530.9 5531.2 5535.2 5537.1 5838.4 5990.7 6038.3 6054.5 6057.5 5785.2 5786.4 5790.2 5791.2 5799.8 5870.3 5874.3 5884.6 5889.9 5890.9 5709.0 5765.5 5834.2 5835.6 5835.8 5782.6 5818.4 5819.8 5820.4 5830.9 4430.9 4462.0 4462.7 4468.8 4495.9 3905.4 3914.5 3970.7 3985.6 4011.7 5580.4 5591.4 5595.1 5595.4 5596.6 5902.3 5909.6 5911.3 5912.5 5913.9 5486.8 5523.4 5562.6 5570.0 5610.5 5039.4 5052.2 5055.5 5065.5 5083.5 5905.8 6095.7 6121.1 6121.9 6125.7 5887.2 5911.1 5940.0 5947.4 5954.4 5903.2 5937.0 5938.3 5960.1 6067.2 5694.7 5763.6 5772.1 5775.9 5784.2 5783.2 5814.9 5818.2 5822.2 5848.8 5595.4 5646.7 5652.9 5655.6 5672.7 5650.3 5671.1 5672.1 5766.4 5786.5 5672.5 5696.5 5704.9 5706.8 5715.2 5735.0 5767.9 5796.2 5799.4 5804.4 5560.9 5647.1 5688.7 5690.1 5733.4 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#1] ext.html Cycles:180 Average:48807.36 Median:39787.00 stddev:82817.04 (208.2%) stddev-sans-first:82970.10 19:14:50 INFO - PROCESS | 11575 | Values: 550.7 563.1 569.4 575.0 582.8 31570.4 40171.0 40467.6 40497.6 40504.8 46592.3 47002.3 47155.5 47262.5 47362.5 9257.0 9454.5 9471.0 9476.5 9487.1 9174.7 9289.6 9301.4 9308.3 9310.0 9290.4 9370.9 9373.4 9389.2 9392.5 9280.7 9340.1 9352.7 9359.1 9369.7 9162.0 9288.0 9294.6 9301.2 9309.3 42936.6 43453.6 43511.0 43522.3 43554.1 3523.3 3534.4 3703.8 4185.8 4358.5 31351.5 32343.0 32790.2 32931.5 32993.2 4279.8 4297.2 4360.7 4365.5 4370.5 227855.0 229270.0 229320.0 229505.0 230422.0 64309.4 65190.0 65421.3 65471.3 65537.7 71196.0 71436.0 75880.2 76252.0 76715.0 16457.8 16617.1 16666.5 16669.6 16677.9 12419.4 12459.0 12482.2 12488.9 12508.5 22022.9 22044.9 22056.3 22091.0 22229.7 8433.8 8670.3 8787.9 8799.3 8839.3 1103.3 1150.9 1153.5 1154.5 1205.3 31363.7 32018.0 32322.5 32736.2 33096.8 1128.7 1146.8 1166.5 1179.0 1217.7 16032.0 17297.0 17767.5 18069.9 18106.6 441179.0 442123.0 442649.0 446872.0 448156.0 61764.0 63045.7 63062.0 63100.7 63205.7 1419.9 1462.6 1498.9 1508.8 1517.9 28429.7 28779.7 28858.1 29162.0 29203.7 44532.8 45081.8 45222.5 45240.0 45256.8 211216.0 212048.0 212081.0 212288.0 213181.0 31159.8 35058.3 35138.0 35537.5 35767.0 50764.0 51407.5 51855.0 52111.0 52204.7 35899.3 36298.5 36737.4 36863.3 37214.4 38218.8 38252.4 39192.8 39597.4 39788.6 39043.2 39564.0 39785.4 39827.8 40149.0 34140.3 35303.6 35858.3 36042.3 36271.3 26741.3 27563.2 27793.9 28103.3 28108.6 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#2] jquery.html Cycles:180 Average:25813.87 Median:12564.84 stddev:70696.87 (562.7%) stddev-sans-first:70869.37 19:14:50 INFO - PROCESS | 11575 | Values: 364.8 392.0 393.3 397.9 406.8 15161.5 17250.4 18300.9 19052.0 19138.0 18160.6 18329.9 18619.4 18622.6 18695.4 5396.4 5554.4 5781.8 5793.9 5816.5 5649.2 5688.1 5689.1 5695.3 5706.3 5484.1 5664.8 5668.8 5676.7 5723.2 5674.5 5680.9 5701.3 5721.8 5723.6 4930.8 5107.6 5127.1 5130.1 5147.8 22006.0 22223.8 22411.0 22436.9 22736.8 2392.9 2394.4 2481.7 2486.7 2629.1 13906.4 13978.9 13984.9 14095.1 14150.2 1942.4 1953.4 2039.2 2096.1 2103.8 60621.0 61488.4 62612.7 62836.4 63429.7 10707.0 10838.9 11097.8 11099.1 11192.6 13341.8 14521.3 14649.9 14657.4 14667.0 7654.5 7763.7 7766.7 7810.3 8249.8 7970.3 8052.3 8069.4 8235.0 8281.8 6592.1 6844.5 6846.7 6869.8 6884.4 1947.3 1956.9 1974.2 2002.6 2041.2 993.8 1041.5 1114.2 1156.5 1159.7 18864.2 19466.9 19552.0 19611.8 19752.8 1016.5 1022.1 1038.7 1079.0 1084.2 11014.5 11091.2 11233.3 11299.3 11341.4 420975.0 429269.0 431820.0 436768.0 438405.0 75962.6 77289.6 79293.2 79724.0 80882.6 1060.4 1062.2 1097.3 1104.3 1104.9 15642.1 15914.4 16298.3 16331.6 16602.8 28229.7 28364.9 32043.7 33256.2 36442.0 44540.6 44649.0 44955.0 44989.8 47089.0 8351.5 8368.8 8451.5 8464.0 8530.2 12708.3 13227.5 13279.5 13405.8 13411.3 11139.0 11201.7 11321.7 11559.1 11656.5 5221.6 8711.2 10886.8 11388.7 11595.8 11847.0 11936.6 11963.1 11998.5 12082.9 8577.5 8580.5 8674.3 8686.5 8729.7 9414.0 11690.9 11858.4 12066.5 12164.6 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#3] mootools.html Cycles:180 Average:6085.72 Median:512.22 stddev:3249.32 (634.4%) stddev-sans-first:3239.54 19:14:50 INFO - PROCESS | 11575 | Values: 1424.2 1582.4 1598.3 1816.3 1922.6 8404.5 8672.3 8676.4 8683.7 8695.1 8536.4 8702.7 8716.6 8723.9 8729.8 2182.6 2239.2 2410.8 2454.1 2479.1 2452.8 2495.4 2495.9 2498.6 2499.2 2460.4 2495.2 2506.4 2507.6 2511.4 2408.6 2427.2 2434.1 2449.2 2457.1 2479.3 2503.5 2505.3 2510.4 2523.6 8662.3 8715.7 8739.1 8745.5 8764.3 5152.5 5293.4 5295.6 5296.1 5298.8 3307.9 3343.4 3397.9 3468.5 3487.9 1067.3 1068.5 1077.8 1101.0 1101.4 12383.1 12536.6 12570.8 12592.9 12593.6 4707.3 4826.7 4840.9 4864.8 4888.8 10539.4 10545.4 10608.6 10611.3 10630.6 5351.0 5355.4 5363.9 5397.9 5399.7 4284.0 4595.7 4634.5 4658.0 4706.4 4167.3 4167.9 4190.7 4204.1 4205.8 1301.3 1336.1 1345.7 1346.8 1349.3 1424.9 1438.1 1451.8 1453.5 1457.6 8198.5 8278.5 8302.1 8309.4 8316.4 507.1 510.1 514.3 518.5 524.5 6032.2 6035.3 6039.0 6095.5 6107.8 10230.7 10356.3 10449.2 10467.7 10487.1 10020.3 10296.9 10306.6 10321.5 10343.7 8089.1 8207.7 8249.0 8293.5 8308.1 8015.9 8021.9 8115.6 8124.7 8196.8 9434.8 9521.6 9620.7 9677.7 9956.0 9985.6 10020.0 10024.8 10083.8 10250.4 6821.4 7321.5 7463.2 7759.4 7886.6 8266.0 8267.1 8281.8 8311.8 8330.3 7305.3 7320.7 7483.9 7582.2 7597.1 7386.6 7420.9 7422.4 7527.3 7546.6 7819.3 7830.9 7851.3 7862.5 7871.3 7043.0 7070.9 7113.7 7147.9 7170.0 7262.2 7283.2 7296.4 7356.7 7396.3 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#4] prototype.html Cycles:180 Average:5362.69 Median:6117.01 stddev:1594.09 (26.1%) stddev-sans-first:1553.60 19:14:50 INFO - PROCESS | 11575 | Values: 353.7 364.0 364.4 368.4 372.7 6041.7 6093.5 6096.4 6117.3 6122.0 5984.2 5994.9 6005.6 6009.1 6012.8 4483.8 4498.9 4542.2 4618.6 4634.6 4619.1 4646.7 4650.8 4654.5 4664.6 4601.9 4615.4 4621.9 4622.4 4635.0 4462.0 4522.1 4646.0 4650.6 4667.8 4123.2 4125.2 4134.7 4142.6 4147.2 5731.3 5744.5 5754.8 5761.9 5765.7 5473.3 5473.8 5477.8 5482.3 5483.4 6377.5 6388.7 6400.9 6402.6 6403.1 4365.8 4468.6 4469.8 4471.2 4595.8 6494.3 6588.6 6684.5 6686.7 6688.7 4608.8 4615.5 4620.0 4621.9 4626.7 4667.7 4682.6 4684.0 4686.0 4688.2 5347.0 5362.1 5391.9 5392.6 5392.8 6304.0 6421.8 6430.2 6436.6 6453.0 1637.0 1637.1 1643.2 1644.4 1661.4 1070.4 1102.1 1105.3 1129.1 1131.1 6080.4 6130.5 6135.3 6139.4 6146.6 6574.3 6581.6 6582.7 6592.3 6593.9 6205.7 6206.9 6210.6 6214.7 6224.8 3538.3 3561.7 3568.8 3569.4 3572.6 6637.5 6787.6 6806.9 6813.7 6814.8 6708.5 6728.1 6733.2 6739.9 6742.3 6758.8 6762.9 6778.3 6845.0 6850.6 6571.6 6575.2 6579.4 6580.5 6583.1 6295.8 6449.6 6460.6 6466.0 6476.4 6762.4 6782.7 6783.0 6794.5 6813.0 4592.8 4601.8 4603.7 4606.3 4613.0 6560.0 6575.9 6576.2 6581.5 6593.3 6262.3 6387.1 6393.3 6398.5 6402.4 6385.7 6400.5 6407.1 6413.2 6413.2 6296.6 6303.7 6314.0 6314.5 6367.0 6419.3 6422.6 6430.1 6433.4 6434.1 6011.1 6116.7 6282.5 6286.2 6309.1 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - PROCESS | 11575 | [#5] yui.html Cycles:180 Average:14423.82 Median:24196.85 stddev:16661.82 (68.9%) stddev-sans-first:16677.61 19:14:50 INFO - PROCESS | 11575 | Values: 900.5 906.6 909.0 924.2 932.7 14126.9 14304.6 14391.1 14407.9 14420.5 13181.9 13345.6 13401.9 13411.4 13415.1 897.3 921.5 922.8 922.8 923.0 939.4 956.5 958.0 958.8 958.8 987.5 996.1 997.2 997.6 997.8 988.3 989.0 989.1 989.4 990.9 731.2 731.6 731.7 732.1 733.0 12146.9 12193.1 12200.0 12236.1 12252.5 11576.7 11870.2 12181.2 13725.0 13848.2 11333.7 11408.5 11438.3 11529.4 11777.5 3863.1 3911.8 3914.7 3914.8 3970.4 53191.7 54075.5 54283.5 54364.0 54472.0 10829.1 10952.9 11051.9 11052.8 11341.9 19128.2 19205.8 19242.0 19271.2 19280.3 8348.2 8444.7 8460.8 8528.0 8580.6 4501.2 4654.5 4896.3 4998.4 5124.9 3428.2 3493.9 3499.2 3503.7 3509.8 619.2 643.5 651.2 665.4 700.0 684.6 691.2 745.5 746.8 758.8 8098.1 8312.9 8362.3 8705.0 8906.8 580.3 696.7 708.9 719.2 728.4 3827.7 4144.0 4155.0 4171.2 4181.9 58331.4 59345.7 59503.0 59772.0 59891.7 48813.5 51469.0 54339.5 54710.5 61827.7 47946.3 48045.0 48724.5 49080.5 49100.3 9030.5 9041.4 9221.2 9239.7 9254.6 34654.0 34682.1 34957.8 35037.9 35876.0 40536.6 41744.8 44211.8 44922.8 45498.8 11683.8 11732.9 11893.8 11903.9 12165.0 12432.3 12515.4 12593.3 12706.9 12723.9 11660.0 12044.1 12211.7 12211.8 12283.3 11436.4 11496.8 11503.9 11779.2 11887.0 10653.4 11006.2 11418.4 11652.8 12666.9 10071.4 10356.2 10377.6 10584.2 10641.3 9879.6 10217.8 10281.6 10310.5 10360.8 19:14:50 INFO - PROCESS | 11575 | -------- Summary: end -------- 19:14:50 INFO - PROCESS | 11575 | 19:14:50 INFO - TEST-INFO | 11575: exit 0 19:14:50 INFO - TEST-OK | dromaeo_css | took 1111541ms 19:14:50 INFO - TEST-START | kraken 19:14:50 INFO - operating with platform_type : linux_ 19:14:50 INFO - Initialising browser for kraken test... 19:14:50 INFO - TEST-INFO | started process 11771 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp96eejZ/profile http://localhost:49687/getInfo.html) 19:14:55 INFO - PROCESS | 11771 | __metrics Screen width/height:1600/1200 19:14:55 INFO - PROCESS | 11771 | colorDepth:24 19:14:55 INFO - PROCESS | 11771 | Browser inner width/height: 1024/697 19:14:55 INFO - PROCESS | 11771 | __metrics 19:14:55 INFO - PROCESS | 11771 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:14:56 INFO - TEST-INFO | 11771: exit 0 19:14:56 INFO - Browser initialized. 19:14:56 INFO - Running cycle 1/1 for kraken test... 19:14:56 INFO - TEST-INFO | started process 11861 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp96eejZ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:15:08 INFO - PROCESS | 11861 | RSS: Main: 144015360 19:15:08 INFO - PROCESS | 11861 | 19:15:11 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49687/tests/kraken/driver.html?testName=audio-beat-detection) 19:15:11 INFO - PROCESS | 11861 | RSS: Main: 180260864 19:15:11 INFO - PROCESS | 11861 | 19:15:14 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49687/tests/kraken/driver.html?testName=audio-dft) 19:15:14 INFO - PROCESS | 11861 | RSS: Main: 178716672 19:15:14 INFO - PROCESS | 11861 | 19:15:17 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49687/tests/kraken/driver.html?testName=audio-fft) 19:15:18 INFO - PROCESS | 11861 | RSS: Main: 174075904 19:15:18 INFO - PROCESS | 11861 | 19:15:20 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49687/tests/kraken/driver.html?testName=audio-oscillator) 19:15:20 INFO - PROCESS | 11861 | RSS: Main: 173056000 19:15:20 INFO - PROCESS | 11861 | 19:15:23 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49687/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:15:23 INFO - PROCESS | 11861 | RSS: Main: 173187072 19:15:23 INFO - PROCESS | 11861 | 19:15:26 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49687/tests/kraken/driver.html?testName=imaging-darkroom) 19:15:27 INFO - PROCESS | 11861 | RSS: Main: 171761664 19:15:27 INFO - PROCESS | 11861 | 19:15:30 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49687/tests/kraken/driver.html?testName=imaging-desaturate) 19:15:31 INFO - PROCESS | 11861 | RSS: Main: 173932544 19:15:31 INFO - PROCESS | 11861 | 19:15:33 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49687/tests/kraken/driver.html?testName=json-parse-financial) 19:15:34 INFO - PROCESS | 11861 | RSS: Main: 173043712 19:15:34 INFO - PROCESS | 11861 | 19:15:36 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49687/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:15:36 INFO - PROCESS | 11861 | RSS: Main: 178196480 19:15:36 INFO - PROCESS | 11861 | 19:15:38 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:15:39 INFO - PROCESS | 11861 | RSS: Main: 174731264 19:15:39 INFO - PROCESS | 11861 | 19:15:40 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:15:41 INFO - PROCESS | 11861 | RSS: Main: 180760576 19:15:41 INFO - PROCESS | 11861 | 19:15:43 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:15:44 INFO - PROCESS | 11861 | RSS: Main: 191942656 19:15:44 INFO - PROCESS | 11861 | 19:15:46 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:15:47 INFO - PROCESS | 11861 | RSS: Main: 192143360 19:15:47 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | Cycle 1(1): loaded http://localhost:49687/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49687/tests/kraken/driver.html?testName=ai-astar) 19:15:49 INFO - PROCESS | 11861 | RSS: Main: 250916864 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | __start_tp_report 19:15:49 INFO - PROCESS | 11861 | _x_x_mozilla_page_load 19:15:49 INFO - PROCESS | 11861 | _x_x_mozilla_page_load_details 19:15:49 INFO - PROCESS | 11861 | |i|pagename|runs| 19:15:49 INFO - PROCESS | 11861 | |0;ai-astar;110;110;107;112;110;110;99;110;110;110 19:15:49 INFO - PROCESS | 11861 | |1;audio-beat-detection;164;125;153;169;127;155;156;126;163;131 19:15:49 INFO - PROCESS | 11861 | |2;audio-dft;162;159;160;160;161;160;158;163;159;161 19:15:49 INFO - PROCESS | 11861 | |3;audio-fft;74;75;75;156;75;76;73;76;159;75 19:15:49 INFO - PROCESS | 11861 | |4;audio-oscillator;93;92;139;93;92;93;147;93;93;134 19:15:49 INFO - PROCESS | 11861 | |5;imaging-gaussian-blur;117;116;117;118;116;116;116;117;117;116 19:15:49 INFO - PROCESS | 11861 | |6;imaging-darkroom;146;147;145;146;145;146;146;146;145;145 19:15:49 INFO - PROCESS | 11861 | |7;imaging-desaturate;95;95;95;96;96;95;95;95;96;96 19:15:49 INFO - PROCESS | 11861 | |8;json-parse-financial;54;57;56;54;56;55;55;63;54;53 19:15:49 INFO - PROCESS | 11861 | |9;json-stringify-tinderbox;64;64;64;65;67;64;64;70;65;64 19:15:49 INFO - PROCESS | 11861 | |10;stanford-crypto-aes;77;79;79;79;80;79;78;79;77;78 19:15:49 INFO - PROCESS | 11861 | |11;stanford-crypto-ccm;110;111;111;114;118;115;126;111;111;111 19:15:49 INFO - PROCESS | 11861 | |12;stanford-crypto-pbkdf2;145;134;136;134;136;136;134;142;142;145 19:15:49 INFO - PROCESS | 11861 | |13;stanford-crypto-sha256-iterative;65;65;68;67;66;66;64;67;64;65 19:15:49 INFO - PROCESS | 11861 | __end_tp_report 19:15:49 INFO - PROCESS | 11861 | __start_cc_report 19:15:49 INFO - PROCESS | 11861 | _x_x_mozilla_cycle_collect,1057 19:15:49 INFO - PROCESS | 11861 | __end_cc_report 19:15:49 INFO - PROCESS | 11861 | __startTimestamp1458785749490__endTimestamp 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | ------- Summary: start ------- 19:15:49 INFO - PROCESS | 11861 | Number of tests: 14 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#0] ai-astar Cycles:10 Average:108.80 Median:110.00 stddev:3.65 (3.3%) stddev-sans-first:3.84 19:15:49 INFO - PROCESS | 11861 | Values: 110.0 110.0 107.0 112.0 110.0 110.0 99.0 110.0 110.0 110.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#1] audio-beat-detection Cycles:10 Average:146.90 Median:155.50 stddev:17.61 (11.3%) stddev-sans-first:17.56 19:15:49 INFO - PROCESS | 11861 | Values: 164.0 125.0 153.0 169.0 127.0 155.0 156.0 126.0 163.0 131.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#2] audio-dft Cycles:10 Average:160.30 Median:160.50 stddev:1.49 (0.9%) stddev-sans-first:1.45 19:15:49 INFO - PROCESS | 11861 | Values: 162.0 159.0 160.0 160.0 161.0 160.0 158.0 163.0 159.0 161.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#3] audio-fft Cycles:10 Average:91.40 Median:75.00 stddev:34.86 (46.5%) stddev-sans-first:36.40 19:15:49 INFO - PROCESS | 11861 | Values: 74.0 75.0 75.0 156.0 75.0 76.0 73.0 76.0 159.0 75.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#4] audio-oscillator Cycles:10 Average:106.90 Median:93.00 stddev:23.05 (24.8%) stddev-sans-first:23.90 19:15:49 INFO - PROCESS | 11861 | Values: 93.0 92.0 139.0 93.0 92.0 93.0 147.0 93.0 93.0 134.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#5] imaging-gaussian-blur Cycles:10 Average:116.60 Median:117.00 stddev:0.70 (0.6%) stddev-sans-first:0.73 19:15:49 INFO - PROCESS | 11861 | Values: 117.0 116.0 117.0 118.0 116.0 116.0 116.0 117.0 117.0 116.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#6] imaging-darkroom Cycles:10 Average:145.70 Median:146.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 19:15:49 INFO - PROCESS | 11861 | Values: 146.0 147.0 145.0 146.0 145.0 146.0 146.0 146.0 145.0 145.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 19:15:49 INFO - PROCESS | 11861 | Values: 95.0 95.0 95.0 96.0 96.0 95.0 95.0 95.0 96.0 96.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#8] json-parse-financial Cycles:10 Average:55.70 Median:55.50 stddev:2.83 (5.1%) stddev-sans-first:2.93 19:15:49 INFO - PROCESS | 11861 | Values: 54.0 57.0 56.0 54.0 56.0 55.0 55.0 63.0 54.0 53.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#9] json-stringify-tinderbox Cycles:10 Average:65.10 Median:64.50 stddev:1.97 (3.1%) stddev-sans-first:2.05 19:15:49 INFO - PROCESS | 11861 | Values: 64.0 64.0 64.0 65.0 67.0 64.0 64.0 70.0 65.0 64.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#10] stanford-crypto-aes Cycles:10 Average:78.50 Median:79.00 stddev:0.97 (1.2%) stddev-sans-first:0.87 19:15:49 INFO - PROCESS | 11861 | Values: 77.0 79.0 79.0 79.0 80.0 79.0 78.0 79.0 77.0 78.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#11] stanford-crypto-ccm Cycles:10 Average:113.80 Median:112.50 stddev:4.96 (4.4%) stddev-sans-first:5.07 19:15:49 INFO - PROCESS | 11861 | Values: 110.0 111.0 111.0 114.0 118.0 115.0 126.0 111.0 111.0 111.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:138.40 Median:139.00 stddev:4.58 (3.3%) stddev-sans-first:4.18 19:15:49 INFO - PROCESS | 11861 | Values: 145.0 134.0 136.0 134.0 136.0 136.0 134.0 142.0 142.0 145.0 19:15:49 INFO - PROCESS | 11861 | 19:15:49 INFO - PROCESS | 11861 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.70 Median:66.00 stddev:1.34 (2.0%) stddev-sans-first:1.39 19:15:49 INFO - PROCESS | 11861 | Values: 65.0 65.0 68.0 67.0 66.0 66.0 64.0 67.0 64.0 65.0 19:15:49 INFO - PROCESS | 11861 | -------- Summary: end -------- 19:15:49 INFO - PROCESS | 11861 | 19:15:50 INFO - TEST-INFO | 11861: exit 0 19:15:50 INFO - TEST-OK | kraken | took 59518ms 19:15:50 INFO - SUITE-END | took 1171s 19:15:50 INFO - Completed test suite (00:19:31) 19:15:50 INFO - javascript benchmark 19:15:50 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3247.8538465769047, 3278.6229583597865, 3294.7528935329856, 3295.9782467435098, 3335.716464100552, 5303.496167864051, 5312.4687531246855, 5317.494837990394, 5327.147656374981, 5373.865653358663, 5334.5999050071305, 5359.115745901931, 5361.839144825652, 5366.677999320043, 5372.650777699447, 4854.8300809471675, 4872.7563621818945, 4889.8777530561665, 4922.0402021605805, 4952.653314268003, 4950.232713929347, 5031.371078615173, 5033.068882256776, 5034.748262586874, 5036.571891389236, 4941.555260026596, 4985.875353116165, 4986.252062190682, 4998.450170481262, 5012.799488020493, 5003.47463516331, 5024.62315326352, 5049.4950504949575, 5049.570786483153, 5080.949190508085, 4791.784369703371, 4878.682885612424, 4902.28916807061, 4906.337644418029, 4923.532264434873, 5258.684478931238, 5287.101192797195, 5292.947070529284, 5299.364076310829, 5326.0, 5806.1000544915605, 5808.332041815203, 5876.030454974924, 5878.50032747217, 5886.264216972879, 5873.412658734135, 5907.02534081876, 5907.261592300963, 5932.436418540232, 5933.139694744281, 5523.392426833045, 5530.917036244459, 5531.170324451325, 5535.225068490415, 5537.0863807471715, 5838.386969368155, 5990.73041713124, 6038.305594856648, 6054.485368743618, 6057.545684073624, 5785.190073389729, 5786.392428795, 5790.218320526675, 5791.247137872134, 5799.768009279666, 5870.295564532198, 5874.265716785402, 5884.646921184657, 5889.941100589025, 5890.882182356415, 5709.0, 5765.538756899438, 5834.183214349994, 5835.649861008353, 5835.79574714883, 5782.595218334676, 5818.44724751148, 5819.79630712923, 5820.417958204231, 5830.883382332329, 4430.911381772346, 4461.977690111528, 4462.665300102505, 4468.754218518013, 4495.865124046284, 3905.414187871842, 3914.4715463412645, 3970.7021973352116, 3985.5815139410524, 4011.6590089842107, 5580.35825880029, 5591.3569939456665, 5595.104783234663, 5595.356533998561, 5596.608237423423, 5902.2622172228475, 5909.615874968199, 5911.320198177179, 5912.526997840162, 5913.9112913306335, 5486.835394938158, 5523.392426833045, 5562.638428502134, 5570.025245582007, 5610.4670056344585, 5039.395272567315, 5052.242163675478, 5055.51972562606, 5065.493450654905, 5083.542481176638, 5905.793297234576, 6095.6952152392205, 6121.143039974407, 6121.877562448726, 6125.693715314216, 5887.20522729426, 5911.113333000085, 5940.049592065248, 5947.434993675594, 5954.4343287389365, 5903.203067585992, 5937.0, 5938.346781854079, 5960.1357803117435, 6067.24159480065, 5694.686792226467, 5763.567732420001, 5772.134179873053, 5775.8556036099435, 5784.190213370216, 5783.248177736868, 5814.883702326015, 5818.185454036354, 5822.184894114743, 5848.824535263949, 5595.412481689526, 5646.7458964347525, 5652.886942261214, 5655.575831812548, 5672.716364181857, 5650.26546548946, 5671.120976248688, 5672.12082127271, 5766.423357664368, 5786.508146807569, 5672.5461963042035, 5696.54427645779, 5704.857378565569, 5706.828795136153, 5715.199872017838, 5735.0, 5767.9134812977, 5796.246487956539, 5799.449052340021, 5804.3905389935135, 5560.91658625129, 5647.0964645656495, 5688.658680479184, 5690.118031705092, 5733.397993210653], "unit": "score", "name": "dojo.html", "value": 5391.26685734173}, {"lowerIsBetter": false, "replicates": [550.7411516587205, 563.0737436916276, 569.3822202909844, 575.002370886512, 582.839719077254, 31570.368592628132, 40171.0, 40467.59532404675, 40497.59502404975, 40504.797476012616, 46592.30111548329, 47002.294965575544, 47155.52844471554, 47262.52737472624, 47362.52637473624, 9257.0, 9454.527273636326, 9470.952645236765, 9476.478793666345, 9487.098725621056, 9174.724758257264, 9289.581968811386, 9301.44191348518, 9308.301877359192, 9309.953450232739, 9290.396124251936, 9370.85943710845, 9373.437593744364, 9389.248860091177, 9392.48341341226, 9280.675176368828, 9340.112689294507, 9352.719418417459, 9359.064093590654, 9369.718908432758, 9161.954190229006, 9287.953560232156, 9294.628214871396, 9301.162895339385, 9309.255259579217, 42936.57063429388, 43453.565464345585, 43511.0, 43522.347164792554, 43554.12891742179, 3523.330567192251, 3534.416821224495, 3703.777773333609, 4185.811638476276, 4358.5205627380965, 31351.529727054112, 32343.0, 32790.180245493815, 32931.50602740961, 32993.19557837587, 4279.828806847722, 4297.226499230137, 4360.738355698637, 4365.5416181300825, 4370.519242883281, 227855.0, 229270.0, 229320.0, 229505.0, 230422.0, 64309.356906431276, 65190.0, 65421.345786541526, 65471.345286547476, 65537.67231163813, 71196.0, 71436.0, 75880.24119758731, 76252.0, 76715.0, 16457.753133703005, 16617.08606026656, 16666.50000499987, 16669.583260418585, 16677.91661041687, 12419.379031048593, 12459.0, 12482.188657737219, 12488.875111248954, 12508.49966001368, 22022.88988555079, 22044.88977555102, 22056.33830985073, 22091.0, 22229.666555001688, 8433.831323373499, 8670.349723770742, 8787.912120878837, 8799.29605631548, 8839.32052909945, 1103.2938919091787, 1150.8503894493663, 1153.4694040741185, 1154.5319613097367, 1205.2647884790447, 31363.686363136076, 32018.0, 32322.515162272586, 32736.181595460304, 33096.83451582775, 1128.7234627516148, 1146.827975803636, 1166.4984056855465, 1178.9823152652716, 1217.7442737025146, 16032.0, 17297.048662323443, 17767.46697599074, 18069.909650451664, 18106.642001849916, 441179.0, 442123.0, 442649.0, 446872.0, 448156.0, 61764.0, 63045.68477157585, 63062.0, 63100.684496577225, 63205.683971580766, 1419.9148051116758, 1462.612407711957, 1498.8501149885142, 1508.8264849542225, 1517.9165145917302, 28429.715702843536, 28779.712202877705, 28858.134255972356, 29162.0, 29203.707962920947, 44532.77733611311, 45081.774591126836, 45222.54777452183, 45240.0, 45256.77371613121, 211216.0, 212048.0, 212081.0, 212288.0, 213181.0, 31159.844200779757, 35058.298834022666, 35138.0, 35537.466937995436, 35767.0, 50764.0, 51407.485925141766, 51855.0, 52111.0, 52204.73897630488, 35899.28201436009, 36298.4555231677, 36737.44893826648, 36863.262734745695, 37214.44178337381, 38218.808905955295, 38252.426213607374, 39192.804035979636, 39597.40603891001, 39788.602113978486, 39043.2191356177, 39564.0, 39785.403218951156, 39827.80086099551, 40149.0, 34140.31719365549, 35303.62917714783, 35858.28283434369, 36042.27915441624, 36271.27457450889, 26741.33146671271, 27563.173104806887, 27793.861030694716, 28103.297417564725, 28108.594570271813], "unit": "score", "name": "ext.html", "value": 19979.5220055544}, {"lowerIsBetter": false, "replicates": [364.7865998390941, 391.95296564412257, 393.25085711719186, 397.8766582359469, 406.790502891011, 15161.469348572802, 17250.39623613174, 18300.908495457537, 19052.0, 19138.0, 18160.636787264248, 18329.90835045823, 18619.44141675752, 18622.627547449043, 18695.41089007436, 5396.43337449568, 5554.361248456439, 5781.768729250846, 5793.855153621172, 5816.505597024258, 5649.209110724481, 5688.089905615102, 5689.089745640698, 5695.288088988877, 5706.315242170925, 5484.149956756709, 5664.773409063653, 5668.829935101933, 5676.687782171979, 5723.198752174699, 5674.517665998395, 5680.857978550549, 5701.287339082614, 5721.799737009184, 5723.627964182336, 4930.778114984834, 5107.591392688613, 5127.077126117298, 5130.102232109366, 5147.845564633029, 22006.0, 22223.777762222333, 22411.0, 22436.887815560982, 22736.77263227363, 2392.916247931314, 2394.3535245483795, 2481.702195736505, 2486.66430031947, 2629.0929629277866, 13906.443742250298, 13978.860211397858, 13984.93007534966, 14095.083819551697, 14150.150990940474, 1942.417274817549, 1953.4139758072522, 2039.2454791727007, 2096.0777258006583, 2103.779103194158, 60621.0, 61488.38511614871, 62612.68693656548, 62836.37163628351, 63429.68285158591, 10707.0, 10838.891611083789, 11097.778044439066, 11099.056580190774, 11192.608258710907, 13341.799873001914, 14521.273936303143, 14649.901257405738, 14657.413703451955, 14667.0, 7654.545636329191, 7763.689452421952, 7766.650500727481, 7810.29707326332, 8249.752507424786, 7970.322522585529, 8052.315553177928, 8069.3544516439715, 8235.0, 8281.8343633127, 6592.143021407186, 6844.486663500257, 6846.691898864563, 6869.793906182823, 6884.449244060464, 1947.3476385410763, 1956.923691969411, 1974.2497850816599, 2002.609491149241, 2041.1835265893762, 993.8211121997965, 1041.4896700616644, 1114.2478826792046, 1156.5200441816721, 1159.6984783956232, 18864.245430182913, 19466.902665486865, 19552.0, 19611.803881961285, 19752.802471975097, 1016.4815943868532, 1022.1414012229762, 1038.7299302181486, 1078.9892101079047, 1084.208527774713, 11014.50434730439, 11091.223614346918, 11233.269837460539, 11299.265547739371, 11341.376224307578, 420975.0, 429269.0, 431820.0, 436768.0, 438405.0, 75962.62018689871, 77289.61355193188, 79293.20706792858, 79724.0, 80882.59558702286, 1060.4273692206123, 1062.150279776176, 1097.2757979733497, 1104.282216559243, 1104.8729396119388, 15642.062184957736, 15914.363425462852, 16298.266578004255, 16331.59171020734, 16602.83397166013, 28229.71770282271, 28364.858175709815, 32043.67956320407, 33256.1685957853, 36442.0, 44540.55459445364, 44649.0, 44955.0, 44989.77505112453, 47089.0, 8351.498910065415, 8368.83262334762, 8451.45065570736, 8464.0, 8530.232279094911, 12708.30104344233, 13227.537036204072, 13279.468821247428, 13405.798913016117, 13411.32943352809, 11139.0, 11201.71995700114, 11321.660350189508, 11559.133065019989, 11656.475458604213, 5221.556167725786, 8711.21599056088, 10886.836697449702, 11388.715282117682, 11595.768084638092, 11847.0, 11936.641900742992, 11963.102767292661, 11998.520059197534, 12082.879171208528, 8577.528235947082, 8580.528070956158, 8674.306055515417, 8686.478811271343, 8729.650813967624, 9413.964463909102, 11690.941545292219, 11858.407079646156, 12066.457009434422, 12164.574239901562], "unit": "score", "name": "jquery.html", "value": 9051.692172913046}, {"lowerIsBetter": false, "replicates": [1424.1597457500086, 1582.4303250829703, 1598.2727858824237, 1816.3370369815023, 1922.567422329976, 8404.45371050882, 8672.34957378196, 8676.436031657939, 8683.652653893845, 8695.087015863339, 8536.359773017033, 8702.651893924236, 8716.60775265113, 8723.91276087239, 8729.825403491943, 2182.6398644223764, 2239.193890199527, 2410.783029527342, 2454.067454367338, 2479.0579579759665, 2452.7792498675117, 2495.3761559610098, 2495.9376015599573, 2498.6252062190724, 2499.237732491589, 2460.3972026853444, 2495.189063554343, 2506.385935445818, 2507.5862482690336, 2511.4223728542447, 2408.614621660535, 2427.2111563741764, 2434.1480481831395, 2449.191766716979, 2457.0785955266774, 2479.3429741118616, 2503.499300139961, 2505.260948020338, 2510.3724068982756, 2523.608840629687, 8662.263707584863, 8715.694950676696, 8739.126087391274, 8745.47527148373, 8764.25503832175, 5152.458991805844, 5293.444188360205, 5295.629305948585, 5296.099663057251, 5298.81454149103, 3307.9173020674434, 3343.3981883261004, 3397.8980630581123, 3468.479728040789, 3487.930241395183, 1067.3489171605315, 1068.5458680061022, 1077.8221593437074, 1101.014591940217, 1101.438266484099, 12383.133180677356, 12536.623901282976, 12570.811437828439, 12592.874071259354, 12593.559225427067, 4707.293905914072, 4826.698356110107, 4840.903181936342, 4864.756762161948, 4888.804447822118, 10539.42033188182, 10545.367277963347, 10608.628697995533, 10611.31026483276, 10630.574777008987, 5351.0, 5355.384130825005, 5363.946360536423, 5397.919031214535, 5399.676019438768, 4284.014676624394, 4595.747233902168, 4634.513376095529, 4658.0, 4706.435227772689, 4167.333226683716, 4167.874963751093, 4190.727602705814, 4204.096119334296, 4205.76868272248, 1301.3038024656764, 1336.0580790542645, 1345.6837643153851, 1346.7777816660337, 1349.2713934475273, 1424.893133015028, 1438.0940007795023, 1451.7894905238682, 1453.4622189789845, 1457.5845883923032, 8198.467099638505, 8278.503289802511, 8302.128276530999, 8309.418340716213, 8316.417850750511, 507.14039702703565, 510.1149505607768, 514.3313692200124, 518.5048278893723, 524.4991033562939, 6032.185654936615, 6035.30593981689, 6038.969805151034, 6095.4818840398175, 6107.786227482017, 10230.744231394274, 10356.326838755456, 10449.216308776871, 10467.738306542398, 10487.05616494504, 10020.34867733595, 10296.948515257525, 10306.587736490606, 10321.535530901128, 10343.689689309333, 8089.110197878229, 8207.671693132328, 8249.010118785784, 8293.543855087908, 8308.12764659714, 8015.919840801751, 8021.879671804811, 8115.553644549606, 8124.715634952749, 8196.836063278583, 9434.764130896783, 9521.61913523479, 9620.663276785279, 9677.70966870995, 9955.950220248853, 9985.60057597717, 10020.0, 10024.849627255451, 10083.798324033332, 10250.436226007343, 6821.386075253251, 7321.450891183289, 7463.179050304354, 7759.418043646862, 7886.566238856918, 8266.049404318339, 8267.131951145044, 8281.751547453345, 8311.750647480585, 8330.333573314, 7305.269473052865, 7320.707171713072, 7483.8503229934, 7582.203868593939, 7597.126330471845, 7386.630668466448, 7420.851582968418, 7422.443316751157, 7527.322540971119, 7546.622668866645, 7819.335356494534, 7830.92169078302, 7851.254130857559, 7862.52824830512, 7871.33093687043, 7043.049188359506, 7070.929290707027, 7113.679884405317, 7147.928520714934, 7170.0, 7262.164851042197, 7283.162436319679, 7296.379807716191, 7356.66894989716, 7396.3343299103335], "unit": "score", "name": "mootools.html", "value": 4879.150445638107}, {"lowerIsBetter": false, "replicates": [353.74176850898857, 363.9799811010395, 364.4114754671205, 368.35353953811057, 372.73163322407856, 6041.667708276049, 6093.451589356957, 6096.35988221237, 6117.327094019654, 6121.969390153048, 5984.1921340619, 5994.910076348859, 6005.579609427342, 6009.128676341938, 6012.789552365668, 4483.820647174109, 4498.910021799562, 4542.15970045541, 4618.561236682526, 4634.606058485025, 4619.076184763044, 4646.674732768707, 4650.767461626922, 4654.534546545336, 4664.580187783099, 4601.930971035437, 4615.353850460938, 4621.930671039937, 4622.375979242793, 4635.049814787961, 4462.0, 4522.140793249288, 4646.047560250141, 4650.627949764011, 4667.766611669437, 4123.195976784528, 4125.23683118624, 4134.710570260083, 4142.647874930634, 4147.170565886835, 5731.340895796995, 5744.4829965303325, 5754.798582049608, 5761.884762304772, 5765.654060756368, 5473.28847249859, 5473.75368108436, 5477.835664930059, 5482.259894914176, 5483.424240454775, 6377.457916077139, 6388.744450221986, 6400.935990640127, 6402.551821372505, 6403.103565500834, 4365.80353884076, 4468.597826195658, 4469.843555475542, 4471.217536931056, 4595.839145629887, 6494.285628580852, 6588.637624930627, 6684.465242780566, 6686.665666716644, 6688.7324507019175, 4608.815647374135, 4615.515370886009, 4619.9769001155455, 4621.930671039937, 4626.7223966562115, 4667.719936803803, 4682.648801339913, 4684.0, 4685.976570117127, 4688.203005489075, 5346.973265133727, 5362.142057270896, 5391.9460805391445, 5392.595555333366, 5392.784288628411, 6303.968480157661, 6421.775237866652, 6430.164078669743, 6436.645984470899, 6452.9677351612945, 1636.9508914732578, 1637.0668718830152, 1643.1619873864415, 1644.3587001069593, 1661.3852874436295, 1070.4112737994228, 1102.1458369763336, 1105.2815669814686, 1129.1136457880525, 1131.112077019552, 6080.422359875804, 6130.509559235251, 6135.32511423743, 6139.355367686418, 6146.569740118238, 6574.342565743387, 6581.638009909405, 6582.670866456658, 6592.340765923369, 6593.86812263752, 6205.727825795701, 6206.937930620727, 6210.627362358273, 6214.689265536705, 6224.844378890473, 3538.274653695986, 3561.679448849616, 3568.803715795656, 3569.37535931211, 3572.5712914450432, 6637.46900247979, 6787.626680532618, 6806.897896531556, 6813.693383797741, 6814.795556133324, 6708.530402871752, 6728.058071869942, 6733.192016957996, 6739.865202695919, 6742.325767423316, 6758.831029224309, 6762.932370676231, 6778.254392016875, 6845.041694162821, 6850.554713943478, 6571.57284776488, 6575.24384695747, 6579.440747536513, 6580.5064620154635, 6583.111279977142, 6295.842603934938, 6449.645574429423, 6460.612363258219, 6466.030095485715, 6476.417122459001, 6762.357576030269, 6782.694778735067, 6783.0, 6794.490413219127, 6813.0, 4592.839250626212, 4601.815927362868, 4603.700759450625, 4606.262997920317, 4612.976935115303, 6560.0, 6575.934240657532, 6576.177977752781, 6581.473482121514, 6593.340665933369, 6262.279837818709, 6387.105805187184, 6393.2647745508, 6398.456131228898, 6402.423781859655, 6385.68071596409, 6400.51996100285, 6407.10300557913, 6413.16628838248, 6413.198350206224, 6296.5592408530965, 6303.747850085945, 6313.96843015782, 6314.463270622048, 6367.0, 6419.2938776735455, 6422.550421470452, 6430.131932189094, 6433.394475237536, 6434.131392261985, 6011.128386384037, 6116.694165291807, 6282.465990390868, 6286.214223222098, 6309.148264984168], "unit": "score", "name": "prototype.html", "value": 4853.074357321023}, {"lowerIsBetter": false, "replicates": [900.5452246615461, 906.6464079009188, 909.022800489474, 924.2236521322088, 932.6595792535727, 14126.858731412683, 14304.642383940407, 14391.136531808099, 14407.855921440796, 14420.49528266511, 13181.868181318185, 13345.599632011032, 13401.865981340183, 13411.396487158101, 13415.12801667891, 897.2732087009526, 921.5023887100991, 922.8154369126169, 922.8246633139715, 922.9939366090993, 939.3847030195199, 956.4691596164126, 958.018031517693, 958.8274110660078, 958.832204364237, 987.4667679453087, 996.1234113979688, 997.1972562087517, 997.5560875410446, 997.8104160209573, 988.3032462114193, 988.990110098897, 989.1493315748451, 989.3816364772017, 990.9108180263775, 731.228553875661, 731.5976213082783, 731.7073170731696, 732.0593037946213, 732.9780106596811, 12146.939265303705, 12193.085518586142, 12200.0, 12236.143469957107, 12252.509899604005, 11576.652700419001, 11870.169088163831, 12181.208221465666, 13725.0, 13848.238346890917, 11333.659990200307, 11408.54365825366, 11438.313701177956, 11529.365884876328, 11777.470013849397, 3863.1114843586133, 3911.8239679214503, 3914.706397020235, 3914.823832927525, 3970.404439334123, 53191.73404132993, 54075.45924540744, 54283.45716542863, 54363.99999999961, 54472.0, 10829.079528240189, 10952.890471095347, 11051.889481105247, 11052.778944421067, 11341.886581134084, 19128.234870605298, 19205.80794192068, 19242.0, 19271.22915083381, 19280.32518861833, 8348.248657620721, 8444.746657600283, 8460.788480288042, 8527.957360213159, 8580.570971451403, 4501.234790085693, 4654.511276315938, 4896.290037944478, 4998.375203099613, 5124.948750512522, 3428.211511352353, 3493.94759078614, 3499.2126771476214, 3503.702185314277, 3509.824508774551, 619.2445216835454, 643.4980715042275, 651.1697585578426, 665.4277321503503, 699.9685014174374, 684.5755631508497, 691.1740470138137, 745.5377665847101, 746.8394295226552, 758.7761610324967, 8098.149694282133, 8312.8753068704, 8362.331013518904, 8705.0, 8906.777330566658, 580.2920437066772, 696.7178292791427, 708.9184743754431, 719.2447929673822, 728.3990707666196, 3827.6937844972335, 4144.001038997382, 4155.023569461174, 4171.207470580641, 4181.916361672749, 58331.41668583345, 59345.70327148337, 59503.0, 59772.0, 59891.70054149701, 48813.511864881606, 51469.0, 54339.45660543423, 54710.45289547133, 61827.6908615454, 47946.280805787945, 48044.9999999993, 48724.5127548727, 49080.50919490831, 49100.263496047584, 9030.45817250967, 9041.412308199946, 9221.216196623362, 9239.72280831576, 9254.629814807333, 34654.0, 34682.13294667654, 34957.82521087378, 35037.9488615342, 35876.0, 40536.59463405328, 41744.79127604343, 44211.77894110509, 44922.77538612286, 45498.772506137255, 11683.824742628698, 11732.882671173178, 11893.821592675944, 11903.940480297542, 12165.0, 12432.254064756144, 12515.436805343963, 12593.307368094842, 12706.936465317614, 12723.872761272269, 11660.0, 12044.096692748255, 12211.694707632025, 12211.816822747489, 12283.324417157142, 11436.370999595103, 11496.827547586625, 11503.884961150616, 11779.234349767237, 11887.049036077266, 10653.360798352123, 11006.229563930448, 11418.429078546205, 11652.766944661229, 12666.87333126657, 10071.395716257048, 10356.17150627963, 10377.636782712569, 10584.153267738717, 10641.255112142077, 9879.604815807288, 10217.795644086927, 10281.588736450458, 10310.536025878704, 10360.792784144425], "unit": "score", "name": "yui.html", "value": 6771.3795508120165}], "name": "dromaeo_css", "value": 7339.73389300961}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 110.0, 107.0, 112.0, 110.0, 110.0, 99.0, 110.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 108.8}, {"lowerIsBetter": true, "replicates": [164.0, 125.0, 153.0, 169.0, 127.0, 155.0, 156.0, 126.0, 163.0, 131.0], "unit": "score", "name": "audio-beat-detection", "value": 146.9}, {"lowerIsBetter": true, "replicates": [162.0, 159.0, 160.0, 160.0, 161.0, 160.0, 158.0, 163.0, 159.0, 161.0], "unit": "score", "name": "audio-dft", "value": 160.3}, {"lowerIsBetter": true, "replicates": [74.0, 75.0, 75.0, 156.0, 75.0, 76.0, 73.0, 76.0, 159.0, 75.0], "unit": "score", "name": "audio-fft", "value": 91.4}, {"lowerIsBetter": true, "replicates": [93.0, 92.0, 139.0, 93.0, 92.0, 93.0, 147.0, 93.0, 93.0, 134.0], "unit": "score", "name": "audio-oscillator", "value": 106.9}, {"lowerIsBetter": true, "replicates": [117.0, 116.0, 117.0, 118.0, 116.0, 116.0, 116.0, 117.0, 117.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.6}, {"lowerIsBetter": true, "replicates": [146.0, 147.0, 145.0, 146.0, 145.0, 146.0, 146.0, 146.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.7}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [54.0, 57.0, 56.0, 54.0, 56.0, 55.0, 55.0, 63.0, 54.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.7}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 64.0, 65.0, 67.0, 64.0, 64.0, 70.0, 65.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 65.1}, {"lowerIsBetter": true, "replicates": [77.0, 79.0, 79.0, 79.0, 80.0, 79.0, 78.0, 79.0, 77.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 78.5}, {"lowerIsBetter": true, "replicates": [110.0, 111.0, 111.0, 114.0, 118.0, 115.0, 126.0, 111.0, 111.0, 111.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 113.8}, {"lowerIsBetter": true, "replicates": [145.0, 134.0, 136.0, 134.0, 136.0, 136.0, 134.0, 142.0, 142.0, 145.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 138.4}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 68.0, 67.0, 66.0, 66.0, 64.0, 67.0, 64.0, 65.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.7}], "name": "kraken", "value": 1489.1999999999998}]} 19:15:50 INFO - Return code: 0 19:15:50 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 19:15:50 INFO - # TBPL SUCCESS # 19:15:50 INFO - Running post-action listener: _resource_record_post_action 19:15:50 INFO - Running post-run listener: _resource_record_post_run 19:15:51 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 270336; Write bytes: 497848320; Read time: 428; Write time: 449856 19:15:51 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 4096; Write bytes: 227815424; Read time: 176; Write time: 247452 19:15:51 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 266240; Write bytes: 253067264; Read time: 252; Write time: 200252 19:15:51 INFO - Running post-run listener: _upload_blobber_files 19:15:51 INFO - Blob upload gear active. 19:15:51 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 19:15:51 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 19:15:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 19:15:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Aurora -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 19:15:52 INFO - (blobuploader) - INFO - Open directory for files ... 19:15:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 19:15:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:15:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:15:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 19:15:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:15:53 INFO - (blobuploader) - INFO - Done attempting. 19:15:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 19:15:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:15:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:15:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 19:15:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:15:54 INFO - (blobuploader) - INFO - Done attempting. 19:15:54 INFO - (blobuploader) - INFO - Iteration through files over. 19:15:54 INFO - Return code: 0 19:15:54 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 19:15:54 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 19:15:54 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6e59046355aaad5f8ba79c31f120d646166d6caf5a82e526b6bf12199dddb8796035bdbc978fd494cb7399cc11b1b7eb4ebf2f581fbe08b650ca3f370f3de3c6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c898499a598eaf5d3b2f5b84b37eae6a17a90abea4a9a3b7567fae83965b53afa1841daab89e178d763ef1352f4a7cbb32e6af79f31d62e39a400446c1df3cd2"} 19:15:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 19:15:54 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 19:15:54 INFO - Contents: 19:15:54 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6e59046355aaad5f8ba79c31f120d646166d6caf5a82e526b6bf12199dddb8796035bdbc978fd494cb7399cc11b1b7eb4ebf2f581fbe08b650ca3f370f3de3c6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c898499a598eaf5d3b2f5b84b37eae6a17a90abea4a9a3b7567fae83965b53afa1841daab89e178d763ef1352f4a7cbb32e6af79f31d62e39a400446c1df3cd2"} 19:15:54 INFO - Running post-run listener: copy_logs_to_upload_dir 19:15:54 INFO - Copying logs to upload dir... 19:15:54 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 19:15:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.790264 ========= master_lag: 0.76 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-03-23 19:15:54.974956) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-23 19:15:54.979636) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6e59046355aaad5f8ba79c31f120d646166d6caf5a82e526b6bf12199dddb8796035bdbc978fd494cb7399cc11b1b7eb4ebf2f581fbe08b650ca3f370f3de3c6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c898499a598eaf5d3b2f5b84b37eae6a17a90abea4a9a3b7567fae83965b53afa1841daab89e178d763ef1352f4a7cbb32e6af79f31d62e39a400446c1df3cd2"} build_url:https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011375 build_url: 'https://queue.taskcluster.net/v1/task/TCWTL-LLSEaBD7xuAnGBSg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6e59046355aaad5f8ba79c31f120d646166d6caf5a82e526b6bf12199dddb8796035bdbc978fd494cb7399cc11b1b7eb4ebf2f581fbe08b650ca3f370f3de3c6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c898499a598eaf5d3b2f5b84b37eae6a17a90abea4a9a3b7567fae83965b53afa1841daab89e178d763ef1352f4a7cbb32e6af79f31d62e39a400446c1df3cd2"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-23 19:15:55.010429) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 19:15:55.010762) ========= 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=8c6b6742ce8f6f39ef4ce27d000001f1-1458783459.169098-76785189 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004665 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-23 19:15:55.059954) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-23 19:15:55.062315) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-23 19:15:55.329527) ========= ========= Total master_lag: 1.00 =========