builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-064 starttime: 1454427555.81 results: success (0) buildid: 20160202020519 builduid: e403483cfa1f4d9d984784d58ad6a945 revision: 820774173b754a27bb29abe534a73ff675240db9 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.809256) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.809723) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.810012) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006354 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.864169) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.864514) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.968653) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:15.968905) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004519 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.037772) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.038047) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.038457) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.038737) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-02 07:39:16-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-02-02 07:39:16 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.144591 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.203525) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.204055) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016325 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.259396) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.259711) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 820774173b754a27bb29abe534a73ff675240db9 --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 820774173b754a27bb29abe534a73ff675240db9 --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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-02 07:39:16,786 truncating revision to first 12 chars 2016-02-02 07:39:16,786 Setting DEBUG logging. 2016-02-02 07:39:16,786 attempt 1/10 2016-02-02 07:39:16,787 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/820774173b75?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-02 07:39:17,042 unpacking tar archive at: mozilla-aurora-820774173b75/testing/mozharness/ program finished with exit code 0 elapsedTime=0.514521 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.788055) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.788411) ========= echo 820774173b754a27bb29abe534a73ff675240db9 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'820774173b754a27bb29abe534a73ff675240db9'] 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 820774173b754a27bb29abe534a73ff675240db9 program finished with exit code 0 elapsedTime=0.003594 script_repo_revision: '820774173b754a27bb29abe534a73ff675240db9' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.836095) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.836417) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-02 07:39:16.852648) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 29 secs) (at 2016-02-02 07:39:16.853026) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:39:17 INFO - MultiFileLogger online at 20160202 07:39:17 in /builds/slave/test-pgo 07:39:17 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 07:39:17 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:39:17 INFO - {'append_to_log': False, 07:39:17 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:39:17 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 07:39:17 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:39:17 INFO - 'branch': 'Mozilla-Aurora', 07:39:17 INFO - 'buildbot_json_path': 'buildprops.json', 07:39:17 INFO - 'config_files': ('talos/linux_config.py',), 07:39:17 INFO - 'default_actions': ('clobber', 07:39:17 INFO - 'read-buildbot-config', 07:39:17 INFO - 'download-and-extract', 07:39:17 INFO - 'populate-webroot', 07:39:17 INFO - 'create-virtualenv', 07:39:17 INFO - 'install', 07:39:17 INFO - 'run-tests'), 07:39:17 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:39:17 INFO - 'download_minidump_stackwalk': True, 07:39:17 INFO - 'download_symbols': 'ondemand', 07:39:17 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:39:17 INFO - 'tooltool.py': '/tools/tooltool.py', 07:39:17 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:39:17 INFO - '/tools/misc-python/virtualenv.py')}, 07:39:17 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:39:17 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:39:17 INFO - 'installer_path': 'installer.exe', 07:39:17 INFO - 'log_level': 'info', 07:39:17 INFO - 'log_name': 'talos', 07:39:17 INFO - 'log_to_console': True, 07:39:17 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:39:17 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:39:17 INFO - 'opt_config_files': (), 07:39:17 INFO - 'pip_index': False, 07:39:17 INFO - 'sps_profile': False, 07:39:17 INFO - 'sps_profile_interval': 0, 07:39:17 INFO - 'suite': 'dromaeojs-e10s', 07:39:17 INFO - 'system_bits': '32', 07:39:17 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:39:17 INFO - 'title': 'talos-linux64-ix-064', 07:39:17 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:39:17 INFO - 'use_talos_json': True, 07:39:17 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:39:17 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:39:17 INFO - 'work_dir': 'build'} 07:39:17 INFO - ##### 07:39:17 INFO - ##### Running clobber step. 07:39:17 INFO - ##### 07:39:17 INFO - Running pre-action listener: _resource_record_pre_action 07:39:17 INFO - Running main action method: clobber 07:39:17 INFO - rmtree: /builds/slave/test-pgo/build 07:39:17 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:39:17 INFO - Running post-action listener: _resource_record_post_action 07:39:17 INFO - ##### 07:39:17 INFO - ##### Running read-buildbot-config step. 07:39:17 INFO - ##### 07:39:17 INFO - Running pre-action listener: _resource_record_pre_action 07:39:17 INFO - Running main action method: read_buildbot_config 07:39:17 INFO - Using buildbot properties: 07:39:17 INFO - { 07:39:17 INFO - "project": "", 07:39:17 INFO - "product": "firefox", 07:39:17 INFO - "script_repo_revision": "production", 07:39:17 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 07:39:17 INFO - "repository": "", 07:39:17 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 07:39:17 INFO - "buildid": "20160202020519", 07:39:17 INFO - "pgo_build": "True", 07:39:17 INFO - "basedir": "/builds/slave/test-pgo", 07:39:17 INFO - "buildnumber": 34, 07:39:17 INFO - "slavename": "talos-linux64-ix-064", 07:39:17 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:39:17 INFO - "platform": "ubuntu64_hw", 07:39:17 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 07:39:17 INFO - "branch": "mozilla-aurora", 07:39:17 INFO - "repo_path": "releases/mozilla-aurora", 07:39:17 INFO - "revision": "820774173b754a27bb29abe534a73ff675240db9", 07:39:17 INFO - "stage_platform": "linux64-pgo", 07:39:17 INFO - "builduid": "e403483cfa1f4d9d984784d58ad6a945", 07:39:17 INFO - "slavebuilddir": "test" 07:39:17 INFO - } 07:39:17 INFO - Found installer url https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2. 07:39:17 INFO - Running post-action listener: _resource_record_post_action 07:39:17 INFO - ##### 07:39:17 INFO - ##### Running download-and-extract step. 07:39:17 INFO - ##### 07:39:17 INFO - Running pre-action listener: _resource_record_pre_action 07:39:17 INFO - Running main action method: download_and_extract 07:39:17 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:39:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:17 INFO - https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 07:39:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/test_packages.json 07:39:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/test_packages.json 07:39:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 07:39:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 07:39:28 INFO - Downloaded 1448 bytes. 07:39:28 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 07:39:28 INFO - Using the following test package requirements: 07:39:28 INFO - {u'common': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 07:39:28 INFO - u'cppunittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 07:39:28 INFO - u'gtest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.gtest.tests.zip'], 07:39:28 INFO - u'jittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'jsshell-linux-x86_64.zip'], 07:39:28 INFO - u'mochitest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 07:39:28 INFO - u'mozbase': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 07:39:28 INFO - u'reftest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.reftest.tests.zip'], 07:39:28 INFO - u'talos': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'], 07:39:28 INFO - u'web-platform': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 07:39:28 INFO - u'webapprt': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 07:39:28 INFO - u'xpcshell': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 07:39:28 INFO - u'firefox-46.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 07:39:28 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:39:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:28 INFO - https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:39:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 07:39:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 07:39:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:30 INFO - Downloaded 22399439 bytes. 07:39:30 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'] 07:39:30 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 07:39:31 INFO - Return code: 0 07:39:31 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 07:39: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')]} 07:39:31 INFO - https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:39:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 07:39:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 07:39:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:44 INFO - Downloaded 22399439 bytes. 07:39:44 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'] 07:39:44 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 07:39:46 INFO - Return code: 0 07:39:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:46 INFO - https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:39:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 07:39:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 07:39:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:47 INFO - Downloaded 10706572 bytes. 07:39:47 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'] 07:39:47 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 07:39:47 INFO - Return code: 0 07:39:47 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')]} 07:39:47 INFO - https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:39:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 07:39:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 07:39:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/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 07:39:49 INFO - Downloaded 59576914 bytes. 07:39:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 07:39:49 INFO - mkdir: /builds/slave/test-pgo/properties 07:39:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:39:49 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:39:49 INFO - Contents: 07:39:49 INFO - build_url:https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 07:39:49 INFO - Running post-action listener: _resource_record_post_action 07:39:49 INFO - Running post-action listener: set_extra_try_arguments 07:39:49 INFO - ##### 07:39:49 INFO - ##### Running populate-webroot step. 07:39:49 INFO - ##### 07:39:49 INFO - Running pre-action listener: _resource_record_pre_action 07:39:49 INFO - Running main action method: populate_webroot 07:39:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:39:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:39:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:39:49 INFO - '--tppagecycles', 07:39:49 INFO - '7'], 07:39:49 INFO - 'tests': ['tsvgm']}}, 07:39:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:39:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:39:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:39:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:39:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:39:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:39:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'tests': ['damp', 'tps']}, 07:39:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['damp', 'tps']}, 07:39:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:39:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:39:49 INFO - 'other': {'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'other_l64': {'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'other_nol64': {'tests': ['a11yr', 07:39:49 INFO - 'ts_paint', 07:39:49 INFO - 'tpaint', 07:39:49 INFO - 'sessionrestore', 07:39:49 INFO - 'sessionrestore_no_auto_restore']}, 07:39:49 INFO - 'svgr': {'tests': ['tsvgx', 07:39:49 INFO - 'tsvgr_opacity', 07:39:49 INFO - 'tart', 07:39:49 INFO - 'tscrollx', 07:39:49 INFO - 'cart']}, 07:39:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['tsvgx', 07:39:49 INFO - 'tsvgr_opacity', 07:39:49 INFO - 'tart', 07:39:49 INFO - 'tscrollx', 07:39:49 INFO - 'cart']}, 07:39:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'tests': ['tp5o']}, 07:39:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'talos_options': ['--e10s'], 07:39:49 INFO - 'tests': ['tp5o']}, 07:39:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'talos_options': ['--xperf_path', 07:39:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:39:49 INFO - 'tests': ['tp5n']}, 07:39:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:39:49 INFO - 'talos_options': ['--e10s', 07:39:49 INFO - '--xperf_path', 07:39:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:39:49 INFO - 'tests': ['tp5n']}}, 07:39:49 INFO - 'talos.zip': {'path': '', 07:39:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:39:49 INFO - Running post-action listener: _resource_record_post_action 07:39:49 INFO - ##### 07:39:49 INFO - ##### Running create-virtualenv step. 07:39:49 INFO - ##### 07:39:49 INFO - Running pre-action listener: _resource_record_pre_action 07:39:49 INFO - Running main action method: create_virtualenv 07:39:49 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:39:49 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 07:39:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:39:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:39:49 INFO - Using real prefix '/usr' 07:39:49 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:39:49 INFO - Installing distribute.............................................................................................................................................................................................done. 07:39:51 INFO - Installing pip.................done. 07:39:51 INFO - Return code: 0 07:39:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:39:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:39:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:39:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:51 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:39:51 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 07:39:51 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 07:39:51 INFO - Using env: {'DISPLAY': ':0', 07:39:51 INFO - 'HOME': '/home/cltbld', 07:39:51 INFO - 'LANG': 'en_US.UTF-8', 07:39:51 INFO - 'LANGUAGE': 'en_US:en', 07:39:51 INFO - 'LOGNAME': 'cltbld', 07:39:51 INFO - 'MAIL': '/var/mail/cltbld', 07:39:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:39:51 INFO - 'MOZ_NO_REMOTE': '1', 07:39:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:39:51 INFO - 'NO_EM_RESTART': '1', 07:39:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:39:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:39:51 INFO - 'PWD': '/builds/slave/test-pgo', 07:39:51 INFO - 'SHELL': '/bin/bash', 07:39:51 INFO - 'SHLVL': '1', 07:39:51 INFO - 'TERM': 'linux', 07:39:51 INFO - 'TMOUT': '86400', 07:39:51 INFO - 'USER': 'cltbld', 07:39:51 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:39:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:39:51 INFO - '_': '/tools/buildbot/bin/python'} 07:39:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:39:51 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 07:39:51 INFO - Cleaning up... 07:39:51 INFO - Return code: 0 07:39:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:39:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:39:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:39:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:51 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:39:51 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 07:39:51 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 07:39:51 INFO - Using env: {'DISPLAY': ':0', 07:39:51 INFO - 'HOME': '/home/cltbld', 07:39:51 INFO - 'LANG': 'en_US.UTF-8', 07:39:51 INFO - 'LANGUAGE': 'en_US:en', 07:39:51 INFO - 'LOGNAME': 'cltbld', 07:39:51 INFO - 'MAIL': '/var/mail/cltbld', 07:39:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:39:51 INFO - 'MOZ_NO_REMOTE': '1', 07:39:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:39:51 INFO - 'NO_EM_RESTART': '1', 07:39:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:39:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:39:51 INFO - 'PWD': '/builds/slave/test-pgo', 07:39:51 INFO - 'SHELL': '/bin/bash', 07:39:51 INFO - 'SHLVL': '1', 07:39:51 INFO - 'TERM': 'linux', 07:39:51 INFO - 'TMOUT': '86400', 07:39:51 INFO - 'USER': 'cltbld', 07:39:51 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:39:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:39:51 INFO - '_': '/tools/buildbot/bin/python'} 07:39:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:39:52 INFO - Downloading/unpacking psutil>=0.7.1 07:39:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:39:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:39:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:39:54 INFO - Installing collected packages: psutil 07:39:54 INFO - Running setup.py install for psutil 07:39:54 INFO - building 'psutil._psutil_linux' extension 07:39:54 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 07:39:54 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 07:39:54 INFO - building 'psutil._psutil_posix' extension 07:39:54 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 07:39:54 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 07:39:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:39:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:39:54 INFO - Successfully installed psutil 07:39:54 INFO - Cleaning up... 07:39:54 INFO - Return code: 0 07:39:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:39:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:39:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:39:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:54 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:39:54 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 07:39:54 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 07:39:54 INFO - Using env: {'DISPLAY': ':0', 07:39:54 INFO - 'HOME': '/home/cltbld', 07:39:54 INFO - 'LANG': 'en_US.UTF-8', 07:39:54 INFO - 'LANGUAGE': 'en_US:en', 07:39:54 INFO - 'LOGNAME': 'cltbld', 07:39:54 INFO - 'MAIL': '/var/mail/cltbld', 07:39:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:39:54 INFO - 'MOZ_NO_REMOTE': '1', 07:39:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:39:54 INFO - 'NO_EM_RESTART': '1', 07:39:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:39:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:39:54 INFO - 'PWD': '/builds/slave/test-pgo', 07:39:54 INFO - 'SHELL': '/bin/bash', 07:39:54 INFO - 'SHLVL': '1', 07:39:54 INFO - 'TERM': 'linux', 07:39:54 INFO - 'TMOUT': '86400', 07:39:54 INFO - 'USER': 'cltbld', 07:39:54 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:39:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:39:54 INFO - '_': '/tools/buildbot/bin/python'} 07:39:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:39:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:39:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:39:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:39:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:39:56 INFO - Installing collected packages: mozsystemmonitor 07:39:56 INFO - Running setup.py install for mozsystemmonitor 07:39:56 INFO - Successfully installed mozsystemmonitor 07:39:56 INFO - Cleaning up... 07:39:56 INFO - Return code: 0 07:39:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:39:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:39:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:39:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:39:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:39:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:39:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 07:39:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:39:56 INFO - Using env: {'DISPLAY': ':0', 07:39:56 INFO - 'HOME': '/home/cltbld', 07:39:56 INFO - 'LANG': 'en_US.UTF-8', 07:39:56 INFO - 'LANGUAGE': 'en_US:en', 07:39:56 INFO - 'LOGNAME': 'cltbld', 07:39:56 INFO - 'MAIL': '/var/mail/cltbld', 07:39:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:39:56 INFO - 'MOZ_NO_REMOTE': '1', 07:39:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:39:56 INFO - 'NO_EM_RESTART': '1', 07:39:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:39:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:39:56 INFO - 'PWD': '/builds/slave/test-pgo', 07:39:56 INFO - 'SHELL': '/bin/bash', 07:39:56 INFO - 'SHLVL': '1', 07:39:56 INFO - 'TERM': 'linux', 07:39:56 INFO - 'TMOUT': '86400', 07:39:56 INFO - 'USER': 'cltbld', 07:39:56 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:39:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:39:56 INFO - '_': '/tools/buildbot/bin/python'} 07:39:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:39:56 INFO - Downloading/unpacking blobuploader==1.2.4 07:39:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:58 INFO - Downloading blobuploader-1.2.4.tar.gz 07:39:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:39:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:39:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:39:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:39:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:39:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:39:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:39:59 INFO - Downloading docopt-0.6.1.tar.gz 07:39:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:39:59 INFO - Installing collected packages: blobuploader, requests, docopt 07:39:59 INFO - Running setup.py install for blobuploader 07:39:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:39:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:39:59 INFO - Running setup.py install for requests 07:39:59 INFO - Running setup.py install for docopt 07:40:00 INFO - Successfully installed blobuploader requests docopt 07:40:00 INFO - Cleaning up... 07:40:00 INFO - Return code: 0 07:40:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:40: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')]} 07:40:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:40:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40: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')]} 07:40:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:40:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:00 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:40:00 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 07:40:00 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 07:40:00 INFO - Using env: {'DISPLAY': ':0', 07:40:00 INFO - 'HOME': '/home/cltbld', 07:40:00 INFO - 'LANG': 'en_US.UTF-8', 07:40:00 INFO - 'LANGUAGE': 'en_US:en', 07:40:00 INFO - 'LOGNAME': 'cltbld', 07:40:00 INFO - 'MAIL': '/var/mail/cltbld', 07:40:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:00 INFO - 'MOZ_NO_REMOTE': '1', 07:40:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:00 INFO - 'NO_EM_RESTART': '1', 07:40:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:00 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:00 INFO - 'SHELL': '/bin/bash', 07:40:00 INFO - 'SHLVL': '1', 07:40:00 INFO - 'TERM': 'linux', 07:40:00 INFO - 'TMOUT': '86400', 07:40:00 INFO - 'USER': 'cltbld', 07:40:00 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:00 INFO - '_': '/tools/buildbot/bin/python'} 07:40:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:40:00 INFO - Running setup.py (path:/tmp/pip-exaExj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:40:00 INFO - Running setup.py (path:/tmp/pip-SuBp5s-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:40:00 INFO - Running setup.py (path:/tmp/pip-WkyWcw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:40:00 INFO - Running setup.py (path:/tmp/pip-WOM247-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:40:00 INFO - Running setup.py (path:/tmp/pip-073jat-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:40:00 INFO - Running setup.py (path:/tmp/pip-wFG7Vt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:40:00 INFO - Running setup.py (path:/tmp/pip-Zy4Lef-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:40:00 INFO - Running setup.py (path:/tmp/pip-uYN5es-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:40:00 INFO - Running setup.py (path:/tmp/pip-su5oXI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:40:00 INFO - Running setup.py (path:/tmp/pip-0rN650-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:40:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:40:00 INFO - Running setup.py (path:/tmp/pip-_Ygdpp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:40:01 INFO - Running setup.py (path:/tmp/pip-MPdsll-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:40:01 INFO - Running setup.py (path:/tmp/pip-XnQQDq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:40:01 INFO - Running setup.py (path:/tmp/pip-zQyRVQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:40:01 INFO - Running setup.py (path:/tmp/pip-f2mg6H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:40:01 INFO - Running setup.py (path:/tmp/pip-2pGYBY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:40:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:40:01 INFO - Running setup.py (path:/tmp/pip-Q_SG3Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:40:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:40:01 INFO - Running setup.py install for manifestparser 07:40:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:40:01 INFO - Running setup.py install for mozcrash 07:40:01 INFO - Running setup.py install for mozdebug 07:40:01 INFO - Running setup.py install for mozdevice 07:40:01 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:40:01 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:40:01 INFO - Running setup.py install for mozfile 07:40:02 INFO - Running setup.py install for mozhttpd 07:40:02 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozinfo 07:40:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozInstall 07:40:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozleak 07:40:02 INFO - Running setup.py install for mozlog 07:40:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for moznetwork 07:40:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozprocess 07:40:02 INFO - Running setup.py install for mozprofile 07:40:02 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozrunner 07:40:02 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:40:02 INFO - Running setup.py install for mozscreenshot 07:40:03 INFO - Running setup.py install for moztest 07:40:03 INFO - Running setup.py install for mozversion 07:40:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:40:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:40:03 INFO - Cleaning up... 07:40:03 INFO - Return code: 0 07:40:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:40: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')]} 07:40:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:40:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40: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')]} 07:40:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:40:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:03 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:40:03 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 07:40:03 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 07:40:03 INFO - Using env: {'DISPLAY': ':0', 07:40:03 INFO - 'HOME': '/home/cltbld', 07:40:03 INFO - 'LANG': 'en_US.UTF-8', 07:40:03 INFO - 'LANGUAGE': 'en_US:en', 07:40:03 INFO - 'LOGNAME': 'cltbld', 07:40:03 INFO - 'MAIL': '/var/mail/cltbld', 07:40:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:03 INFO - 'MOZ_NO_REMOTE': '1', 07:40:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:03 INFO - 'NO_EM_RESTART': '1', 07:40:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:03 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:03 INFO - 'SHELL': '/bin/bash', 07:40:03 INFO - 'SHLVL': '1', 07:40:03 INFO - 'TERM': 'linux', 07:40:03 INFO - 'TMOUT': '86400', 07:40:03 INFO - 'USER': 'cltbld', 07:40:03 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:03 INFO - '_': '/tools/buildbot/bin/python'} 07:40:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:40:03 INFO - Running setup.py (path:/tmp/pip-IJw6r8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:40:03 INFO - Running setup.py (path:/tmp/pip-fFxnuJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:40:03 INFO - Running setup.py (path:/tmp/pip-aOilbd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:40:03 INFO - Running setup.py (path:/tmp/pip-xahx65-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:40:03 INFO - Running setup.py (path:/tmp/pip-T689Qz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:40:03 INFO - Running setup.py (path:/tmp/pip-nJoBkT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:40:03 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)) 07:40:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:40:03 INFO - Running setup.py (path:/tmp/pip-3Ro2uL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:40:04 INFO - Running setup.py (path:/tmp/pip-9pAHwI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:40:04 INFO - Running setup.py (path:/tmp/pip-8IQwaU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:40:04 INFO - Running setup.py (path:/tmp/pip-zf9B31-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:40:04 INFO - Running setup.py (path:/tmp/pip-T5vkL4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:40:04 INFO - Running setup.py (path:/tmp/pip-f3qjhk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:40:04 INFO - Running setup.py (path:/tmp/pip-BkUUvl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:40:04 INFO - Running setup.py (path:/tmp/pip-KGqXth-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:40:04 INFO - Running setup.py (path:/tmp/pip-Q31w9I-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:40:04 INFO - Running setup.py (path:/tmp/pip-6rjq77-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:40:04 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)) 07:40:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:40:04 INFO - Running setup.py (path:/tmp/pip-mNfOqm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:40:04 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)) 07:40:04 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)) 07:40:04 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)) 07:40:04 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)) 07:40:04 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)) 07:40:04 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)) 07:40:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:40:04 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 07:40:04 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 07:40:04 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 07:40:04 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 07:40:04 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 07:40:04 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 07:40:06 INFO - Downloading blessings-1.6.tar.gz 07:40:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:40:06 INFO - Installing collected packages: blessings 07:40:06 INFO - Running setup.py install for blessings 07:40:06 INFO - Successfully installed blessings 07:40:06 INFO - Cleaning up... 07:40:06 INFO - Return code: 0 07:40:06 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:40:06 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:40:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:40:06 INFO - Reading from file tmpfile_stdout 07:40:06 INFO - Current package versions: 07:40:06 INFO - argparse == 1.2.1 07:40:06 INFO - blessings == 1.6 07:40:06 INFO - blobuploader == 1.2.4 07:40:06 INFO - docopt == 0.6.1 07:40:06 INFO - manifestparser == 1.1 07:40:06 INFO - mozInstall == 1.12 07:40:06 INFO - mozcrash == 0.16 07:40:06 INFO - mozdebug == 0.1 07:40:06 INFO - mozdevice == 0.48 07:40:06 INFO - mozfile == 1.2 07:40:06 INFO - mozhttpd == 0.7 07:40:06 INFO - mozinfo == 0.9 07:40:06 INFO - mozleak == 0.1 07:40:06 INFO - mozlog == 3.1 07:40:06 INFO - moznetwork == 0.27 07:40:06 INFO - mozprocess == 0.22 07:40:06 INFO - mozprofile == 0.28 07:40:06 INFO - mozrunner == 6.11 07:40:06 INFO - mozscreenshot == 0.1 07:40:06 INFO - mozsystemmonitor == 0.0 07:40:06 INFO - moztest == 0.7 07:40:06 INFO - mozversion == 1.4 07:40:06 INFO - psutil == 3.1.1 07:40:06 INFO - requests == 1.2.3 07:40:06 INFO - wsgiref == 0.1.2 07:40:06 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:40:06 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')]} 07:40:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:40:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:06 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')]} 07:40:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:40:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:06 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:40:06 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 07:40:06 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 07:40:06 INFO - Using env: {'DISPLAY': ':0', 07:40:06 INFO - 'HOME': '/home/cltbld', 07:40:06 INFO - 'LANG': 'en_US.UTF-8', 07:40:06 INFO - 'LANGUAGE': 'en_US:en', 07:40:06 INFO - 'LOGNAME': 'cltbld', 07:40:06 INFO - 'MAIL': '/var/mail/cltbld', 07:40:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:06 INFO - 'MOZ_NO_REMOTE': '1', 07:40:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:06 INFO - 'NO_EM_RESTART': '1', 07:40:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:06 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:06 INFO - 'SHELL': '/bin/bash', 07:40:06 INFO - 'SHLVL': '1', 07:40:06 INFO - 'TERM': 'linux', 07:40:06 INFO - 'TMOUT': '86400', 07:40:06 INFO - 'USER': 'cltbld', 07:40:06 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:06 INFO - '_': '/tools/buildbot/bin/python'} 07:40:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 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)) 07:40:07 INFO - Cleaning up... 07:40:07 INFO - Return code: 0 07:40:07 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 07:40: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')]} 07:40:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:40:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40: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')]} 07:40:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:40:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:07 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:40:07 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 07:40:07 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 07:40:07 INFO - Using env: {'DISPLAY': ':0', 07:40:07 INFO - 'HOME': '/home/cltbld', 07:40:07 INFO - 'LANG': 'en_US.UTF-8', 07:40:07 INFO - 'LANGUAGE': 'en_US:en', 07:40:07 INFO - 'LOGNAME': 'cltbld', 07:40:07 INFO - 'MAIL': '/var/mail/cltbld', 07:40:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:07 INFO - 'MOZ_NO_REMOTE': '1', 07:40:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:07 INFO - 'NO_EM_RESTART': '1', 07:40:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:07 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:07 INFO - 'SHELL': '/bin/bash', 07:40:07 INFO - 'SHLVL': '1', 07:40:07 INFO - 'TERM': 'linux', 07:40:07 INFO - 'TMOUT': '86400', 07:40:07 INFO - 'USER': 'cltbld', 07:40:07 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:07 INFO - '_': '/tools/buildbot/bin/python'} 07:40:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:40:07 INFO - Downloading/unpacking jsonschema 07:40:07 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 07:40:07 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 07:40:07 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 07:40:07 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 07:40:07 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 07:40:07 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 07:40:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:40:09 INFO - Downloading/unpacking functools32 (from jsonschema) 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 INFO - Downloading functools32-3.2.3-2.tar.gz 07:40:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 07:40:09 INFO - warning: no files found matching '*.txt' 07:40:09 INFO - no previously-included directories found matching 'build' 07:40:09 INFO - no previously-included directories found matching 'dist' 07:40:09 INFO - no previously-included directories found matching '.git*' 07:40:09 INFO - Installing collected packages: jsonschema, functools32 07:40:09 INFO - Running setup.py install for functools32 07:40:09 INFO - warning: no files found matching '*.txt' 07:40:09 INFO - no previously-included directories found matching 'build' 07:40:09 INFO - no previously-included directories found matching 'dist' 07:40:09 INFO - no previously-included directories found matching '.git*' 07:40:09 INFO - Successfully installed jsonschema functools32 07:40:09 INFO - Cleaning up... 07:40:09 INFO - Return code: 0 07:40:09 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 07:40:09 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')]} 07:40:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:40:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:09 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')]} 07:40:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:40:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:40:09 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 0x7fe61484ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x114a230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', '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 07:40:09 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 07:40:09 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 07:40:09 INFO - Using env: {'DISPLAY': ':0', 07:40:09 INFO - 'HOME': '/home/cltbld', 07:40:09 INFO - 'LANG': 'en_US.UTF-8', 07:40:09 INFO - 'LANGUAGE': 'en_US:en', 07:40:09 INFO - 'LOGNAME': 'cltbld', 07:40:09 INFO - 'MAIL': '/var/mail/cltbld', 07:40:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:09 INFO - 'MOZ_NO_REMOTE': '1', 07:40:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:09 INFO - 'NO_EM_RESTART': '1', 07:40:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:09 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:09 INFO - 'SHELL': '/bin/bash', 07:40:09 INFO - 'SHLVL': '1', 07:40:09 INFO - 'TERM': 'linux', 07:40:09 INFO - 'TMOUT': '86400', 07:40:09 INFO - 'USER': 'cltbld', 07:40:09 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:09 INFO - '_': '/tools/buildbot/bin/python'} 07:40:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:40:09 INFO - Downloading/unpacking flake8 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:09 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 07:40:11 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:40:11 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:40:11 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:11 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 07:40:12 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:40: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 07:40: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 07:40: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 07:40: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 07:40: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 07:40: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 07:40:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 07:40:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:40:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:40:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:40:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:40:12 INFO - no previously-included directories found matching 'docs/_build' 07:40:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:40:12 INFO - Running setup.py install for pep8 07:40:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:40:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:40:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:40:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:40:12 INFO - no previously-included directories found matching 'docs/_build' 07:40:12 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 07:40:12 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:40:12 INFO - Cleaning up... 07:40:12 INFO - Return code: 0 07:40:12 INFO - Running post-action listener: _resource_record_post_action 07:40:12 INFO - Running post-action listener: _start_resource_monitoring 07:40:12 INFO - Starting resource monitoring. 07:40:12 INFO - ##### 07:40:12 INFO - ##### Running install step. 07:40:12 INFO - ##### 07:40:12 INFO - Running pre-action listener: _resource_record_pre_action 07:40:12 INFO - Running main action method: install 07:40:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:40:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:40:12 INFO - Reading from file tmpfile_stdout 07:40:12 INFO - Detecting whether we're running mozinstall >=1.0... 07:40:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:40:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:40:12 INFO - Reading from file tmpfile_stdout 07:40:12 INFO - Output received: 07:40:12 INFO - Usage: mozinstall [options] installer 07:40:12 INFO - Options: 07:40:12 INFO - -h, --help show this help message and exit 07:40:12 INFO - -d DEST, --destination=DEST 07:40:12 INFO - Directory to install application into. [default: 07:40:12 INFO - "/builds/slave/test-pgo"] 07:40:12 INFO - --app=APP Application being installed. [default: firefox] 07:40:12 INFO - mkdir: /builds/slave/test-pgo/build/application 07:40:12 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'] 07:40:12 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 07:40:27 INFO - Reading from file tmpfile_stdout 07:40:27 INFO - Output received: 07:40:27 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:40:27 INFO - Running post-action listener: _resource_record_post_action 07:40:27 INFO - ##### 07:40:27 INFO - ##### Running run-tests step. 07:40:27 INFO - ##### 07:40:27 INFO - Running pre-action listener: _resource_record_pre_action 07:40:27 INFO - Running main action method: run_tests 07:40:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:40:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:40:27 INFO - Python 2.7.3 07:40:27 INFO - Return code: 0 07:40:27 INFO - grabbing minidump binary from tooltool 07:40:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:40:27 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 0x11dc7f0>, '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 0x11482d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1148760>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:40:27 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 07:40:27 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 07:40:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:40:28 INFO - Return code: 0 07:40:28 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:40:28 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:40:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:40:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:40:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:40:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 07:40:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 07:40:29 INFO - Return code: 0 07:40:29 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 07:40:29 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-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-064 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 07:40:29 INFO - Using env: {'DISPLAY': ':0', 07:40:29 INFO - 'HOME': '/home/cltbld', 07:40:29 INFO - 'LANG': 'en_US.UTF-8', 07:40:29 INFO - 'LANGUAGE': 'en_US:en', 07:40:29 INFO - 'LOGNAME': 'cltbld', 07:40:29 INFO - 'MAIL': '/var/mail/cltbld', 07:40:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:40:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:40:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:40:29 INFO - 'MOZ_NO_REMOTE': '1', 07:40:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:40:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:40:29 INFO - 'NO_EM_RESTART': '1', 07:40:29 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:40:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:40:29 INFO - 'PWD': '/builds/slave/test-pgo', 07:40:29 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:40:29 INFO - 'SHELL': '/bin/bash', 07:40:29 INFO - 'SHLVL': '1', 07:40:29 INFO - 'TERM': 'linux', 07:40:29 INFO - 'TMOUT': '86400', 07:40:29 INFO - 'USER': 'cltbld', 07:40:29 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318', 07:40:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:40:29 INFO - '_': '/tools/buildbot/bin/python'} 07:40:29 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 07:40:29 INFO - mozversion application_buildid: 20160202020519 07:40:29 INFO - mozversion application_changeset: 820774173b754a27bb29abe534a73ff675240db9 07:40:29 INFO - mozversion application_display_name: FirefoxDeveloperEdition 07:40:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:40:29 INFO - mozversion application_name: Firefox 07:40:29 INFO - mozversion application_remotingname: firefox-dev 07:40:29 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:40:29 INFO - mozversion application_vendor: Mozilla 07:40:29 INFO - mozversion application_version: 46.0a2 07:40:29 INFO - mozversion platform_buildid: 20160202020519 07:40:29 INFO - mozversion platform_changeset: 820774173b754a27bb29abe534a73ff675240db9 07:40:29 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:40:29 INFO - mozversion platform_version: 46.0a2 07:40:29 INFO - using testdate: 1454427629 07:40:29 INFO - actual date: 1454427629 07:40:29 INFO - starting webserver on 'localhost:37170' 07:40:29 INFO - SUITE-START | Running 3 tests 07:40:29 INFO - TEST-START | dromaeo_css 07:40:29 INFO - operating with platform_type : linux_ 07:40:29 INFO - Initialising browser for dromaeo_css test... 07:40:29 INFO - TEST-INFO | started process 14936 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmppZhse7/profile http://localhost:37170/getInfo.html) 07:40:33 INFO - PROCESS | 14936 | 07:40:33 INFO - PROCESS | 14936 | (process:15013): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:40:34 INFO - PROCESS | 14936 | __metrics Screen width/height:1600/1200 07:40:34 INFO - PROCESS | 14936 | colorDepth:24 07:40:34 INFO - PROCESS | 14936 | Browser inner width/height: 1024/697 07:40:34 INFO - PROCESS | 14936 | __metrics 07:40:35 INFO - TEST-INFO | 14936: exit 0 07:40:35 INFO - Browser initialized. 07:40:35 INFO - Running cycle 1/1 for dromaeo_css test... 07:40:35 INFO - TEST-INFO | started process 15062 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmppZhse7/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:40:36 INFO - PROCESS | 15062 | 07:40:36 INFO - PROCESS | 15062 | (process:15126): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:40:47 INFO - PROCESS | 15062 | RSS: Main: 140750848 07:40:47 INFO - PROCESS | 15062 | 07:41:36 INFO - PROCESS | 15062 | 1454427696901 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] 07:43:44 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-dojo.html (next: http://localhost:37170/tests/dromaeo/cssquery-ext.html) 07:43:45 INFO - PROCESS | 15062 | RSS: Main: 144900096 07:43:45 INFO - PROCESS | 15062 | 07:46:47 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-ext.html (next: http://localhost:37170/tests/dromaeo/cssquery-jquery.html) 07:46:48 INFO - PROCESS | 15062 | RSS: Main: 143794176 07:46:48 INFO - PROCESS | 15062 | 07:49:49 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-jquery.html (next: http://localhost:37170/tests/dromaeo/cssquery-mootools.html) 07:49:50 INFO - PROCESS | 15062 | RSS: Main: 143175680 07:49:50 INFO - PROCESS | 15062 | 07:52:51 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-mootools.html (next: http://localhost:37170/tests/dromaeo/cssquery-prototype.html) 07:52:52 INFO - PROCESS | 15062 | RSS: Main: 143216640 07:52:52 INFO - PROCESS | 15062 | 07:55:54 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-prototype.html (next: http://localhost:37170/tests/dromaeo/cssquery-yui.html) 07:55:55 INFO - PROCESS | 15062 | RSS: Main: 142458880 07:55:55 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | Cycle 1(1): loaded http://localhost:37170/tests/dromaeo/cssquery-yui.html (next: http://localhost:37170/tests/dromaeo/cssquery-dojo.html) 07:58:57 INFO - PROCESS | 15062 | RSS: Main: 146341888 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | __start_tp_report 07:58:57 INFO - PROCESS | 15062 | _x_x_mozilla_page_load 07:58:57 INFO - PROCESS | 15062 | _x_x_mozilla_page_load_details 07:58:57 INFO - PROCESS | 15062 | |i|pagename|runs| 07:58:57 INFO - PROCESS | 15062 | |0;dojo.html;3362.7141692956097;3370.8483118259683;3396.1509622594353;3414.6756058174474;3421.0421082097023;5564.777408903639;5565.2486914266565;5573.386927437979;5599.440055994399;5610.270664813579;5559.77760889565;5599.076152434844;5608.046632072547;5617.775288988446;5636.577256705753;5045.8486245412605;5079.161938280179;5157.200633901752;5172.172452407615;5181.274621552986;4859.295402166701;4996.375453068366;5027.522385373402;5038.420581633122;5112.565431938289;5051;5144.279800827887;5148.073346797575;5164.1995490699;5173.767180476888;5096.362954630671;5127.820526281581;5131.871703207413;5163.922541161885;5173.301604283449;4877.707337559757;4937.185364414903;4998.325226094467;5059.241113832918;5074.797008119708;5350.170723537858;5360.678359298455;5423.105187644073;5425.13197888336;5426.403095659474;6042.274927008743;6042.9395706042815;6044.455998960115;6054.96972515139;6074;5777.19119323295;5911.261092363455;5981.940180598225;6057.515398768088;6063.545234107415;5640.717964101778;5650.830475085754;5658.066419040853;5663.915041274384;5675.148727690838;5977.462028417463;6102.4507794298725;6115.266168059861;6116.541259405473;6128.969355153285;5827.271591051119;5842.5618078644275;5889.911651325234;5913.940860591425;5937.584369094122;5951.642901425928;5956.910646340309;5957.076653118774;5961.5230781537375;5966.671833049224;5691.8861622768145;5793.507551858139;5832.212651292106;5921.052631579013;5928.584999050025;5966.955782738003;5978.073398623221;6003.789867354709;6031.638101713911;6070.726817293233;4546.181687296253;4554.567316104964;4563.247064234364;4570.451545814523;4584.839530616412;4022;4022.8390864365097;4094.815733292009;4101.446304748881;4103.610157035077;5629.5926018495375;5667.234923285386;5699.686517241592;5709;5709.200711900337;5977.850553736192;6005.489533389624;6008.399160084044;6016.977113890649;6025.0359942409;5499.917501237484;5551.611387202938;5596.244506991504;5610.214569960209;5672.432756724377;5069.9746501267255;5140.40885298188;5200.141976573898;5200.583953283728;5209.6353255272525;6127.111568822495;6160.44555989963;6179.752809887555;6214.9689251553455;6222.502199824004;5735.197072409783;5880.176775251382;6026.54800889935;6048.36492168316;6062.696865156813;5966;6022.819315420545;6136.365905528278;6238.157848690369;6243.937560624336;5884.941150588439;5914.674692891932;5923.339749041367;5947.762089516544;6011;5858.355580886185;6044.395560443921;6062.938985677577;6063.272407311151;6064.757409703562;5767.798127065533;5882.294124705063;5925.318588362394;5951.434613711691;5954.434328738763;5792.739326730223;5819.185314056121;5841.1238314253205;5859.765609375577;5862.443067908542;5632.2678051853;5690.2887139107615;5776.595638305278;5776.797812076557;5796.217510636179;5835.095560188178;5920.3783602722815;5925.40745925404;5936.37668044849;5975.940240597538;5814.680192589448;5820.970895145667;5825.883482330414;5869.236999190078;5880.294364676266 07:58:57 INFO - PROCESS | 15062 | |1;ext.html;538.9568834493241;548.2981783317352;558.4443478738656;586.5864565481336;599.5683108162121;35449.291014179704;35972.2805543889;36012.099697507576;36128.63871361289;36246.81876590614;36520.45219321713;36558.634413655855;36809.815950920274;36963.260734785355;37056.62943370565;8490.999999999985;8684.8697269541;8691.26124279437;8720.171583699539;8752.387332886668;8480.279176270025;8808.119188081173;8849.867251991225;8850.867236991451;8878.60046297915;8775.95612021939;8885.422447540921;8888.06675299094;8889.15553022465;8934.731958041237;8726.301895848317;8784;8796.956015219916;8806.427582207136;8855.64577416909;8796.472211667256;8865.468071915706;8883.156100170538;8891.288696904297;8895.599698013604;38072.428913566044;38108.80945595254;38547.42178867319;38563.8071809642;38569.03577410559;3684.871029513954;3822.827972741233;4197.223513649985;4275.46556680415;4408.118376324715;31473.842630786927;31932.36135277305;32087;32227;32283.19292017695;3691.907702307437;3742.6257374262627;3790.2040571480024;3906.3554513505237;3969.7419667721506;274269;275255;275317;275447.999999998;275604;43500;43987.78006109949;43998.560014400085;44192.779036105254;44256;42556.78721606372;42631.786841065594;42712.14575708468;42718;42947.141057178684;15813.36746530149;15818.841811581968;15960.281787319598;16054.357825686842;16134.35462581507;12047.096467764954;12067;12143.514259429701;12159.088068394729;12480.126391152533;15037.699246015238;15191;15195.848041519665;15299.46451874179;15362;5972.462478376967;6234.189555357865;6290.433860952537;6293.2762732285455;6343.619382837044;1076.8761592416815;1137.6985098948785;1144.1761931409371;1146.3809542846936;1151.3207207747469;30473;30567.541486877715;30907.33186383582;31151;31475.213119672193;1133.7392399748105;1137.5961533655598;1155.664857191405;1203.1998720850536;1342.664333916521;17261.0506422148;17517.824821751874;17557.736633950502;18076.54808629795;18097.18562664683;405324;514082;525257;759850;769968;56284.71857640768;56649.150262746094;56849.715751420976;57013.71493142508;57126.7143664279;1506.0662389318475;1508.4795745467795;1520.2702702702543;1522.5204060720837;1526.900751451152;30289.697103028688;30483.695163048087;30707;31263;31516.52725209078;49078;49911.75044124756;49913.750431249064;50004.24993625171;50062;344200;348083;348652;348858;349161;34575.82712086423;45499;45599.77200113978;46042.53957460383;46425;42435.57564424316;42997;43065.354019689104;43298;43734.781326093165;36266.63733362738;36737.81631091827;37355.81322093481;37704.245915080995;38048.239035219696;36856.44715329326;37251.62748372481;40359;42869.57130428656;45192.77403612961;39493.60506394899;39558.208835822545;42080;42379.364309534765;42880;31786;32572.674273256966;33078.834605826814;33170;33819.3236135271;27300.59049114225;27479.31301717473;27828.165155045383;27843.582346265226;28029.579556306264 07:58:57 INFO - PROCESS | 15062 | |2;jquery.html;371.13710622801983;372.0475582508778;373.5480069116369;377.20598140913376;378.8730775190311;14925.477608283712;16995;17050.23273952672;17672.734908976374;18343.908280458614;11451.885481145207;11662.825057624143;11880.643580692571;11892.7621447571;11947.820782688266;4524.819007239723;5092.3889133303965;5142.382914050319;5236.581073514109;5320.095583750753;4016;4148.94201978495;5245.44922783108;5422.945770542303;5629.493345598895;5457.945420545783;5610.382857885629;5610.495055445009;5613.326400831886;5615.354234263051;5524;5542.91685624716;5576.247206627135;5587.525060369873;5617.719114044281;5358.2498450217;5401.810936617238;5567.220589117486;5601.131824567198;5612.663240205601;20028.1988720451;20343.5931281375;20849;20884.060217290258;20976.37070887876;2210.436338733629;2245.5508898220423;2286.885655717224;2326.3835083702834;2336.1473062332125;10196.38821670702;10272.33229840058;10370.429626370547;12456.564020259339;12661.493540258378;1779.314963738957;1919.0500702152385;1981.197614965941;1999.7500312460943;2017.1527958257568;51996.48003519954;57594.560135996515;58049.70975145097;59515;60141;10444.791104177873;10463.581456741646;10494.108000819862;10552.15582753378;10638.73403164927;13693.931530342485;13738.725225495635;13744.518941837188;13879.791803122962;13908.165510069428;8126.349892008743;8146.877796833052;8171.509709417454;8179.591020448954;8392.664293428317;8178.059523154794;8188.836223275501;8225.136360682161;8236.011678598607;8238.340932725368;4641.559051890065;4661.347411362412;4688.156131896291;4823.252395878644;7804.2195780422635;3192.0104767522143;3271.3457308538386;3320.2529430877858;3335.816530090868;3488.4418493040994;1009.5709323537467;1037.865077539915;1096.9561217551209;1132.4111462039857;1154.6478324111226;17016.57458563521;17434.21546030406;17474.47576572705;17785.46643600694;17968;1042.2860340666668;1048.2033654422694;1085.0126384989621;1104.618906477264;1116.1405717597568;9863.30956833029;9939.950300248453;10084.647037353805;10145.898541014496;10179.236557258235;526884;533650;535905;537781;587199;54784.17823732647;79505.60247198843;79589.20410795818;79684.6015769929;82288.17711822805;1160.158884808507;1165.8367828504017;1189.5895915908998;1192.898603618702;1198.7003249187703;15694.450694225647;15721.371145154524;15864.60338491547;16058.197090145213;16151.111688857225;35564.11089722778;35761.28477430385;35994;36270.09324766902;37381.6261837389;45616.31575526436;45812;47504.762476187396;47584.2862357058;47600.2859957094;7890.526568405914;7979.760607181794;8041.798955026171;8048.114707382067;8072.636731347221;3965.4646622705563;7904.723334683258;8971.205758848126;11627.88372116268;12199.329036903055;10328.690139295833;10394.792104158027;10418;10666.946665266623;10710.518026688973;10385.688429347132;10395.792084158425;10546.57813687444;10551.577936882439;10623.521941512496;11029.83455248156;11127.387993660102;11243.49404276826;11477.713057173638;11482.77034459323;7942.523448593103;8032.59837008159;8298.08721040673;8309.916900831156;8405;9879.703608891745;11287.379194144072;11357.772844542898;11430.657080287605;11581.420928953687 07:58:57 INFO - PROCESS | 15062 | |3;mootools.html;1492.0972811449074;1572.2846105022215;1778.3686791189127;1888.7733471983363;1908.1318000309852;7902.249286317805;8088.474249173814;8108.310793582546;8181.795455113625;8317.667293308275;8233.505989640626;8294.253517183452;8296.543690097042;8332.250227452227;8365.414420990533;2471.480988992314;2474.072222916406;2488.9875550622314;2494.962575561368;2497.725250222474;2457.0785955266774;2526.3557792762913;2527.646129541866;2530.215633153719;2532.15172917073;2111.6832475128776;2145.8283337332978;2384.3204686664303;2459.114718701266;2463.950720985579;2359.6224604063354;2399.9880000599887;2403.9999999999914;2409.361519197414;2414.8068154547595;2374.1334412939327;2383.3803211165223;2414.6619473273754;2417.697787776528;2420.4674971506242;8020.3984701147065;8129.471584347058;8146.063202731643;8153.633086511121;8176;5058.54473097423;5150.948490515084;5159.458256883048;5202.167653175512;5247.763850626731;3294.390537750524;3364.96635033649;3404.3531728971416;3408.7954722716718;3423.760336776427;1131.3099009604134;1133.6825688807148;1142.5886680794906;1149.4425203776161;1182.9645110646609;11255.493502792395;11439.485223164895;11454.198206125575;11482.368469734161;11494.540218391254;4595.149897269016;4639.512851150648;4670.369500117508;4743.430788305425;4749.810007599726;9797.06927841854;9840.261980351503;9910.900890990997;9925.30522863407;9952.154066904393;5153;5186.040582492251;5188.377394712583;5200.60995425337;5202.03762303975;4652.62778977681;4675.766211689402;4679.415073115861;4693.48371679115;4708.764561771898;3923;3935.2916475034194;3968.1468484275442;3972.245273398045;3975.383815508601;1239.1264158768047;1247.5820600098887;1260.1934761752486;1267.5753622536554;1276.8276282701715;1107.5791199344199;1150.9769804603861;1173.2549830857467;1187.038498815962;1236.9010479161645;7743.264389882952;7876.72431464896;7895.684172633145;7900;7908.248716371935;1170.5434880396651;1190.3572071081692;1201.3212534917743;1204.2894692131508;1222.743223922986;6121.510279177655;6150.661713605705;6172.351903050205;6180;6218.657973811484;9528.571214295373;9651.517424128766;9714.12572868431;9730.221582273402;9874;9241.630334786532;9544.61821527145;9547.713568592953;9549.140577348073;9708.174805141642;7633.770986870402;7652;7694.192109828387;7699.961500192463;7729.420293478011;7660.655270512729;7742.1483636798785;7783.649735761791;7827.882581761392;7936.761897143095;8784.209421152127;8884.644614215358;8937.28501719848;8963.148500892405;9017.368784185044;8926.553672316228;8990.32572557074;9063.63745450201;9108.134727200906;9316.114969077928;7446.367058799846;7586.355159811257;7589.734359297398;7598.354139898171;7601.467897247361;7830.530168189927;7965.522068675898;8006.399520035904;8029.3175080118845;8087;7544.547327160388;7616.771496855104;7653.311201991847;7684.731034413769;7695.422843286664;6947.340002699735;7021.648917554;7054;7136.750213742702;7141.82145446368;7150.284971502808;7230.530015548972;7239.746608868664;7242.13094428672;7249.818754531179;6134.079888016833;6163.291221509584;6180.134781130555;6182.845428864314;6189.938100619116;6722.865542689021;6842.0763196969765;6844.452443804584;6865.862682746417;6881.380675739208 07:58:57 INFO - PROCESS | 15062 | |4;prototype.html;349.8373256435757;357.10901301253375;358.5768792824466;358.9910252243694;361.95475565554307;6332.3984221498995;6384.042393640951;6423.197100362443;6467.02994550817;6528.640924749148;6376.42612164905;6402.071699603554;6431.742730290783;6461.160049193598;6461.321561236073;4842.346283251769;4853.174960256756;4867.537583929521;4867.659263851532;4878.048780487807;4883.316335713003;4886.560209581137;4890.388701412324;4892.535209155142;4900.705957642553;4646.326282689008;4659.627229821623;4763.690360126598;4778;4781.115493633689;4770.713757174563;4779.593734532569;4814.66297359185;4814.879628009293;4826.734529600871;4177.4778152730905;4179.728317659373;4187.560306167869;4190.53904070552;4207.453031105937;6096.908546371808;6110.144579758838;6112.724927378279;6119.204503414572;6122.632642041447;5533.474319939599;5651.06757385031;5664.122061080539;5672.092465205547;5696.658200507942;6833.350831670983;6853.862922741567;6854.691538880762;6912.82481978065;6926.515143939926;4654.324443200445;4671.836485723017;4675.906481870344;4677.251639737626;4688.789004494806;7053.470989675743;7087.468439867031;7098.3256590623805;7115.288471152895;7150.427965762727;4699.78850951708;4703.435587729426;4704.647151463654;4716.316134160596;4721.811127554928;4748.881277968078;4770.880727981758;4780.545848144421;4781.880452988634;4782.665213435026;5564.916526252109;5565.220869078333;5605.915911261252;5606.467385598362;5620;6629.613339197885;6829.863402732017;6859.862802744017;6870.931290687129;6881.208661003949;1665.5669525923347;1707.8633709303474;1710.6664200480786;1712.0583678976761;1713.1348668922114;1114.9219554631097;1124.5108377855659;1124.9043831274269;1130.5308297056795;1136.1195073817858;6605.141331626954;6643.302453242437;6645.933540664531;6653.702528006992;6668;7053.4004609608755;7088.503804733722;7114.359707626339;7115.573065615976;7127.002219689248;6485.578437401554;6544.770933017417;6589.472842172615;6621.602703837689;6681.799546013627;3812.694984401241;3828.789416582115;3842.1739326045035;3845.403962385835;3853.4412510185866;7258.709651613876;7307.7807665770115;7321.194668586451;7410.258974102654;7411.370033547101;7172.318629730167;7334.229905859808;7359.59522226272;7383.446241531907;7386.778396648109;7329.083864516935;7378.003969464054;7392.741254056083;7409.259074092655;7410.629468526552;7119.964400177966;7121.786346409616;7153.8180854839775;7156.606386648784;7181.605011724405;6889.173299204128;7026.086608740831;7026.262242464672;7032.894506582303;7068.964655176691;7448.478606497493;7472.551646900986;7477;7478.551286922802;7487.663055162422;4887.560119589254;4904.215325548038;4956.826511072095;4967.3424717775815;4981.1283025469675;7051.788446346618;7115.648026874877;7118.359347658736;7129.893051604334;7130.465215108784;6932.064171337007;6943.201531823905;6946.965265173844;6949.3745562899585;6957.7216911325;6814;6929.376356127973;6946.79159625212;6954.408875245661;7036.331548502884;6851.862962740617;6887.20797108339;6895.827604309932;6904.827379315558;6909.447244220551;7033.261507541634;7073.858522829618;7076.929230707833;7082.858342833011;7101.82245443868;6579.868402632016;6724.529282950147;6751.966240168767;6760.425363843931;6858.5199036067 07:58:57 INFO - PROCESS | 15062 | |5;yui.html;800.7677773445705;810.088650268448;845.5434065604574;861.2205953611981;900.2527901841472;16633.168341582917;16904;17024.744628830576;17032.148392580384;17190.398336058224;15086.39654413822;15189.316480758365;15199;15262.542123736277;15326.693466130671;884.3367474394204;904.9321300902426;910.2308549275851;913.1234015345276;923.3121324613172;898.2185498616213;903.0517956146053;906.3202598051462;906.4515967839461;911.7219248129351;920.2178148573693;932.4871320773582;932.8693982842408;937.8546325319586;940.5814412586402;920.8618707193907;921.709661456639;922.2898368256472;923.6074668265994;935.508857849631;682.7644462660375;683.0096360277618;683.2962049089397;686.9969844027726;698.6402002968475;15387.384504619802;15494.147821869792;15514.224288785515;15527.223638818126;15568.06591604496;13670;13779.724405511934;13841.100328478617;13844.792328115087;13977.720445591132;11229.933156350133;11332.886671133349;11458.656240312721;11594.420278986101;11915.821262681067;3940.8226629801443;3942.4283478895686;3981.422693709425;3982.3429134192825;4048.271311163989;54171;54384;54589.1811622826;54726.452735472536;54752.726236368566;10544.894551054545;11241.100711943025;11374.715632109099;11510.482028308747;11605.30368177912;18850.245990160514;18884.716729249074;19003.809961900202;19005.714914276297;19008.809911900982;8389.07720150783;8431.704890328809;8496.575171241537;8515.148485151436;8650.437721548205;4787.61699064074;4828.058528586892;4864.100141473838;4874.975625121851;4890.535399137077;3276.6068071831533;3309.5366648669205;3313.2710803623163;3317.286783341545;3323.6011678598725;601.1793901324747;607.7690477618477;609.8780243951228;610.1153327674889;615.2033117113349;714.3784907130726;723.5333210079574;727.5489196698081;728.4172661870482;729.6680010595167;9487.705734667028;9719.951400242953;9726.270529710158;9751.90248097524;9816;734.4638413957734;748.8988986486863;760.4182800157884;773.377431167904;783.9764807055798;4058.2513623061072;4122.319817230184;4149.439825623563;4302.225599392077;4409.338599210144;59450.70274648686;61068.694656527325;61390;62656.37343626505;63001.68499157475;55287;55604.72197639067;55872;57125;57261.71369143128;49522.75238623784;50017.74991125094;50209.49790502121;50425;50500.747496263015;9570.521473926416;9681.757956051155;9815.11663950248;9911.355761875455;9941.453220072965;35666.28667426585;36348.818255908554;36431.27137457183;37252.25495490021;37496.43755343727;42390.57609423866;48349.27476087791;48535.71964205398;48623.27065094097;48799;11477.311361318014;11507.252028618113;11956.940215298868;12062.75874482488;12255.264684118982;13532.864671353555;13545.322733863464;13641.658958526115;13673;13729.794053089012;12713.93643031816;12957.611271661865;12963;13000.674983125498;13040.869591303965;12343.13598048128;12580.748385032432;12599.748005039664;12675.366231688564;12722.427490763122;12169.878301217228;12588.055895807667;12627.116101873147;12682.365881705693;12991.935040324737;9563.282753793354;9784.168345690696;9994.550245238835;10079.89920100819;10236.436995964996;10777.946110269399;11112.666620001413;11121.944390277997;11194.384308863091;11275.379854108103 07:58:57 INFO - PROCESS | 15062 | __end_tp_report 07:58:57 INFO - PROCESS | 15062 | __start_cc_report 07:58:57 INFO - PROCESS | 15062 | _x_x_mozilla_cycle_collect,291 07:58:57 INFO - PROCESS | 15062 | __end_cc_report 07:58:57 INFO - PROCESS | 15062 | __startTimestamp1454428737865__endTimestamp 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | ------- Summary: start ------- 07:58:57 INFO - PROCESS | 15062 | Number of tests: 6 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#0] dojo.html Cycles:165 Average:5555.25 Median:5777.19 stddev:616.22 (10.7%) stddev-sans-first:593.62 07:58:57 INFO - PROCESS | 15062 | Values: 3362.7 3370.8 3396.2 3414.7 3421.0 5564.8 5565.2 5573.4 5599.4 5610.3 5559.8 5599.1 5608.0 5617.8 5636.6 5045.8 5079.2 5157.2 5172.2 5181.3 4859.3 4996.4 5027.5 5038.4 5112.6 5051.0 5144.3 5148.1 5164.2 5173.8 5096.4 5127.8 5131.9 5163.9 5173.3 4877.7 4937.2 4998.3 5059.2 5074.8 5350.2 5360.7 5423.1 5425.1 5426.4 6042.3 6042.9 6044.5 6055.0 6074.0 5777.2 5911.3 5981.9 6057.5 6063.5 5640.7 5650.8 5658.1 5663.9 5675.1 5977.5 6102.5 6115.3 6116.5 6129.0 5827.3 5842.6 5889.9 5913.9 5937.6 5951.6 5956.9 5957.1 5961.5 5966.7 5691.9 5793.5 5832.2 5921.1 5928.6 5967.0 5978.1 6003.8 6031.6 6070.7 4546.2 4554.6 4563.2 4570.5 4584.8 4022.0 4022.8 4094.8 4101.4 4103.6 5629.6 5667.2 5699.7 5709.0 5709.2 5977.9 6005.5 6008.4 6017.0 6025.0 5499.9 5551.6 5596.2 5610.2 5672.4 5070.0 5140.4 5200.1 5200.6 5209.6 6127.1 6160.4 6179.8 6215.0 6222.5 5735.2 5880.2 6026.5 6048.4 6062.7 5966.0 6022.8 6136.4 6238.2 6243.9 5884.9 5914.7 5923.3 5947.8 6011.0 5858.4 6044.4 6062.9 6063.3 6064.8 5767.8 5882.3 5925.3 5951.4 5954.4 5792.7 5819.2 5841.1 5859.8 5862.4 5632.3 5690.3 5776.6 5776.8 5796.2 5835.1 5920.4 5925.4 5936.4 5975.9 5814.7 5821.0 5825.9 5869.2 5880.3 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#1] ext.html Cycles:180 Average:55719.88 Median:20919.22 stddev:116771.28 (558.2%) stddev-sans-first:117025.35 07:58:57 INFO - PROCESS | 15062 | Values: 539.0 548.3 558.4 586.6 599.6 35449.3 35972.3 36012.1 36128.6 36246.8 36520.5 36558.6 36809.8 36963.3 37056.6 8491.0 8684.9 8691.3 8720.2 8752.4 8480.3 8808.1 8849.9 8850.9 8878.6 8776.0 8885.4 8888.1 8889.2 8934.7 8726.3 8784.0 8797.0 8806.4 8855.6 8796.5 8865.5 8883.2 8891.3 8895.6 38072.4 38108.8 38547.4 38563.8 38569.0 3684.9 3822.8 4197.2 4275.5 4408.1 31473.8 31932.4 32087.0 32227.0 32283.2 3691.9 3742.6 3790.2 3906.4 3969.7 274269.0 275255.0 275317.0 275448.0 275604.0 43500.0 43987.8 43998.6 44192.8 44256.0 42556.8 42631.8 42712.1 42718.0 42947.1 15813.4 15818.8 15960.3 16054.4 16134.4 12047.1 12067.0 12143.5 12159.1 12480.1 15037.7 15191.0 15195.8 15299.5 15362.0 5972.5 6234.2 6290.4 6293.3 6343.6 1076.9 1137.7 1144.2 1146.4 1151.3 30473.0 30567.5 30907.3 31151.0 31475.2 1133.7 1137.6 1155.7 1203.2 1342.7 17261.1 17517.8 17557.7 18076.5 18097.2 405324.0 514082.0 525257.0 759850.0 769968.0 56284.7 56649.2 56849.7 57013.7 57126.7 1506.1 1508.5 1520.3 1522.5 1526.9 30289.7 30483.7 30707.0 31263.0 31516.5 49078.0 49911.8 49913.8 50004.2 50062.0 344200.0 348083.0 348652.0 348858.0 349161.0 34575.8 45499.0 45599.8 46042.5 46425.0 42435.6 42997.0 43065.4 43298.0 43734.8 36266.6 36737.8 37355.8 37704.2 38048.2 36856.4 37251.6 40359.0 42869.6 45192.8 39493.6 39558.2 42080.0 42379.4 42880.0 31786.0 32572.7 33078.8 33170.0 33819.3 27300.6 27479.3 27828.2 27843.6 28029.6 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#2] jquery.html Cycles:180 Average:28234.24 Median:3295.80 stddev:88997.35 (2700.3%) stddev-sans-first:89222.42 07:58:57 INFO - PROCESS | 15062 | Values: 371.1 372.0 373.5 377.2 378.9 14925.5 16995.0 17050.2 17672.7 18343.9 11451.9 11662.8 11880.6 11892.8 11947.8 4524.8 5092.4 5142.4 5236.6 5320.1 4016.0 4148.9 5245.4 5422.9 5629.5 5457.9 5610.4 5610.5 5613.3 5615.4 5524.0 5542.9 5576.2 5587.5 5617.7 5358.2 5401.8 5567.2 5601.1 5612.7 20028.2 20343.6 20849.0 20884.1 20976.4 2210.4 2245.6 2286.9 2326.4 2336.1 10196.4 10272.3 10370.4 12456.6 12661.5 1779.3 1919.1 1981.2 1999.8 2017.2 51996.5 57594.6 58049.7 59515.0 60141.0 10444.8 10463.6 10494.1 10552.2 10638.7 13693.9 13738.7 13744.5 13879.8 13908.2 8126.3 8146.9 8171.5 8179.6 8392.7 8178.1 8188.8 8225.1 8236.0 8238.3 4641.6 4661.3 4688.2 4823.3 7804.2 3192.0 3271.3 3320.3 3335.8 3488.4 1009.6 1037.9 1097.0 1132.4 1154.6 17016.6 17434.2 17474.5 17785.5 17968.0 1042.3 1048.2 1085.0 1104.6 1116.1 9863.3 9940.0 10084.6 10145.9 10179.2 526884.0 533650.0 535905.0 537781.0 587199.0 54784.2 79505.6 79589.2 79684.6 82288.2 1160.2 1165.8 1189.6 1192.9 1198.7 15694.5 15721.4 15864.6 16058.2 16151.1 35564.1 35761.3 35994.0 36270.1 37381.6 45616.3 45812.0 47504.8 47584.3 47600.3 7890.5 7979.8 8041.8 8048.1 8072.6 3965.5 7904.7 8971.2 11627.9 12199.3 10328.7 10394.8 10418.0 10666.9 10710.5 10385.7 10395.8 10546.6 10551.6 10623.5 11029.8 11127.4 11243.5 11477.7 11482.8 7942.5 8032.6 8298.1 8309.9 8405.0 9879.7 11287.4 11357.8 11430.7 11581.4 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#3] mootools.html Cycles:180 Average:5797.61 Median:6180.07 stddev:2962.30 (47.9%) stddev-sans-first:2952.93 07:58:57 INFO - PROCESS | 15062 | Values: 1492.1 1572.3 1778.4 1888.8 1908.1 7902.2 8088.5 8108.3 8181.8 8317.7 8233.5 8294.3 8296.5 8332.3 8365.4 2471.5 2474.1 2489.0 2495.0 2497.7 2457.1 2526.4 2527.6 2530.2 2532.2 2111.7 2145.8 2384.3 2459.1 2464.0 2359.6 2400.0 2404.0 2409.4 2414.8 2374.1 2383.4 2414.7 2417.7 2420.5 8020.4 8129.5 8146.1 8153.6 8176.0 5058.5 5150.9 5159.5 5202.2 5247.8 3294.4 3365.0 3404.4 3408.8 3423.8 1131.3 1133.7 1142.6 1149.4 1183.0 11255.5 11439.5 11454.2 11482.4 11494.5 4595.1 4639.5 4670.4 4743.4 4749.8 9797.1 9840.3 9910.9 9925.3 9952.2 5153.0 5186.0 5188.4 5200.6 5202.0 4652.6 4675.8 4679.4 4693.5 4708.8 3923.0 3935.3 3968.1 3972.2 3975.4 1239.1 1247.6 1260.2 1267.6 1276.8 1107.6 1151.0 1173.3 1187.0 1236.9 7743.3 7876.7 7895.7 7900.0 7908.2 1170.5 1190.4 1201.3 1204.3 1222.7 6121.5 6150.7 6172.4 6180.0 6218.7 9528.6 9651.5 9714.1 9730.2 9874.0 9241.6 9544.6 9547.7 9549.1 9708.2 7633.8 7652.0 7694.2 7700.0 7729.4 7660.7 7742.1 7783.6 7827.9 7936.8 8784.2 8884.6 8937.3 8963.1 9017.4 8926.6 8990.3 9063.6 9108.1 9316.1 7446.4 7586.4 7589.7 7598.4 7601.5 7830.5 7965.5 8006.4 8029.3 8087.0 7544.5 7616.8 7653.3 7684.7 7695.4 6947.3 7021.6 7054.0 7136.8 7141.8 7150.3 7230.5 7239.7 7242.1 7249.8 6134.1 6163.3 6180.1 6182.8 6189.9 6722.9 6842.1 6844.5 6865.9 6881.4 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#4] prototype.html Cycles:180 Average:5729.93 Median:6536.71 stddev:1767.60 (27.0%) stddev-sans-first:1725.82 07:58:57 INFO - PROCESS | 15062 | Values: 349.8 357.1 358.6 359.0 362.0 6332.4 6384.0 6423.2 6467.0 6528.6 6376.4 6402.1 6431.7 6461.2 6461.3 4842.3 4853.2 4867.5 4867.7 4878.0 4883.3 4886.6 4890.4 4892.5 4900.7 4646.3 4659.6 4763.7 4778.0 4781.1 4770.7 4779.6 4814.7 4814.9 4826.7 4177.5 4179.7 4187.6 4190.5 4207.5 6096.9 6110.1 6112.7 6119.2 6122.6 5533.5 5651.1 5664.1 5672.1 5696.7 6833.4 6853.9 6854.7 6912.8 6926.5 4654.3 4671.8 4675.9 4677.3 4688.8 7053.5 7087.5 7098.3 7115.3 7150.4 4699.8 4703.4 4704.6 4716.3 4721.8 4748.9 4770.9 4780.5 4781.9 4782.7 5564.9 5565.2 5605.9 5606.5 5620.0 6629.6 6829.9 6859.9 6870.9 6881.2 1665.6 1707.9 1710.7 1712.1 1713.1 1114.9 1124.5 1124.9 1130.5 1136.1 6605.1 6643.3 6645.9 6653.7 6668.0 7053.4 7088.5 7114.4 7115.6 7127.0 6485.6 6544.8 6589.5 6621.6 6681.8 3812.7 3828.8 3842.2 3845.4 3853.4 7258.7 7307.8 7321.2 7410.3 7411.4 7172.3 7334.2 7359.6 7383.4 7386.8 7329.1 7378.0 7392.7 7409.3 7410.6 7120.0 7121.8 7153.8 7156.6 7181.6 6889.2 7026.1 7026.3 7032.9 7069.0 7448.5 7472.6 7477.0 7478.6 7487.7 4887.6 4904.2 4956.8 4967.3 4981.1 7051.8 7115.6 7118.4 7129.9 7130.5 6932.1 6943.2 6947.0 6949.4 6957.7 6814.0 6929.4 6946.8 6954.4 7036.3 6851.9 6887.2 6895.8 6904.8 6909.4 7033.3 7073.9 7076.9 7082.9 7101.8 6579.9 6724.5 6752.0 6760.4 6858.5 07:58:57 INFO - PROCESS | 15062 | 07:58:57 INFO - PROCESS | 15062 | [#5] yui.html Cycles:180 Average:15162.24 Median:48442.50 stddev:17277.06 (35.7%) stddev-sans-first:17291.86 07:58:57 INFO - PROCESS | 15062 | Values: 800.8 810.1 845.5 861.2 900.3 16633.2 16904.0 17024.7 17032.1 17190.4 15086.4 15189.3 15199.0 15262.5 15326.7 884.3 904.9 910.2 913.1 923.3 898.2 903.1 906.3 906.5 911.7 920.2 932.5 932.9 937.9 940.6 920.9 921.7 922.3 923.6 935.5 682.8 683.0 683.3 687.0 698.6 15387.4 15494.1 15514.2 15527.2 15568.1 13670.0 13779.7 13841.1 13844.8 13977.7 11229.9 11332.9 11458.7 11594.4 11915.8 3940.8 3942.4 3981.4 3982.3 4048.3 54171.0 54384.0 54589.2 54726.5 54752.7 10544.9 11241.1 11374.7 11510.5 11605.3 18850.2 18884.7 19003.8 19005.7 19008.8 8389.1 8431.7 8496.6 8515.1 8650.4 4787.6 4828.1 4864.1 4875.0 4890.5 3276.6 3309.5 3313.3 3317.3 3323.6 601.2 607.8 609.9 610.1 615.2 714.4 723.5 727.5 728.4 729.7 9487.7 9720.0 9726.3 9751.9 9816.0 734.5 748.9 760.4 773.4 784.0 4058.3 4122.3 4149.4 4302.2 4409.3 59450.7 61068.7 61390.0 62656.4 63001.7 55287.0 55604.7 55872.0 57125.0 57261.7 49522.8 50017.7 50209.5 50425.0 50500.7 9570.5 9681.8 9815.1 9911.4 9941.5 35666.3 36348.8 36431.3 37252.3 37496.4 42390.6 48349.3 48535.7 48623.3 48799.0 11477.3 11507.3 11956.9 12062.8 12255.3 13532.9 13545.3 13641.7 13673.0 13729.8 12713.9 12957.6 12963.0 13000.7 13040.9 12343.1 12580.7 12599.7 12675.4 12722.4 12169.9 12588.1 12627.1 12682.4 12991.9 9563.3 9784.2 9994.6 10079.9 10236.4 10777.9 11112.7 11121.9 11194.4 11275.4 07:58:57 INFO - PROCESS | 15062 | -------- Summary: end -------- 07:58:57 INFO - PROCESS | 15062 | 07:58:58 INFO - TEST-INFO | 15062: exit 0 07:58:58 INFO - TEST-OK | dromaeo_css | took 1109182ms 07:58:58 INFO - TEST-START | kraken 07:58:58 INFO - operating with platform_type : linux_ 07:58:58 INFO - Initialising browser for kraken test... 07:58:58 INFO - TEST-INFO | started process 15305 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLuCRYW/profile http://localhost:37170/getInfo.html) 07:59:02 INFO - PROCESS | 15305 | 07:59:02 INFO - PROCESS | 15305 | (process:15384): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:59:03 INFO - PROCESS | 15305 | __metrics Screen width/height:1600/1200 07:59:03 INFO - PROCESS | 15305 | colorDepth:24 07:59:03 INFO - PROCESS | 15305 | Browser inner width/height: 1024/697 07:59:03 INFO - PROCESS | 15305 | __metrics 07:59:04 INFO - TEST-INFO | 15305: exit 0 07:59:04 INFO - Browser initialized. 07:59:04 INFO - Running cycle 1/1 for kraken test... 07:59:04 INFO - TEST-INFO | started process 15433 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLuCRYW/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:59:05 INFO - PROCESS | 15433 | 07:59:05 INFO - PROCESS | 15433 | (process:15499): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:59:16 INFO - PROCESS | 15433 | RSS: Main: 140206080 07:59:16 INFO - PROCESS | 15433 | 07:59:18 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:37170/tests/kraken/driver.html?testName=audio-beat-detection) 07:59:19 INFO - PROCESS | 15433 | RSS: Main: 145309696 07:59:19 INFO - PROCESS | 15433 | 07:59:22 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:37170/tests/kraken/driver.html?testName=audio-dft) 07:59:22 INFO - PROCESS | 15433 | RSS: Main: 144596992 07:59:22 INFO - PROCESS | 15433 | 07:59:25 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:37170/tests/kraken/driver.html?testName=audio-fft) 07:59:26 INFO - PROCESS | 15433 | RSS: Main: 145567744 07:59:26 INFO - PROCESS | 15433 | 07:59:28 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:37170/tests/kraken/driver.html?testName=audio-oscillator) 07:59:28 INFO - PROCESS | 15433 | RSS: Main: 145260544 07:59:28 INFO - PROCESS | 15433 | 07:59:30 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:37170/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:59:31 INFO - PROCESS | 15433 | RSS: Main: 144732160 07:59:31 INFO - PROCESS | 15433 | 07:59:34 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:37170/tests/kraken/driver.html?testName=imaging-darkroom) 07:59:34 INFO - PROCESS | 15433 | RSS: Main: 146513920 07:59:35 INFO - PROCESS | 15433 | 07:59:38 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:37170/tests/kraken/driver.html?testName=imaging-desaturate) 07:59:38 INFO - PROCESS | 15433 | RSS: Main: 146501632 07:59:38 INFO - PROCESS | 15433 | 07:59:41 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:37170/tests/kraken/driver.html?testName=json-parse-financial) 07:59:42 INFO - PROCESS | 15433 | RSS: Main: 146620416 07:59:42 INFO - PROCESS | 15433 | 07:59:43 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:37170/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:59:44 INFO - PROCESS | 15433 | RSS: Main: 145756160 07:59:44 INFO - PROCESS | 15433 | 07:59:46 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:59:46 INFO - PROCESS | 15433 | RSS: Main: 145289216 07:59:46 INFO - PROCESS | 15433 | 07:59:48 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:59:49 INFO - PROCESS | 15433 | RSS: Main: 146300928 07:59:49 INFO - PROCESS | 15433 | 07:59:51 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:59:52 INFO - PROCESS | 15433 | RSS: Main: 145739776 07:59:52 INFO - PROCESS | 15433 | 07:59:54 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:59:55 INFO - PROCESS | 15433 | RSS: Main: 145793024 07:59:55 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | Cycle 1(1): loaded http://localhost:37170/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:37170/tests/kraken/driver.html?testName=ai-astar) 07:59:57 INFO - PROCESS | 15433 | RSS: Main: 146812928 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | __start_tp_report 07:59:57 INFO - PROCESS | 15433 | _x_x_mozilla_page_load 07:59:57 INFO - PROCESS | 15433 | _x_x_mozilla_page_load_details 07:59:57 INFO - PROCESS | 15433 | |i|pagename|runs| 07:59:57 INFO - PROCESS | 15433 | |0;ai-astar;111;104;113;111;113;120;110;109;110;110 07:59:57 INFO - PROCESS | 15433 | |1;audio-beat-detection;152;126;147;162;128;158;148;127;163;133 07:59:57 INFO - PROCESS | 15433 | |2;audio-dft;162;161;161;165;161;163;162;163;164;163 07:59:57 INFO - PROCESS | 15433 | |3;audio-fft;74;76;74;144;73;76;77;76;165;76 07:59:57 INFO - PROCESS | 15433 | |4;audio-oscillator;96;95;148;95;97;96;136;96;97;138 07:59:57 INFO - PROCESS | 15433 | |5;imaging-gaussian-blur;109;111;110;110;110;110;110;109;109;109 07:59:57 INFO - PROCESS | 15433 | |6;imaging-darkroom;150;148;148;149;147;146;148;147;146;147 07:59:57 INFO - PROCESS | 15433 | |7;imaging-desaturate;95;97;97;96;97;97;98;96;95;98 07:59:57 INFO - PROCESS | 15433 | |8;json-parse-financial;54;55;59;54;54;56;55;63;52;53 07:59:57 INFO - PROCESS | 15433 | |9;json-stringify-tinderbox;64;64;71;64;64;65;65;65;68;65 07:59:57 INFO - PROCESS | 15433 | |10;stanford-crypto-aes;84;81;82;81;81;82;83;82;83;81 07:59:57 INFO - PROCESS | 15433 | |11;stanford-crypto-ccm;116;115;114;118;118;111;116;123;114;118 07:59:57 INFO - PROCESS | 15433 | |12;stanford-crypto-pbkdf2;138;137;136;137;140;141;135;149;140;138 07:59:57 INFO - PROCESS | 15433 | |13;stanford-crypto-sha256-iterative;66;67;64;65;66;70;64;66;63;64 07:59:57 INFO - PROCESS | 15433 | __end_tp_report 07:59:57 INFO - PROCESS | 15433 | __start_cc_report 07:59:57 INFO - PROCESS | 15433 | _x_x_mozilla_cycle_collect,739 07:59:57 INFO - PROCESS | 15433 | __end_cc_report 07:59:57 INFO - PROCESS | 15433 | __startTimestamp1454428797363__endTimestamp 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | ------- Summary: start ------- 07:59:57 INFO - PROCESS | 15433 | Number of tests: 14 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#0] ai-astar Cycles:10 Average:111.10 Median:111.00 stddev:4.01 (3.6%) stddev-sans-first:4.26 07:59:57 INFO - PROCESS | 15433 | Values: 111.0 104.0 113.0 111.0 113.0 120.0 110.0 109.0 110.0 110.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#1] audio-beat-detection Cycles:10 Average:144.40 Median:150.00 stddev:14.75 (9.8%) stddev-sans-first:15.39 07:59:57 INFO - PROCESS | 15433 | Values: 152.0 126.0 147.0 162.0 128.0 158.0 148.0 127.0 163.0 133.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#2] audio-dft Cycles:10 Average:162.50 Median:163.00 stddev:1.35 (0.8%) stddev-sans-first:1.42 07:59:57 INFO - PROCESS | 15433 | Values: 162.0 161.0 161.0 165.0 161.0 163.0 162.0 163.0 164.0 163.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#3] audio-fft Cycles:10 Average:91.10 Median:76.00 stddev:33.80 (44.5%) stddev-sans-first:35.28 07:59:57 INFO - PROCESS | 15433 | Values: 74.0 76.0 74.0 144.0 73.0 76.0 77.0 76.0 165.0 76.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#4] audio-oscillator Cycles:10 Average:109.40 Median:96.00 stddev:21.80 (22.7%) stddev-sans-first:22.57 07:59:57 INFO - PROCESS | 15433 | Values: 96.0 95.0 148.0 95.0 97.0 96.0 136.0 96.0 97.0 138.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#5] imaging-gaussian-blur Cycles:10 Average:109.70 Median:110.00 stddev:0.67 (0.6%) stddev-sans-first:0.67 07:59:57 INFO - PROCESS | 15433 | Values: 109.0 111.0 110.0 110.0 110.0 110.0 110.0 109.0 109.0 109.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:1.26 (0.9%) stddev-sans-first:1.00 07:59:57 INFO - PROCESS | 15433 | Values: 150.0 148.0 148.0 149.0 147.0 146.0 148.0 147.0 146.0 147.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#7] imaging-desaturate Cycles:10 Average:96.60 Median:97.00 stddev:1.07 (1.1%) stddev-sans-first:0.97 07:59:57 INFO - PROCESS | 15433 | Values: 95.0 97.0 97.0 96.0 97.0 97.0 98.0 96.0 95.0 98.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#8] json-parse-financial Cycles:10 Average:55.50 Median:55.00 stddev:3.24 (5.9%) stddev-sans-first:3.39 07:59:57 INFO - PROCESS | 15433 | Values: 54.0 55.0 59.0 54.0 54.0 56.0 55.0 63.0 52.0 53.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#9] json-stringify-tinderbox Cycles:10 Average:65.50 Median:65.00 stddev:2.27 (3.5%) stddev-sans-first:2.35 07:59:57 INFO - PROCESS | 15433 | Values: 64.0 64.0 71.0 64.0 64.0 65.0 65.0 65.0 68.0 65.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#10] stanford-crypto-aes Cycles:10 Average:82.00 Median:82.00 stddev:1.05 (1.3%) stddev-sans-first:0.83 07:59:57 INFO - PROCESS | 15433 | Values: 84.0 81.0 82.0 81.0 81.0 82.0 83.0 82.0 83.0 81.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#11] stanford-crypto-ccm Cycles:10 Average:116.30 Median:117.00 stddev:3.23 (2.8%) stddev-sans-first:3.43 07:59:57 INFO - PROCESS | 15433 | Values: 116.0 115.0 114.0 118.0 118.0 111.0 116.0 123.0 114.0 118.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:139.10 Median:139.00 stddev:3.96 (2.8%) stddev-sans-first:4.18 07:59:57 INFO - PROCESS | 15433 | Values: 138.0 137.0 136.0 137.0 140.0 141.0 135.0 149.0 140.0 138.0 07:59:57 INFO - PROCESS | 15433 | 07:59:57 INFO - PROCESS | 15433 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.50 Median:66.00 stddev:2.01 (3.1%) stddev-sans-first:2.13 07:59:57 INFO - PROCESS | 15433 | Values: 66.0 67.0 64.0 65.0 66.0 70.0 64.0 66.0 63.0 64.0 07:59:57 INFO - PROCESS | 15433 | -------- Summary: end -------- 07:59:57 INFO - PROCESS | 15433 | 07:59:58 INFO - TEST-INFO | 15433: exit 0 07:59:58 INFO - TEST-OK | kraken | took 60038ms 07:59:58 INFO - TEST-START | v8_7 07:59:58 INFO - operating with platform_type : linux_ 07:59:58 INFO - Initialising browser for v8_7 test... 07:59:58 INFO - TEST-INFO | started process 15727 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRK4LVD/profile http://localhost:37170/getInfo.html) 08:00:02 INFO - PROCESS | 15727 | 08:00:02 INFO - PROCESS | 15727 | (process:15807): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:00:03 INFO - PROCESS | 15727 | __metrics Screen width/height:1600/1200 08:00:03 INFO - PROCESS | 15727 | colorDepth:24 08:00:03 INFO - PROCESS | 15727 | Browser inner width/height: 1024/697 08:00:03 INFO - PROCESS | 15727 | __metrics 08:00:04 INFO - TEST-INFO | 15727: exit 0 08:00:04 INFO - Browser initialized. 08:00:04 INFO - Running cycle 1/1 for v8_7 test... 08:00:04 INFO - TEST-INFO | started process 15856 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRK4LVD/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:00:05 INFO - PROCESS | 15856 | 08:00:05 INFO - PROCESS | 15856 | (process:15918): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:00:16 INFO - PROCESS | 15856 | RSS: Main: 140152832 08:00:16 INFO - PROCESS | 15856 | 08:00:38 INFO - PROCESS | 15856 | Cycle 1(1): loaded http://localhost:37170/tests/v8_7/run.html (next: http://localhost:37170/tests/v8_7/run.html) 08:00:39 INFO - PROCESS | 15856 | RSS: Main: 144420864 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | __start_tp_report 08:00:39 INFO - PROCESS | 15856 | _x_x_mozilla_page_load 08:00:39 INFO - PROCESS | 15856 | _x_x_mozilla_page_load_details 08:00:39 INFO - PROCESS | 15856 | |i|pagename|runs| 08:00:39 INFO - PROCESS | 15856 | |0;Richards;166.41704110500916 08:00:39 INFO - PROCESS | 15856 | |1;DeltaBlue;170.44486108743823 08:00:39 INFO - PROCESS | 15856 | |2;Encrypt;279.17364600781684 08:00:39 INFO - PROCESS | 15856 | |3;Decrypt;5263.1578947368425 08:00:39 INFO - PROCESS | 15856 | |4;RayTrace;909.0909090909091 08:00:39 INFO - PROCESS | 15856 | |5;Earley;546.448087431694 08:00:39 INFO - PROCESS | 15856 | |6;Boyer;11133.333333333334 08:00:39 INFO - PROCESS | 15856 | |7;RegExp;39096.153846153844 08:00:39 INFO - PROCESS | 15856 | |8;Splay;505.28434826371415 08:00:39 INFO - PROCESS | 15856 | |9;NavierStokes;4830.917874396136 08:00:39 INFO - PROCESS | 15856 | __end_tp_report 08:00:39 INFO - PROCESS | 15856 | __startTimestamp1454428839003__endTimestamp 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | ------- Summary: start ------- 08:00:39 INFO - PROCESS | 15856 | Number of tests: 10 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#0] Richards Cycles:1 Average:166.42 Median:166.42 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 166.4 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#1] DeltaBlue Cycles:1 Average:170.44 Median:170.44 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 170.4 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#2] Encrypt Cycles:1 Average:279.17 Median:279.17 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 279.2 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#3] Decrypt Cycles:1 Average:5263.16 Median:5263.16 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 5263.2 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#4] RayTrace Cycles:1 Average:909.09 Median:909.09 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 909.1 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#5] Earley Cycles:1 Average:546.45 Median:546.45 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 546.4 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#6] Boyer Cycles:1 Average:11133.33 Median:11133.33 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 11133.3 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#7] RegExp Cycles:1 Average:39096.15 Median:39096.15 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 39096.2 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#8] Splay Cycles:1 Average:505.28 Median:505.28 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 505.3 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - PROCESS | 15856 | [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 08:00:39 INFO - PROCESS | 15856 | Values: 4830.9 08:00:39 INFO - PROCESS | 15856 | -------- Summary: end -------- 08:00:39 INFO - PROCESS | 15856 | 08:00:39 INFO - TEST-INFO | 15856: exit 0 08:00:39 INFO - TEST-OK | v8_7 | took 41408ms 08:00:39 INFO - SUITE-END | took 1210s 08:00:40 INFO - Completed test suite (00:20:10) 08:00:40 INFO - Working with test: dromaeo_css 08:00:40 INFO - Generating results file: dromaeo_css 08:00:40 INFO - Working with test: kraken 08:00:40 INFO - Generating results file: kraken 08:00:40 INFO - javascript benchmark 08:00:40 INFO - Working with test: v8_7 08:00:40 INFO - Generating results file: v8_7 08:00:40 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:00:40 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 08:00:40 INFO - process_Request line: dromaeo_css 7359.56 graph.html#tests=[[72,52,43]] 08:00:40 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:00:40 INFO - process_Request line: kraken 1496.30 graph.html#tests=[[232,52,43]] 08:00:40 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:00:40 INFO - process_Request line: v8_7 22171.38 graph.html#tests=[[230,52,43]] 08:00:40 INFO - RETURN: dromaeo_css: 7359.56 08:00:40 INFO - RETURN: kraken: 1496.30 08:00:40 INFO - RETURN: v8_7: 22171.38 08:00:40 INFO - javascript benchmark 08:00:40 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3362.7141692956097, 3370.8483118259683, 3396.1509622594353, 3414.6756058174474, 3421.0421082097023, 5564.777408903639, 5565.2486914266565, 5573.386927437979, 5599.440055994399, 5610.270664813579, 5559.77760889565, 5599.076152434844, 5608.046632072547, 5617.775288988446, 5636.577256705753, 5045.8486245412605, 5079.161938280179, 5157.200633901752, 5172.172452407615, 5181.274621552986, 4859.295402166701, 4996.375453068366, 5027.522385373402, 5038.420581633122, 5112.565431938289, 5051.0, 5144.279800827887, 5148.073346797575, 5164.1995490699, 5173.767180476888, 5096.362954630671, 5127.820526281581, 5131.871703207413, 5163.922541161885, 5173.301604283449, 4877.707337559757, 4937.185364414903, 4998.325226094467, 5059.241113832918, 5074.797008119708, 5350.170723537858, 5360.678359298455, 5423.105187644073, 5425.13197888336, 5426.403095659474, 6042.274927008743, 6042.9395706042815, 6044.455998960115, 6054.96972515139, 6074.0, 5777.19119323295, 5911.261092363455, 5981.940180598225, 6057.515398768088, 6063.545234107415, 5640.717964101778, 5650.830475085754, 5658.066419040853, 5663.915041274384, 5675.148727690838, 5977.462028417463, 6102.4507794298725, 6115.266168059861, 6116.541259405473, 6128.969355153285, 5827.271591051119, 5842.5618078644275, 5889.911651325234, 5913.940860591425, 5937.584369094122, 5951.642901425928, 5956.910646340309, 5957.076653118774, 5961.5230781537375, 5966.671833049224, 5691.8861622768145, 5793.507551858139, 5832.212651292106, 5921.052631579013, 5928.584999050025, 5966.955782738003, 5978.073398623221, 6003.789867354709, 6031.638101713911, 6070.726817293233, 4546.181687296253, 4554.567316104964, 4563.247064234364, 4570.451545814523, 4584.839530616412, 4022.0, 4022.8390864365097, 4094.815733292009, 4101.446304748881, 4103.610157035077, 5629.5926018495375, 5667.234923285386, 5699.686517241592, 5709.0, 5709.200711900337, 5977.850553736192, 6005.489533389624, 6008.399160084044, 6016.977113890649, 6025.0359942409, 5499.917501237484, 5551.611387202938, 5596.244506991504, 5610.214569960209, 5672.432756724377, 5069.9746501267255, 5140.40885298188, 5200.141976573898, 5200.583953283728, 5209.6353255272525, 6127.111568822495, 6160.44555989963, 6179.752809887555, 6214.9689251553455, 6222.502199824004, 5735.197072409783, 5880.176775251382, 6026.54800889935, 6048.36492168316, 6062.696865156813, 5966.0, 6022.819315420545, 6136.365905528278, 6238.157848690369, 6243.937560624336, 5884.941150588439, 5914.674692891932, 5923.339749041367, 5947.762089516544, 6011.0, 5858.355580886185, 6044.395560443921, 6062.938985677577, 6063.272407311151, 6064.757409703562, 5767.798127065533, 5882.294124705063, 5925.318588362394, 5951.434613711691, 5954.434328738763, 5792.739326730223, 5819.185314056121, 5841.1238314253205, 5859.765609375577, 5862.443067908542, 5632.2678051853, 5690.2887139107615, 5776.595638305278, 5776.797812076557, 5796.217510636179, 5835.095560188178, 5920.3783602722815, 5925.40745925404, 5936.37668044849, 5975.940240597538, 5814.680192589448, 5820.970895145667, 5825.883482330414, 5869.236999190078, 5880.294364676266], "unit": "score", "name": "dojo.html", "value": 5515.5017137939885}, {"lowerIsBetter": false, "replicates": [538.9568834493241, 548.2981783317352, 558.4443478738656, 586.5864565481336, 599.5683108162121, 35449.291014179704, 35972.2805543889, 36012.099697507576, 36128.63871361289, 36246.81876590614, 36520.45219321713, 36558.634413655855, 36809.815950920274, 36963.260734785355, 37056.62943370565, 8490.999999999985, 8684.8697269541, 8691.26124279437, 8720.171583699539, 8752.387332886668, 8480.279176270025, 8808.119188081173, 8849.867251991225, 8850.867236991451, 8878.60046297915, 8775.95612021939, 8885.422447540921, 8888.06675299094, 8889.15553022465, 8934.731958041237, 8726.301895848317, 8784.0, 8796.956015219916, 8806.427582207136, 8855.64577416909, 8796.472211667256, 8865.468071915706, 8883.156100170538, 8891.288696904297, 8895.599698013604, 38072.428913566044, 38108.80945595254, 38547.42178867319, 38563.8071809642, 38569.03577410559, 3684.871029513954, 3822.827972741233, 4197.223513649985, 4275.46556680415, 4408.118376324715, 31473.842630786927, 31932.36135277305, 32087.0, 32227.0, 32283.19292017695, 3691.907702307437, 3742.6257374262627, 3790.2040571480024, 3906.3554513505237, 3969.7419667721506, 274269.0, 275255.0, 275317.0, 275447.999999998, 275604.0, 43500.0, 43987.78006109949, 43998.560014400085, 44192.779036105254, 44256.0, 42556.78721606372, 42631.786841065594, 42712.14575708468, 42718.0, 42947.141057178684, 15813.36746530149, 15818.841811581968, 15960.281787319598, 16054.357825686842, 16134.35462581507, 12047.096467764954, 12067.0, 12143.514259429701, 12159.088068394729, 12480.126391152533, 15037.699246015238, 15191.0, 15195.848041519665, 15299.46451874179, 15362.0, 5972.462478376967, 6234.189555357865, 6290.433860952537, 6293.2762732285455, 6343.619382837044, 1076.8761592416815, 1137.6985098948785, 1144.1761931409371, 1146.3809542846936, 1151.3207207747469, 30473.0, 30567.541486877715, 30907.33186383582, 31151.0, 31475.213119672193, 1133.7392399748105, 1137.5961533655598, 1155.664857191405, 1203.1998720850536, 1342.664333916521, 17261.0506422148, 17517.824821751874, 17557.736633950502, 18076.54808629795, 18097.18562664683, 405324.0, 514082.0, 525257.0, 759850.0, 769968.0, 56284.71857640768, 56649.150262746094, 56849.715751420976, 57013.71493142508, 57126.7143664279, 1506.0662389318475, 1508.4795745467795, 1520.2702702702543, 1522.5204060720837, 1526.900751451152, 30289.697103028688, 30483.695163048087, 30707.0, 31263.0, 31516.52725209078, 49078.0, 49911.75044124756, 49913.750431249064, 50004.24993625171, 50062.0, 344200.0, 348083.0, 348652.0, 348858.0, 349161.0, 34575.82712086423, 45499.0, 45599.77200113978, 46042.53957460383, 46425.0, 42435.57564424316, 42997.0, 43065.354019689104, 43298.0, 43734.781326093165, 36266.63733362738, 36737.81631091827, 37355.81322093481, 37704.245915080995, 38048.239035219696, 36856.44715329326, 37251.62748372481, 40359.0, 42869.57130428656, 45192.77403612961, 39493.60506394899, 39558.208835822545, 42080.0, 42379.364309534765, 42880.0, 31786.0, 32572.674273256966, 33078.834605826814, 33170.0, 33819.3236135271, 27300.59049114225, 27479.31301717473, 27828.165155045383, 27843.582346265226, 28029.579556306264], "unit": "score", "name": "ext.html", "value": 19191.67067285041}, {"lowerIsBetter": false, "replicates": [371.13710622801983, 372.0475582508778, 373.5480069116369, 377.20598140913376, 378.8730775190311, 14925.477608283712, 16995.0, 17050.23273952672, 17672.734908976374, 18343.908280458614, 11451.885481145207, 11662.825057624143, 11880.643580692571, 11892.7621447571, 11947.820782688266, 4524.819007239723, 5092.3889133303965, 5142.382914050319, 5236.581073514109, 5320.095583750753, 4016.0, 4148.94201978495, 5245.44922783108, 5422.945770542303, 5629.493345598895, 5457.945420545783, 5610.382857885629, 5610.495055445009, 5613.326400831886, 5615.354234263051, 5524.0, 5542.91685624716, 5576.247206627135, 5587.525060369873, 5617.719114044281, 5358.2498450217, 5401.810936617238, 5567.220589117486, 5601.131824567198, 5612.663240205601, 20028.1988720451, 20343.5931281375, 20849.0, 20884.060217290258, 20976.37070887876, 2210.436338733629, 2245.5508898220423, 2286.885655717224, 2326.3835083702834, 2336.1473062332125, 10196.38821670702, 10272.33229840058, 10370.429626370547, 12456.564020259339, 12661.493540258378, 1779.314963738957, 1919.0500702152385, 1981.197614965941, 1999.7500312460943, 2017.1527958257568, 51996.48003519954, 57594.560135996515, 58049.70975145097, 59515.0, 60141.0, 10444.791104177873, 10463.581456741646, 10494.108000819862, 10552.15582753378, 10638.73403164927, 13693.931530342485, 13738.725225495635, 13744.518941837188, 13879.791803122962, 13908.165510069428, 8126.349892008743, 8146.877796833052, 8171.509709417454, 8179.591020448954, 8392.664293428317, 8178.059523154794, 8188.836223275501, 8225.136360682161, 8236.011678598607, 8238.340932725368, 4641.559051890065, 4661.347411362412, 4688.156131896291, 4823.252395878644, 7804.2195780422635, 3192.0104767522143, 3271.3457308538386, 3320.2529430877858, 3335.816530090868, 3488.4418493040994, 1009.5709323537467, 1037.865077539915, 1096.9561217551209, 1132.4111462039857, 1154.6478324111226, 17016.57458563521, 17434.21546030406, 17474.47576572705, 17785.46643600694, 17968.0, 1042.2860340666668, 1048.2033654422694, 1085.0126384989621, 1104.618906477264, 1116.1405717597568, 9863.30956833029, 9939.950300248453, 10084.647037353805, 10145.898541014496, 10179.236557258235, 526884.0, 533650.0, 535905.0, 537781.0, 587199.0, 54784.17823732647, 79505.60247198843, 79589.20410795818, 79684.6015769929, 82288.17711822805, 1160.158884808507, 1165.8367828504017, 1189.5895915908998, 1192.898603618702, 1198.7003249187703, 15694.450694225647, 15721.371145154524, 15864.60338491547, 16058.197090145213, 16151.111688857225, 35564.11089722778, 35761.28477430385, 35994.0, 36270.09324766902, 37381.6261837389, 45616.31575526436, 45812.0, 47504.762476187396, 47584.2862357058, 47600.2859957094, 7890.526568405914, 7979.760607181794, 8041.798955026171, 8048.114707382067, 8072.636731347221, 3965.4646622705563, 7904.723334683258, 8971.205758848126, 11627.88372116268, 12199.329036903055, 10328.690139295833, 10394.792104158027, 10418.0, 10666.946665266623, 10710.518026688973, 10385.688429347132, 10395.792084158425, 10546.57813687444, 10551.577936882439, 10623.521941512496, 11029.83455248156, 11127.387993660102, 11243.49404276826, 11477.713057173638, 11482.77034459323, 7942.523448593103, 8032.59837008159, 8298.08721040673, 8309.916900831156, 8405.0, 9879.703608891745, 11287.379194144072, 11357.772844542898, 11430.657080287605, 11581.420928953687], "unit": "score", "name": "jquery.html", "value": 8714.262283968614}, {"lowerIsBetter": false, "replicates": [1492.0972811449074, 1572.2846105022215, 1778.3686791189127, 1888.7733471983363, 1908.1318000309852, 7902.249286317805, 8088.474249173814, 8108.310793582546, 8181.795455113625, 8317.667293308275, 8233.505989640626, 8294.253517183452, 8296.543690097042, 8332.250227452227, 8365.414420990533, 2471.480988992314, 2474.072222916406, 2488.9875550622314, 2494.962575561368, 2497.725250222474, 2457.0785955266774, 2526.3557792762913, 2527.646129541866, 2530.215633153719, 2532.15172917073, 2111.6832475128776, 2145.8283337332978, 2384.3204686664303, 2459.114718701266, 2463.950720985579, 2359.6224604063354, 2399.9880000599887, 2403.9999999999914, 2409.361519197414, 2414.8068154547595, 2374.1334412939327, 2383.3803211165223, 2414.6619473273754, 2417.697787776528, 2420.4674971506242, 8020.3984701147065, 8129.471584347058, 8146.063202731643, 8153.633086511121, 8176.0, 5058.54473097423, 5150.948490515084, 5159.458256883048, 5202.167653175512, 5247.763850626731, 3294.390537750524, 3364.96635033649, 3404.3531728971416, 3408.7954722716718, 3423.760336776427, 1131.3099009604134, 1133.6825688807148, 1142.5886680794906, 1149.4425203776161, 1182.9645110646609, 11255.493502792395, 11439.485223164895, 11454.198206125575, 11482.368469734161, 11494.540218391254, 4595.149897269016, 4639.512851150648, 4670.369500117508, 4743.430788305425, 4749.810007599726, 9797.06927841854, 9840.261980351503, 9910.900890990997, 9925.30522863407, 9952.154066904393, 5153.0, 5186.040582492251, 5188.377394712583, 5200.60995425337, 5202.03762303975, 4652.62778977681, 4675.766211689402, 4679.415073115861, 4693.48371679115, 4708.764561771898, 3923.0, 3935.2916475034194, 3968.1468484275442, 3972.245273398045, 3975.383815508601, 1239.1264158768047, 1247.5820600098887, 1260.1934761752486, 1267.5753622536554, 1276.8276282701715, 1107.5791199344199, 1150.9769804603861, 1173.2549830857467, 1187.038498815962, 1236.9010479161645, 7743.264389882952, 7876.72431464896, 7895.684172633145, 7900.0, 7908.248716371935, 1170.5434880396651, 1190.3572071081692, 1201.3212534917743, 1204.2894692131508, 1222.743223922986, 6121.510279177655, 6150.661713605705, 6172.351903050205, 6180.0, 6218.657973811484, 9528.571214295373, 9651.517424128766, 9714.12572868431, 9730.221582273402, 9874.0, 9241.630334786532, 9544.61821527145, 9547.713568592953, 9549.140577348073, 9708.174805141642, 7633.770986870402, 7652.0, 7694.192109828387, 7699.961500192463, 7729.420293478011, 7660.655270512729, 7742.1483636798785, 7783.649735761791, 7827.882581761392, 7936.761897143095, 8784.209421152127, 8884.644614215358, 8937.28501719848, 8963.148500892405, 9017.368784185044, 8926.553672316228, 8990.32572557074, 9063.63745450201, 9108.134727200906, 9316.114969077928, 7446.367058799846, 7586.355159811257, 7589.734359297398, 7598.354139898171, 7601.467897247361, 7830.530168189927, 7965.522068675898, 8006.399520035904, 8029.3175080118845, 8087.0, 7544.547327160388, 7616.771496855104, 7653.311201991847, 7684.731034413769, 7695.422843286664, 6947.340002699735, 7021.648917554, 7054.0, 7136.750213742702, 7141.82145446368, 7150.284971502808, 7230.530015548972, 7239.746608868664, 7242.13094428672, 7249.818754531179, 6134.079888016833, 6163.291221509584, 6180.134781130555, 6182.845428864314, 6189.938100619116, 6722.865542689021, 6842.0763196969765, 6844.452443804584, 6865.862682746417, 6881.380675739208], "unit": "score", "name": "mootools.html", "value": 4787.680719610913}, {"lowerIsBetter": false, "replicates": [349.8373256435757, 357.10901301253375, 358.5768792824466, 358.9910252243694, 361.95475565554307, 6332.3984221498995, 6384.042393640951, 6423.197100362443, 6467.02994550817, 6528.640924749148, 6376.42612164905, 6402.071699603554, 6431.742730290783, 6461.160049193598, 6461.321561236073, 4842.346283251769, 4853.174960256756, 4867.537583929521, 4867.659263851532, 4878.048780487807, 4883.316335713003, 4886.560209581137, 4890.388701412324, 4892.535209155142, 4900.705957642553, 4646.326282689008, 4659.627229821623, 4763.690360126598, 4778.0, 4781.115493633689, 4770.713757174563, 4779.593734532569, 4814.66297359185, 4814.879628009293, 4826.734529600871, 4177.4778152730905, 4179.728317659373, 4187.560306167869, 4190.53904070552, 4207.453031105937, 6096.908546371808, 6110.144579758838, 6112.724927378279, 6119.204503414572, 6122.632642041447, 5533.474319939599, 5651.06757385031, 5664.122061080539, 5672.092465205547, 5696.658200507942, 6833.350831670983, 6853.862922741567, 6854.691538880762, 6912.82481978065, 6926.515143939926, 4654.324443200445, 4671.836485723017, 4675.906481870344, 4677.251639737626, 4688.789004494806, 7053.470989675743, 7087.468439867031, 7098.3256590623805, 7115.288471152895, 7150.427965762727, 4699.78850951708, 4703.435587729426, 4704.647151463654, 4716.316134160596, 4721.811127554928, 4748.881277968078, 4770.880727981758, 4780.545848144421, 4781.880452988634, 4782.665213435026, 5564.916526252109, 5565.220869078333, 5605.915911261252, 5606.467385598362, 5620.0, 6629.613339197885, 6829.863402732017, 6859.862802744017, 6870.931290687129, 6881.208661003949, 1665.5669525923347, 1707.8633709303474, 1710.6664200480786, 1712.0583678976761, 1713.1348668922114, 1114.9219554631097, 1124.5108377855659, 1124.9043831274269, 1130.5308297056795, 1136.1195073817858, 6605.141331626954, 6643.302453242437, 6645.933540664531, 6653.702528006992, 6668.0, 7053.4004609608755, 7088.503804733722, 7114.359707626339, 7115.573065615976, 7127.002219689248, 6485.578437401554, 6544.770933017417, 6589.472842172615, 6621.602703837689, 6681.799546013627, 3812.694984401241, 3828.789416582115, 3842.1739326045035, 3845.403962385835, 3853.4412510185866, 7258.709651613876, 7307.7807665770115, 7321.194668586451, 7410.258974102654, 7411.370033547101, 7172.318629730167, 7334.229905859808, 7359.59522226272, 7383.446241531907, 7386.778396648109, 7329.083864516935, 7378.003969464054, 7392.741254056083, 7409.259074092655, 7410.629468526552, 7119.964400177966, 7121.786346409616, 7153.8180854839775, 7156.606386648784, 7181.605011724405, 6889.173299204128, 7026.086608740831, 7026.262242464672, 7032.894506582303, 7068.964655176691, 7448.478606497493, 7472.551646900986, 7477.0, 7478.551286922802, 7487.663055162422, 4887.560119589254, 4904.215325548038, 4956.826511072095, 4967.3424717775815, 4981.1283025469675, 7051.788446346618, 7115.648026874877, 7118.359347658736, 7129.893051604334, 7130.465215108784, 6932.064171337007, 6943.201531823905, 6946.965265173844, 6949.3745562899585, 6957.7216911325, 6814.0, 6929.376356127973, 6946.79159625212, 6954.408875245661, 7036.331548502884, 6851.862962740617, 6887.20797108339, 6895.827604309932, 6904.827379315558, 6909.447244220551, 7033.261507541634, 7073.858522829618, 7076.929230707833, 7082.858342833011, 7101.82245443868, 6579.868402632016, 6724.529282950147, 6751.966240168767, 6760.425363843931, 6858.5199036067], "unit": "score", "name": "prototype.html", "value": 5151.163538079355}, {"lowerIsBetter": false, "replicates": [800.7677773445705, 810.088650268448, 845.5434065604574, 861.2205953611981, 900.2527901841472, 16633.168341582917, 16904.0, 17024.744628830576, 17032.148392580384, 17190.398336058224, 15086.39654413822, 15189.316480758365, 15199.0, 15262.542123736277, 15326.693466130671, 884.3367474394204, 904.9321300902426, 910.2308549275851, 913.1234015345276, 923.3121324613172, 898.2185498616213, 903.0517956146053, 906.3202598051462, 906.4515967839461, 911.7219248129351, 920.2178148573693, 932.4871320773582, 932.8693982842408, 937.8546325319586, 940.5814412586402, 920.8618707193907, 921.709661456639, 922.2898368256472, 923.6074668265994, 935.508857849631, 682.7644462660375, 683.0096360277618, 683.2962049089397, 686.9969844027726, 698.6402002968475, 15387.384504619802, 15494.147821869792, 15514.224288785515, 15527.223638818126, 15568.06591604496, 13670.0, 13779.724405511934, 13841.100328478617, 13844.792328115087, 13977.720445591132, 11229.933156350133, 11332.886671133349, 11458.656240312721, 11594.420278986101, 11915.821262681067, 3940.8226629801443, 3942.4283478895686, 3981.422693709425, 3982.3429134192825, 4048.271311163989, 54171.0, 54384.0, 54589.1811622826, 54726.452735472536, 54752.726236368566, 10544.894551054545, 11241.100711943025, 11374.715632109099, 11510.482028308747, 11605.30368177912, 18850.245990160514, 18884.716729249074, 19003.809961900202, 19005.714914276297, 19008.809911900982, 8389.07720150783, 8431.704890328809, 8496.575171241537, 8515.148485151436, 8650.437721548205, 4787.61699064074, 4828.058528586892, 4864.100141473838, 4874.975625121851, 4890.535399137077, 3276.6068071831533, 3309.5366648669205, 3313.2710803623163, 3317.286783341545, 3323.6011678598725, 601.1793901324747, 607.7690477618477, 609.8780243951228, 610.1153327674889, 615.2033117113349, 714.3784907130726, 723.5333210079574, 727.5489196698081, 728.4172661870482, 729.6680010595167, 9487.705734667028, 9719.951400242953, 9726.270529710158, 9751.90248097524, 9816.0, 734.4638413957734, 748.8988986486863, 760.4182800157884, 773.377431167904, 783.9764807055798, 4058.2513623061072, 4122.319817230184, 4149.439825623563, 4302.225599392077, 4409.338599210144, 59450.70274648686, 61068.694656527325, 61390.0, 62656.37343626505, 63001.68499157475, 55287.0, 55604.72197639067, 55872.0, 57125.0, 57261.71369143128, 49522.75238623784, 50017.74991125094, 50209.49790502121, 50425.0, 50500.747496263015, 9570.521473926416, 9681.757956051155, 9815.11663950248, 9911.355761875455, 9941.453220072965, 35666.28667426585, 36348.818255908554, 36431.27137457183, 37252.25495490021, 37496.43755343727, 42390.57609423866, 48349.27476087791, 48535.71964205398, 48623.27065094097, 48799.0, 11477.311361318014, 11507.252028618113, 11956.940215298868, 12062.75874482488, 12255.264684118982, 13532.864671353555, 13545.322733863464, 13641.658958526115, 13673.0, 13729.794053089012, 12713.93643031816, 12957.611271661865, 12963.0, 13000.674983125498, 13040.869591303965, 12343.13598048128, 12580.748385032432, 12599.748005039664, 12675.366231688564, 12722.427490763122, 12169.878301217228, 12588.055895807667, 12627.116101873147, 12682.365881705693, 12991.935040324737, 9563.282753793354, 9784.168345690696, 9994.550245238835, 10079.89920100819, 10236.436995964996, 10777.946110269399, 11112.666620001413, 11121.944390277997, 11194.384308863091, 11275.379854108103], "unit": "score", "name": "yui.html", "value": 6984.214970245324}], "name": "dromaeo_css", "value": 7359.559392028052}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 104.0, 113.0, 111.0, 113.0, 120.0, 110.0, 109.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 111.1}, {"lowerIsBetter": true, "replicates": [152.0, 126.0, 147.0, 162.0, 128.0, 158.0, 148.0, 127.0, 163.0, 133.0], "unit": "score", "name": "audio-beat-detection", "value": 144.4}, {"lowerIsBetter": true, "replicates": [162.0, 161.0, 161.0, 165.0, 161.0, 163.0, 162.0, 163.0, 164.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.5}, {"lowerIsBetter": true, "replicates": [74.0, 76.0, 74.0, 144.0, 73.0, 76.0, 77.0, 76.0, 165.0, 76.0], "unit": "score", "name": "audio-fft", "value": 91.1}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 148.0, 95.0, 97.0, 96.0, 136.0, 96.0, 97.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 109.4}, {"lowerIsBetter": true, "replicates": [109.0, 111.0, 110.0, 110.0, 110.0, 110.0, 110.0, 109.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.7}, {"lowerIsBetter": true, "replicates": [150.0, 148.0, 148.0, 149.0, 147.0, 146.0, 148.0, 147.0, 146.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.6}, {"lowerIsBetter": true, "replicates": [95.0, 97.0, 97.0, 96.0, 97.0, 97.0, 98.0, 96.0, 95.0, 98.0], "unit": "score", "name": "imaging-desaturate", "value": 96.6}, {"lowerIsBetter": true, "replicates": [54.0, 55.0, 59.0, 54.0, 54.0, 56.0, 55.0, 63.0, 52.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.5}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 71.0, 64.0, 64.0, 65.0, 65.0, 65.0, 68.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 65.5}, {"lowerIsBetter": true, "replicates": [84.0, 81.0, 82.0, 81.0, 81.0, 82.0, 83.0, 82.0, 83.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.0}, {"lowerIsBetter": true, "replicates": [116.0, 115.0, 114.0, 118.0, 118.0, 111.0, 116.0, 123.0, 114.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.3}, {"lowerIsBetter": true, "replicates": [138.0, 137.0, 136.0, 137.0, 140.0, 141.0, 135.0, 149.0, 140.0, 138.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 139.1}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 64.0, 65.0, 66.0, 70.0, 64.0, 66.0, 63.0, 64.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.5}], "name": "kraken", "value": 1496.3}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.41704110500916], "unit": "score", "name": "Richards", "value": 212.1297179999999}, {"lowerIsBetter": false, "replicates": [170.44486108743823], "unit": "score", "name": "DeltaBlue", "value": 387.91430599999984}, {"lowerIsBetter": false, "replicates": [279.17364600781684], "unit": "score", "name": "Encrypt", "value": 953.4603419999996}, {"lowerIsBetter": false, "replicates": [5263.1578947368425], "unit": "score", "name": "Decrypt", "value": 50.57439}, {"lowerIsBetter": false, "replicates": [909.0909090909091], "unit": "score", "name": "RayTrace", "value": 813.9879}, {"lowerIsBetter": false, "replicates": [546.448087431694], "unit": "score", "name": "Earley", "value": 1219.6272900000001}, {"lowerIsBetter": false, "replicates": [11133.333333333334], "unit": "score", "name": "Boyer", "value": 59.86194610778439}, {"lowerIsBetter": false, "replicates": [39096.153846153844], "unit": "score", "name": "RegExp", "value": 23.301141170683742}, {"lowerIsBetter": false, "replicates": [505.28434826371415], "unit": "score", "name": "Splay", "value": 161.27750697211152}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 22171.37706805624}]} 08:00:40 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "22171.38"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1496.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7359.56"}}} 08:00:40 INFO - Return code: 0 08:00:40 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 08:00:40 INFO - # TBPL SUCCESS # 08:00:40 INFO - Running post-action listener: _resource_record_post_action 08:00:40 INFO - Running post-run listener: _resource_record_post_run 08:00:41 INFO - Total resource usage - Wall time: 1227s; CPU: 13.0%; Read bytes: 4096; Write bytes: 507912192; Read time: 16; Write time: 389508 08:00:41 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 239685632; Read time: 0; Write time: 221408 08:00:41 INFO - run-tests - Wall time: 1212s; CPU: 13.0%; Read bytes: 4096; Write bytes: 268226560; Read time: 16; Write time: 168100 08:00:41 INFO - Running post-run listener: _upload_blobber_files 08:00:41 INFO - Blob upload gear active. 08:00:41 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 08:00:41 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:00:41 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'] 08:00:41 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 08:00:41 INFO - (blobuploader) - INFO - Open directory for files ... 08:00:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:00:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:00:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:00:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:00:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:00:42 INFO - (blobuploader) - INFO - Done attempting. 08:00:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:00:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:00:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:00:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:00:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:00:43 INFO - (blobuploader) - INFO - Done attempting. 08:00:43 INFO - (blobuploader) - INFO - Iteration through files over. 08:00:43 INFO - Return code: 0 08:00:43 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 08:00:43 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 08:00:43 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05cd34b4658fb3e906d994ab52c17fc50cf1fd328a482612f8001f659f8daa741c5c60c56afcd565dc7180e193da0ac32651d33b160c1d3bd39ecc7ccb3b5368", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/499e4368b6aa1c6bd5f2c379197ba6255b5e9c8125aa889dd90fdae22ff6fc4054757f49c958f28c796b14fb381c06ea605c7a5c099256410acb16f9c2bc907a"} 08:00:43 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 08:00:43 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 08:00:43 INFO - Contents: 08:00:43 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05cd34b4658fb3e906d994ab52c17fc50cf1fd328a482612f8001f659f8daa741c5c60c56afcd565dc7180e193da0ac32651d33b160c1d3bd39ecc7ccb3b5368", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/499e4368b6aa1c6bd5f2c379197ba6255b5e9c8125aa889dd90fdae22ff6fc4054757f49c958f28c796b14fb381c06ea605c7a5c099256410acb16f9c2bc907a"} 08:00:43 INFO - Running post-run listener: copy_logs_to_upload_dir 08:00:43 INFO - Copying logs to upload dir... 08:00:43 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 08:00:43 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1286.388273 ========= master_lag: 3.50 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 29 secs) (at 2016-02-02 08:00:46.744592) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-02 08:00:46.746671) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05cd34b4658fb3e906d994ab52c17fc50cf1fd328a482612f8001f659f8daa741c5c60c56afcd565dc7180e193da0ac32651d33b160c1d3bd39ecc7ccb3b5368", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/499e4368b6aa1c6bd5f2c379197ba6255b5e9c8125aa889dd90fdae22ff6fc4054757f49c958f28c796b14fb381c06ea605c7a5c099256410acb16f9c2bc907a"} build_url:https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010521 build_url: 'https://queue.taskcluster.net/v1/task/QMTnkFthRbeBXrBsqXZ4cQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05cd34b4658fb3e906d994ab52c17fc50cf1fd328a482612f8001f659f8daa741c5c60c56afcd565dc7180e193da0ac32651d33b160c1d3bd39ecc7ccb3b5368", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/499e4368b6aa1c6bd5f2c379197ba6255b5e9c8125aa889dd90fdae22ff6fc4054757f49c958f28c796b14fb381c06ea605c7a5c099256410acb16f9c2bc907a"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-02 08:00:46.783645) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 08:00:46.783966) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1454425578.383111-1362744318 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004740 ========= master_lag: 0.83 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-02 08:00:47.614105) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-02 08:00:47.618593) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-02 08:00:47.619130) ========= ========= Total master_lag: 4.58 =========