builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-038 starttime: 1456054317.35 results: success (0) buildid: 20160221004008 builduid: 0aa0ec5c97e9465b926b09ad9f718d7c revision: 97126e4bc6380071750a619dbad4f5d174df2f46 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.354497) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.354931) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.355261) ========= bash -c pwd in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006768 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.376300) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.376606) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.390623) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.391020) ========= rm -rf properties in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004775 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.441343) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.441695) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.442083) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.442388) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-21 03:31:58-- 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% 60.9M=0s 2016-02-21 03:31:58 (60.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.477201 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.961833) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:57.962185) ========= rm -rf scripts in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020658 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.006671) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.007108) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 97126e4bc6380071750a619dbad4f5d174df2f46 --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 97126e4bc6380071750a619dbad4f5d174df2f46 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-21 03:31:58,690 truncating revision to first 12 chars 2016-02-21 03:31:58,690 Setting DEBUG logging. 2016-02-21 03:31:58,690 attempt 1/10 2016-02-21 03:31:58,690 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/97126e4bc638?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-21 03:31:58,962 unpacking tar archive at: mozilla-aurora-97126e4bc638/testing/mozharness/ program finished with exit code 0 elapsedTime=0.577418 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.603065) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.603398) ========= echo 97126e4bc6380071750a619dbad4f5d174df2f46 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'97126e4bc6380071750a619dbad4f5d174df2f46'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 97126e4bc6380071750a619dbad4f5d174df2f46 program finished with exit code 0 elapsedTime=0.003912 script_repo_revision: '97126e4bc6380071750a619dbad4f5d174df2f46' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.656943) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.657269) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-21 03:31:58.667100) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-02-21 03:31:58.667396) ========= /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=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:31:59 INFO - MultiFileLogger online at 20160221 03:31:59 in /builds/slave/test-pgo 03:31:59 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 03:31:59 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 03:31:59 INFO - {'append_to_log': False, 03:31:59 INFO - 'base_work_dir': '/builds/slave/test-pgo', 03:31:59 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:31:59 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 03:31:59 INFO - 'branch': 'Mozilla-Aurora', 03:31:59 INFO - 'buildbot_json_path': 'buildprops.json', 03:31:59 INFO - 'config_files': ('talos/linux_config.py',), 03:31:59 INFO - 'default_actions': ('clobber', 03:31:59 INFO - 'read-buildbot-config', 03:31:59 INFO - 'download-and-extract', 03:31:59 INFO - 'populate-webroot', 03:31:59 INFO - 'create-virtualenv', 03:31:59 INFO - 'install', 03:31:59 INFO - 'run-tests'), 03:31:59 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:31:59 INFO - 'download_minidump_stackwalk': True, 03:31:59 INFO - 'download_symbols': 'ondemand', 03:31:59 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:31:59 INFO - 'tooltool.py': '/tools/tooltool.py', 03:31:59 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:31:59 INFO - '/tools/misc-python/virtualenv.py')}, 03:31:59 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:31:59 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:31:59 INFO - 'installer_path': 'installer.exe', 03:31:59 INFO - 'log_level': 'info', 03:31:59 INFO - 'log_name': 'talos', 03:31:59 INFO - 'log_to_console': True, 03:31:59 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:31:59 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:31:59 INFO - 'opt_config_files': (), 03:31:59 INFO - 'pip_index': False, 03:31:59 INFO - 'sps_profile': False, 03:31:59 INFO - 'sps_profile_interval': 0, 03:31:59 INFO - 'suite': 'dromaeojs', 03:31:59 INFO - 'system_bits': '32', 03:31:59 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:31:59 INFO - 'title': 'talos-linux64-ix-038', 03:31:59 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:31:59 INFO - 'use_talos_json': True, 03:31:59 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 03:31:59 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:31:59 INFO - 'work_dir': 'build'} 03:31:59 INFO - ##### 03:31:59 INFO - ##### Running clobber step. 03:31:59 INFO - ##### 03:31:59 INFO - Running pre-action listener: _resource_record_pre_action 03:31:59 INFO - Running main action method: clobber 03:31:59 INFO - rmtree: /builds/slave/test-pgo/build 03:31:59 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 03:31:59 INFO - Running post-action listener: _resource_record_post_action 03:31:59 INFO - ##### 03:31:59 INFO - ##### Running read-buildbot-config step. 03:31:59 INFO - ##### 03:31:59 INFO - Running pre-action listener: _resource_record_pre_action 03:31:59 INFO - Running main action method: read_buildbot_config 03:31:59 INFO - Using buildbot properties: 03:31:59 INFO - { 03:31:59 INFO - "project": "", 03:31:59 INFO - "product": "firefox", 03:31:59 INFO - "script_repo_revision": "production", 03:31:59 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 03:31:59 INFO - "repository": "", 03:31:59 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 03:31:59 INFO - "buildid": "20160221004008", 03:31:59 INFO - "stage_platform": "linux64-pgo", 03:31:59 INFO - "basedir": "/builds/slave/test-pgo", 03:31:59 INFO - "nightly_build": "True", 03:31:59 INFO - "buildnumber": 176, 03:31:59 INFO - "slavename": "talos-linux64-ix-038", 03:31:59 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:31:59 INFO - "platform": "ubuntu64_hw", 03:31:59 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 03:31:59 INFO - "branch": "mozilla-aurora", 03:31:59 INFO - "repo_path": "releases/mozilla-aurora", 03:31:59 INFO - "revision": "97126e4bc6380071750a619dbad4f5d174df2f46", 03:31:59 INFO - "pgo_build": "True", 03:31:59 INFO - "builduid": "0aa0ec5c97e9465b926b09ad9f718d7c", 03:31:59 INFO - "slavebuilddir": "test" 03:31:59 INFO - } 03:31:59 INFO - Found installer url https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2. 03:31:59 INFO - Running post-action listener: _resource_record_post_action 03:31:59 INFO - ##### 03:31:59 INFO - ##### Running download-and-extract step. 03:31:59 INFO - ##### 03:31:59 INFO - Running pre-action listener: _resource_record_pre_action 03:31:59 INFO - Running main action method: download_and_extract 03:31:59 INFO - mkdir: /builds/slave/test-pgo/build/tests 03:31: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')]} 03:31:59 INFO - https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 03:31:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/test_packages.json 03:31:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/test_packages.json 03:31:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 03:31:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 03:32:00 INFO - Downloaded 1448 bytes. 03:32:00 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 03:32:00 INFO - Using the following test package requirements: 03:32:00 INFO - {u'common': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:32:00 INFO - u'cppunittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 03:32:00 INFO - u'gtest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.gtest.tests.zip'], 03:32:00 INFO - u'jittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'jsshell-linux-x86_64.zip'], 03:32:00 INFO - u'mochitest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 03:32:00 INFO - u'mozbase': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:32:00 INFO - u'reftest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.reftest.tests.zip'], 03:32:00 INFO - u'talos': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'], 03:32:00 INFO - u'web-platform': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 03:32:00 INFO - u'webapprt': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:32:00 INFO - u'xpcshell': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:32:00 INFO - u'firefox-46.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 03:32:00 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:32:00 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')]} 03:32:00 INFO - https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:32:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:32:01 INFO - Downloaded 23079737 bytes. 03:32:01 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:32:01 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 03:32:03 INFO - Return code: 0 03:32:03 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:32:03 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')]} 03:32:03 INFO - https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:32:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:32:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:32:04 INFO - Downloaded 23079737 bytes. 03:32:04 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:32:04 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 03:32:05 INFO - Return code: 0 03:32:05 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')]} 03:32:05 INFO - https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:32:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 03:32:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 03:32:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 03:32:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:32:07 INFO - Downloaded 10706572 bytes. 03:32:07 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:32:07 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 03:32:07 INFO - Return code: 0 03:32:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:32:07 INFO - https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:32:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:32:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:32:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:32:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:32:09 INFO - Downloaded 59952431 bytes. 03:32:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:32:09 INFO - mkdir: /builds/slave/test-pgo/properties 03:32:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 03:32:09 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 03:32:09 INFO - Contents: 03:32:09 INFO - build_url:https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:32:09 INFO - Running post-action listener: _resource_record_post_action 03:32:09 INFO - Running post-action listener: set_extra_try_arguments 03:32:09 INFO - ##### 03:32:09 INFO - ##### Running populate-webroot step. 03:32:09 INFO - ##### 03:32:09 INFO - Running pre-action listener: _resource_record_pre_action 03:32:09 INFO - Running main action method: populate_webroot 03:32:09 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:32:09 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:32:09 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:32:09 INFO - '--tppagecycles', 03:32:09 INFO - '7'], 03:32:09 INFO - 'tests': ['tsvgm']}}, 03:32:09 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:32:09 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:32:09 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:32:09 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:32:09 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:32:09 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:32:09 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'tests': ['damp', 'tps']}, 03:32:09 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['damp', 'tps']}, 03:32:09 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:32:09 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:32:09 INFO - 'other': {'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'other_l64': {'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'other_nol64': {'tests': ['a11yr', 03:32:09 INFO - 'ts_paint', 03:32:09 INFO - 'tpaint', 03:32:09 INFO - 'sessionrestore', 03:32:09 INFO - 'sessionrestore_no_auto_restore']}, 03:32:09 INFO - 'svgr': {'tests': ['tsvgx', 03:32:09 INFO - 'tsvgr_opacity', 03:32:09 INFO - 'tart', 03:32:09 INFO - 'tscrollx', 03:32:09 INFO - 'cart']}, 03:32:09 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['tsvgx', 03:32:09 INFO - 'tsvgr_opacity', 03:32:09 INFO - 'tart', 03:32:09 INFO - 'tscrollx', 03:32:09 INFO - 'cart']}, 03:32:09 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'tests': ['tp5o']}, 03:32:09 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'talos_options': ['--e10s'], 03:32:09 INFO - 'tests': ['tp5o']}, 03:32:09 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'talos_options': ['--xperf_path', 03:32:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:32:09 INFO - 'tests': ['tp5n']}, 03:32:09 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:32:09 INFO - 'talos_options': ['--e10s', 03:32:09 INFO - '--xperf_path', 03:32:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:32:09 INFO - 'tests': ['tp5n']}}, 03:32:09 INFO - 'talos.zip': {'path': '', 03:32:09 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:32:09 INFO - Running post-action listener: _resource_record_post_action 03:32:09 INFO - ##### 03:32:09 INFO - ##### Running create-virtualenv step. 03:32:09 INFO - ##### 03:32:09 INFO - Running pre-action listener: _resource_record_pre_action 03:32:09 INFO - Running main action method: create_virtualenv 03:32:09 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 03:32:09 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 03:32:09 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 03:32:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:32:10 INFO - Using real prefix '/usr' 03:32:10 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 03:32:10 INFO - Installing distribute.............................................................................................................................................................................................done. 03:32:12 INFO - Installing pip.................done. 03:32:12 INFO - Return code: 0 03:32:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 03:32:12 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')]} 03:32:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:12 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')]} 03:32:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:12 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:12 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 03:32:12 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 03:32:12 INFO - Using env: {'DISPLAY': ':0', 03:32:12 INFO - 'HOME': '/home/cltbld', 03:32:12 INFO - 'LANG': 'en_US.UTF-8', 03:32:12 INFO - 'LANGUAGE': 'en_US:en', 03:32:12 INFO - 'LOGNAME': 'cltbld', 03:32:12 INFO - 'MAIL': '/var/mail/cltbld', 03:32:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:12 INFO - 'MOZ_NO_REMOTE': '1', 03:32:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:12 INFO - 'NO_EM_RESTART': '1', 03:32:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:12 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:12 INFO - 'SHELL': '/bin/bash', 03:32:12 INFO - 'SHLVL': '1', 03:32:12 INFO - 'TERM': 'linux', 03:32:12 INFO - 'TMOUT': '86400', 03:32:12 INFO - 'USER': 'cltbld', 03:32:12 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:12 INFO - '_': '/tools/buildbot/bin/python'} 03:32:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:12 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 03:32:12 INFO - Cleaning up... 03:32:12 INFO - Return code: 0 03:32:12 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 03:32:12 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')]} 03:32:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:12 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')]} 03:32:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:12 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:12 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 03:32:12 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 03:32:12 INFO - Using env: {'DISPLAY': ':0', 03:32:12 INFO - 'HOME': '/home/cltbld', 03:32:12 INFO - 'LANG': 'en_US.UTF-8', 03:32:12 INFO - 'LANGUAGE': 'en_US:en', 03:32:12 INFO - 'LOGNAME': 'cltbld', 03:32:12 INFO - 'MAIL': '/var/mail/cltbld', 03:32:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:12 INFO - 'MOZ_NO_REMOTE': '1', 03:32:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:12 INFO - 'NO_EM_RESTART': '1', 03:32:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:12 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:12 INFO - 'SHELL': '/bin/bash', 03:32:12 INFO - 'SHLVL': '1', 03:32:12 INFO - 'TERM': 'linux', 03:32:12 INFO - 'TMOUT': '86400', 03:32:12 INFO - 'USER': 'cltbld', 03:32:12 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:12 INFO - '_': '/tools/buildbot/bin/python'} 03:32:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:12 INFO - Downloading/unpacking psutil>=0.7.1 03:32:12 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 03:32:12 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 03:32:12 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 03:32:12 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 03:32:12 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 03:32:12 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 03:32:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 03:32:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:32:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:32:15 INFO - Installing collected packages: psutil 03:32:15 INFO - Running setup.py install for psutil 03:32:15 INFO - building 'psutil._psutil_linux' extension 03:32:15 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 03:32:16 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 03:32:16 INFO - building 'psutil._psutil_posix' extension 03:32:16 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 03:32:16 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 03:32:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:32:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:32:16 INFO - Successfully installed psutil 03:32:16 INFO - Cleaning up... 03:32:16 INFO - Return code: 0 03:32:16 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 03:32:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:32:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:16 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:16 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 03:32:16 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 03:32:16 INFO - Using env: {'DISPLAY': ':0', 03:32:16 INFO - 'HOME': '/home/cltbld', 03:32:16 INFO - 'LANG': 'en_US.UTF-8', 03:32:16 INFO - 'LANGUAGE': 'en_US:en', 03:32:16 INFO - 'LOGNAME': 'cltbld', 03:32:16 INFO - 'MAIL': '/var/mail/cltbld', 03:32:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:16 INFO - 'MOZ_NO_REMOTE': '1', 03:32:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:16 INFO - 'NO_EM_RESTART': '1', 03:32:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:16 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:16 INFO - 'SHELL': '/bin/bash', 03:32:16 INFO - 'SHLVL': '1', 03:32:16 INFO - 'TERM': 'linux', 03:32:16 INFO - 'TMOUT': '86400', 03:32:16 INFO - 'USER': 'cltbld', 03:32:16 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:16 INFO - '_': '/tools/buildbot/bin/python'} 03:32:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:16 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:32:16 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 03:32:16 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 03:32:16 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 03:32:16 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 03:32:16 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 03:32:16 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 03:32:18 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:32:18 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:32:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:32:18 INFO - Installing collected packages: mozsystemmonitor 03:32:18 INFO - Running setup.py install for mozsystemmonitor 03:32:18 INFO - Successfully installed mozsystemmonitor 03:32:18 INFO - Cleaning up... 03:32:18 INFO - Return code: 0 03:32:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 03:32: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')]} 03:32:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32: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')]} 03:32:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:18 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:18 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 03:32:18 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 03:32:18 INFO - Using env: {'DISPLAY': ':0', 03:32:18 INFO - 'HOME': '/home/cltbld', 03:32:18 INFO - 'LANG': 'en_US.UTF-8', 03:32:18 INFO - 'LANGUAGE': 'en_US:en', 03:32:18 INFO - 'LOGNAME': 'cltbld', 03:32:18 INFO - 'MAIL': '/var/mail/cltbld', 03:32:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:18 INFO - 'MOZ_NO_REMOTE': '1', 03:32:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:18 INFO - 'NO_EM_RESTART': '1', 03:32:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:18 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:18 INFO - 'SHELL': '/bin/bash', 03:32:18 INFO - 'SHLVL': '1', 03:32:18 INFO - 'TERM': 'linux', 03:32:18 INFO - 'TMOUT': '86400', 03:32:18 INFO - 'USER': 'cltbld', 03:32:18 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:18 INFO - '_': '/tools/buildbot/bin/python'} 03:32:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:18 INFO - Downloading/unpacking blobuploader==1.2.4 03:32:18 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 03:32:18 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 03:32:18 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 03:32:18 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 03:32:18 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 03:32:18 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 03:32:20 INFO - Downloading blobuploader-1.2.4.tar.gz 03:32:20 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:32:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:32:20 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 03:32:20 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 03:32:20 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 03:32:20 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 03:32:20 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 03:32:20 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 03:32:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 03:32:21 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:32:21 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 03:32:21 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 03:32:21 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 03:32:21 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 03:32:21 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 03:32:21 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 03:32:21 INFO - Downloading docopt-0.6.1.tar.gz 03:32:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 03:32:21 INFO - Installing collected packages: blobuploader, requests, docopt 03:32:21 INFO - Running setup.py install for blobuploader 03:32:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:32:21 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 03:32:21 INFO - Running setup.py install for requests 03:32:21 INFO - Running setup.py install for docopt 03:32:21 INFO - Successfully installed blobuploader requests docopt 03:32:21 INFO - Cleaning up... 03:32:22 INFO - Return code: 0 03:32:22 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:32: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')]} 03:32:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32: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')]} 03:32:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:22 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:22 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 03:32:22 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 03:32:22 INFO - Using env: {'DISPLAY': ':0', 03:32:22 INFO - 'HOME': '/home/cltbld', 03:32:22 INFO - 'LANG': 'en_US.UTF-8', 03:32:22 INFO - 'LANGUAGE': 'en_US:en', 03:32:22 INFO - 'LOGNAME': 'cltbld', 03:32:22 INFO - 'MAIL': '/var/mail/cltbld', 03:32:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:22 INFO - 'MOZ_NO_REMOTE': '1', 03:32:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:22 INFO - 'NO_EM_RESTART': '1', 03:32:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:22 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:22 INFO - 'SHELL': '/bin/bash', 03:32:22 INFO - 'SHLVL': '1', 03:32:22 INFO - 'TERM': 'linux', 03:32:22 INFO - 'TMOUT': '86400', 03:32:22 INFO - 'USER': 'cltbld', 03:32:22 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:22 INFO - '_': '/tools/buildbot/bin/python'} 03:32:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:32:22 INFO - Running setup.py (path:/tmp/pip-1oHg9H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:32:22 INFO - Running setup.py (path:/tmp/pip-nYf3NG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:32:22 INFO - Running setup.py (path:/tmp/pip-w9x5vD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:32:22 INFO - Running setup.py (path:/tmp/pip-Cz7ZML-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:32:22 INFO - Running setup.py (path:/tmp/pip-hVMZcB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:32:22 INFO - Running setup.py (path:/tmp/pip-2uWhWK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:32:22 INFO - Running setup.py (path:/tmp/pip-S9FO6e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:32:22 INFO - Running setup.py (path:/tmp/pip-IA1sPd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:32:22 INFO - Running setup.py (path:/tmp/pip-i5wzb5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:32:22 INFO - Running setup.py (path:/tmp/pip-yDyBKg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:32:22 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:32:23 INFO - Running setup.py (path:/tmp/pip-npr1TG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:32:23 INFO - Running setup.py (path:/tmp/pip-aAKOzx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:32:23 INFO - Running setup.py (path:/tmp/pip-5GlHEq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:32:23 INFO - Running setup.py (path:/tmp/pip-iQTLX_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:32:23 INFO - Running setup.py (path:/tmp/pip-Aizx4y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:32:23 INFO - Running setup.py (path:/tmp/pip-ciiW8k-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:32:23 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:32:23 INFO - Running setup.py (path:/tmp/pip-l6vdF1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:32:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:32:23 INFO - Running setup.py install for manifestparser 03:32:23 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 03:32:23 INFO - Running setup.py install for mozcrash 03:32:23 INFO - Running setup.py install for mozdebug 03:32:23 INFO - Running setup.py install for mozdevice 03:32:23 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 03:32:23 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 03:32:23 INFO - Running setup.py install for mozfile 03:32:24 INFO - Running setup.py install for mozhttpd 03:32:24 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozinfo 03:32:24 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozInstall 03:32:24 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozleak 03:32:24 INFO - Running setup.py install for mozlog 03:32:24 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for moznetwork 03:32:24 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozprocess 03:32:24 INFO - Running setup.py install for mozprofile 03:32:24 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozrunner 03:32:24 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 03:32:24 INFO - Running setup.py install for mozscreenshot 03:32:25 INFO - Running setup.py install for moztest 03:32:25 INFO - Running setup.py install for mozversion 03:32:25 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 03:32:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:32:25 INFO - Cleaning up... 03:32:25 INFO - Return code: 0 03:32:25 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:32:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:32:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:32:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:25 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:25 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 03:32:25 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 03:32:25 INFO - Using env: {'DISPLAY': ':0', 03:32:25 INFO - 'HOME': '/home/cltbld', 03:32:25 INFO - 'LANG': 'en_US.UTF-8', 03:32:25 INFO - 'LANGUAGE': 'en_US:en', 03:32:25 INFO - 'LOGNAME': 'cltbld', 03:32:25 INFO - 'MAIL': '/var/mail/cltbld', 03:32:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:25 INFO - 'MOZ_NO_REMOTE': '1', 03:32:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:25 INFO - 'NO_EM_RESTART': '1', 03:32:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:25 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:25 INFO - 'SHELL': '/bin/bash', 03:32:25 INFO - 'SHLVL': '1', 03:32:25 INFO - 'TERM': 'linux', 03:32:25 INFO - 'TMOUT': '86400', 03:32:25 INFO - 'USER': 'cltbld', 03:32:25 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:25 INFO - '_': '/tools/buildbot/bin/python'} 03:32:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:32:25 INFO - Running setup.py (path:/tmp/pip-2EndIC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:32:25 INFO - Running setup.py (path:/tmp/pip-rcIORz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:32:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:32:25 INFO - Running setup.py (path:/tmp/pip-jFHhcm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:32:25 INFO - Running setup.py (path:/tmp/pip-lipbTX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:32:25 INFO - Running setup.py (path:/tmp/pip-aTpDlf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:32:25 INFO - Running setup.py (path:/tmp/pip-Cl6Hco-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:32:25 INFO - Running setup.py (path:/tmp/pip-qSvkfb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:32:25 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)) 03:32:25 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:32:25 INFO - Running setup.py (path:/tmp/pip-GbgeBe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:32:26 INFO - Running setup.py (path:/tmp/pip-iSKaWR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:32:26 INFO - Running setup.py (path:/tmp/pip-it5fW9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:32:26 INFO - Running setup.py (path:/tmp/pip-4vl0Ge-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:32:26 INFO - Running setup.py (path:/tmp/pip-PALFSo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:32:26 INFO - Running setup.py (path:/tmp/pip-XB5QHR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:32:26 INFO - Running setup.py (path:/tmp/pip-QKs0Gr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:32:26 INFO - Running setup.py (path:/tmp/pip-gI2v7N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:32:26 INFO - Running setup.py (path:/tmp/pip-r0Ol5u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:32:26 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)) 03:32:26 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:32:26 INFO - Running setup.py (path:/tmp/pip-R7ujPD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:32:26 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)) 03:32:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 03:32:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 03:32:26 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)) 03:32:26 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)) 03:32:26 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)) 03:32:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 03:32:26 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 03:32:26 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 03:32:26 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 03:32:26 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 03:32:26 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 03:32:26 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 03:32:28 INFO - Downloading blessings-1.6.tar.gz 03:32:28 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 03:32:28 INFO - Installing collected packages: blessings 03:32:28 INFO - Running setup.py install for blessings 03:32:28 INFO - Successfully installed blessings 03:32:28 INFO - Cleaning up... 03:32:28 INFO - Return code: 0 03:32:28 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 03:32:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:32:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:32:29 INFO - Reading from file tmpfile_stdout 03:32:29 INFO - Current package versions: 03:32:29 INFO - argparse == 1.2.1 03:32:29 INFO - blessings == 1.6 03:32:29 INFO - blobuploader == 1.2.4 03:32:29 INFO - docopt == 0.6.1 03:32:29 INFO - manifestparser == 1.1 03:32:29 INFO - mozInstall == 1.12 03:32:29 INFO - mozcrash == 0.16 03:32:29 INFO - mozdebug == 0.1 03:32:29 INFO - mozdevice == 0.48 03:32:29 INFO - mozfile == 1.2 03:32:29 INFO - mozhttpd == 0.7 03:32:29 INFO - mozinfo == 0.9 03:32:29 INFO - mozleak == 0.1 03:32:29 INFO - mozlog == 3.1 03:32:29 INFO - moznetwork == 0.27 03:32:29 INFO - mozprocess == 0.22 03:32:29 INFO - mozprofile == 0.28 03:32:29 INFO - mozrunner == 6.11 03:32:29 INFO - mozscreenshot == 0.1 03:32:29 INFO - mozsystemmonitor == 0.0 03:32:29 INFO - moztest == 0.7 03:32:29 INFO - mozversion == 1.4 03:32:29 INFO - psutil == 3.1.1 03:32:29 INFO - requests == 1.2.3 03:32:29 INFO - wsgiref == 0.1.2 03:32:29 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:32:29 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')]} 03:32:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:29 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')]} 03:32:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:29 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:29 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 03:32:29 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 03:32:29 INFO - Using env: {'DISPLAY': ':0', 03:32:29 INFO - 'HOME': '/home/cltbld', 03:32:29 INFO - 'LANG': 'en_US.UTF-8', 03:32:29 INFO - 'LANGUAGE': 'en_US:en', 03:32:29 INFO - 'LOGNAME': 'cltbld', 03:32:29 INFO - 'MAIL': '/var/mail/cltbld', 03:32:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:29 INFO - 'MOZ_NO_REMOTE': '1', 03:32:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:29 INFO - 'NO_EM_RESTART': '1', 03:32:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:29 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:29 INFO - 'SHELL': '/bin/bash', 03:32:29 INFO - 'SHLVL': '1', 03:32:29 INFO - 'TERM': 'linux', 03:32:29 INFO - 'TMOUT': '86400', 03:32:29 INFO - 'USER': 'cltbld', 03:32:29 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:29 INFO - '_': '/tools/buildbot/bin/python'} 03:32:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 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)) 03:32:29 INFO - Cleaning up... 03:32:29 INFO - Return code: 0 03:32:29 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 03:32:29 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')]} 03:32:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:29 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')]} 03:32:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:29 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:29 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 03:32:29 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 03:32:29 INFO - Using env: {'DISPLAY': ':0', 03:32:29 INFO - 'HOME': '/home/cltbld', 03:32:29 INFO - 'LANG': 'en_US.UTF-8', 03:32:29 INFO - 'LANGUAGE': 'en_US:en', 03:32:29 INFO - 'LOGNAME': 'cltbld', 03:32:29 INFO - 'MAIL': '/var/mail/cltbld', 03:32:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:29 INFO - 'MOZ_NO_REMOTE': '1', 03:32:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:29 INFO - 'NO_EM_RESTART': '1', 03:32:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:29 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:29 INFO - 'SHELL': '/bin/bash', 03:32:29 INFO - 'SHLVL': '1', 03:32:29 INFO - 'TERM': 'linux', 03:32:29 INFO - 'TMOUT': '86400', 03:32:29 INFO - 'USER': 'cltbld', 03:32:29 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:29 INFO - '_': '/tools/buildbot/bin/python'} 03:32:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:29 INFO - Downloading/unpacking jsonschema 03:32:29 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 03:32:29 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 03:32:29 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 03:32:29 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 03:32:29 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 03:32:29 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 03:32:31 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:32:31 INFO - Downloading/unpacking functools32 (from jsonschema) 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 INFO - Downloading functools32-3.2.3-2.tar.gz 03:32:31 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 03:32:31 INFO - warning: no files found matching '*.txt' 03:32:31 INFO - no previously-included directories found matching 'build' 03:32:31 INFO - no previously-included directories found matching 'dist' 03:32:31 INFO - no previously-included directories found matching '.git*' 03:32:31 INFO - Installing collected packages: jsonschema, functools32 03:32:31 INFO - Running setup.py install for functools32 03:32:31 INFO - warning: no files found matching '*.txt' 03:32:31 INFO - no previously-included directories found matching 'build' 03:32:31 INFO - no previously-included directories found matching 'dist' 03:32:31 INFO - no previously-included directories found matching '.git*' 03:32:31 INFO - Successfully installed jsonschema functools32 03:32:31 INFO - Cleaning up... 03:32:31 INFO - Return code: 0 03:32:31 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 03:32:31 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')]} 03:32:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:32:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:31 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')]} 03:32:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:32:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:32:31 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 0x7fdc8dc09f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe828a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf51230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', '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 03:32:31 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 03:32:31 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 03:32:31 INFO - Using env: {'DISPLAY': ':0', 03:32:31 INFO - 'HOME': '/home/cltbld', 03:32:31 INFO - 'LANG': 'en_US.UTF-8', 03:32:31 INFO - 'LANGUAGE': 'en_US:en', 03:32:31 INFO - 'LOGNAME': 'cltbld', 03:32:31 INFO - 'MAIL': '/var/mail/cltbld', 03:32:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:31 INFO - 'MOZ_NO_REMOTE': '1', 03:32:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:31 INFO - 'NO_EM_RESTART': '1', 03:32:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:31 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:31 INFO - 'SHELL': '/bin/bash', 03:32:31 INFO - 'SHLVL': '1', 03:32:31 INFO - 'TERM': 'linux', 03:32:31 INFO - 'TMOUT': '86400', 03:32:31 INFO - 'USER': 'cltbld', 03:32:31 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:31 INFO - '_': '/tools/buildbot/bin/python'} 03:32:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:32:31 INFO - Downloading/unpacking flake8 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:31 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 03:32:33 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:32:33 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:32:33 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:33 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 03:32:34 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:32:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:32:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:32:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:32:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:32:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:32:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 03:32:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:32:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:32:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:32:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:32:34 INFO - no previously-included directories found matching 'docs/_build' 03:32:34 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:32:34 INFO - Running setup.py install for pep8 03:32:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:32:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:32:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:32:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:32:34 INFO - no previously-included directories found matching 'docs/_build' 03:32:34 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 03:32:34 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:32:34 INFO - Cleaning up... 03:32:34 INFO - Return code: 0 03:32:34 INFO - Running post-action listener: _resource_record_post_action 03:32:34 INFO - Running post-action listener: _start_resource_monitoring 03:32:34 INFO - Starting resource monitoring. 03:32:34 INFO - ##### 03:32:34 INFO - ##### Running install step. 03:32:34 INFO - ##### 03:32:34 INFO - Running pre-action listener: _resource_record_pre_action 03:32:34 INFO - Running main action method: install 03:32:34 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:32:34 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:32:34 INFO - Reading from file tmpfile_stdout 03:32:34 INFO - Detecting whether we're running mozinstall >=1.0... 03:32:34 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 03:32:34 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 03:32:35 INFO - Reading from file tmpfile_stdout 03:32:35 INFO - Output received: 03:32:35 INFO - Usage: mozinstall [options] installer 03:32:35 INFO - Options: 03:32:35 INFO - -h, --help show this help message and exit 03:32:35 INFO - -d DEST, --destination=DEST 03:32:35 INFO - Directory to install application into. [default: 03:32:35 INFO - "/builds/slave/test-pgo"] 03:32:35 INFO - --app=APP Application being installed. [default: firefox] 03:32:35 INFO - mkdir: /builds/slave/test-pgo/build/application 03:32:35 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 03:32:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 03:32:52 INFO - Reading from file tmpfile_stdout 03:32:52 INFO - Output received: 03:32:52 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 03:32:52 INFO - Running post-action listener: _resource_record_post_action 03:32:52 INFO - ##### 03:32:52 INFO - ##### Running run-tests step. 03:32:52 INFO - ##### 03:32:52 INFO - Running pre-action listener: _resource_record_pre_action 03:32:52 INFO - Running main action method: run_tests 03:32:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 03:32:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 03:32:52 INFO - Python 2.7.3 03:32:52 INFO - Return code: 0 03:32:52 INFO - grabbing minidump binary from tooltool 03:32: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')]} 03:32:52 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 0xfe37f0>, '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 0xf4f2d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf4f760>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 03:32:52 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 03:32:52 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 03:32:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:32:52 INFO - Return code: 0 03:32:52 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 03:32:52 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 03:32:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 03:32:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 03:32:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 03:32:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 03:32:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 03:32:53 INFO - Return code: 0 03:32:53 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/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 03:32:53 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/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-038 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 03:32:53 INFO - Using env: {'DISPLAY': ':0', 03:32:53 INFO - 'HOME': '/home/cltbld', 03:32:53 INFO - 'LANG': 'en_US.UTF-8', 03:32:53 INFO - 'LANGUAGE': 'en_US:en', 03:32:53 INFO - 'LOGNAME': 'cltbld', 03:32:53 INFO - 'MAIL': '/var/mail/cltbld', 03:32:53 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:32:53 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 03:32:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:32:53 INFO - 'MOZ_NO_REMOTE': '1', 03:32:53 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:32:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:32:53 INFO - 'NO_EM_RESTART': '1', 03:32:53 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:32:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:32:53 INFO - 'PWD': '/builds/slave/test-pgo', 03:32:53 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 03:32:53 INFO - 'SHELL': '/bin/bash', 03:32:53 INFO - 'SHLVL': '1', 03:32:53 INFO - 'TERM': 'linux', 03:32:53 INFO - 'TMOUT': '86400', 03:32:53 INFO - 'USER': 'cltbld', 03:32:53 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076', 03:32:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:32:53 INFO - '_': '/tools/buildbot/bin/python'} 03:32:53 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/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 03:32:53 INFO - mozversion application_buildid: 20160221004008 03:32:53 INFO - mozversion application_changeset: 97126e4bc6380071750a619dbad4f5d174df2f46 03:32:53 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:32:53 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:32:53 INFO - mozversion application_name: Firefox 03:32:53 INFO - mozversion application_remotingname: firefox-dev 03:32:53 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:32:53 INFO - mozversion application_vendor: Mozilla 03:32:53 INFO - mozversion application_version: 46.0a2 03:32:53 INFO - mozversion platform_buildid: 20160221004008 03:32:53 INFO - mozversion platform_changeset: 97126e4bc6380071750a619dbad4f5d174df2f46 03:32:53 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:32:53 INFO - mozversion platform_version: 46.0a2 03:32:53 INFO - using testdate: 1456054373 03:32:53 INFO - actual date: 1456054373 03:32:53 INFO - starting webserver on 'localhost:47547' 03:32:53 INFO - SUITE-START | Running 3 tests 03:32:53 INFO - TEST-START | dromaeo_css 03:32:53 INFO - operating with platform_type : linux_ 03:32:53 INFO - Initialising browser for dromaeo_css test... 03:32:53 INFO - TEST-INFO | started process 1380 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1ddHFW/profile http://localhost:47547/getInfo.html) 03:32:58 INFO - PROCESS | 1380 | __metrics Screen width/height:1600/1200 03:32:58 INFO - PROCESS | 1380 | colorDepth:24 03:32:58 INFO - PROCESS | 1380 | Browser inner width/height: 1024/697 03:32:58 INFO - PROCESS | 1380 | __metrics 03:32:58 INFO - PROCESS | 1380 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:32:59 INFO - TEST-INFO | 1380: exit 0 03:32:59 INFO - Browser initialized. 03:32:59 INFO - Running cycle 1/1 for dromaeo_css test... 03:32:59 INFO - TEST-INFO | started process 1470 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1ddHFW/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:33:10 INFO - PROCESS | 1470 | RSS: Main: 137424896 03:33:10 INFO - PROCESS | 1470 | 03:34:01 INFO - PROCESS | 1470 | 1456054441759 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] 03:36:10 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47547/tests/dromaeo/cssquery-ext.html) 03:36:11 INFO - PROCESS | 1470 | RSS: Main: 246198272 03:36:11 INFO - PROCESS | 1470 | 03:39:13 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-ext.html (next: http://localhost:47547/tests/dromaeo/cssquery-jquery.html) 03:39:14 INFO - PROCESS | 1470 | RSS: Main: 221970432 03:39:14 INFO - PROCESS | 1470 | 03:42:15 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47547/tests/dromaeo/cssquery-mootools.html) 03:42:16 INFO - PROCESS | 1470 | RSS: Main: 223903744 03:42:16 INFO - PROCESS | 1470 | 03:45:18 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47547/tests/dromaeo/cssquery-prototype.html) 03:45:18 INFO - PROCESS | 1470 | RSS: Main: 205234176 03:45:18 INFO - PROCESS | 1470 | 03:48:21 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47547/tests/dromaeo/cssquery-yui.html) 03:48:22 INFO - PROCESS | 1470 | RSS: Main: 206757888 03:48:22 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | Cycle 1(1): loaded http://localhost:47547/tests/dromaeo/cssquery-yui.html (next: http://localhost:47547/tests/dromaeo/cssquery-dojo.html) 03:51:24 INFO - PROCESS | 1470 | RSS: Main: 252870656 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | __start_tp_report 03:51:24 INFO - PROCESS | 1470 | _x_x_mozilla_page_load 03:51:24 INFO - PROCESS | 1470 | _x_x_mozilla_page_load_details 03:51:24 INFO - PROCESS | 1470 | |i|pagename|runs| 03:51:24 INFO - PROCESS | 1470 | |0;dojo.html;3275.279438523525;3284.146122008277;3315.3535060663166;3340.532325474434;3351.664833516648;5375.166849138385;5389.218563308318;5400.027994960906;5400.081986062369;5413.404525502201;5356.812511562096;5368.677879327243;5403.918941215885;5411.053065713504;5414.756335964881;4867.099586576494;5001.324821149153;5010.398752149738;5016.47327030662;5068.74656267187;4932.827351042714;4986.900261994758;4995.750212489379;4999.150144475429;5000.449950505442;4950.900981980359;4957.876053098666;5000.549950504454;5001.324821149135;5107.642465027449;4993.400791904958;5054.545090941796;5058.215976523645;5075.492450754932;5088.465711100318;4948.38145231846;4999.150144475448;5009.849704508871;5014.674046187022;5032;5153.072446959546;5187.559057480119;5188.610854185951;5251.711155886424;5266.4733526647415;5737.655740655574;5743.5118014968775;5774.105013722879;5781.277340332458;5790.015697331463;5794.420557944214;5818.912716309259;5832.533397328203;5835.241418615553;5837.970810145965;5356.571474282048;5465.836024919219;5515.779368825282;5517.917231241535;5559.499645031926;5921.82234532956;5923.17075609415;5928.851778705567;5932.110183472513;5976.163337132805;5591.552675785927;5724.370319264877;5734.16854556087;5734.77060917567;5735.1970724098655;5767.913481297784;5837.445442682938;5901.085331773582;5929.555283353679;5933.228680271537;5822.563307751935;5830.47525722687;5845.269341332333;5847.56143289255;5854.443827836434;5623.915641265385;5782.045962416154;5825.592208545361;5846.298444186725;5846.4153584642045;4409.382686423904;4423.491298500714;4450.443694538183;4451.421315229064;4457.888552786141;3896.201278737852;3959.3071212538266;3984.641382275551;4031.9193616127513;4041.2927737645796;5512.779488820483;5535.474129957647;5537.1140617501005;5540.833774986757;5543;5898.085796701518;5911.674857882857;5921.555883308769;5921.7631294747725;5956.612820166675;5352.892942141213;5451.863703407367;5484.7531861066345;5520.806771762969;5547.11246200606;5068.949310506921;5078.822241221539;5094;5098.08234517783;5099.821506247264;5794.536437085023;6005.279366476051;6014.639121652627;6017.819465416044;6023.518118550505;5772.797952071825;5785.9132113017495;5852;5859.267591551056;5864.44287792659;5941.405859414024;5960.016597261403;5960.135780311917;5964.254468191476;5966.76132954677;5638.323401191719;5718.51392631631;5833.79581714638;5848.210491583752;5854.385289544536;5797.971010144923;5839.591228613956;5842.269716285465;5844.12338149264;5884.676342801187;5663.8017669383025;5698.373178950395;5701.40135285789;5701.401352858056;5707.172459993195;5555.166724991283;5642.689652069175;5657.377688454185;5661.122526008476;5678.659280443187;5566.666000040011;5640.379558248672;5645.4072322405555;5648.068068768772;5648.378678345461;5712.914306285492;5717.085266357363;5758.71206439668;5758.712064396847;5768.105943578752;5432.158015507603;5547.639403438763;5607.046802043744;5608.46719561641;5609.635373700697 03:51:24 INFO - PROCESS | 1470 | |1;ext.html;532.3585079978626;560.3192121572291;568.1846550200465;578.6585914310556;594.4293478260869;31117.222069448275;31794.364112717732;31818.840905795438;31835;38242.235155296876;43092;43457.348139777925;43614.78192609033;43659;43741.34387984183;8770.6930257441;8957.328200384965;8970.820583588324;8973.865392019125;8977.281817454621;8660.263877570414;8790.340724445692;8795.780105497382;8795.912040879573;8797.428167169146;8785.253253473462;9076.682316118937;9081.59132839024;9084.09159084093;9091.863622045674;8958.552072396387;9042;9047.954760226223;9048.638054477879;9056.230220431238;8888.866667;8954.328425368123;9000.459972401612;9021.14299141587;9030.27757779376;42203;42633.57366426358;42680;42733.077011534246;42759.57240427587;3746.7002639789025;3822.2490751425125;4174.895627609334;4235.639970602502;4432.667549933735;31781;31917.680823191702;31957.680423195703;32100.518492222636;32190.678093219;4309.806058727333;4386.670999675037;4406.405135306724;4425.668074894395;4469.08383781324;278141;278764;279525;280424;280492.99999999796;59613.403865961656;60305.09542356868;65102;73187;74735.62632186804;67331.66334168297;67362;67684.6615766918;67689.66155169193;67891.32108678948;15783.605409864846;16154.111523866066;16205.675886482204;16230.107344095952;16301.673966520602;10892.019718225398;10893.618723344645;12185.390730463441;12227.388630568614;12467.376631168405;21132;21290.25484108049;21310.254141104986;21399.8930005349;21458.78541214599;7590.582517961565;7776.84446311082;7982.401319901031;8036.156203598655;8075.83848323042;1058.439027315524;1130.6721050895312;1134.3874307873655;1201.567435723139;1205.0058701571063;30734;30990.69009309923;31237.843810781254;31813.20466988344;31911;1118.3792994887915;1182.7693599748138;1211.3882489342825;1232.7287996640725;1296.3259105265208;13594.93202533981;14701.117932924059;15148.772768408482;15832.92083539598;16634.833651663328;277007;279825;280077;280291;280306;52575.47424525782;52782.20826687603;52860;52862.73568632209;52910;1350.3180893648644;1394.7001394699985;1484;1533.6472611299241;1535.869451096647;30751.846240768653;30775;31029;31502.212444689067;32017.359652807278;42726.78636606797;43848.780756097294;47141.52858471371;47955.280670790664;47983.76008119937;209927;210938;212532;212927;213368;32779.836100819346;33116.1720956978;33158.66841331556;33159;33174.17064573405;44057.339139913565;44165.558344416146;44591.9869499489;45597;48095.27857082077;39659.80170099131;39673;40555.1888962225;40822.59177408188;42262;37961.24077518379;38130.809345953094;39453;39578.60421395749;41476.58523414848;39345.40981885331;39956.80021599874;40025.39961900632;40154.39768403535;40300.79849600733;34159.14602134967;36035.27929441449;36154.8192259037;36890.26219475649;36971.26057478889;29101.417971640025;29360.41279174447;29382.70617293885;29400.852995734884;29644.851775740983 03:51:24 INFO - PROCESS | 1470 | |2;jquery.html;387.88751262133985;391.3523119237661;391.43633168237733;392.62504308385496;394.91311911379506;14653.044739951834;14923.253837308146;16640.167991600418;18142.90928545357;18148.274069037237;17213.483595492125;17371.13144342781;17778.377756778515;18190.363337283197;18262.908685456554;6006.159137720711;6203.945329294031;6206.503479721611;6229.221347331583;6230.065490176487;4584.541545845422;4742.264948932921;6069.848253793646;6704.932950670504;6993.965030174867;6672.799816005528;6858.074159988388;6870.209925858515;7006.894896576556;7013.754518591851;6587.604743715345;6784.8303792405095;6814.2845001274645;6864.24493305736;6917.204521480044;6529.967350163266;6540.738370465176;6546.901796473009;6547.3125321841;6548.967255163694;21571.46071348213;21609.45976350588;22302.776972230233;22395.776042239533;22476;2420.6248031555137;2426.296374051523;2453.7914277286454;2547.3758929062496;2598.1555994301925;13761.587152385444;13945.930270348685;14074.71850562983;14479.05886117399;14513.27433628325;1956.6380219659409;2049.108637742587;2089.320970684518;2102.747670279561;2111.2610586294827;68154;69288.6535567324;69688;70169;70277.2972270281;14831.555053348417;15195.924020379827;15228.46700365482;15296.541103766906;15325.31036103378;22958.65562016571;23099;23270;23367.298981030595;23369.649455258186;8830.911690883137;9338.95330523343;9477.526123693788;9595.712128636153;9604;8283.83432331362;8338.583070846433;8355.665773369119;8421.747347579583;8440.831183376298;6902.792916212522;7221.097362829646;7602.973598564123;7747.457677962601;7767.067951845815;2706.3775331673824;2933.858283453091;2976.4939960206384;3038.118945505823;3082.660907300195;485.6284942019358;489.87263311539255;506.9949300506948;975.205207755691;1077.1705786544317;11592.188546801812;12145;12180.939095304468;12379.328790613332;12433.191842530206;486.6374550959558;487.26666367117264;503.6147347279334;525.2148038682194;537.2103008577385;6612.462332652008;6728.153604828977;6785.728570857111;6880.174379074543;6887.965560172267;611848;621923;623591;637069;658717;81542.59228703819;81959;82154.17845821465;83259.16740832635;84991;509.53377659441935;515.6107139109948;516.5041560102344;517.3429744224813;518.2692403710749;10817.18871084656;11294.830577541508;15586.142762147738;15658;15938.36246550125;31563.84218078895;32004.679953201103;32950.18773967455;34969.475457867644;35127;43643.345349819145;44324.77837610791;44730.77634611806;44798.10403791971;46035.53964460446;7963.442559020813;8124.918750812652;8149.307308878811;8179.10029896699;8294.046184688597;9990;10682.89317106819;11729.824052639047;11762.58830940913;11798.292102473879;10045.899541004788;10522.579096836042;10774.622888199188;10844.728881777703;11193.66419007431;10565.366078035342;10738.624148154777;10893.455327233765;10938.726531836768;10995.285306455055;10514.684559463229;10954.56181752721;10954.726131846768;11016.339019658846;11303.648388314154;7423.480356375002;7468.887966680395;7532.209118042746;7542.094948605983;7985.800354991172;7830.843383132419;10132.936041715513;10189.643362482277;10425.270231083752;10429.530671119666 03:51:24 INFO - PROCESS | 1470 | |3;mootools.html;1399.4961813747043;1492.2315007770999;1500.5198336532308;1736.9044702541364;1914.0429785107456;7412;8084.838303233932;8208.83582328353;8209.384296177788;8221.260086592205;8017.278444939954;8272.545010024447;8306.335493160548;8311.376646751487;8312.750617481484;2156.5902478529106;2212.6017316882953;2215.3464727905225;2436.707595088592;2468.0127948820436;2442.3649851038767;2500.2624225853324;2500.312414086132;2500.362407586063;2501.687289088864;2370.182287110944;2446.9510609787794;2459.5080983803223;2461.6676748638884;2462.0890270599903;2413.6741539892155;2433.8783060846977;2475.9504809903883;2476.0590975429222;2480.1567467061286;2424.8908799104083;2450.497647982177;2455.484348286862;2493.1897133431526;2498.25052484254;8425.410221284512;8444.57777111142;8468.576571171418;8473;8503.319734421231;4983.6013118950395;5123.974380128076;5151.793928242866;5165.302684137631;5172.896542069175;3229.1442767666585;3255.4140254754134;3273.4271502486968;3388.508666243381;3391.1352605085544;1058.2116323339085;1103.7682086761708;1111.1943840715498;1124.8987591116756;1141.4578075414195;11922.10584206188;11942.104342174285;11959.103067269902;11996.400179990966;12001.219920705125;4548.95451045492;4555.749433781108;4563.110193512233;4606.976965115153;4639.814407423665;10090;10098.697039088838;10100.393976361294;10101.949490252502;10104.494775261208;5131.87170320745;5153.768080436389;5167.457416971239;5168.043911876315;5168.534831865075;4660.021395506914;4713.787879545429;4714.269288260325;4717.551832575899;4718.646101542398;3436.106612280825;3448.6723761242642;3636.4908912752235;3719.925601487955;3898.5321761388814;1238.8079847623633;1243.042857000123;1254.3163975633302;1256.0391300655006;1258.0627432562799;1042.4422933730418;1042.5412818359898;1067.5196161727254;1089.9509522071526;1091.8034753744403;7781.41639377049;7857.646405911633;7861.449698521163;7881.5665138417935;7897.17079706634;1191.7259030423052;1194.0507296699145;1205.2587658589905;1208.474313673555;1221.2306247064294;6102.115193296947;6146.877062458815;6212.223472065992;6217.285012223561;6233.501319894488;10130.138938190335;10383.84424233637;10462.947685261524;10624.575016999388;10630.043296103388;10091.7477063074;10180.440075795903;10236.795264094826;10237.18102551794;10352.637657681946;8032.59837008159;8085.595720213966;8128.75613731589;8135.186481351936;8145.674173033012;7688.308052275322;7724.227577242231;7751.883721744066;7793.493422927491;7809.960950195213;9006.909930900607;9022.188003079491;9217.170454659114;9422.104900034486;9432.056794320513;9299.72100836976;9627.518624068909;9696.369735967139;9712;9719.46542940145;6986.825329366807;7431.219721929119;7486.850262994601;7503.212162722835;7506.924930750841;7327.596982165819;7462.10454745434;7653.349465295512;7840.451168418384;7886.0536735592095;7323.194448610755;7368.336849683555;7379;7396.9260307396235;7480.102387713509;7376.225496323023;7377.3360397564475;7419.258074192753;7476.5887876167335;7482.850342993001;7271.3455788979245;7299.5620262784405;7348.889766653398;7358;7360.631968401452;6977.79066628002;6992.475564332593;7015.684294206875;7018.859622807413;7019.333163349474;7041.859162816612;7077.363037326665;7124.750633727795;7131.358177764027;7136.821579460555 03:51:24 INFO - PROCESS | 1470 | |4;prototype.html;364.95802982656994;369.61190749712813;377.30764047972;381.0929986631817;390.660125690649;5929.525637948965;5960.582759206857;5966.5226781857455;5969.880602387955;5987.880242395149;5938.7624495020145;5945.227120474332;5946.464818166364;5969.731362088705;5981.820545383645;4508.5716856898625;4637.1189474;4662.020975595112;4671.04243630055;4674.6494012949;4646.814127434898;4666.789994450258;4676.97661511692;4677.766111694419;4678.438587369504;4381.474223093233;4481.215787237236;4493.146302202587;4629.328747331635;4636.79134438951;4548.204064288736;4567.246404343279;4577.038821847416;4580.541945805426;4588.862334129998;3998.3802510610903;4002.3796311571755;4004.4794176756836;4006.8597599084183;4009.1380353224195;5487.890242195173;5515.393306736256;5593.972030139864;5599.160125981095;5622.269105016363;5325.547328477084;5328;5329.546988505982;5332.440093790135;5336.332958380202;6180.227471566054;6210.50315974721;6243.094751261087;6247.625142491465;6251.874962500725;4381.255186618282;4508.436445444319;4509.368688383629;4529.750863702495;4540.6594505411895;6510;6550.181227346582;6563.081168636395;6567.047778072153;6569.835754106138;4503.392042074343;4505.7071290366675;4506.932396014063;4508.616767574793;4510.391097201836;4558.97720511402;4568.474625418119;4569.383133276965;4571.245744452194;4573.405457290531;5150.150225212873;5262.6317157539315;5270.894582108336;5275.498827611371;5280.366356037223;6322.9051564226575;6330.68346582669;6331.778387756406;6331.810045698637;6334.144890439824;1639.8032236131742;1660.8173100958884;1664.342584679045;1664.459050808492;1665.1341302522621;1121.1927412263158;1130;1135.432283858071;1139.2594813371375;1163.7265242667966;6108.869859076085;6115.052166914135;6117.327094019654;6122.265328160649;6122.7857025004805;6556.573822701509;6569.113169722026;6580.967095164589;6583.275839657634;6595.142631457976;5987.191729116514;6099.9085013724825;6118.1128736332985;6120.326764055951;6121.908171377433;3519.964800352015;3557.6975957043423;3560.483729859208;3561.679448849616;3566.3937130687327;6461.61230326182;6636.004599310142;6690.130283063268;6739.629320387426;6759.087523184406;6785.558938668971;6812.420944219797;6813.523053386215;6823.351781580742;6829.726810927507;6790.49071319653;6801.081853949752;6808.046873437624;6811.557248778912;6817.284185160586;6475.320091390525;6607.108040414482;6614.735410583715;6614.933850661624;6631.038499417654;6516.771912983023;6533.281339052605;6533.314002029909;6538.901916471352;6539.476841852736;6794.082798822095;6795.762148324785;6797.388235058868;6798.320167983162;6801.489888258301;4539.387182730289;4609.792559334771;4643.442786865598;4655.9301610475195;4675.438947326343;6584.868302633825;6586.1438013058;6591.044298576584;6593.076969224217;6603.9339606605245;6436.710348034256;6439.066335381437;6441.516886233458;6451;6452.709628066655;6231.813045608639;6389.552731308764;6406.487481001602;6408.583442076437;6441.967790161019;6300.716467759054;6306.621602703853;6307.90538141919;6309.05364195356;6315.400036996478;6463.515236357198;6465.515086368635;6465.547411681137;6472.579282346633;6480.157579514633;6096.451319381277;6220.7511699531515;6242.219722534684;6251.593646412968;6294 03:51:24 INFO - PROCESS | 1470 | |5;yui.html;861.8965724113106;868.496272162146;887.3921363865749;918.0910898210765;920.364948185752;13974.301284935751;14226.28868556572;14232;14261;14268.357923893424;13152.73694526109;13160.144590601603;13212;13229.14010589311;13235.470581176742;751.6091632351174;761.733393312339;878.8989266234385;884.2174675412242;892.1970226795871;895.789489469974;902.7697937026082;902.8194361127768;903.2322525853006;904.7557159566913;919.3518569408584;919.7286800393866;926.703454894434;926.7312479381005;926.9582868770888;780.6096951524238;791.3194652598761;907.2787134228304;916.8670542771328;921.1985572551856;678.0168755304828;679.7213142611555;680.571240118722;682.9009793579953;683.9863202735967;12608.558700445441;12612.369381530887;12656.240625562496;12656.873431265662;12666.936665316614;13286.402111904987;13785.793213101811;13943.511977080854;14127.858721412756;14161.362738676784;10932.125429965583;10991.395473248967;11165.330080195214;11207.66377008691;11291.604793832177;3778.5843557208686;3874.9418758718643;3878.049877779962;3894.4547763313158;3912.8043597819997;52277;54007;54511.727441362935;54601.180982285296;54832.9999999996;10975.670729878117;11055;11085.445727713583;11199.60801371948;11360.715982100513;19704.211831526864;19735.013249337477;19756.802431975782;19768.505787355432;19773.30793422252;7845.960770196112;8006.759797206093;8087.110417854032;8217.30152937007;8289.0467596226;4563.817447302071;4678.859634210911;4688.507706690816;4761.142994261067;4784.497627749106;3240.1737556922835;3261.4944683574086;3276.639569647337;3278.49183376577;3279.3441311737747;563.1215304125577;582.8076734677546;583.6556431705314;594.5184400635499;596.4542443663998;619.6344156947423;631.5957787016313;675.6182756742425;684.2302409788988;706.86569551785;9411.43531388119;9631.325807193429;9638;9690.079442452956;9704.563294651758;676.3067855448205;708.1602772880683;726.6475759256756;729.941604671625;730.521508411991;4432.13573353193;4710.3405523226775;4772.832950846704;4845.830395936126;4878.634102442331;63964.36035639677;64257.357426426075;64263.35736642667;65054;65107.34892651013;56780.43219567752;56976;57686.42313576894;57709;57941.130883036785;49878.25182622264;51197.232041519404;51230.74384628053;51874.22188667173;52610.21084683656;9412;9442.244620430212;9525.04749525042;9532.761680958032;9552.761180970532;35277.647223527434;35673.46489802707;35688.286234275685;35933.46099808453;36287.27425451529;44625.776871115435;46079.3088103672;49592.504074958786;49816;50249;11938.64184074479;12083.818742718691;12169;12221.57224497174;12223;13129.474821007052;13348.733025339245;13491.460341586228;13554.186748795104;13788.86211137916;12277.20198187115;12312.13815032939;12375.504979800708;12928;13368.799468007794;12383.071269654632;12545.247285162919;12578.685532861751;12913.806292905427;12939.676508087374;12552.497900083894;12567.560135395217;12579.68550786201;12726;12822.551210707581;10424.739381515523;10602.310849794738;10722.678319650424;10872.782544349227;10879.891201087888;10696.62561810333;10844.891551084704;10875.50240906689;10972.451377430936;11156.609518666808 03:51:24 INFO - PROCESS | 1470 | __end_tp_report 03:51:24 INFO - PROCESS | 1470 | __start_cc_report 03:51:24 INFO - PROCESS | 1470 | _x_x_mozilla_cycle_collect,825 03:51:24 INFO - PROCESS | 1470 | __end_cc_report 03:51:24 INFO - PROCESS | 1470 | __startTimestamp1456055484527__endTimestamp 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | ------- Summary: start ------- 03:51:24 INFO - PROCESS | 1470 | Number of tests: 6 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#0] dojo.html Cycles:165 Average:5413.21 Median:5609.64 stddev:587.48 (10.5%) stddev-sans-first:564.83 03:51:24 INFO - PROCESS | 1470 | Values: 3275.3 3284.1 3315.4 3340.5 3351.7 5375.2 5389.2 5400.0 5400.1 5413.4 5356.8 5368.7 5403.9 5411.1 5414.8 4867.1 5001.3 5010.4 5016.5 5068.7 4932.8 4986.9 4995.8 4999.2 5000.4 4950.9 4957.9 5000.5 5001.3 5107.6 4993.4 5054.5 5058.2 5075.5 5088.5 4948.4 4999.2 5009.8 5014.7 5032.0 5153.1 5187.6 5188.6 5251.7 5266.5 5737.7 5743.5 5774.1 5781.3 5790.0 5794.4 5818.9 5832.5 5835.2 5838.0 5356.6 5465.8 5515.8 5517.9 5559.5 5921.8 5923.2 5928.9 5932.1 5976.2 5591.6 5724.4 5734.2 5734.8 5735.2 5767.9 5837.4 5901.1 5929.6 5933.2 5822.6 5830.5 5845.3 5847.6 5854.4 5623.9 5782.0 5825.6 5846.3 5846.4 4409.4 4423.5 4450.4 4451.4 4457.9 3896.2 3959.3 3984.6 4031.9 4041.3 5512.8 5535.5 5537.1 5540.8 5543.0 5898.1 5911.7 5921.6 5921.8 5956.6 5352.9 5451.9 5484.8 5520.8 5547.1 5068.9 5078.8 5094.0 5098.1 5099.8 5794.5 6005.3 6014.6 6017.8 6023.5 5772.8 5785.9 5852.0 5859.3 5864.4 5941.4 5960.0 5960.1 5964.3 5966.8 5638.3 5718.5 5833.8 5848.2 5854.4 5798.0 5839.6 5842.3 5844.1 5884.7 5663.8 5698.4 5701.4 5701.4 5707.2 5555.2 5642.7 5657.4 5661.1 5678.7 5566.7 5640.4 5645.4 5648.1 5648.4 5712.9 5717.1 5758.7 5758.7 5768.1 5432.2 5547.6 5607.0 5608.5 5609.6 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#1] ext.html Cycles:180 Average:44748.97 Median:39515.80 stddev:67368.25 (170.5%) stddev-sans-first:67475.42 03:51:24 INFO - PROCESS | 1470 | Values: 532.4 560.3 568.2 578.7 594.4 31117.2 31794.4 31818.8 31835.0 38242.2 43092.0 43457.3 43614.8 43659.0 43741.3 8770.7 8957.3 8970.8 8973.9 8977.3 8660.3 8790.3 8795.8 8795.9 8797.4 8785.3 9076.7 9081.6 9084.1 9091.9 8958.6 9042.0 9048.0 9048.6 9056.2 8888.9 8954.3 9000.5 9021.1 9030.3 42203.0 42633.6 42680.0 42733.1 42759.6 3746.7 3822.2 4174.9 4235.6 4432.7 31781.0 31917.7 31957.7 32100.5 32190.7 4309.8 4386.7 4406.4 4425.7 4469.1 278141.0 278764.0 279525.0 280424.0 280493.0 59613.4 60305.1 65102.0 73187.0 74735.6 67331.7 67362.0 67684.7 67689.7 67891.3 15783.6 16154.1 16205.7 16230.1 16301.7 10892.0 10893.6 12185.4 12227.4 12467.4 21132.0 21290.3 21310.3 21399.9 21458.8 7590.6 7776.8 7982.4 8036.2 8075.8 1058.4 1130.7 1134.4 1201.6 1205.0 30734.0 30990.7 31237.8 31813.2 31911.0 1118.4 1182.8 1211.4 1232.7 1296.3 13594.9 14701.1 15148.8 15832.9 16634.8 277007.0 279825.0 280077.0 280291.0 280306.0 52575.5 52782.2 52860.0 52862.7 52910.0 1350.3 1394.7 1484.0 1533.6 1535.9 30751.8 30775.0 31029.0 31502.2 32017.4 42726.8 43848.8 47141.5 47955.3 47983.8 209927.0 210938.0 212532.0 212927.0 213368.0 32779.8 33116.2 33158.7 33159.0 33174.2 44057.3 44165.6 44592.0 45597.0 48095.3 39659.8 39673.0 40555.2 40822.6 42262.0 37961.2 38130.8 39453.0 39578.6 41476.6 39345.4 39956.8 40025.4 40154.4 40300.8 34159.1 36035.3 36154.8 36890.3 36971.3 29101.4 29360.4 29382.7 29400.9 29644.9 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#2] jquery.html Cycles:180 Average:31633.86 Median:44527.78 stddev:103068.67 (231.5%) stddev-sans-first:103331.10 03:51:24 INFO - PROCESS | 1470 | Values: 387.9 391.4 391.4 392.6 394.9 14653.0 14923.3 16640.2 18142.9 18148.3 17213.5 17371.1 17778.4 18190.4 18262.9 6006.2 6203.9 6206.5 6229.2 6230.1 4584.5 4742.3 6069.8 6704.9 6994.0 6672.8 6858.1 6870.2 7006.9 7013.8 6587.6 6784.8 6814.3 6864.2 6917.2 6530.0 6540.7 6546.9 6547.3 6549.0 21571.5 21609.5 22302.8 22395.8 22476.0 2420.6 2426.3 2453.8 2547.4 2598.2 13761.6 13945.9 14074.7 14479.1 14513.3 1956.6 2049.1 2089.3 2102.7 2111.3 68154.0 69288.7 69688.0 70169.0 70277.3 14831.6 15195.9 15228.5 15296.5 15325.3 22958.7 23099.0 23270.0 23367.3 23369.6 8830.9 9339.0 9477.5 9595.7 9604.0 8283.8 8338.6 8355.7 8421.7 8440.8 6902.8 7221.1 7603.0 7747.5 7767.1 2706.4 2933.9 2976.5 3038.1 3082.7 485.6 489.9 507.0 975.2 1077.2 11592.2 12145.0 12180.9 12379.3 12433.2 486.6 487.3 503.6 525.2 537.2 6612.5 6728.2 6785.7 6880.2 6888.0 611848.0 621923.0 623591.0 637069.0 658717.0 81542.6 81959.0 82154.2 83259.2 84991.0 509.5 515.6 516.5 517.3 518.3 10817.2 11294.8 15586.1 15658.0 15938.4 31563.8 32004.7 32950.2 34969.5 35127.0 43643.3 44324.8 44730.8 44798.1 46035.5 7963.4 8124.9 8149.3 8179.1 8294.0 9990.0 10682.9 11729.8 11762.6 11798.3 10045.9 10522.6 10774.6 10844.7 11193.7 10565.4 10738.6 10893.5 10938.7 10995.3 10514.7 10954.6 10954.7 11016.3 11303.6 7423.5 7468.9 7532.2 7542.1 7985.8 7830.8 10132.9 10189.6 10425.3 10429.5 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#3] mootools.html Cycles:180 Average:5898.49 Median:5053.79 stddev:3113.59 (61.6%) stddev-sans-first:3103.96 03:51:24 INFO - PROCESS | 1470 | Values: 1399.5 1492.2 1500.5 1736.9 1914.0 7412.0 8084.8 8208.8 8209.4 8221.3 8017.3 8272.5 8306.3 8311.4 8312.8 2156.6 2212.6 2215.3 2436.7 2468.0 2442.4 2500.3 2500.3 2500.4 2501.7 2370.2 2447.0 2459.5 2461.7 2462.1 2413.7 2433.9 2476.0 2476.1 2480.2 2424.9 2450.5 2455.5 2493.2 2498.3 8425.4 8444.6 8468.6 8473.0 8503.3 4983.6 5124.0 5151.8 5165.3 5172.9 3229.1 3255.4 3273.4 3388.5 3391.1 1058.2 1103.8 1111.2 1124.9 1141.5 11922.1 11942.1 11959.1 11996.4 12001.2 4549.0 4555.7 4563.1 4607.0 4639.8 10090.0 10098.7 10100.4 10101.9 10104.5 5131.9 5153.8 5167.5 5168.0 5168.5 4660.0 4713.8 4714.3 4717.6 4718.6 3436.1 3448.7 3636.5 3719.9 3898.5 1238.8 1243.0 1254.3 1256.0 1258.1 1042.4 1042.5 1067.5 1090.0 1091.8 7781.4 7857.6 7861.4 7881.6 7897.2 1191.7 1194.1 1205.3 1208.5 1221.2 6102.1 6146.9 6212.2 6217.3 6233.5 10130.1 10383.8 10462.9 10624.6 10630.0 10091.7 10180.4 10236.8 10237.2 10352.6 8032.6 8085.6 8128.8 8135.2 8145.7 7688.3 7724.2 7751.9 7793.5 7810.0 9006.9 9022.2 9217.2 9422.1 9432.1 9299.7 9627.5 9696.4 9712.0 9719.5 6986.8 7431.2 7486.9 7503.2 7506.9 7327.6 7462.1 7653.3 7840.5 7886.1 7323.2 7368.3 7379.0 7396.9 7480.1 7376.2 7377.3 7419.3 7476.6 7482.9 7271.3 7299.6 7348.9 7358.0 7360.6 6977.8 6992.5 7015.7 7018.9 7019.3 7041.9 7077.4 7124.8 7131.4 7136.8 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#4] prototype.html Cycles:180 Average:5330.01 Median:6042.17 stddev:1588.70 (26.3%) stddev-sans-first:1548.83 03:51:24 INFO - PROCESS | 1470 | Values: 365.0 369.6 377.3 381.1 390.7 5929.5 5960.6 5966.5 5969.9 5987.9 5938.8 5945.2 5946.5 5969.7 5981.8 4508.6 4637.1 4662.0 4671.0 4674.6 4646.8 4666.8 4677.0 4677.8 4678.4 4381.5 4481.2 4493.1 4629.3 4636.8 4548.2 4567.2 4577.0 4580.5 4588.9 3998.4 4002.4 4004.5 4006.9 4009.1 5487.9 5515.4 5594.0 5599.2 5622.3 5325.5 5328.0 5329.5 5332.4 5336.3 6180.2 6210.5 6243.1 6247.6 6251.9 4381.3 4508.4 4509.4 4529.8 4540.7 6510.0 6550.2 6563.1 6567.0 6569.8 4503.4 4505.7 4506.9 4508.6 4510.4 4559.0 4568.5 4569.4 4571.2 4573.4 5150.2 5262.6 5270.9 5275.5 5280.4 6322.9 6330.7 6331.8 6331.8 6334.1 1639.8 1660.8 1664.3 1664.5 1665.1 1121.2 1130.0 1135.4 1139.3 1163.7 6108.9 6115.1 6117.3 6122.3 6122.8 6556.6 6569.1 6581.0 6583.3 6595.1 5987.2 6099.9 6118.1 6120.3 6121.9 3520.0 3557.7 3560.5 3561.7 3566.4 6461.6 6636.0 6690.1 6739.6 6759.1 6785.6 6812.4 6813.5 6823.4 6829.7 6790.5 6801.1 6808.0 6811.6 6817.3 6475.3 6607.1 6614.7 6614.9 6631.0 6516.8 6533.3 6533.3 6538.9 6539.5 6794.1 6795.8 6797.4 6798.3 6801.5 4539.4 4609.8 4643.4 4655.9 4675.4 6584.9 6586.1 6591.0 6593.1 6603.9 6436.7 6439.1 6441.5 6451.0 6452.7 6231.8 6389.6 6406.5 6408.6 6442.0 6300.7 6306.6 6307.9 6309.1 6315.4 6463.5 6465.5 6465.5 6472.6 6480.2 6096.5 6220.8 6242.2 6251.6 6294.0 03:51:24 INFO - PROCESS | 1470 | 03:51:24 INFO - PROCESS | 1470 | [#5] yui.html Cycles:180 Average:15085.41 Median:4699.42 stddev:17653.47 (375.7%) stddev-sans-first:17670.68 03:51:24 INFO - PROCESS | 1470 | Values: 861.9 868.5 887.4 918.1 920.4 13974.3 14226.3 14232.0 14261.0 14268.4 13152.7 13160.1 13212.0 13229.1 13235.5 751.6 761.7 878.9 884.2 892.2 895.8 902.8 902.8 903.2 904.8 919.4 919.7 926.7 926.7 927.0 780.6 791.3 907.3 916.9 921.2 678.0 679.7 680.6 682.9 684.0 12608.6 12612.4 12656.2 12656.9 12666.9 13286.4 13785.8 13943.5 14127.9 14161.4 10932.1 10991.4 11165.3 11207.7 11291.6 3778.6 3874.9 3878.0 3894.5 3912.8 52277.0 54007.0 54511.7 54601.2 54833.0 10975.7 11055.0 11085.4 11199.6 11360.7 19704.2 19735.0 19756.8 19768.5 19773.3 7846.0 8006.8 8087.1 8217.3 8289.0 4563.8 4678.9 4688.5 4761.1 4784.5 3240.2 3261.5 3276.6 3278.5 3279.3 563.1 582.8 583.7 594.5 596.5 619.6 631.6 675.6 684.2 706.9 9411.4 9631.3 9638.0 9690.1 9704.6 676.3 708.2 726.6 729.9 730.5 4432.1 4710.3 4772.8 4845.8 4878.6 63964.4 64257.4 64263.4 65054.0 65107.3 56780.4 56976.0 57686.4 57709.0 57941.1 49878.3 51197.2 51230.7 51874.2 52610.2 9412.0 9442.2 9525.0 9532.8 9552.8 35277.6 35673.5 35688.3 35933.5 36287.3 44625.8 46079.3 49592.5 49816.0 50249.0 11938.6 12083.8 12169.0 12221.6 12223.0 13129.5 13348.7 13491.5 13554.2 13788.9 12277.2 12312.1 12375.5 12928.0 13368.8 12383.1 12545.2 12578.7 12913.8 12939.7 12552.5 12567.6 12579.7 12726.0 12822.6 10424.7 10602.3 10722.7 10872.8 10879.9 10696.6 10844.9 10875.5 10972.5 11156.6 03:51:24 INFO - PROCESS | 1470 | -------- Summary: end -------- 03:51:24 INFO - PROCESS | 1470 | 03:51:25 INFO - TEST-INFO | 1470: exit 0 03:51:25 INFO - TEST-OK | dromaeo_css | took 1111679ms 03:51:25 INFO - TEST-START | kraken 03:51:25 INFO - operating with platform_type : linux_ 03:51:25 INFO - Initialising browser for kraken test... 03:51:25 INFO - TEST-INFO | started process 1658 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpAKblAk/profile http://localhost:47547/getInfo.html) 03:51:29 INFO - PROCESS | 1658 | __metrics Screen width/height:1600/1200 03:51:29 INFO - PROCESS | 1658 | colorDepth:24 03:51:29 INFO - PROCESS | 1658 | Browser inner width/height: 1024/697 03:51:29 INFO - PROCESS | 1658 | __metrics 03:51:29 INFO - PROCESS | 1658 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:51:30 INFO - TEST-INFO | 1658: exit 0 03:51:30 INFO - Browser initialized. 03:51:30 INFO - Running cycle 1/1 for kraken test... 03:51:30 INFO - TEST-INFO | started process 1746 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpAKblAk/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:51:42 INFO - PROCESS | 1746 | RSS: Main: 138252288 03:51:42 INFO - PROCESS | 1746 | 03:51:45 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47547/tests/kraken/driver.html?testName=audio-beat-detection) 03:51:45 INFO - PROCESS | 1746 | RSS: Main: 172146688 03:51:45 INFO - PROCESS | 1746 | 03:51:48 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47547/tests/kraken/driver.html?testName=audio-dft) 03:51:48 INFO - PROCESS | 1746 | RSS: Main: 171454464 03:51:48 INFO - PROCESS | 1746 | 03:51:51 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47547/tests/kraken/driver.html?testName=audio-fft) 03:51:52 INFO - PROCESS | 1746 | RSS: Main: 167002112 03:51:52 INFO - PROCESS | 1746 | 03:51:54 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47547/tests/kraken/driver.html?testName=audio-oscillator) 03:51:54 INFO - PROCESS | 1746 | RSS: Main: 168108032 03:51:54 INFO - PROCESS | 1746 | 03:51:56 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47547/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:51:57 INFO - PROCESS | 1746 | RSS: Main: 166092800 03:51:57 INFO - PROCESS | 1746 | 03:52:00 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47547/tests/kraken/driver.html?testName=imaging-darkroom) 03:52:00 INFO - PROCESS | 1746 | RSS: Main: 166817792 03:52:00 INFO - PROCESS | 1746 | 03:52:04 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47547/tests/kraken/driver.html?testName=imaging-desaturate) 03:52:04 INFO - PROCESS | 1746 | RSS: Main: 165658624 03:52:04 INFO - PROCESS | 1746 | 03:52:07 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47547/tests/kraken/driver.html?testName=json-parse-financial) 03:52:08 INFO - PROCESS | 1746 | RSS: Main: 166625280 03:52:08 INFO - PROCESS | 1746 | 03:52:09 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47547/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:52:10 INFO - PROCESS | 1746 | RSS: Main: 172204032 03:52:10 INFO - PROCESS | 1746 | 03:52:12 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:52:12 INFO - PROCESS | 1746 | RSS: Main: 171253760 03:52:12 INFO - PROCESS | 1746 | 03:52:14 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:52:15 INFO - PROCESS | 1746 | RSS: Main: 173740032 03:52:15 INFO - PROCESS | 1746 | 03:52:17 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:52:18 INFO - PROCESS | 1746 | RSS: Main: 183144448 03:52:18 INFO - PROCESS | 1746 | 03:52:20 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:52:21 INFO - PROCESS | 1746 | RSS: Main: 182292480 03:52:21 INFO - PROCESS | 1746 | 03:52:22 INFO - PROCESS | 1746 | Cycle 1(1): loaded http://localhost:47547/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47547/tests/kraken/driver.html?testName=ai-astar) 03:52:23 INFO - PROCESS | 1746 | RSS: Main: 241389568 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | __start_tp_report 03:52:23 INFO - PROCESS | 1746 | _x_x_mozilla_page_load 03:52:23 INFO - PROCESS | 1746 | _x_x_mozilla_page_load_details 03:52:23 INFO - PROCESS | 1746 | |i|pagename|runs| 03:52:23 INFO - PROCESS | 1746 | |0;ai-astar;110;111;107;109;111;109;100;111;111;111 03:52:23 INFO - PROCESS | 1746 | |1;audio-beat-detection;150;126;151;157;123;150;146;137;169;122 03:52:23 INFO - PROCESS | 1746 | |2;audio-dft;161;161;160;163;163;159;160;163;159;160 03:52:23 INFO - PROCESS | 1746 | |3;audio-fft;72;72;73;158;83;73;76;73;144;76 03:52:23 INFO - PROCESS | 1746 | |4;audio-oscillator;94;94;142;101;95;95;148;94;94;138 03:52:23 INFO - PROCESS | 1746 | |5;imaging-gaussian-blur;108;109;109;109;110;109;110;108;109;109 03:52:23 INFO - PROCESS | 1746 | |6;imaging-darkroom;145;147;147;147;145;146;146;145;146;145 03:52:23 INFO - PROCESS | 1746 | |7;imaging-desaturate;96;96;96;95;96;96;96;95;96;96 03:52:23 INFO - PROCESS | 1746 | |8;json-parse-financial;53;53;54;54;52;53;53;53;50;51 03:52:23 INFO - PROCESS | 1746 | |9;json-stringify-tinderbox;63;63;63;64;64;65;65;63;65;64 03:52:23 INFO - PROCESS | 1746 | |10;stanford-crypto-aes;79;80;81;82;80;81;80;81;81;79 03:52:23 INFO - PROCESS | 1746 | |11;stanford-crypto-ccm;111;111;123;117;111;126;113;109;111;118 03:52:23 INFO - PROCESS | 1746 | |12;stanford-crypto-pbkdf2;134;139;136;135;134;127;134;136;136;136 03:52:23 INFO - PROCESS | 1746 | |13;stanford-crypto-sha256-iterative;67;65;65;67;67;65;66;68;64;63 03:52:23 INFO - PROCESS | 1746 | __end_tp_report 03:52:23 INFO - PROCESS | 1746 | __start_cc_report 03:52:23 INFO - PROCESS | 1746 | _x_x_mozilla_cycle_collect,928 03:52:23 INFO - PROCESS | 1746 | __end_cc_report 03:52:23 INFO - PROCESS | 1746 | __startTimestamp1456055543051__endTimestamp 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | ------- Summary: start ------- 03:52:23 INFO - PROCESS | 1746 | Number of tests: 14 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#0] ai-astar Cycles:10 Average:109.00 Median:111.00 stddev:3.43 (3.1%) stddev-sans-first:3.62 03:52:23 INFO - PROCESS | 1746 | Values: 110.0 111.0 107.0 109.0 111.0 109.0 100.0 111.0 111.0 111.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#1] audio-beat-detection Cycles:10 Average:143.10 Median:150.00 stddev:15.67 (10.4%) stddev-sans-first:16.42 03:52:23 INFO - PROCESS | 1746 | Values: 150.0 126.0 151.0 157.0 123.0 150.0 146.0 137.0 169.0 122.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#2] audio-dft Cycles:10 Average:160.90 Median:161.00 stddev:1.60 (1.0%) stddev-sans-first:1.69 03:52:23 INFO - PROCESS | 1746 | Values: 161.0 161.0 160.0 163.0 163.0 159.0 160.0 163.0 159.0 160.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#3] audio-fft Cycles:10 Average:90.00 Median:73.00 stddev:32.48 (44.5%) stddev-sans-first:33.79 03:52:23 INFO - PROCESS | 1746 | Values: 72.0 72.0 73.0 158.0 83.0 73.0 76.0 73.0 144.0 76.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#4] audio-oscillator Cycles:10 Average:109.50 Median:94.00 stddev:23.10 (24.6%) stddev-sans-first:23.82 03:52:23 INFO - PROCESS | 1746 | Values: 94.0 94.0 142.0 101.0 95.0 95.0 148.0 94.0 94.0 138.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#5] imaging-gaussian-blur Cycles:10 Average:109.00 Median:109.00 stddev:0.67 (0.6%) stddev-sans-first:0.60 03:52:23 INFO - PROCESS | 1746 | Values: 108.0 109.0 109.0 109.0 110.0 109.0 110.0 108.0 109.0 109.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.88 (0.6%) stddev-sans-first:0.87 03:52:23 INFO - PROCESS | 1746 | Values: 145.0 147.0 147.0 147.0 145.0 146.0 146.0 145.0 146.0 145.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 03:52:23 INFO - PROCESS | 1746 | Values: 96.0 96.0 96.0 95.0 96.0 96.0 96.0 95.0 96.0 96.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#8] json-parse-financial Cycles:10 Average:52.60 Median:53.00 stddev:1.26 (2.4%) stddev-sans-first:1.33 03:52:23 INFO - PROCESS | 1746 | Values: 53.0 53.0 54.0 54.0 52.0 53.0 53.0 53.0 50.0 51.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#9] json-stringify-tinderbox Cycles:10 Average:63.90 Median:64.00 stddev:0.88 (1.4%) stddev-sans-first:0.87 03:52:23 INFO - PROCESS | 1746 | Values: 63.0 63.0 63.0 64.0 64.0 65.0 65.0 63.0 65.0 64.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#10] stanford-crypto-aes Cycles:10 Average:80.40 Median:81.00 stddev:0.97 (1.2%) stddev-sans-first:0.88 03:52:23 INFO - PROCESS | 1746 | Values: 79.0 80.0 81.0 82.0 80.0 81.0 80.0 81.0 81.0 79.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#11] stanford-crypto-ccm Cycles:10 Average:115.00 Median:115.00 stddev:5.79 (5.0%) stddev-sans-first:5.96 03:52:23 INFO - PROCESS | 1746 | Values: 111.0 111.0 123.0 117.0 111.0 126.0 113.0 109.0 111.0 118.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:134.70 Median:136.00 stddev:3.09 (2.3%) stddev-sans-first:3.27 03:52:23 INFO - PROCESS | 1746 | Values: 134.0 139.0 136.0 135.0 134.0 127.0 134.0 136.0 136.0 136.0 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - PROCESS | 1746 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.70 Median:66.50 stddev:1.57 (2.4%) stddev-sans-first:1.59 03:52:23 INFO - PROCESS | 1746 | Values: 67.0 65.0 65.0 67.0 67.0 65.0 66.0 68.0 64.0 63.0 03:52:23 INFO - PROCESS | 1746 | -------- Summary: end -------- 03:52:23 INFO - PROCESS | 1746 | 03:52:23 INFO - TEST-INFO | 1746: exit 0 03:52:23 INFO - TEST-OK | kraken | took 58834ms 03:52:23 INFO - TEST-START | v8_7 03:52:23 INFO - operating with platform_type : linux_ 03:52:23 INFO - Initialising browser for v8_7 test... 03:52:23 INFO - TEST-INFO | started process 2000 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFQaTqj/profile http://localhost:47547/getInfo.html) 03:52:28 INFO - PROCESS | 2000 | __metrics Screen width/height:1600/1200 03:52:28 INFO - PROCESS | 2000 | colorDepth:24 03:52:28 INFO - PROCESS | 2000 | Browser inner width/height: 1024/697 03:52:28 INFO - PROCESS | 2000 | __metrics 03:52:28 INFO - PROCESS | 2000 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:52:30 INFO - TEST-INFO | 2000: exit 0 03:52:30 INFO - Browser initialized. 03:52:30 INFO - Running cycle 1/1 for v8_7 test... 03:52:30 INFO - TEST-INFO | started process 2089 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFQaTqj/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:52:41 INFO - PROCESS | 2089 | RSS: Main: 138235904 03:52:41 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | Cycle 1(1): loaded http://localhost:47547/tests/v8_7/run.html (next: http://localhost:47547/tests/v8_7/run.html) 03:53:04 INFO - PROCESS | 2089 | RSS: Main: 429871104 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | __start_tp_report 03:53:04 INFO - PROCESS | 2089 | _x_x_mozilla_page_load 03:53:04 INFO - PROCESS | 2089 | _x_x_mozilla_page_load_details 03:53:04 INFO - PROCESS | 2089 | |i|pagename|runs| 03:53:04 INFO - PROCESS | 2089 | |0;Richards;166.25103906899417 03:53:04 INFO - PROCESS | 2089 | |1;DeltaBlue;170.35775127768312 03:53:04 INFO - PROCESS | 2089 | |2;Encrypt;279.4857462269424 03:53:04 INFO - PROCESS | 2089 | |3;Decrypt;5240.837696335078 03:53:04 INFO - PROCESS | 2089 | |4;RayTrace;1001.001001001001 03:53:04 INFO - PROCESS | 2089 | |5;Earley;568.5048322910744 03:53:04 INFO - PROCESS | 2089 | |6;Boyer;11122.222222222223 03:53:04 INFO - PROCESS | 2089 | |7;RegExp;40800 03:53:04 INFO - PROCESS | 2089 | |8;Splay;494.0711462450593 03:53:04 INFO - PROCESS | 2089 | |9;NavierStokes;4822.115384615385 03:53:04 INFO - PROCESS | 2089 | __end_tp_report 03:53:04 INFO - PROCESS | 2089 | __startTimestamp1456055584685__endTimestamp 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | ------- Summary: start ------- 03:53:04 INFO - PROCESS | 2089 | Number of tests: 10 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#0] Richards Cycles:1 Average:166.25 Median:166.25 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 166.3 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#1] DeltaBlue Cycles:1 Average:170.36 Median:170.36 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 170.4 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#2] Encrypt Cycles:1 Average:279.49 Median:279.49 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 279.5 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#3] Decrypt Cycles:1 Average:5240.84 Median:5240.84 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 5240.8 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#4] RayTrace Cycles:1 Average:1001.00 Median:1001.00 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 1001.0 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#5] Earley Cycles:1 Average:568.50 Median:568.50 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 568.5 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#6] Boyer Cycles:1 Average:11122.22 Median:11122.22 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 11122.2 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#7] RegExp Cycles:1 Average:40800.00 Median:40800.00 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 40800.0 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#8] Splay Cycles:1 Average:494.07 Median:494.07 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 494.1 03:53:04 INFO - PROCESS | 2089 | 03:53:04 INFO - PROCESS | 2089 | [#9] NavierStokes Cycles:1 Average:4822.12 Median:4822.12 stddev:0.00 (0.0%) 03:53:04 INFO - PROCESS | 2089 | Values: 4822.1 03:53:04 INFO - PROCESS | 2089 | -------- Summary: end -------- 03:53:04 INFO - PROCESS | 2089 | 03:53:05 INFO - TEST-INFO | 2089: exit 0 03:53:05 INFO - TEST-OK | v8_7 | took 41582ms 03:53:05 INFO - SUITE-END | took 1212s 03:53:05 INFO - Completed test suite (00:20:12) 03:53:05 INFO - Working with test: dromaeo_css 03:53:05 INFO - Generating results file: dromaeo_css 03:53:05 INFO - Working with test: kraken 03:53:05 INFO - Generating results file: kraken 03:53:05 INFO - javascript benchmark 03:53:05 INFO - Working with test: v8_7 03:53:05 INFO - Generating results file: v8_7 03:53:05 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:53:05 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,52,35]] 03:53:05 INFO - process_Request line: dromaeo_css 7257.68 graph.html#tests=[[72,52,35]] 03:53:05 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:53:05 INFO - process_Request line: kraken 1475.50 graph.html#tests=[[232,52,35]] 03:53:05 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:53:05 INFO - process_Request line: v8_7 21846.53 graph.html#tests=[[230,52,35]] 03:53:05 INFO - RETURN: dromaeo_css: 7257.68 03:53:05 INFO - RETURN: kraken: 1475.50 03:53:05 INFO - RETURN: v8_7: 21846.53 03:53:05 INFO - javascript benchmark 03:53:05 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3275.279438523525, 3284.146122008277, 3315.3535060663166, 3340.532325474434, 3351.664833516648, 5375.166849138385, 5389.218563308318, 5400.027994960906, 5400.081986062369, 5413.404525502201, 5356.812511562096, 5368.677879327243, 5403.918941215885, 5411.053065713504, 5414.756335964881, 4867.099586576494, 5001.324821149153, 5010.398752149738, 5016.47327030662, 5068.74656267187, 4932.827351042714, 4986.900261994758, 4995.750212489379, 4999.150144475429, 5000.449950505442, 4950.900981980359, 4957.876053098666, 5000.549950504454, 5001.324821149135, 5107.642465027449, 4993.400791904958, 5054.545090941796, 5058.215976523645, 5075.492450754932, 5088.465711100318, 4948.38145231846, 4999.150144475448, 5009.849704508871, 5014.674046187022, 5032.0, 5153.072446959546, 5187.559057480119, 5188.610854185951, 5251.711155886424, 5266.4733526647415, 5737.655740655574, 5743.5118014968775, 5774.105013722879, 5781.277340332458, 5790.015697331463, 5794.420557944214, 5818.912716309259, 5832.533397328203, 5835.241418615553, 5837.970810145965, 5356.571474282048, 5465.836024919219, 5515.779368825282, 5517.917231241535, 5559.499645031926, 5921.82234532956, 5923.17075609415, 5928.851778705567, 5932.110183472513, 5976.163337132805, 5591.552675785927, 5724.370319264877, 5734.16854556087, 5734.77060917567, 5735.1970724098655, 5767.913481297784, 5837.445442682938, 5901.085331773582, 5929.555283353679, 5933.228680271537, 5822.563307751935, 5830.47525722687, 5845.269341332333, 5847.56143289255, 5854.443827836434, 5623.915641265385, 5782.045962416154, 5825.592208545361, 5846.298444186725, 5846.4153584642045, 4409.382686423904, 4423.491298500714, 4450.443694538183, 4451.421315229064, 4457.888552786141, 3896.201278737852, 3959.3071212538266, 3984.641382275551, 4031.9193616127513, 4041.2927737645796, 5512.779488820483, 5535.474129957647, 5537.1140617501005, 5540.833774986757, 5543.0, 5898.085796701518, 5911.674857882857, 5921.555883308769, 5921.7631294747725, 5956.612820166675, 5352.892942141213, 5451.863703407367, 5484.7531861066345, 5520.806771762969, 5547.11246200606, 5068.949310506921, 5078.822241221539, 5094.0, 5098.08234517783, 5099.821506247264, 5794.536437085023, 6005.279366476051, 6014.639121652627, 6017.819465416044, 6023.518118550505, 5772.797952071825, 5785.9132113017495, 5852.0, 5859.267591551056, 5864.44287792659, 5941.405859414024, 5960.016597261403, 5960.135780311917, 5964.254468191476, 5966.76132954677, 5638.323401191719, 5718.51392631631, 5833.79581714638, 5848.210491583752, 5854.385289544536, 5797.971010144923, 5839.591228613956, 5842.269716285465, 5844.12338149264, 5884.676342801187, 5663.8017669383025, 5698.373178950395, 5701.40135285789, 5701.401352858056, 5707.172459993195, 5555.166724991283, 5642.689652069175, 5657.377688454185, 5661.122526008476, 5678.659280443187, 5566.666000040011, 5640.379558248672, 5645.4072322405555, 5648.068068768772, 5648.378678345461, 5712.914306285492, 5717.085266357363, 5758.71206439668, 5758.712064396847, 5768.105943578752, 5432.158015507603, 5547.639403438763, 5607.046802043744, 5608.46719561641, 5609.635373700697], "unit": "score", "name": "dojo.html", "value": 5375.939340619746}, {"lowerIsBetter": false, "replicates": [532.3585079978626, 560.3192121572291, 568.1846550200465, 578.6585914310556, 594.4293478260869, 31117.222069448275, 31794.364112717732, 31818.840905795438, 31835.0, 38242.235155296876, 43092.0, 43457.348139777925, 43614.78192609033, 43659.0, 43741.34387984183, 8770.6930257441, 8957.328200384965, 8970.820583588324, 8973.865392019125, 8977.281817454621, 8660.263877570414, 8790.340724445692, 8795.780105497382, 8795.912040879573, 8797.428167169146, 8785.253253473462, 9076.682316118937, 9081.59132839024, 9084.09159084093, 9091.863622045674, 8958.552072396387, 9042.0, 9047.954760226223, 9048.638054477879, 9056.230220431238, 8888.866667, 8954.328425368123, 9000.459972401612, 9021.14299141587, 9030.27757779376, 42203.0, 42633.57366426358, 42680.0, 42733.077011534246, 42759.57240427587, 3746.7002639789025, 3822.2490751425125, 4174.895627609334, 4235.639970602502, 4432.667549933735, 31781.0, 31917.680823191702, 31957.680423195703, 32100.518492222636, 32190.678093219, 4309.806058727333, 4386.670999675037, 4406.405135306724, 4425.668074894395, 4469.08383781324, 278141.0, 278764.0, 279525.0, 280424.0, 280492.99999999796, 59613.403865961656, 60305.09542356868, 65102.0, 73187.0, 74735.62632186804, 67331.66334168297, 67362.0, 67684.6615766918, 67689.66155169193, 67891.32108678948, 15783.605409864846, 16154.111523866066, 16205.675886482204, 16230.107344095952, 16301.673966520602, 10892.019718225398, 10893.618723344645, 12185.390730463441, 12227.388630568614, 12467.376631168405, 21132.0, 21290.25484108049, 21310.254141104986, 21399.8930005349, 21458.78541214599, 7590.582517961565, 7776.84446311082, 7982.401319901031, 8036.156203598655, 8075.83848323042, 1058.439027315524, 1130.6721050895312, 1134.3874307873655, 1201.567435723139, 1205.0058701571063, 30734.0, 30990.69009309923, 31237.843810781254, 31813.20466988344, 31911.0, 1118.3792994887915, 1182.7693599748138, 1211.3882489342825, 1232.7287996640725, 1296.3259105265208, 13594.93202533981, 14701.117932924059, 15148.772768408482, 15832.92083539598, 16634.833651663328, 277007.0, 279825.0, 280077.0, 280291.0, 280306.0, 52575.47424525782, 52782.20826687603, 52860.0, 52862.73568632209, 52910.0, 1350.3180893648644, 1394.7001394699985, 1484.0, 1533.6472611299241, 1535.869451096647, 30751.846240768653, 30775.0, 31029.0, 31502.212444689067, 32017.359652807278, 42726.78636606797, 43848.780756097294, 47141.52858471371, 47955.280670790664, 47983.76008119937, 209927.0, 210938.0, 212532.0, 212927.0, 213368.0, 32779.836100819346, 33116.1720956978, 33158.66841331556, 33159.0, 33174.17064573405, 44057.339139913565, 44165.558344416146, 44591.9869499489, 45597.0, 48095.27857082077, 39659.80170099131, 39673.0, 40555.1888962225, 40822.59177408188, 42262.0, 37961.24077518379, 38130.809345953094, 39453.0, 39578.60421395749, 41476.58523414848, 39345.40981885331, 39956.80021599874, 40025.39961900632, 40154.39768403535, 40300.79849600733, 34159.14602134967, 36035.27929441449, 36154.8192259037, 36890.26219475649, 36971.26057478889, 29101.417971640025, 29360.41279174447, 29382.70617293885, 29400.852995734884, 29644.851775740983], "unit": "score", "name": "ext.html", "value": 19326.293918487227}, {"lowerIsBetter": false, "replicates": [387.88751262133985, 391.3523119237661, 391.43633168237733, 392.62504308385496, 394.91311911379506, 14653.044739951834, 14923.253837308146, 16640.167991600418, 18142.90928545357, 18148.274069037237, 17213.483595492125, 17371.13144342781, 17778.377756778515, 18190.363337283197, 18262.908685456554, 6006.159137720711, 6203.945329294031, 6206.503479721611, 6229.221347331583, 6230.065490176487, 4584.541545845422, 4742.264948932921, 6069.848253793646, 6704.932950670504, 6993.965030174867, 6672.799816005528, 6858.074159988388, 6870.209925858515, 7006.894896576556, 7013.754518591851, 6587.604743715345, 6784.8303792405095, 6814.2845001274645, 6864.24493305736, 6917.204521480044, 6529.967350163266, 6540.738370465176, 6546.901796473009, 6547.3125321841, 6548.967255163694, 21571.46071348213, 21609.45976350588, 22302.776972230233, 22395.776042239533, 22476.0, 2420.6248031555137, 2426.296374051523, 2453.7914277286454, 2547.3758929062496, 2598.1555994301925, 13761.587152385444, 13945.930270348685, 14074.71850562983, 14479.05886117399, 14513.27433628325, 1956.6380219659409, 2049.108637742587, 2089.320970684518, 2102.747670279561, 2111.2610586294827, 68154.0, 69288.6535567324, 69688.0, 70169.0, 70277.2972270281, 14831.555053348417, 15195.924020379827, 15228.46700365482, 15296.541103766906, 15325.31036103378, 22958.65562016571, 23099.0, 23270.0, 23367.298981030595, 23369.649455258186, 8830.911690883137, 9338.95330523343, 9477.526123693788, 9595.712128636153, 9604.0, 8283.83432331362, 8338.583070846433, 8355.665773369119, 8421.747347579583, 8440.831183376298, 6902.792916212522, 7221.097362829646, 7602.973598564123, 7747.457677962601, 7767.067951845815, 2706.3775331673824, 2933.858283453091, 2976.4939960206384, 3038.118945505823, 3082.660907300195, 485.6284942019358, 489.87263311539255, 506.9949300506948, 975.205207755691, 1077.1705786544317, 11592.188546801812, 12145.0, 12180.939095304468, 12379.328790613332, 12433.191842530206, 486.6374550959558, 487.26666367117264, 503.6147347279334, 525.2148038682194, 537.2103008577385, 6612.462332652008, 6728.153604828977, 6785.728570857111, 6880.174379074543, 6887.965560172267, 611848.0, 621923.0, 623591.0, 637069.0, 658717.0, 81542.59228703819, 81959.0, 82154.17845821465, 83259.16740832635, 84991.0, 509.53377659441935, 515.6107139109948, 516.5041560102344, 517.3429744224813, 518.2692403710749, 10817.18871084656, 11294.830577541508, 15586.142762147738, 15658.0, 15938.36246550125, 31563.84218078895, 32004.679953201103, 32950.18773967455, 34969.475457867644, 35127.0, 43643.345349819145, 44324.77837610791, 44730.77634611806, 44798.10403791971, 46035.53964460446, 7963.442559020813, 8124.918750812652, 8149.307308878811, 8179.10029896699, 8294.046184688597, 9990.0, 10682.89317106819, 11729.824052639047, 11762.58830940913, 11798.292102473879, 10045.899541004788, 10522.579096836042, 10774.622888199188, 10844.728881777703, 11193.66419007431, 10565.366078035342, 10738.624148154777, 10893.455327233765, 10938.726531836768, 10995.285306455055, 10514.684559463229, 10954.56181752721, 10954.726131846768, 11016.339019658846, 11303.648388314154, 7423.480356375002, 7468.887966680395, 7532.209118042746, 7542.094948605983, 7985.800354991172, 7830.843383132419, 10132.936041715513, 10189.643362482277, 10425.270231083752, 10429.530671119666], "unit": "score", "name": "jquery.html", "value": 8846.309237346819}, {"lowerIsBetter": false, "replicates": [1399.4961813747043, 1492.2315007770999, 1500.5198336532308, 1736.9044702541364, 1914.0429785107456, 7412.0, 8084.838303233932, 8208.83582328353, 8209.384296177788, 8221.260086592205, 8017.278444939954, 8272.545010024447, 8306.335493160548, 8311.376646751487, 8312.750617481484, 2156.5902478529106, 2212.6017316882953, 2215.3464727905225, 2436.707595088592, 2468.0127948820436, 2442.3649851038767, 2500.2624225853324, 2500.312414086132, 2500.362407586063, 2501.687289088864, 2370.182287110944, 2446.9510609787794, 2459.5080983803223, 2461.6676748638884, 2462.0890270599903, 2413.6741539892155, 2433.8783060846977, 2475.9504809903883, 2476.0590975429222, 2480.1567467061286, 2424.8908799104083, 2450.497647982177, 2455.484348286862, 2493.1897133431526, 2498.25052484254, 8425.410221284512, 8444.57777111142, 8468.576571171418, 8473.0, 8503.319734421231, 4983.6013118950395, 5123.974380128076, 5151.793928242866, 5165.302684137631, 5172.896542069175, 3229.1442767666585, 3255.4140254754134, 3273.4271502486968, 3388.508666243381, 3391.1352605085544, 1058.2116323339085, 1103.7682086761708, 1111.1943840715498, 1124.8987591116756, 1141.4578075414195, 11922.10584206188, 11942.104342174285, 11959.103067269902, 11996.400179990966, 12001.219920705125, 4548.95451045492, 4555.749433781108, 4563.110193512233, 4606.976965115153, 4639.814407423665, 10090.0, 10098.697039088838, 10100.393976361294, 10101.949490252502, 10104.494775261208, 5131.87170320745, 5153.768080436389, 5167.457416971239, 5168.043911876315, 5168.534831865075, 4660.021395506914, 4713.787879545429, 4714.269288260325, 4717.551832575899, 4718.646101542398, 3436.106612280825, 3448.6723761242642, 3636.4908912752235, 3719.925601487955, 3898.5321761388814, 1238.8079847623633, 1243.042857000123, 1254.3163975633302, 1256.0391300655006, 1258.0627432562799, 1042.4422933730418, 1042.5412818359898, 1067.5196161727254, 1089.9509522071526, 1091.8034753744403, 7781.41639377049, 7857.646405911633, 7861.449698521163, 7881.5665138417935, 7897.17079706634, 1191.7259030423052, 1194.0507296699145, 1205.2587658589905, 1208.474313673555, 1221.2306247064294, 6102.115193296947, 6146.877062458815, 6212.223472065992, 6217.285012223561, 6233.501319894488, 10130.138938190335, 10383.84424233637, 10462.947685261524, 10624.575016999388, 10630.043296103388, 10091.7477063074, 10180.440075795903, 10236.795264094826, 10237.18102551794, 10352.637657681946, 8032.59837008159, 8085.595720213966, 8128.75613731589, 8135.186481351936, 8145.674173033012, 7688.308052275322, 7724.227577242231, 7751.883721744066, 7793.493422927491, 7809.960950195213, 9006.909930900607, 9022.188003079491, 9217.170454659114, 9422.104900034486, 9432.056794320513, 9299.72100836976, 9627.518624068909, 9696.369735967139, 9712.0, 9719.46542940145, 6986.825329366807, 7431.219721929119, 7486.850262994601, 7503.212162722835, 7506.924930750841, 7327.596982165819, 7462.10454745434, 7653.349465295512, 7840.451168418384, 7886.0536735592095, 7323.194448610755, 7368.336849683555, 7379.0, 7396.9260307396235, 7480.102387713509, 7376.225496323023, 7377.3360397564475, 7419.258074192753, 7476.5887876167335, 7482.850342993001, 7271.3455788979245, 7299.5620262784405, 7348.889766653398, 7358.0, 7360.631968401452, 6977.79066628002, 6992.475564332593, 7015.684294206875, 7018.859622807413, 7019.333163349474, 7041.859162816612, 7077.363037326665, 7124.750633727795, 7131.358177764027, 7136.821579460555], "unit": "score", "name": "mootools.html", "value": 4811.502396292718}, {"lowerIsBetter": false, "replicates": [364.95802982656994, 369.61190749712813, 377.30764047972, 381.0929986631817, 390.660125690649, 5929.525637948965, 5960.582759206857, 5966.5226781857455, 5969.880602387955, 5987.880242395149, 5938.7624495020145, 5945.227120474332, 5946.464818166364, 5969.731362088705, 5981.820545383645, 4508.5716856898625, 4637.1189474, 4662.020975595112, 4671.04243630055, 4674.6494012949, 4646.814127434898, 4666.789994450258, 4676.97661511692, 4677.766111694419, 4678.438587369504, 4381.474223093233, 4481.215787237236, 4493.146302202587, 4629.328747331635, 4636.79134438951, 4548.204064288736, 4567.246404343279, 4577.038821847416, 4580.541945805426, 4588.862334129998, 3998.3802510610903, 4002.3796311571755, 4004.4794176756836, 4006.8597599084183, 4009.1380353224195, 5487.890242195173, 5515.393306736256, 5593.972030139864, 5599.160125981095, 5622.269105016363, 5325.547328477084, 5328.0, 5329.546988505982, 5332.440093790135, 5336.332958380202, 6180.227471566054, 6210.50315974721, 6243.094751261087, 6247.625142491465, 6251.874962500725, 4381.255186618282, 4508.436445444319, 4509.368688383629, 4529.750863702495, 4540.6594505411895, 6510.0, 6550.181227346582, 6563.081168636395, 6567.047778072153, 6569.835754106138, 4503.392042074343, 4505.7071290366675, 4506.932396014063, 4508.616767574793, 4510.391097201836, 4558.97720511402, 4568.474625418119, 4569.383133276965, 4571.245744452194, 4573.405457290531, 5150.150225212873, 5262.6317157539315, 5270.894582108336, 5275.498827611371, 5280.366356037223, 6322.9051564226575, 6330.68346582669, 6331.778387756406, 6331.810045698637, 6334.144890439824, 1639.8032236131742, 1660.8173100958884, 1664.342584679045, 1664.459050808492, 1665.1341302522621, 1121.1927412263158, 1130.0, 1135.432283858071, 1139.2594813371375, 1163.7265242667966, 6108.869859076085, 6115.052166914135, 6117.327094019654, 6122.265328160649, 6122.7857025004805, 6556.573822701509, 6569.113169722026, 6580.967095164589, 6583.275839657634, 6595.142631457976, 5987.191729116514, 6099.9085013724825, 6118.1128736332985, 6120.326764055951, 6121.908171377433, 3519.964800352015, 3557.6975957043423, 3560.483729859208, 3561.679448849616, 3566.3937130687327, 6461.61230326182, 6636.004599310142, 6690.130283063268, 6739.629320387426, 6759.087523184406, 6785.558938668971, 6812.420944219797, 6813.523053386215, 6823.351781580742, 6829.726810927507, 6790.49071319653, 6801.081853949752, 6808.046873437624, 6811.557248778912, 6817.284185160586, 6475.320091390525, 6607.108040414482, 6614.735410583715, 6614.933850661624, 6631.038499417654, 6516.771912983023, 6533.281339052605, 6533.314002029909, 6538.901916471352, 6539.476841852736, 6794.082798822095, 6795.762148324785, 6797.388235058868, 6798.320167983162, 6801.489888258301, 4539.387182730289, 4609.792559334771, 4643.442786865598, 4655.9301610475195, 4675.438947326343, 6584.868302633825, 6586.1438013058, 6591.044298576584, 6593.076969224217, 6603.9339606605245, 6436.710348034256, 6439.066335381437, 6441.516886233458, 6451.0, 6452.709628066655, 6231.813045608639, 6389.552731308764, 6406.487481001602, 6408.583442076437, 6441.967790161019, 6300.716467759054, 6306.621602703853, 6307.90538141919, 6309.05364195356, 6315.400036996478, 6463.515236357198, 6465.515086368635, 6465.547411681137, 6472.579282346633, 6480.157579514633, 6096.451319381277, 6220.7511699531515, 6242.219722534684, 6251.593646412968, 6294.0], "unit": "score", "name": "prototype.html", "value": 4830.9011717962485}, {"lowerIsBetter": false, "replicates": [861.8965724113106, 868.496272162146, 887.3921363865749, 918.0910898210765, 920.364948185752, 13974.301284935751, 14226.28868556572, 14232.0, 14261.0, 14268.357923893424, 13152.73694526109, 13160.144590601603, 13212.0, 13229.14010589311, 13235.470581176742, 751.6091632351174, 761.733393312339, 878.8989266234385, 884.2174675412242, 892.1970226795871, 895.789489469974, 902.7697937026082, 902.8194361127768, 903.2322525853006, 904.7557159566913, 919.3518569408584, 919.7286800393866, 926.703454894434, 926.7312479381005, 926.9582868770888, 780.6096951524238, 791.3194652598761, 907.2787134228304, 916.8670542771328, 921.1985572551856, 678.0168755304828, 679.7213142611555, 680.571240118722, 682.9009793579953, 683.9863202735967, 12608.558700445441, 12612.369381530887, 12656.240625562496, 12656.873431265662, 12666.936665316614, 13286.402111904987, 13785.793213101811, 13943.511977080854, 14127.858721412756, 14161.362738676784, 10932.125429965583, 10991.395473248967, 11165.330080195214, 11207.66377008691, 11291.604793832177, 3778.5843557208686, 3874.9418758718643, 3878.049877779962, 3894.4547763313158, 3912.8043597819997, 52277.0, 54007.0, 54511.727441362935, 54601.180982285296, 54832.9999999996, 10975.670729878117, 11055.0, 11085.445727713583, 11199.60801371948, 11360.715982100513, 19704.211831526864, 19735.013249337477, 19756.802431975782, 19768.505787355432, 19773.30793422252, 7845.960770196112, 8006.759797206093, 8087.110417854032, 8217.30152937007, 8289.0467596226, 4563.817447302071, 4678.859634210911, 4688.507706690816, 4761.142994261067, 4784.497627749106, 3240.1737556922835, 3261.4944683574086, 3276.639569647337, 3278.49183376577, 3279.3441311737747, 563.1215304125577, 582.8076734677546, 583.6556431705314, 594.5184400635499, 596.4542443663998, 619.6344156947423, 631.5957787016313, 675.6182756742425, 684.2302409788988, 706.86569551785, 9411.43531388119, 9631.325807193429, 9638.0, 9690.079442452956, 9704.563294651758, 676.3067855448205, 708.1602772880683, 726.6475759256756, 729.941604671625, 730.521508411991, 4432.13573353193, 4710.3405523226775, 4772.832950846704, 4845.830395936126, 4878.634102442331, 63964.36035639677, 64257.357426426075, 64263.35736642667, 65054.0, 65107.34892651013, 56780.43219567752, 56976.0, 57686.42313576894, 57709.0, 57941.130883036785, 49878.25182622264, 51197.232041519404, 51230.74384628053, 51874.22188667173, 52610.21084683656, 9412.0, 9442.244620430212, 9525.04749525042, 9532.761680958032, 9552.761180970532, 35277.647223527434, 35673.46489802707, 35688.286234275685, 35933.46099808453, 36287.27425451529, 44625.776871115435, 46079.3088103672, 49592.504074958786, 49816.0, 50249.0, 11938.64184074479, 12083.818742718691, 12169.0, 12221.57224497174, 12223.0, 13129.474821007052, 13348.733025339245, 13491.460341586228, 13554.186748795104, 13788.86211137916, 12277.20198187115, 12312.13815032939, 12375.504979800708, 12928.0, 13368.799468007794, 12383.071269654632, 12545.247285162919, 12578.685532861751, 12913.806292905427, 12939.676508087374, 12552.497900083894, 12567.560135395217, 12579.68550786201, 12726.0, 12822.551210707581, 10424.739381515523, 10602.310849794738, 10722.678319650424, 10872.782544349227, 10879.891201087888, 10696.62561810333, 10844.891551084704, 10875.50240906689, 10972.451377430936, 11156.609518666808], "unit": "score", "name": "yui.html", "value": 6840.340841600789}], "name": "dromaeo_css", "value": 7257.684790878247}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 111.0, 107.0, 109.0, 111.0, 109.0, 100.0, 111.0, 111.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.0}, {"lowerIsBetter": true, "replicates": [150.0, 126.0, 151.0, 157.0, 123.0, 150.0, 146.0, 137.0, 169.0, 122.0], "unit": "score", "name": "audio-beat-detection", "value": 143.1}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 160.0, 163.0, 163.0, 159.0, 160.0, 163.0, 159.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.9}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 73.0, 158.0, 83.0, 73.0, 76.0, 73.0, 144.0, 76.0], "unit": "score", "name": "audio-fft", "value": 90.0}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 142.0, 101.0, 95.0, 95.0, 148.0, 94.0, 94.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 109.5}, {"lowerIsBetter": true, "replicates": [108.0, 109.0, 109.0, 109.0, 110.0, 109.0, 110.0, 108.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.0}, {"lowerIsBetter": true, "replicates": [145.0, 147.0, 147.0, 147.0, 145.0, 146.0, 146.0, 145.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.9}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [53.0, 53.0, 54.0, 54.0, 52.0, 53.0, 53.0, 53.0, 50.0, 51.0], "unit": "score", "name": "json-parse-financial", "value": 52.6}, {"lowerIsBetter": true, "replicates": [63.0, 63.0, 63.0, 64.0, 64.0, 65.0, 65.0, 63.0, 65.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 63.9}, {"lowerIsBetter": true, "replicates": [79.0, 80.0, 81.0, 82.0, 80.0, 81.0, 80.0, 81.0, 81.0, 79.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.4}, {"lowerIsBetter": true, "replicates": [111.0, 111.0, 123.0, 117.0, 111.0, 126.0, 113.0, 109.0, 111.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.0}, {"lowerIsBetter": true, "replicates": [134.0, 139.0, 136.0, 135.0, 134.0, 127.0, 134.0, 136.0, 136.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 134.7}, {"lowerIsBetter": true, "replicates": [67.0, 65.0, 65.0, 67.0, 67.0, 65.0, 66.0, 68.0, 64.0, 63.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.7}], "name": "kraken", "value": 1475.5000000000002}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.25103906899417], "unit": "score", "name": "Richards", "value": 212.3415300000001}, {"lowerIsBetter": false, "replicates": [170.35775127768312], "unit": "score", "name": "DeltaBlue", "value": 388.1126600000002}, {"lowerIsBetter": false, "replicates": [279.4857462269424], "unit": "score", "name": "Encrypt", "value": 952.3956179999999}, {"lowerIsBetter": false, "replicates": [5240.837696335078], "unit": "score", "name": "Decrypt", "value": 50.78978121878119}, {"lowerIsBetter": false, "replicates": [1001.001001001001], "unit": "score", "name": "RayTrace", "value": 739.2490110000002}, {"lowerIsBetter": false, "replicates": [568.5048322910744], "unit": "score", "name": "Earley", "value": 1172.3084170000006}, {"lowerIsBetter": false, "replicates": [11122.222222222223], "unit": "score", "name": "Boyer", "value": 59.92174825174829}, {"lowerIsBetter": false, "replicates": [40800.0], "unit": "score", "name": "RegExp", "value": 22.328063725490182}, {"lowerIsBetter": false, "replicates": [494.0711462450593], "unit": "score", "name": "Splay", "value": 164.93778400000005}, {"lowerIsBetter": false, "replicates": [4822.115384615385], "unit": "score", "name": "NavierStokes", "value": 307.7487537387835}], "name": "v8_7", "value": 21846.534729725856}]} 03:53:05 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,35]]", "result": "21846.53"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,35]]", "result": "1475.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,35]]", "result": "7257.68"}}} 03:53:05 INFO - Return code: 0 03:53:05 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 03:53:05 INFO - # TBPL SUCCESS # 03:53:05 INFO - Running post-action listener: _resource_record_post_action 03:53:05 INFO - Running post-run listener: _resource_record_post_run 03:53:06 INFO - Total resource usage - Wall time: 1231s; CPU: 13.0%; Read bytes: 294912; Write bytes: 507117568; Read time: 924; Write time: 1662324 03:53:06 INFO - install - Wall time: 17s; CPU: 17.0%; Read bytes: 8192; Write bytes: 249905152; Read time: 244; Write time: 984544 03:53:07 INFO - run-tests - Wall time: 1214s; CPU: 13.0%; Read bytes: 286720; Write bytes: 257212416; Read time: 680; Write time: 677780 03:53:07 INFO - Running post-run listener: _upload_blobber_files 03:53:07 INFO - Blob upload gear active. 03:53:07 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 03:53:07 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 03:53:07 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'] 03:53:07 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 03:53:07 INFO - (blobuploader) - INFO - Open directory for files ... 03:53:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:53:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:53:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:53:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:53:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:53:08 INFO - (blobuploader) - INFO - Done attempting. 03:53:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 03:53:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:53:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:53:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:53:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:53:09 INFO - (blobuploader) - INFO - Done attempting. 03:53:09 INFO - (blobuploader) - INFO - Iteration through files over. 03:53:09 INFO - Return code: 0 03:53:09 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 03:53:09 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 03:53:09 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/cb19717430c79e5d2dc4c513f0ddf5031f84313000d0b840368af0b93939b2482036604990087d2930a4674e21e586be95a885786b24a267d346889cb16f6829", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05d72590e088cf273e56ad5f78c0beb8b08e9a108fc35bbafd774b4ffdb231d23903eb5fc0d761f3a003e95ea07e0592162d2d8898e8b666719f04af8fbc6323"} 03:53:09 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 03:53:09 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 03:53:09 INFO - Contents: 03:53:09 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/cb19717430c79e5d2dc4c513f0ddf5031f84313000d0b840368af0b93939b2482036604990087d2930a4674e21e586be95a885786b24a267d346889cb16f6829", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05d72590e088cf273e56ad5f78c0beb8b08e9a108fc35bbafd774b4ffdb231d23903eb5fc0d761f3a003e95ea07e0592162d2d8898e8b666719f04af8fbc6323"} 03:53:09 INFO - Running post-run listener: copy_logs_to_upload_dir 03:53:09 INFO - Copying logs to upload dir... 03:53:09 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 03:53:09 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.800285 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-02-21 03:53:08.496020) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-21 03:53:08.501488) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test-pgo/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 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/cb19717430c79e5d2dc4c513f0ddf5031f84313000d0b840368af0b93939b2482036604990087d2930a4674e21e586be95a885786b24a267d346889cb16f6829", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05d72590e088cf273e56ad5f78c0beb8b08e9a108fc35bbafd774b4ffdb231d23903eb5fc0d761f3a003e95ea07e0592162d2d8898e8b666719f04af8fbc6323"} build_url:https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011395 build_url: 'https://queue.taskcluster.net/v1/task/X6mVC_jQRayqIQCLuUaqaw/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/cb19717430c79e5d2dc4c513f0ddf5031f84313000d0b840368af0b93939b2482036604990087d2930a4674e21e586be95a885786b24a267d346889cb16f6829", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05d72590e088cf273e56ad5f78c0beb8b08e9a108fc35bbafd774b4ffdb231d23903eb5fc0d761f3a003e95ea07e0592162d2d8898e8b666719f04af8fbc6323"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-21 03:53:08.529378) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:53:08.529964) ========= rm -f oauth.txt in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8783db0840cc980e80bb0bd400000236-1456029851.646545-151641076 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004506 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-21 03:53:08.612097) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-21 03:53:08.612439) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-21 03:53:08.612747) ========= ========= Total master_lag: 0.32 =========