builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-048 starttime: 1459527154.59 results: success (0) buildid: 20160401063137 builduid: 28d1561e73c54ca89aaa428c223620c0 revision: 9b5b1c40eb872b629bedef7aa6c857f44c31d353 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.588885) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.591069) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.591391) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006448 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.623957) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.624551) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.641056) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.641368) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004561 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.691582) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.691895) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.692252) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:34.692578) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-01 09:12:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 42.1K=0.3s 2016-04-01 09:12:35 (42.1 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.456533 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.162804) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.163158) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015028 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.213308) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.213667) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 9b5b1c40eb872b629bedef7aa6c857f44c31d353 --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-beta --rev 9b5b1c40eb872b629bedef7aa6c857f44c31d353 --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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-01 09:12:35,595 truncating revision to first 12 chars 2016-04-01 09:12:35,595 Setting DEBUG logging. 2016-04-01 09:12:35,595 attempt 1/10 2016-04-01 09:12:35,595 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/9b5b1c40eb87?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-01 09:12:35,883 unpacking tar archive at: mozilla-beta-9b5b1c40eb87/testing/mozharness/ program finished with exit code 0 elapsedTime=0.622671 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.851062) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.851456) ========= echo 9b5b1c40eb872b629bedef7aa6c857f44c31d353 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'9b5b1c40eb872b629bedef7aa6c857f44c31d353'] 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 9b5b1c40eb872b629bedef7aa6c857f44c31d353 program finished with exit code 0 elapsedTime=0.003855 script_repo_revision: '9b5b1c40eb872b629bedef7aa6c857f44c31d353' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.900362) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.900715) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:35.911516) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2016-04-01 09:12:35.912188) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:12:36 INFO - MultiFileLogger online at 20160401 09:12:36 in /builds/slave/test-pgo 09:12:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 09:12:36 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 09:12:36 INFO - {'append_to_log': False, 09:12:36 INFO - 'base_work_dir': '/builds/slave/test-pgo', 09:12:36 INFO - 'blob_upload_branch': 'Mozilla-Beta', 09:12:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 09:12:36 INFO - 'branch': 'Mozilla-Beta', 09:12:36 INFO - 'buildbot_json_path': 'buildprops.json', 09:12:36 INFO - 'config_files': ('talos/linux_config.py',), 09:12:36 INFO - 'default_actions': ('clobber', 09:12:36 INFO - 'read-buildbot-config', 09:12:36 INFO - 'download-and-extract', 09:12:36 INFO - 'populate-webroot', 09:12:36 INFO - 'create-virtualenv', 09:12:36 INFO - 'install', 09:12:36 INFO - 'run-tests'), 09:12:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:12:36 INFO - 'download_minidump_stackwalk': True, 09:12:36 INFO - 'download_symbols': 'ondemand', 09:12:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:12:36 INFO - 'tooltool.py': '/tools/tooltool.py', 09:12:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:12:36 INFO - '/tools/misc-python/virtualenv.py')}, 09:12:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:12:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:12:36 INFO - 'installer_path': 'installer.exe', 09:12:36 INFO - 'log_level': 'info', 09:12:36 INFO - 'log_name': 'talos', 09:12:36 INFO - 'log_to_console': True, 09:12:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:12:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:12:36 INFO - 'opt_config_files': (), 09:12:36 INFO - 'pip_index': False, 09:12:36 INFO - 'sps_profile': False, 09:12:36 INFO - 'sps_profile_interval': 0, 09:12:36 INFO - 'suite': 'dromaeojs', 09:12:36 INFO - 'system_bits': '32', 09:12:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:12:36 INFO - 'title': 'talos-linux64-ix-048', 09:12:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:12:36 INFO - 'use_talos_json': True, 09:12:36 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 09:12:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:12:36 INFO - 'work_dir': 'build'} 09:12:36 INFO - ##### 09:12:36 INFO - ##### Running clobber step. 09:12:36 INFO - ##### 09:12:36 INFO - Running pre-action listener: _resource_record_pre_action 09:12:36 INFO - Running main action method: clobber 09:12:36 INFO - rmtree: /builds/slave/test-pgo/build 09:12:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 09:12:37 INFO - Running post-action listener: _resource_record_post_action 09:12:37 INFO - ##### 09:12:37 INFO - ##### Running read-buildbot-config step. 09:12:37 INFO - ##### 09:12:37 INFO - Running pre-action listener: _resource_record_pre_action 09:12:37 INFO - Running main action method: read_buildbot_config 09:12:37 INFO - Using buildbot properties: 09:12:37 INFO - { 09:12:37 INFO - "project": "", 09:12:37 INFO - "product": "firefox", 09:12:37 INFO - "script_repo_revision": "production", 09:12:37 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 09:12:37 INFO - "repository": "", 09:12:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 09:12:37 INFO - "buildid": "20160401063137", 09:12:37 INFO - "pgo_build": "True", 09:12:37 INFO - "basedir": "/builds/slave/test-pgo", 09:12:37 INFO - "buildnumber": 185, 09:12:37 INFO - "slavename": "talos-linux64-ix-048", 09:12:37 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 09:12:37 INFO - "platform": "ubuntu64_hw", 09:12:37 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 09:12:37 INFO - "branch": "mozilla-beta", 09:12:37 INFO - "repo_path": "releases/mozilla-beta", 09:12:37 INFO - "revision": "9b5b1c40eb872b629bedef7aa6c857f44c31d353", 09:12:37 INFO - "stage_platform": "linux64-pgo", 09:12:37 INFO - "builduid": "28d1561e73c54ca89aaa428c223620c0", 09:12:37 INFO - "slavebuilddir": "test" 09:12:37 INFO - } 09:12:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2. 09:12:37 INFO - Running post-action listener: _resource_record_post_action 09:12:37 INFO - ##### 09:12:37 INFO - ##### Running download-and-extract step. 09:12:37 INFO - ##### 09:12:37 INFO - Running pre-action listener: _resource_record_pre_action 09:12:37 INFO - Running main action method: download_and_extract 09:12:37 INFO - mkdir: /builds/slave/test-pgo/build/tests 09:12:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:12:37 INFO - https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 09:12:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/test_packages.json 09:12:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/test_packages.json 09:12:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 09:12:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 09:12:39 INFO - Downloaded 1412 bytes. 09:12:39 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 09:12:39 INFO - Using the following test package requirements: 09:12:39 INFO - {u'common': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:12:39 INFO - u'cppunittest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.cppunittest.tests.zip'], 09:12:39 INFO - u'gtest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.gtest.tests.zip'], 09:12:39 INFO - u'jittest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'jsshell-linux-x86_64.zip'], 09:12:39 INFO - u'mochitest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.mochitest.tests.zip'], 09:12:39 INFO - u'mozbase': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:12:39 INFO - u'reftest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.reftest.tests.zip'], 09:12:39 INFO - u'talos': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.talos.tests.zip'], 09:12:39 INFO - u'web-platform': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.web-platform.tests.zip'], 09:12:39 INFO - u'webapprt': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:12:39 INFO - u'xpcshell': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:12:39 INFO - u'firefox-46.0.en-US.linux-x86_64.xpcshell.tests.zip']} 09:12:39 INFO - Downloading packages: [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:12:39 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')]} 09:12:39 INFO - https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:12:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:12:40 INFO - Downloaded 23141367 bytes. 09:12:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:12:40 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 09:12:41 INFO - Return code: 0 09:12:41 INFO - Downloading packages: [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:12:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:12:41 INFO - https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:12:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:12:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:12:42 INFO - Downloaded 23141367 bytes. 09:12:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:12:42 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 09:12:43 INFO - Return code: 0 09:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:12:43 INFO - https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 09:12:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:12:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:12:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:12:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:12:45 INFO - Downloaded 10801548 bytes. 09:12:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:12:45 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 09:12:46 INFO - Return code: 0 09:12: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')]} 09:12:46 INFO - https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 09:12:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:12:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:12:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:12:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:12:47 INFO - Downloaded 52882867 bytes. 09:12:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:12:47 INFO - mkdir: /builds/slave/test-pgo/properties 09:12:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 09:12:47 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 09:12:47 INFO - Contents: 09:12:47 INFO - build_url:https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:12:48 INFO - Running post-action listener: _resource_record_post_action 09:12:48 INFO - Running post-action listener: set_extra_try_arguments 09:12:48 INFO - ##### 09:12:48 INFO - ##### Running populate-webroot step. 09:12:48 INFO - ##### 09:12:48 INFO - Running pre-action listener: _resource_record_pre_action 09:12:48 INFO - Running main action method: populate_webroot 09:12:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:12:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:12:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:12:48 INFO - '--tppagecycles', 09:12:48 INFO - '7'], 09:12:48 INFO - 'tests': ['tsvgm']}}, 09:12:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 09:12:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:12:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:12:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:12:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:12:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:12:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'tests': ['damp', 'tps']}, 09:12:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['damp', 'tps']}, 09:12:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 09:12:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:12:48 INFO - 'other': {'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'other_l64': {'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'other_nol64': {'tests': ['a11yr', 09:12:48 INFO - 'ts_paint', 09:12:48 INFO - 'tpaint', 09:12:48 INFO - 'sessionrestore', 09:12:48 INFO - 'sessionrestore_no_auto_restore']}, 09:12:48 INFO - 'svgr': {'tests': ['tsvgx', 09:12:48 INFO - 'tsvgr_opacity', 09:12:48 INFO - 'tart', 09:12:48 INFO - 'tscrollx', 09:12:48 INFO - 'cart']}, 09:12:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['tsvgx', 09:12:48 INFO - 'tsvgr_opacity', 09:12:48 INFO - 'tart', 09:12:48 INFO - 'tscrollx', 09:12:48 INFO - 'cart']}, 09:12:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'tests': ['tp5o']}, 09:12:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'talos_options': ['--e10s'], 09:12:48 INFO - 'tests': ['tp5o']}, 09:12:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'talos_options': ['--xperf_path', 09:12:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:12:48 INFO - 'tests': ['tp5n']}, 09:12:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:12:48 INFO - 'talos_options': ['--e10s', 09:12:48 INFO - '--xperf_path', 09:12:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:12:48 INFO - 'tests': ['tp5n']}}, 09:12:48 INFO - 'talos.zip': {'path': '', 09:12:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:12:48 INFO - Running post-action listener: _resource_record_post_action 09:12:48 INFO - ##### 09:12:48 INFO - ##### Running create-virtualenv step. 09:12:48 INFO - ##### 09:12:48 INFO - Running pre-action listener: _resource_record_pre_action 09:12:48 INFO - Running main action method: create_virtualenv 09:12:48 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 09:12:48 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 09:12:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 09:12:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:12:48 INFO - Using real prefix '/usr' 09:12:48 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 09:12:48 INFO - Installing distribute.............................................................................................................................................................................................done. 09:12:50 INFO - Installing pip.................done. 09:12:50 INFO - Return code: 0 09:12:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 09:12:50 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')]} 09:12:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:12:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12:50 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')]} 09:12:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:12:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12:50 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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:12:50 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 09:12:50 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 09:12:50 INFO - Using env: {'DISPLAY': ':0', 09:12:50 INFO - 'HOME': '/home/cltbld', 09:12:50 INFO - 'LANG': 'en_US.UTF-8', 09:12:50 INFO - 'LANGUAGE': 'en_US:en', 09:12:50 INFO - 'LOGNAME': 'cltbld', 09:12:50 INFO - 'MAIL': '/var/mail/cltbld', 09:12:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:12:50 INFO - 'MOZ_NO_REMOTE': '1', 09:12:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:12:50 INFO - 'NO_EM_RESTART': '1', 09:12:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:12:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:12:50 INFO - 'PWD': '/builds/slave/test-pgo', 09:12:50 INFO - 'SHELL': '/bin/bash', 09:12:50 INFO - 'SHLVL': '1', 09:12:50 INFO - 'TERM': 'linux', 09:12:50 INFO - 'TMOUT': '86400', 09:12:50 INFO - 'USER': 'cltbld', 09:12:50 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:12:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:12:50 INFO - '_': '/tools/buildbot/bin/python'} 09:12:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:12: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 09:12:51 INFO - Cleaning up... 09:12:51 INFO - Return code: 0 09:12:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 09:12: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')]} 09:12:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:12:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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')]} 09:12:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:12:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:12: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 09:12: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 09:12:51 INFO - Using env: {'DISPLAY': ':0', 09:12:51 INFO - 'HOME': '/home/cltbld', 09:12:51 INFO - 'LANG': 'en_US.UTF-8', 09:12:51 INFO - 'LANGUAGE': 'en_US:en', 09:12:51 INFO - 'LOGNAME': 'cltbld', 09:12:51 INFO - 'MAIL': '/var/mail/cltbld', 09:12:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:12:51 INFO - 'MOZ_NO_REMOTE': '1', 09:12:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:12:51 INFO - 'NO_EM_RESTART': '1', 09:12:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:12:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:12:51 INFO - 'PWD': '/builds/slave/test-pgo', 09:12:51 INFO - 'SHELL': '/bin/bash', 09:12:51 INFO - 'SHLVL': '1', 09:12:51 INFO - 'TERM': 'linux', 09:12:51 INFO - 'TMOUT': '86400', 09:12:51 INFO - 'USER': 'cltbld', 09:12:51 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:12:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:12:51 INFO - '_': '/tools/buildbot/bin/python'} 09:12:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:12:51 INFO - Downloading/unpacking psutil>=0.7.1 09:12:51 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 09:12:51 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 09:12:51 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 09:12:51 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 09:12:51 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 09:12:51 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 09:12:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 09:12:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:12:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:12:53 INFO - Installing collected packages: psutil 09:12:53 INFO - Running setup.py install for psutil 09:12:53 INFO - building 'psutil._psutil_linux' extension 09:12:53 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 09:12:53 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 09:12:53 INFO - building 'psutil._psutil_posix' extension 09:12:53 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 09:12:53 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 09:12:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:12:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:12:53 INFO - Successfully installed psutil 09:12:53 INFO - Cleaning up... 09:12:54 INFO - Return code: 0 09:12:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 09:12: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')]} 09:12:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:12:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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')]} 09:12:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:12:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:12: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 09:12: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 09:12:54 INFO - Using env: {'DISPLAY': ':0', 09:12:54 INFO - 'HOME': '/home/cltbld', 09:12:54 INFO - 'LANG': 'en_US.UTF-8', 09:12:54 INFO - 'LANGUAGE': 'en_US:en', 09:12:54 INFO - 'LOGNAME': 'cltbld', 09:12:54 INFO - 'MAIL': '/var/mail/cltbld', 09:12:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:12:54 INFO - 'MOZ_NO_REMOTE': '1', 09:12:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:12:54 INFO - 'NO_EM_RESTART': '1', 09:12:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:12:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:12:54 INFO - 'PWD': '/builds/slave/test-pgo', 09:12:54 INFO - 'SHELL': '/bin/bash', 09:12:54 INFO - 'SHLVL': '1', 09:12:54 INFO - 'TERM': 'linux', 09:12:54 INFO - 'TMOUT': '86400', 09:12:54 INFO - 'USER': 'cltbld', 09:12:54 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:12:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:12:54 INFO - '_': '/tools/buildbot/bin/python'} 09:12:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:12:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:12:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:12: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) 09:12:56 INFO - Installing collected packages: mozsystemmonitor 09:12:56 INFO - Running setup.py install for mozsystemmonitor 09:12:56 INFO - Successfully installed mozsystemmonitor 09:12:56 INFO - Cleaning up... 09:12:56 INFO - Return code: 0 09:12:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 09:12: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')]} 09:12:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:12:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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')]} 09:12:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:12:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:12: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:12: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 09:12: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 09:12:56 INFO - Using env: {'DISPLAY': ':0', 09:12:56 INFO - 'HOME': '/home/cltbld', 09:12:56 INFO - 'LANG': 'en_US.UTF-8', 09:12:56 INFO - 'LANGUAGE': 'en_US:en', 09:12:56 INFO - 'LOGNAME': 'cltbld', 09:12:56 INFO - 'MAIL': '/var/mail/cltbld', 09:12:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:12:56 INFO - 'MOZ_NO_REMOTE': '1', 09:12:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:12:56 INFO - 'NO_EM_RESTART': '1', 09:12:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:12:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:12:56 INFO - 'PWD': '/builds/slave/test-pgo', 09:12:56 INFO - 'SHELL': '/bin/bash', 09:12:56 INFO - 'SHLVL': '1', 09:12:56 INFO - 'TERM': 'linux', 09:12:56 INFO - 'TMOUT': '86400', 09:12:56 INFO - 'USER': 'cltbld', 09:12:56 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:12:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:12:56 INFO - '_': '/tools/buildbot/bin/python'} 09:12:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:12:56 INFO - Downloading/unpacking blobuploader==1.2.4 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12:58 INFO - Downloading blobuploader-1.2.4.tar.gz 09:12:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:12:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 09:12:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12: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 09:12:59 INFO - Downloading docopt-0.6.1.tar.gz 09:12:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 09:12:59 INFO - Installing collected packages: blobuploader, requests, docopt 09:12:59 INFO - Running setup.py install for blobuploader 09:12:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:12:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 09:12:59 INFO - Running setup.py install for requests 09:12:59 INFO - Running setup.py install for docopt 09:12:59 INFO - Successfully installed blobuploader requests docopt 09:12:59 INFO - Cleaning up... 09:13:00 INFO - Return code: 0 09:13:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:13: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')]} 09:13:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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')]} 09:13:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:13: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 09:13: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 09:13:00 INFO - Using env: {'DISPLAY': ':0', 09:13:00 INFO - 'HOME': '/home/cltbld', 09:13:00 INFO - 'LANG': 'en_US.UTF-8', 09:13:00 INFO - 'LANGUAGE': 'en_US:en', 09:13:00 INFO - 'LOGNAME': 'cltbld', 09:13:00 INFO - 'MAIL': '/var/mail/cltbld', 09:13:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:00 INFO - 'MOZ_NO_REMOTE': '1', 09:13:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:00 INFO - 'NO_EM_RESTART': '1', 09:13:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:00 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:00 INFO - 'SHELL': '/bin/bash', 09:13:00 INFO - 'SHLVL': '1', 09:13:00 INFO - 'TERM': 'linux', 09:13:00 INFO - 'TMOUT': '86400', 09:13:00 INFO - 'USER': 'cltbld', 09:13:00 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:00 INFO - '_': '/tools/buildbot/bin/python'} 09:13:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:13:00 INFO - Running setup.py (path:/tmp/pip-246fi0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:13:00 INFO - Running setup.py (path:/tmp/pip-BzkS27-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:13:00 INFO - Running setup.py (path:/tmp/pip-0xro1g-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:13:00 INFO - Running setup.py (path:/tmp/pip-SSKapi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 09:13:00 INFO - Running setup.py (path:/tmp/pip-PswySV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:13:00 INFO - Running setup.py (path:/tmp/pip-JLOzj_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:13:00 INFO - Running setup.py (path:/tmp/pip-Kutf3D-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:13:00 INFO - Running setup.py (path:/tmp/pip-mY6ZYa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 09:13:00 INFO - Running setup.py (path:/tmp/pip-rWgxY6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 09:13:00 INFO - Running setup.py (path:/tmp/pip-1ONI3s-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:13:00 INFO - Running setup.py (path:/tmp/pip-CFKZt7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:13:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:13:01 INFO - Running setup.py (path:/tmp/pip-nqpkqb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:13:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:13:01 INFO - Running setup.py (path:/tmp/pip-UfeXzT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:13:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:13:01 INFO - Running setup.py (path:/tmp/pip-0Tqpiq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:13:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:13:01 INFO - Running setup.py (path:/tmp/pip-V5KRcF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:13:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 09:13:01 INFO - Running setup.py (path:/tmp/pip-AOZWGk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 09:13:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 09:13:01 INFO - Running setup.py (path:/tmp/pip-BDuPg2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 09:13:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:13:01 INFO - Running setup.py install for manifestparser 09:13:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 09:13:01 INFO - Running setup.py install for mozcrash 09:13:01 INFO - Running setup.py install for mozdebug 09:13:01 INFO - Running setup.py install for mozdevice 09:13:01 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 09:13:01 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 09:13:01 INFO - Running setup.py install for mozfile 09:13:01 INFO - Running setup.py install for mozhttpd 09:13:02 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozinfo 09:13:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozInstall 09:13:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozleak 09:13:02 INFO - Running setup.py install for mozlog 09:13:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for moznetwork 09:13:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozprocess 09:13:02 INFO - Running setup.py install for mozprofile 09:13:02 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozrunner 09:13:02 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 09:13:02 INFO - Running setup.py install for mozscreenshot 09:13:02 INFO - Running setup.py install for moztest 09:13:03 INFO - Running setup.py install for mozversion 09:13:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 09:13:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:13:03 INFO - Cleaning up... 09:13:03 INFO - Return code: 0 09:13:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:13: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')]} 09:13:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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')]} 09:13:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:13: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 09:13: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 09:13:03 INFO - Using env: {'DISPLAY': ':0', 09:13:03 INFO - 'HOME': '/home/cltbld', 09:13:03 INFO - 'LANG': 'en_US.UTF-8', 09:13:03 INFO - 'LANGUAGE': 'en_US:en', 09:13:03 INFO - 'LOGNAME': 'cltbld', 09:13:03 INFO - 'MAIL': '/var/mail/cltbld', 09:13:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:03 INFO - 'MOZ_NO_REMOTE': '1', 09:13:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:03 INFO - 'NO_EM_RESTART': '1', 09:13:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:03 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:03 INFO - 'SHELL': '/bin/bash', 09:13:03 INFO - 'SHLVL': '1', 09:13:03 INFO - 'TERM': 'linux', 09:13:03 INFO - 'TMOUT': '86400', 09:13:03 INFO - 'USER': 'cltbld', 09:13:03 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:03 INFO - '_': '/tools/buildbot/bin/python'} 09:13:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:13:03 INFO - Running setup.py (path:/tmp/pip-ysupDV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:13:03 INFO - Running setup.py (path:/tmp/pip-E_ER5i-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:13:03 INFO - Running setup.py (path:/tmp/pip-iWkIu7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:13:03 INFO - Running setup.py (path:/tmp/pip-TxmOIQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 09:13:03 INFO - Running setup.py (path:/tmp/pip-ToViu2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:13:03 INFO - Running setup.py (path:/tmp/pip-R0PjOW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:13: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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:13:03 INFO - Running setup.py (path:/tmp/pip-HkiJg2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:13:03 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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:13:03 INFO - Running setup.py (path:/tmp/pip-d1Oiad-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:13:03 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)) 09:13:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 09:13:03 INFO - Running setup.py (path:/tmp/pip-mb7gJy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 09:13:04 INFO - Running setup.py (path:/tmp/pip-HXYIGs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:13:04 INFO - Running setup.py (path:/tmp/pip-nQh1Pp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:13:04 INFO - Running setup.py (path:/tmp/pip-LjBgSW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:13:04 INFO - Running setup.py (path:/tmp/pip-JjTiAx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:13:04 INFO - Running setup.py (path:/tmp/pip-aIAvVT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:13:04 INFO - Running setup.py (path:/tmp/pip-zDhK0H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 09:13:04 INFO - Running setup.py (path:/tmp/pip-zzAgVf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 09:13: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)) 09:13:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 09:13:04 INFO - Running setup.py (path:/tmp/pip-YmPoCi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:13:06 INFO - Downloading blessings-1.6.tar.gz 09:13:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 09:13:06 INFO - Installing collected packages: blessings 09:13:06 INFO - Running setup.py install for blessings 09:13:07 INFO - Successfully installed blessings 09:13:07 INFO - Cleaning up... 09:13:07 INFO - Return code: 0 09:13:07 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 09:13:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 09:13:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 09:13:07 INFO - Reading from file tmpfile_stdout 09:13:07 INFO - Current package versions: 09:13:07 INFO - argparse == 1.2.1 09:13:07 INFO - blessings == 1.6 09:13:07 INFO - blobuploader == 1.2.4 09:13:07 INFO - docopt == 0.6.1 09:13:07 INFO - manifestparser == 1.1 09:13:07 INFO - mozInstall == 1.12 09:13:07 INFO - mozcrash == 0.16 09:13:07 INFO - mozdebug == 0.1 09:13:07 INFO - mozdevice == 0.48 09:13:07 INFO - mozfile == 1.2 09:13:07 INFO - mozhttpd == 0.7 09:13:07 INFO - mozinfo == 0.9 09:13:07 INFO - mozleak == 0.1 09:13:07 INFO - mozlog == 3.1 09:13:07 INFO - moznetwork == 0.27 09:13:07 INFO - mozprocess == 0.22 09:13:07 INFO - mozprofile == 0.28 09:13:07 INFO - mozrunner == 6.11 09:13:07 INFO - mozscreenshot == 0.1 09:13:07 INFO - mozsystemmonitor == 0.0 09:13:07 INFO - moztest == 0.7 09:13:07 INFO - mozversion == 1.4 09:13:07 INFO - psutil == 3.1.1 09:13:07 INFO - requests == 1.2.3 09:13:07 INFO - wsgiref == 0.1.2 09:13:07 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:13: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')]} 09:13:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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')]} 09:13:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:07 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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:13:07 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 09:13:07 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 09:13:07 INFO - Using env: {'DISPLAY': ':0', 09:13:07 INFO - 'HOME': '/home/cltbld', 09:13:07 INFO - 'LANG': 'en_US.UTF-8', 09:13:07 INFO - 'LANGUAGE': 'en_US:en', 09:13:07 INFO - 'LOGNAME': 'cltbld', 09:13:07 INFO - 'MAIL': '/var/mail/cltbld', 09:13:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:07 INFO - 'MOZ_NO_REMOTE': '1', 09:13:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:07 INFO - 'NO_EM_RESTART': '1', 09:13:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:07 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:07 INFO - 'SHELL': '/bin/bash', 09:13:07 INFO - 'SHLVL': '1', 09:13:07 INFO - 'TERM': 'linux', 09:13:07 INFO - 'TMOUT': '86400', 09:13:07 INFO - 'USER': 'cltbld', 09:13:07 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:07 INFO - '_': '/tools/buildbot/bin/python'} 09:13:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13: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)) 09:13:07 INFO - Cleaning up... 09:13:07 INFO - Return code: 0 09:13:07 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 09:13: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')]} 09:13:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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')]} 09:13:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13: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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:13: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 09:13: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 09:13:07 INFO - Using env: {'DISPLAY': ':0', 09:13:07 INFO - 'HOME': '/home/cltbld', 09:13:07 INFO - 'LANG': 'en_US.UTF-8', 09:13:07 INFO - 'LANGUAGE': 'en_US:en', 09:13:07 INFO - 'LOGNAME': 'cltbld', 09:13:07 INFO - 'MAIL': '/var/mail/cltbld', 09:13:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:07 INFO - 'MOZ_NO_REMOTE': '1', 09:13:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:07 INFO - 'NO_EM_RESTART': '1', 09:13:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:07 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:07 INFO - 'SHELL': '/bin/bash', 09:13:07 INFO - 'SHLVL': '1', 09:13:07 INFO - 'TERM': 'linux', 09:13:07 INFO - 'TMOUT': '86400', 09:13:07 INFO - 'USER': 'cltbld', 09:13:07 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:07 INFO - '_': '/tools/buildbot/bin/python'} 09:13:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:07 INFO - Downloading/unpacking jsonschema 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:13:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:13:10 INFO - Downloading/unpacking functools32 (from jsonschema) 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 INFO - Downloading functools32-3.2.3-2.tar.gz 09:13:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 09:13:10 INFO - warning: no files found matching '*.txt' 09:13:10 INFO - no previously-included directories found matching 'build' 09:13:10 INFO - no previously-included directories found matching 'dist' 09:13:10 INFO - no previously-included directories found matching '.git*' 09:13:10 INFO - Installing collected packages: jsonschema, functools32 09:13:10 INFO - Running setup.py install for functools32 09:13:10 INFO - warning: no files found matching '*.txt' 09:13:10 INFO - no previously-included directories found matching 'build' 09:13:10 INFO - no previously-included directories found matching 'dist' 09:13:10 INFO - no previously-included directories found matching '.git*' 09:13:10 INFO - Successfully installed jsonschema functools32 09:13:10 INFO - Cleaning up... 09:13:10 INFO - Return code: 0 09:13:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 09:13:10 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')]} 09:13:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:10 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')]} 09:13:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:10 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 0x7f17445acf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15148a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15e14e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, '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': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', '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 09:13:10 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 09:13:10 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 09:13:10 INFO - Using env: {'DISPLAY': ':0', 09:13:10 INFO - 'HOME': '/home/cltbld', 09:13:10 INFO - 'LANG': 'en_US.UTF-8', 09:13:10 INFO - 'LANGUAGE': 'en_US:en', 09:13:10 INFO - 'LOGNAME': 'cltbld', 09:13:10 INFO - 'MAIL': '/var/mail/cltbld', 09:13:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:10 INFO - 'MOZ_NO_REMOTE': '1', 09:13:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:10 INFO - 'NO_EM_RESTART': '1', 09:13:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:10 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:10 INFO - 'SHELL': '/bin/bash', 09:13:10 INFO - 'SHLVL': '1', 09:13:10 INFO - 'TERM': 'linux', 09:13:10 INFO - 'TMOUT': '86400', 09:13:10 INFO - 'USER': 'cltbld', 09:13:10 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:10 INFO - '_': '/tools/buildbot/bin/python'} 09:13:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:10 INFO - Downloading/unpacking flake8 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:10 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 09:13:13 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 09:13:13 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 09:13:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:13 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 09:13:14 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 09:13:14 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 09:13:14 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 09:13:14 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 09:13:14 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 09:13:14 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 09:13:14 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 09:13:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 09:13:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:13:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:13:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:13:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:13:14 INFO - no previously-included directories found matching 'docs/_build' 09:13:14 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 09:13:14 INFO - Running setup.py install for pep8 09:13:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:13:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:13:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:13:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:13:14 INFO - no previously-included directories found matching 'docs/_build' 09:13:14 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 09:13:14 INFO - Successfully installed flake8 mccabe pyflakes pep8 09:13:14 INFO - Cleaning up... 09:13:14 INFO - Return code: 0 09:13:14 INFO - Running post-action listener: _resource_record_post_action 09:13:14 INFO - Running post-action listener: _start_resource_monitoring 09:13:14 INFO - Starting resource monitoring. 09:13:14 INFO - ##### 09:13:14 INFO - ##### Running install step. 09:13:14 INFO - ##### 09:13:14 INFO - Running pre-action listener: _resource_record_pre_action 09:13:14 INFO - Running main action method: install 09:13:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 09:13:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 09:13:14 INFO - Reading from file tmpfile_stdout 09:13:14 INFO - Detecting whether we're running mozinstall >=1.0... 09:13:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 09:13:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 09:13:14 INFO - Reading from file tmpfile_stdout 09:13:14 INFO - Output received: 09:13:14 INFO - Usage: mozinstall [options] installer 09:13:14 INFO - Options: 09:13:14 INFO - -h, --help show this help message and exit 09:13:14 INFO - -d DEST, --destination=DEST 09:13:14 INFO - Directory to install application into. [default: 09:13:14 INFO - "/builds/slave/test-pgo"] 09:13:14 INFO - --app=APP Application being installed. [default: firefox] 09:13:14 INFO - mkdir: /builds/slave/test-pgo/build/application 09:13:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 09:13:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 09:13:27 INFO - Reading from file tmpfile_stdout 09:13:27 INFO - Output received: 09:13:27 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 09:13:27 INFO - Running post-action listener: _resource_record_post_action 09:13:27 INFO - ##### 09:13:27 INFO - ##### Running run-tests step. 09:13:27 INFO - ##### 09:13:27 INFO - Running pre-action listener: _resource_record_pre_action 09:13:27 INFO - Running main action method: run_tests 09:13:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 09:13:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 09:13:27 INFO - Python 2.7.3 09:13:27 INFO - Return code: 0 09:13:27 INFO - grabbing minidump binary from tooltool 09:13: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')]} 09:13: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 0x16706c0>, '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 0x16715c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1671a70>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 09:13: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 09:13: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 09:13:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:13:27 INFO - Return code: 0 09:13:27 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 09:13:27 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 09:13:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 09:13:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 09:13:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 09:13:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 09:13:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 09:13:29 INFO - Return code: 0 09:13: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-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 09:13: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-Beta --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-048 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 09:13:29 INFO - Using env: {'DISPLAY': ':0', 09:13:29 INFO - 'HOME': '/home/cltbld', 09:13:29 INFO - 'LANG': 'en_US.UTF-8', 09:13:29 INFO - 'LANGUAGE': 'en_US:en', 09:13:29 INFO - 'LOGNAME': 'cltbld', 09:13:29 INFO - 'MAIL': '/var/mail/cltbld', 09:13:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 09:13:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 09:13:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:29 INFO - 'MOZ_NO_REMOTE': '1', 09:13:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 09:13:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:29 INFO - 'NO_EM_RESTART': '1', 09:13:29 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:13:29 INFO - 'PWD': '/builds/slave/test-pgo', 09:13:29 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 09:13:29 INFO - 'SHELL': '/bin/bash', 09:13:29 INFO - 'SHLVL': '1', 09:13:29 INFO - 'TERM': 'linux', 09:13:29 INFO - 'TMOUT': '86400', 09:13:29 INFO - 'USER': 'cltbld', 09:13:29 INFO - 'XDG_SESSION_COOKIE': 'fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652', 09:13:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:29 INFO - '_': '/tools/buildbot/bin/python'} 09:13:29 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-048', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 09:13:29 INFO - mozversion application_buildid: 20160401063137 09:13:29 INFO - mozversion application_changeset: 9b5b1c40eb872b629bedef7aa6c857f44c31d353 09:13:29 INFO - mozversion application_display_name: Firefox 09:13:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:13:29 INFO - mozversion application_name: Firefox 09:13:29 INFO - mozversion application_remotingname: firefox 09:13:29 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 09:13:29 INFO - mozversion application_vendor: Mozilla 09:13:29 INFO - mozversion application_version: 46.0 09:13:29 INFO - mozversion platform_buildid: 20160401063137 09:13:29 INFO - mozversion platform_changeset: 9b5b1c40eb872b629bedef7aa6c857f44c31d353 09:13:29 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 09:13:29 INFO - mozversion platform_version: 46.0 09:13:29 INFO - using testdate: 1459527209 09:13:29 INFO - actual date: 1459527209 09:13:29 INFO - starting webserver on 'localhost:34336' 09:13:29 INFO - SUITE-START | Running 3 tests 09:13:29 INFO - TEST-START | dromaeo_css 09:13:29 INFO - operating with platform_type : linux_ 09:13:29 INFO - Initialising browser for dromaeo_css test... 09:13:29 INFO - TEST-INFO | started process 22929 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpB2iTIK/profile http://localhost:34336/getInfo.html) 09:13:33 INFO - PROCESS | 22929 | __metrics Screen width/height:1600/1200 09:13:33 INFO - PROCESS | 22929 | colorDepth:24 09:13:33 INFO - PROCESS | 22929 | Browser inner width/height: 1024/697 09:13:33 INFO - PROCESS | 22929 | __metrics 09:13:33 INFO - PROCESS | 22929 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:13:34 INFO - TEST-INFO | 22929: exit 0 09:13:34 INFO - Browser initialized. 09:13:34 INFO - Running cycle 1/1 for dromaeo_css test... 09:13:34 INFO - TEST-INFO | started process 23017 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpB2iTIK/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:13:46 INFO - PROCESS | 23017 | RSS: Main: 137191424 09:13:46 INFO - PROCESS | 23017 | 09:14:37 INFO - PROCESS | 23017 | 1459527277158 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] 09:16:45 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34336/tests/dromaeo/cssquery-ext.html) 09:16:46 INFO - PROCESS | 23017 | RSS: Main: 229388288 09:16:46 INFO - PROCESS | 23017 | 09:19:48 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-ext.html (next: http://localhost:34336/tests/dromaeo/cssquery-jquery.html) 09:19:48 INFO - PROCESS | 23017 | RSS: Main: 223805440 09:19:48 INFO - PROCESS | 23017 | 09:22:50 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34336/tests/dromaeo/cssquery-mootools.html) 09:22:51 INFO - PROCESS | 23017 | RSS: Main: 234889216 09:22:51 INFO - PROCESS | 23017 | 09:25:53 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34336/tests/dromaeo/cssquery-prototype.html) 09:25:53 INFO - PROCESS | 23017 | RSS: Main: 198909952 09:25:53 INFO - PROCESS | 23017 | 09:28:56 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34336/tests/dromaeo/cssquery-yui.html) 09:28:56 INFO - PROCESS | 23017 | RSS: Main: 201506816 09:28:56 INFO - PROCESS | 23017 | 09:31:58 INFO - PROCESS | 23017 | Cycle 1(1): loaded http://localhost:34336/tests/dromaeo/cssquery-yui.html (next: http://localhost:34336/tests/dromaeo/cssquery-dojo.html) 09:31:59 INFO - PROCESS | 23017 | RSS: Main: 246681600 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | __start_tp_report 09:31:59 INFO - PROCESS | 23017 | _x_x_mozilla_page_load 09:31:59 INFO - PROCESS | 23017 | _x_x_mozilla_page_load_details 09:31:59 INFO - PROCESS | 23017 | |i|pagename|runs| 09:31:59 INFO - PROCESS | 23017 | |0;dojo.html;3236.724878385337;3287.3425314937017;3316.9336613267737;3320.1201681554376;3354.4297469430185;5233.084210263199;5263.052650522909;5264.526192642671;5272.630915835893;5296.152615581508;5258.605604579653;5263.447338029499;5295.232191332255;5304.734763261831;5324.148136298183;4801.831935882245;4817.325574419584;4839.951600483985;4888.804447822101;4902.215645496722;4835.2505361669;4836.250381190904;4856.368672072644;4865.781039853215;4902.558769710726;4828.420589529262;4866.58634016109;4876.366072410582;4877.975610121945;4898.608111351084;4787.305840653085;4837.758112094416;4854.660173787836;4871.8782030449165;4882.121218180726;4716.622670186377;4731.313959475857;4785.042991401733;4814.350062741555;4824.710517368934;5168.09558327295;5185.274061631375;5202.791888324463;5214.843554693365;5256.789728410859;5578.358488773762;5738.42615738427;5745.511631511326;5747.195392645033;5756.7121643917635;5630.577706671975;5689.203511508392;5711.514521265697;5723.942760572382;5764.308283006066;5403.297571315743;5411.485908838615;5412.485813847678;5418.45815418455;5419.918701219485;5618.831435056954;5715.571332150105;5824.213731146326;5858.53131749459;5878.265216847894;5639.8590035249445;5646.491815736604;5650.689212093374;5659.518940890071;5690.317161940594;5624.21261023457;5666.206731057655;5666.744996475169;5667.149927510906;5670.461306175906;5518.862028449241;5589.189567512769;5605.607607467519;5622.550195984311;5724.513416359573;5663.8867222656145;5666.036773748473;5670.064439367458;5705.400932902068;5707.315122185364;4380.540043295472;4408.294672852392;4409.735415875058;4412.3160910059;4441.244988351988;3920.2747491714126;3976.065624578222;3979.005248687828;3986.5016872890887;3991.980040099839;5354.464553544614;5367.516923476827;5374.758135883894;5429.864253393618;5437.809676661298;5722.914156287659;5750.511206547407;5752.13717942312;5756.769729210785;5761.164631128463;5293.258943747878;5404.489791851413;5447.891042179134;5454.781808727606;5468.48049435303;4867.561919427269;4886.511348865156;4945.134601444733;4949.7772600233075;4977.477364876636;5843;5850.531957443394;5851.970740146272;5861.501772349398;5865.20819689345;5537.8061767839545;5599.748011339418;5643.858903527363;5691.430856914276;5732.57005724564;5864.706764661835;5913.911291330547;5917.733701983507;5920.73356698941;5926;5636.408177141505;5683.090705487102;5683.687397193029;5688.601797874109;5691.914621280601;5664.433556644302;5676.914846277226;5730.369659337553;5746.454086861741;5746.482816546531;5578.49793518569;5579.637323573955;5584.636998595079;5590.636608620427;5594.832155035356;5493.505584497414;5496.560275177896;5557.861053473695;5561.972190139023;5567;5417.377001644862;5453.7545810439415;5489.258950041853;5494.203340515683;5537.307836520435;5590.329160500766;5594.300712410949;5607.523360514402;5623.184638227516;5636;5478.068728316275;5483.5064844162625;5484;5489.313835770528;5505.6696598204235 09:31:59 INFO - PROCESS | 23017 | |1;ext.html;539.3797133296708;561.2423228641335;584.5060923519626;598.4135547163779;619.0590302739838;30125;37090;37890.431643525335;37995.430068548994;38048.42927356092;41384.79307603458;41732.37401438981;41826.16347673045;41863.58136418635;41926.37110443338;8701.260392866614;8879.644814207424;8924.330675199353;8928.330375221853;8930.062343453941;8637.395382323208;8776.341774366916;8782.604782784758;8784.341174411913;8991.550422478882;8990.325725570608;9066.274698024143;9073.228775554086;9076.31927605429;9109.68116115936;8991.55042247885;9031.051739567316;9070.77323066922;9081.818363632723;9089.500077495735;8780.121987801169;9020.097990200993;9026.23277021454;9032.729018129467;9036.367454278203;42129.36805947913;42537;42566;42658.146837063396;42676.359854602204;3707.353793277643;3724.571674257468;3725.5529336479526;3747.475353450519;3912.256671232485;31884.521732174035;32106.35787284241;32262.677373226437;32309.83845080783;32469.51295730566;4332;4361.323994780814;4386.670999675037;4415.20526305265;4537.727736335831;293199;294194;294566;294729;294937;62889.37110628835;64420.355796441436;64558.354416456175;64613;64635;67792.6610366945;67824;67951;68041.65979170073;68132.3186768126;18156.63686726258;18543.072846357896;18602.81397186011;18666.253349866125;18692.813071869106;14158.150510969375;14438;14446.277686115653;14459.566213013626;14491.347889345005;21566.059054685153;21983.560328793334;22070.88964555199;22196;22201;7476.738314159087;7724.729634462767;7755.1469338372735;7758.922410775933;7790.493617914817;1010.141379827141;1036.4506811389974;1057.0919044047268;1093.7211011192255;1166.381817636654;30002.399952000836;30085.849570752005;30652;30656.08031759051;31095;1027.5222021759917;1038.8026275007724;1091.263397206898;1130.37829193943;1194.1879521925;13333.533326333532;14121.699196326053;14855.2572371381;14868.182249976355;15425.84574154244;358896;362452;363775;363783;364471;57431;57585;57732;57744;57865.421345786846;1362.611655678127;1478.8151481064867;1490.2474250503426;1493.9850601493845;1495.9775603365958;30826.845865771425;30892;31228.687713122577;31590.526142108345;31709;50261.74869125631;50829.237561437345;50895.49104509056;50975.74512127416;50986.49013509966;326087;327058;327368;328295;329242;29702.405951881272;30083;32427;34904.82547587348;35122;40220.59779402168;40507.39238911478;41541;41651;43532.347014795436;36802;37245.4413183797;38049.239015218984;38292;38520;26293.868530657226;36565.81717091504;37743;38062;38107.809460952514;35202;35207;35234.8238258807;35307.117322067155;35353.82323088368;28427.573586396633;30359.24101897382;31596.842015789774;31821;32046.67953320437;25462.872685637194;26139.477210455305;26415.735842641327;26427.735722642527;26646 09:31:59 INFO - PROCESS | 23017 | |2;jquery.html;366.3460722610141;366.3863029425713;371.7137803891004;374.07230069427817;374.37105662487045;14022.43910243589;14848.406063757464;16935.576610584743;17918.910405447972;18715.157817898194;16879.40922067728;16990.7451388229;17383.13084345784;17519.299228030894;17791.64416711665;5402.594805389592;5577.358603760558;5581.972090139544;5594.944050559483;5598.720063996804;4057.3508238681816;4215.241256573816;4228.879346973054;4229.34445160999;5438.809641662542;4202.411662367271;5652.886942261152;5736.282964629421;5884.499817515516;5903.734331955073;5954.4938680212235;5977.641341519523;5981.611195272315;5998.910016349758;6014.8797024059495;5066.240063990394;5293.153095504701;5300.92048619271;5305.336832895888;5310.654807437543;19922;19987.400377988684;20019.39941801748;20176.39470815878;21105.577888442298;2465.7041155061506;2483.3170878008514;2493.1772515070165;2515.5849284867977;2553.706323772771;13286.53497127596;13607.659808504768;13673.316334183251;14125.646858828612;14205.289735513286;1926.7109933509946;1969.5371587676884;1976.7529058867642;1978.4163671716879;2016.7781544030145;59749;60029;62414.37585624131;62611.060834087526;63007.369926300606;9806.264530160266;10125.59497620087;10414.114800241912;10425.322354046963;10475.947620262003;13509.59471215865;13802.516911908035;13827.585172444842;13828.93085534566;13885.028048036742;8332.208440198172;8338.916610833936;8369.874451883226;8414.663413463393;8437.734339848948;8326.958365208257;8384.496930184208;8388.916110838936;8461.323094152453;8482.915170848337;6197.411245931629;6264.906026409608;6280.2777680566405;6290.937090629127;6357;1687.8987260764393;1755.683976884173;1792.6952418088695;1800.4958611588777;1841.1806745997903;1012.7771890184148;1046.5970601318547;1065.7974984753027;1084.9186311026704;1136.6476392318407;16753.91623041877;17699.823001770073;18302.450926472226;18588.721169182474;19210.231590736494;942.5098948546718;1075.5912753153752;1083.257968291707;1119.617035586417;1142.257532603814;10103.989601039837;10457.581696732046;10458.424786636655;10469.528871200815;10502.632407865842;514190;516030;525530;555299;610584;49590;62886.685566571876;74079.88880166801;80279.59860200662;83823.16176838275;1217.1358335581658;1233.7039110613389;1249.375312343828;1252.0296770003138;1264.690150913032;15874.60313492172;15875.603109921882;16013.51959441172;16341;16371;34303.82848085744;35134.29731405307;35228.119297016754;35521.82239088788;35569.82215088908;46770.76614616905;47132;47936;48179.5182048189;50622.74688626533;7641.88537171954;7777.57223352721;7896.644650990834;7925.881111783213;8017.238362355567;9218.032106628976;10229.232807539316;11530.711732206762;11971.16201865861;11975.520979160736;9540.427574345284;9944.45305508204;9961.900380996098;10084.596616135272;10254.794904101727;3048.100810260934;6659.966700166468;6799.266187122252;10103;10165.390076595428;10458.738531536772;10645.627403040857;10789.676309710721;10868.565257389615;11076.280041797258;7798.6490607923915;7810.453268271166;7877.960610196912;7901.209879012053;7911.327537159406;10269.74325641865;10321;10586.735331616463;10754.516046777757;10759.08547773448 09:31:59 INFO - PROCESS | 23017 | |3;mootools.html;1418.7233489469559;1532.899927099873;1540.869026132779;1732.2205007746518;1847.8706490545658;7124.893126603105;7801.726939557117;7929.246721561457;7936.92063079369;7952.840943181147;7739.613019349024;7923.168067352932;7967.641456134474;7969.721059762909;7974.32218261447;2367.7277113131954;2401.7598240176017;2405.0500052479347;2406.74729153439;2407.2417188585628;2342.7188737351544;2384.070212617081;2434.099383228208;2438.17102185257;2443.499082688045;2344.9531009379803;2367.715874095102;2368.301351101429;2390.270967354956;2404.158544509425;2329.77867102625;2333.603287441139;2341.356127065054;2343.8124950004044;2369.3484291819714;2330.6154484510034;2347.225415612844;2360.6104992676187;2360.8701521416315;2361.1971929543865;7948.284654381076;8001.439899207058;8046.235607617267;8049.476784009021;8056.436049476539;4986.326845875797;5089.058524173003;5099.056674515189;5102.209157580581;5104.515071068243;3123.5314702794535;3147.9685203147906;3149.5590617313596;3157.778955473118;3247.9188020299443;993.6323560282742;1008.8234558952154;1019.7858449725567;1044.7440377107582;1050.821360368739;11217.439128043647;11225.943870280596;11228.101751859831;11242.831357529643;11282.830757538644;4381.9123617527475;4390.275604525282;4454.510003899569;4460.821567137343;4462.776861156929;9613.759656008655;9737.951310243403;9757.512124393752;9762.072603102693;9786.314957952874;4981.153203955264;5023.271625614266;5028.5977121830165;5029.497050295015;5038.118329292359;3932.6264004919485;4019.8593049243136;4021.155557332934;4376.868693939187;4585.060062687141;3869.8645547406268;3874.9418758718643;3891.105045839473;3892.4355968384425;3938.074552480165;1201.8738032506635;1203.6569577670323;1207.3963018490754;1208.1361826294242;1227.1226073357593;1377.304461247084;1399.0276757653332;1406.7538180818317;1435.6841494871112;1436.3536408616164;7461.813454663677;7690.2694244046725;7694.461387702807;7697.153313135551;7704.614769261514;1175.7178277213407;1190.190670344157;1195.2410219510673;1199.1545960098285;1207.6316723399448;5811.128330750421;5865.853353666193;5885.793997210077;5889.764409423575;5890.087036509348;9470.57382417779;9938.403695778277;9944.751381215383;9953.25350598708;10088.596456141671;9854.50727463624;9943.651972180938;9946.80106397868;9949.850752238723;9984.650537231162;7243.855122897513;7329.5968721719755;7385.076865391826;7385.6307184640555;7408.073990751156;7484.139323977594;7510.286522780327;7517.887231691639;7527.397808175442;7630.580318082559;8784.165504277084;8974.41666291715;9069.455832650063;9070.501122438329;9072.410293330913;9005.324600654845;9052.954735226282;9097.363184577016;9182.586783594888;9284.396514226553;6361.7137228823885;6598.04328372393;6946.340097690711;7029.26192749754;7134.429245660231;7742;7753.612319383896;7762.844743105219;7807.375409967075;7818.765437036898;6873.518853680394;7234.891476627749;7306.4885458017425;7317.963410182915;7542.057242844645;7251.746188883364;7328.267173282842;7398.667059982421;7429.33136017761;7489.213632568501;7288.3076107769675;7333.230010848997;7334.119905611361;7338.486305958531;7357.558546487228;6813.7955861324235;6814.0800991867445;6855.143107111611;6856.451483881177;6876.69054892541;6573.80278591643;6582.473402127723;6600.900986485302;6611.504137189826;6667.766628167991 09:31:59 INFO - PROCESS | 23017 | |4;prototype.html;354.40990750400584;361.8823882238273;364.3132694870169;368.46388504725627;371.6265153520713;6077.0884367344925;6091;6108.664023478706;6141.754329826807;6191.690415479219;5750.223719797837;5882.205902203202;5888.793892213774;6044.8488787780325;6079.270487541501;4705.388299521058;4716.009637976021;4720.952790472103;4727.739974301412;4754.952450475503;4468.597826195642;4738.265568836836;4749.311349854269;4750.833720819772;4763.523647635226;4499.527549607294;4511.458624965009;4602.2636378179495;4676.532346765331;4690.742009189493;4691.437027556715;4693.36639553661;4695.929561056587;4701.811927522929;4704.882377940562;4165.708400411972;4177.373393990925;4180.163967206571;4180.519240287345;4188.91622167558;5605.691686957216;5760.308762948473;5763.337216220147;5767.250257466502;5777.393373695785;5451.863703407446;5454.263674403945;5457.672539647634;5465.617406781527;5478.397376288605;6486.578372405778;6491.51313651478;6498.772542960974;6500.902486462707;6513.120728701612;4554.476235232957;4581.244094724367;4581.839635612738;4585.105904348653;4590.288505281686;6545.149130613037;6650.334966503311;6681.699323530502;6720.865582688319;6721.294264102247;4661.766911654404;4670.252759558454;4676.298555216745;4680.087382960358;4680.906381872343;4726.905461890743;4730.526947305242;4737.028909073631;4738.64460165489;4739.691920025256;5432.67403955756;5449.182622606561;5454.699991500505;5457.045017121988;5457.508824205841;6283.874322513524;6492.383223593751;6508.088867558546;6512.05575191604;6516.218053833571;1655.6605895791333;1664.0847533856331;1674.715298399275;1676.0614056128363;1676.3210899585688;1108.490094556513;1116.525476672411;1133.4955944604737;1136.6419577832955;1138.231693606812;6282.905756413657;6288.276848162428;6296.835085509196;6299.370062993664;6300.464460520907;6426.646534440651;6671.432928201158;6690.598564086073;6693.464522838161;6703.262641109572;6160.383961603804;6195.938040619626;6268.2478102627065;6341.541445467568;6345.524085693592;3579.1231148368815;3623.85848457735;3629.310431018151;3631.5642122945414;3633;6736.696848641823;6890.586564806128;6892.862142757117;6896.3103689631635;6897.586144831226;6841.281665425158;6847.246802851682;6861.451083913275;6900.2409734929115;6903.309669033057;6875.518713689994;6887.931120688829;6902.344277293649;6910.48171387148;6916.515843890879;6500.252470965899;6654.3012983637955;6683.7660681875905;6687.331266873273;6694.330566943267;6571.868562628816;6621.735130594915;6687.866242675216;6694.765683201064;6702.932970670426;6938.722451101899;6955.547889387173;6963.0251764751965;6964.965175174092;6974.5466544676465;4628.39830821991;4662.930056049094;4700.341952126637;4703.294505824154;4706.364640773451;6741.797746067626;6751.56114852533;6753.189617245962;6756.763513277012;6758.763443279461;6571.047198156145;6571.704273307617;6572.14562106923;6576.210854697467;6586.242582103119;6421.197350331208;6537.215534135934;6538.411542961157;6540.934590654223;6553.344665533408;6424.839379015562;6426.164598602152;6429.517786165963;6430.228372595318;6433.324500927335;6556.409923106943;6584.637844918576;6588;6645.966770166118;6663.733450661919;6291.528135389955;6353.14232578596;6390.5526613136635;6394.424501794861;6403.903941440975 09:31:59 INFO - PROCESS | 23017 | |5;yui.html;830.6137645994611;854.6111519258737;926.8934072581651;927.5223260021089;947.6067432015716;12854.935725321371;12877.162984406006;13014.47942082318;13028.609141725752;13041.8043729344;13474.258915759654;15253.847461525382;15457.45898893539;15476.148811815345;15493.457728979489;730.6200775596686;893.5844832153064;905.6875377994581;905.85053466178;908.5411867007185;730.6127752291294;870.8650159225331;883.960221790021;892.2995448572872;892.848215803315;922.9446233226028;938.7277689470045;939.3471537281592;939.7321763297462;940.6002448959165;773.1611201845976;782.0849605961039;917.6512925088457;922.9861552076724;929.066288380177;680.8978653202009;687.2508965227926;687.5118665747325;687.9931200687979;688.5765254368578;14863.777043344358;14909.850901491063;14944.775828362583;14952.700945981129;14956.476523321631;13274.203547787163;13534.661633459144;13814.309284535833;13837.100588461717;13931.58205253844;10837.403942783143;11293.491792869341;11400.144989125765;11410.71473213168;11537.077033837273;3863.265979463893;3897.5517815451303;3929.626685464876;3929.9017524561827;3955.6835453163676;52049.47950520484;52404.21393679098;52667.999999999614;52887.47112528864;52915;11014.669559913216;11202.49588768491;11215.775684486265;11218.158638102175;11388.715282118013;19292.517687057934;19436.51408714765;19480.70778938317;19482.4155275342;19484.610307793766;7697.345725613385;7920.960395197987;8023.759287221393;8190.631421585924;8488.278496327881;4579.793909274024;4604.079184163181;4657.510961349078;4673.509281525459;4763.309320148559;3401.506781516716;3409.7954122752712;3417;3426.0920855973186;3434.5363375944426;585.4730742331935;630.9053641953652;635.707574515728;637.0317117980643;637.0857819029707;615.8121772859231;664.867026594683;702.4275215699291;705.8306006558389;713.5183750968076;9178.862317065115;9186.632534698538;9252.167304942588;9530.904690953003;9574.329796914288;634.4480302137079;659.7690808217086;717.178830239373;733.7321877514776;734.6951015328578;4280.422143010716;4378.190034843564;4420.557944205618;4506.909861802746;4541.874117559595;58357;59008.409915900294;59250.40749592535;59273.70363148156;59398;52685.7365713169;53691.463085369425;54434.45565544373;54756;54796.17805732917;46548.5345146551;47104.76447617808;47105.29342059872;47300.29049564259;47882.76058619685;8534.658613655385;8798;8869.334799890163;8889.64441422336;9041.77395565116;34917.650823491436;36250.27499450049;36398.27203455969;36723.44914826333;37046.07384815401;40297.59702402938;44805;45927.540724593666;45940.54059459363;45941.08117837692;11712.472938717608;11827.704307392383;11950.641480755592;12256.571020014613;12347.506099756269;13361.799573006607;13395.598132056053;13458.461661533429;13770.311484425538;13846.792298115737;12358.44387002569;12406.565770198;12653.936730316289;12959.222446653232;13015.609531713684;12581.508648731708;12762.68093297675;12995.350232488148;13086.607401777961;13134.408951597392;10299.639512617023;11575;11596.304221746723;12088;12931.094823362651;10011.199104071802;10193.184545236512;10252.948735256276;10585.523651435858;11212.958437646535;9876.45679487635;10526;10744.83882741775;10824.458777061272;10877.891221087688 09:31:59 INFO - PROCESS | 23017 | __end_tp_report 09:31:59 INFO - PROCESS | 23017 | __start_cc_report 09:31:59 INFO - PROCESS | 23017 | _x_x_mozilla_cycle_collect,725 09:31:59 INFO - PROCESS | 23017 | __end_cc_report 09:31:59 INFO - PROCESS | 23017 | __startTimestamp1459528319217__endTimestamp 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | ------- Summary: start ------- 09:31:59 INFO - PROCESS | 23017 | Number of tests: 6 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#0] dojo.html Cycles:165 Average:5298.11 Median:5493.51 stddev:566.21 (10.3%) stddev-sans-first:544.36 09:31:59 INFO - PROCESS | 23017 | Values: 3236.7 3287.3 3316.9 3320.1 3354.4 5233.1 5263.1 5264.5 5272.6 5296.2 5258.6 5263.4 5295.2 5304.7 5324.1 4801.8 4817.3 4840.0 4888.8 4902.2 4835.3 4836.3 4856.4 4865.8 4902.6 4828.4 4866.6 4876.4 4878.0 4898.6 4787.3 4837.8 4854.7 4871.9 4882.1 4716.6 4731.3 4785.0 4814.4 4824.7 5168.1 5185.3 5202.8 5214.8 5256.8 5578.4 5738.4 5745.5 5747.2 5756.7 5630.6 5689.2 5711.5 5723.9 5764.3 5403.3 5411.5 5412.5 5418.5 5419.9 5618.8 5715.6 5824.2 5858.5 5878.3 5639.9 5646.5 5650.7 5659.5 5690.3 5624.2 5666.2 5666.7 5667.1 5670.5 5518.9 5589.2 5605.6 5622.6 5724.5 5663.9 5666.0 5670.1 5705.4 5707.3 4380.5 4408.3 4409.7 4412.3 4441.2 3920.3 3976.1 3979.0 3986.5 3992.0 5354.5 5367.5 5374.8 5429.9 5437.8 5722.9 5750.5 5752.1 5756.8 5761.2 5293.3 5404.5 5447.9 5454.8 5468.5 4867.6 4886.5 4945.1 4949.8 4977.5 5843.0 5850.5 5852.0 5861.5 5865.2 5537.8 5599.7 5643.9 5691.4 5732.6 5864.7 5913.9 5917.7 5920.7 5926.0 5636.4 5683.1 5683.7 5688.6 5691.9 5664.4 5676.9 5730.4 5746.5 5746.5 5578.5 5579.6 5584.6 5590.6 5594.8 5493.5 5496.6 5557.9 5562.0 5567.0 5417.4 5453.8 5489.3 5494.2 5537.3 5590.3 5594.3 5607.5 5623.2 5636.0 5478.1 5483.5 5484.0 5489.3 5505.7 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#1] ext.html Cycles:180 Average:50372.07 Median:20407.29 stddev:86315.55 (423.0%) stddev-sans-first:86476.60 09:31:59 INFO - PROCESS | 23017 | Values: 539.4 561.2 584.5 598.4 619.1 30125.0 37090.0 37890.4 37995.4 38048.4 41384.8 41732.4 41826.2 41863.6 41926.4 8701.3 8879.6 8924.3 8928.3 8930.1 8637.4 8776.3 8782.6 8784.3 8991.6 8990.3 9066.3 9073.2 9076.3 9109.7 8991.6 9031.1 9070.8 9081.8 9089.5 8780.1 9020.1 9026.2 9032.7 9036.4 42129.4 42537.0 42566.0 42658.1 42676.4 3707.4 3724.6 3725.6 3747.5 3912.3 31884.5 32106.4 32262.7 32309.8 32469.5 4332.0 4361.3 4386.7 4415.2 4537.7 293199.0 294194.0 294566.0 294729.0 294937.0 62889.4 64420.4 64558.4 64613.0 64635.0 67792.7 67824.0 67951.0 68041.7 68132.3 18156.6 18543.1 18602.8 18666.3 18692.8 14158.2 14438.0 14446.3 14459.6 14491.3 21566.1 21983.6 22070.9 22196.0 22201.0 7476.7 7724.7 7755.1 7758.9 7790.5 1010.1 1036.5 1057.1 1093.7 1166.4 30002.4 30085.8 30652.0 30656.1 31095.0 1027.5 1038.8 1091.3 1130.4 1194.2 13333.5 14121.7 14855.3 14868.2 15425.8 358896.0 362452.0 363775.0 363783.0 364471.0 57431.0 57585.0 57732.0 57744.0 57865.4 1362.6 1478.8 1490.2 1494.0 1496.0 30826.8 30892.0 31228.7 31590.5 31709.0 50261.7 50829.2 50895.5 50975.7 50986.5 326087.0 327058.0 327368.0 328295.0 329242.0 29702.4 30083.0 32427.0 34904.8 35122.0 40220.6 40507.4 41541.0 41651.0 43532.3 36802.0 37245.4 38049.2 38292.0 38520.0 26293.9 36565.8 37743.0 38062.0 38107.8 35202.0 35207.0 35234.8 35307.1 35353.8 28427.6 30359.2 31596.8 31821.0 32046.7 25462.9 26139.5 26415.7 26427.7 26646.0 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#2] jquery.html Cycles:180 Average:28356.61 Median:2800.90 stddev:89101.55 (3181.2%) stddev-sans-first:89326.71 09:31:59 INFO - PROCESS | 23017 | Values: 366.3 366.4 371.7 374.1 374.4 14022.4 14848.4 16935.6 17918.9 18715.2 16879.4 16990.7 17383.1 17519.3 17791.6 5402.6 5577.4 5582.0 5594.9 5598.7 4057.4 4215.2 4228.9 4229.3 5438.8 4202.4 5652.9 5736.3 5884.5 5903.7 5954.5 5977.6 5981.6 5998.9 6014.9 5066.2 5293.2 5300.9 5305.3 5310.7 19922.0 19987.4 20019.4 20176.4 21105.6 2465.7 2483.3 2493.2 2515.6 2553.7 13286.5 13607.7 13673.3 14125.6 14205.3 1926.7 1969.5 1976.8 1978.4 2016.8 59749.0 60029.0 62414.4 62611.1 63007.4 9806.3 10125.6 10414.1 10425.3 10475.9 13509.6 13802.5 13827.6 13828.9 13885.0 8332.2 8338.9 8369.9 8414.7 8437.7 8327.0 8384.5 8388.9 8461.3 8482.9 6197.4 6264.9 6280.3 6290.9 6357.0 1687.9 1755.7 1792.7 1800.5 1841.2 1012.8 1046.6 1065.8 1084.9 1136.6 16753.9 17699.8 18302.5 18588.7 19210.2 942.5 1075.6 1083.3 1119.6 1142.3 10104.0 10457.6 10458.4 10469.5 10502.6 514190.0 516030.0 525530.0 555299.0 610584.0 49590.0 62886.7 74079.9 80279.6 83823.2 1217.1 1233.7 1249.4 1252.0 1264.7 15874.6 15875.6 16013.5 16341.0 16371.0 34303.8 35134.3 35228.1 35521.8 35569.8 46770.8 47132.0 47936.0 48179.5 50622.7 7641.9 7777.6 7896.6 7925.9 8017.2 9218.0 10229.2 11530.7 11971.2 11975.5 9540.4 9944.5 9961.9 10084.6 10254.8 3048.1 6660.0 6799.3 10103.0 10165.4 10458.7 10645.6 10789.7 10868.6 11076.3 7798.6 7810.5 7878.0 7901.2 7911.3 10269.7 10321.0 10586.7 10754.5 10759.1 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#3] mootools.html Cycles:180 Average:5697.21 Median:6467.76 stddev:2954.42 (45.7%) stddev-sans-first:2945.21 09:31:59 INFO - PROCESS | 23017 | Values: 1418.7 1532.9 1540.9 1732.2 1847.9 7124.9 7801.7 7929.2 7936.9 7952.8 7739.6 7923.2 7967.6 7969.7 7974.3 2367.7 2401.8 2405.1 2406.7 2407.2 2342.7 2384.1 2434.1 2438.2 2443.5 2345.0 2367.7 2368.3 2390.3 2404.2 2329.8 2333.6 2341.4 2343.8 2369.3 2330.6 2347.2 2360.6 2360.9 2361.2 7948.3 8001.4 8046.2 8049.5 8056.4 4986.3 5089.1 5099.1 5102.2 5104.5 3123.5 3148.0 3149.6 3157.8 3247.9 993.6 1008.8 1019.8 1044.7 1050.8 11217.4 11225.9 11228.1 11242.8 11282.8 4381.9 4390.3 4454.5 4460.8 4462.8 9613.8 9738.0 9757.5 9762.1 9786.3 4981.2 5023.3 5028.6 5029.5 5038.1 3932.6 4019.9 4021.2 4376.9 4585.1 3869.9 3874.9 3891.1 3892.4 3938.1 1201.9 1203.7 1207.4 1208.1 1227.1 1377.3 1399.0 1406.8 1435.7 1436.4 7461.8 7690.3 7694.5 7697.2 7704.6 1175.7 1190.2 1195.2 1199.2 1207.6 5811.1 5865.9 5885.8 5889.8 5890.1 9470.6 9938.4 9944.8 9953.3 10088.6 9854.5 9943.7 9946.8 9949.9 9984.7 7243.9 7329.6 7385.1 7385.6 7408.1 7484.1 7510.3 7517.9 7527.4 7630.6 8784.2 8974.4 9069.5 9070.5 9072.4 9005.3 9053.0 9097.4 9182.6 9284.4 6361.7 6598.0 6946.3 7029.3 7134.4 7742.0 7753.6 7762.8 7807.4 7818.8 6873.5 7234.9 7306.5 7318.0 7542.1 7251.7 7328.3 7398.7 7429.3 7489.2 7288.3 7333.2 7334.1 7338.5 7357.6 6813.8 6814.1 6855.1 6856.5 6876.7 6573.8 6582.5 6600.9 6611.5 6667.8 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#4] prototype.html Cycles:180 Average:5444.28 Median:6193.81 stddev:1624.01 (26.2%) stddev-sans-first:1582.99 09:31:59 INFO - PROCESS | 23017 | Values: 354.4 361.9 364.3 368.5 371.6 6077.1 6091.0 6108.7 6141.8 6191.7 5750.2 5882.2 5888.8 6044.8 6079.3 4705.4 4716.0 4721.0 4727.7 4755.0 4468.6 4738.3 4749.3 4750.8 4763.5 4499.5 4511.5 4602.3 4676.5 4690.7 4691.4 4693.4 4695.9 4701.8 4704.9 4165.7 4177.4 4180.2 4180.5 4188.9 5605.7 5760.3 5763.3 5767.3 5777.4 5451.9 5454.3 5457.7 5465.6 5478.4 6486.6 6491.5 6498.8 6500.9 6513.1 4554.5 4581.2 4581.8 4585.1 4590.3 6545.1 6650.3 6681.7 6720.9 6721.3 4661.8 4670.3 4676.3 4680.1 4680.9 4726.9 4730.5 4737.0 4738.6 4739.7 5432.7 5449.2 5454.7 5457.0 5457.5 6283.9 6492.4 6508.1 6512.1 6516.2 1655.7 1664.1 1674.7 1676.1 1676.3 1108.5 1116.5 1133.5 1136.6 1138.2 6282.9 6288.3 6296.8 6299.4 6300.5 6426.6 6671.4 6690.6 6693.5 6703.3 6160.4 6195.9 6268.2 6341.5 6345.5 3579.1 3623.9 3629.3 3631.6 3633.0 6736.7 6890.6 6892.9 6896.3 6897.6 6841.3 6847.2 6861.5 6900.2 6903.3 6875.5 6887.9 6902.3 6910.5 6916.5 6500.3 6654.3 6683.8 6687.3 6694.3 6571.9 6621.7 6687.9 6694.8 6702.9 6938.7 6955.5 6963.0 6965.0 6974.5 4628.4 4662.9 4700.3 4703.3 4706.4 6741.8 6751.6 6753.2 6756.8 6758.8 6571.0 6571.7 6572.1 6576.2 6586.2 6421.2 6537.2 6538.4 6540.9 6553.3 6424.8 6426.2 6429.5 6430.2 6433.3 6556.4 6584.6 6588.0 6646.0 6663.7 6291.5 6353.1 6390.6 6394.4 6403.9 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - PROCESS | 23017 | [#5] yui.html Cycles:180 Average:14609.59 Median:4560.83 stddev:16531.66 (362.5%) stddev-sans-first:16545.65 09:31:59 INFO - PROCESS | 23017 | Values: 830.6 854.6 926.9 927.5 947.6 12854.9 12877.2 13014.5 13028.6 13041.8 13474.3 15253.8 15457.5 15476.1 15493.5 730.6 893.6 905.7 905.9 908.5 730.6 870.9 884.0 892.3 892.8 922.9 938.7 939.3 939.7 940.6 773.2 782.1 917.7 923.0 929.1 680.9 687.3 687.5 688.0 688.6 14863.8 14909.9 14944.8 14952.7 14956.5 13274.2 13534.7 13814.3 13837.1 13931.6 10837.4 11293.5 11400.1 11410.7 11537.1 3863.3 3897.6 3929.6 3929.9 3955.7 52049.5 52404.2 52668.0 52887.5 52915.0 11014.7 11202.5 11215.8 11218.2 11388.7 19292.5 19436.5 19480.7 19482.4 19484.6 7697.3 7921.0 8023.8 8190.6 8488.3 4579.8 4604.1 4657.5 4673.5 4763.3 3401.5 3409.8 3417.0 3426.1 3434.5 585.5 630.9 635.7 637.0 637.1 615.8 664.9 702.4 705.8 713.5 9178.9 9186.6 9252.2 9530.9 9574.3 634.4 659.8 717.2 733.7 734.7 4280.4 4378.2 4420.6 4506.9 4541.9 58357.0 59008.4 59250.4 59273.7 59398.0 52685.7 53691.5 54434.5 54756.0 54796.2 46548.5 47104.8 47105.3 47300.3 47882.8 8534.7 8798.0 8869.3 8889.6 9041.8 34917.7 36250.3 36398.3 36723.4 37046.1 40297.6 44805.0 45927.5 45940.5 45941.1 11712.5 11827.7 11950.6 12256.6 12347.5 13361.8 13395.6 13458.5 13770.3 13846.8 12358.4 12406.6 12653.9 12959.2 13015.6 12581.5 12762.7 12995.4 13086.6 13134.4 10299.6 11575.0 11596.3 12088.0 12931.1 10011.2 10193.2 10252.9 10585.5 11213.0 9876.5 10526.0 10744.8 10824.5 10877.9 09:31:59 INFO - PROCESS | 23017 | -------- Summary: end -------- 09:31:59 INFO - PROCESS | 23017 | 09:31:59 INFO - TEST-INFO | 23017: exit 0 09:31:59 INFO - TEST-OK | dromaeo_css | took 1110580ms 09:31:59 INFO - TEST-START | kraken 09:31:59 INFO - operating with platform_type : linux_ 09:31:59 INFO - Initialising browser for kraken test... 09:31:59 INFO - TEST-INFO | started process 23217 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKrLVfp/profile http://localhost:34336/getInfo.html) 09:32:04 INFO - PROCESS | 23217 | __metrics Screen width/height:1600/1200 09:32:04 INFO - PROCESS | 23217 | colorDepth:24 09:32:04 INFO - PROCESS | 23217 | Browser inner width/height: 1024/697 09:32:04 INFO - PROCESS | 23217 | __metrics 09:32:04 INFO - PROCESS | 23217 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:32:05 INFO - TEST-INFO | 23217: exit 0 09:32:05 INFO - Browser initialized. 09:32:05 INFO - Running cycle 1/1 for kraken test... 09:32:05 INFO - TEST-INFO | started process 23308 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKrLVfp/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:32:17 INFO - PROCESS | 23308 | RSS: Main: 137113600 09:32:17 INFO - PROCESS | 23308 | 09:32:19 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34336/tests/kraken/driver.html?testName=audio-beat-detection) 09:32:20 INFO - PROCESS | 23308 | RSS: Main: 169250816 09:32:20 INFO - PROCESS | 23308 | 09:32:22 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34336/tests/kraken/driver.html?testName=audio-dft) 09:32:23 INFO - PROCESS | 23308 | RSS: Main: 168103936 09:32:23 INFO - PROCESS | 23308 | 09:32:26 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34336/tests/kraken/driver.html?testName=audio-fft) 09:32:26 INFO - PROCESS | 23308 | RSS: Main: 165629952 09:32:26 INFO - PROCESS | 23308 | 09:32:28 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34336/tests/kraken/driver.html?testName=audio-oscillator) 09:32:29 INFO - PROCESS | 23308 | RSS: Main: 164007936 09:32:29 INFO - PROCESS | 23308 | 09:32:31 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34336/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:32:31 INFO - PROCESS | 23308 | RSS: Main: 163127296 09:32:31 INFO - PROCESS | 23308 | 09:32:34 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34336/tests/kraken/driver.html?testName=imaging-darkroom) 09:32:35 INFO - PROCESS | 23308 | RSS: Main: 165019648 09:32:35 INFO - PROCESS | 23308 | 09:32:38 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34336/tests/kraken/driver.html?testName=imaging-desaturate) 09:32:39 INFO - PROCESS | 23308 | RSS: Main: 165654528 09:32:39 INFO - PROCESS | 23308 | 09:32:41 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34336/tests/kraken/driver.html?testName=json-parse-financial) 09:32:42 INFO - PROCESS | 23308 | RSS: Main: 165527552 09:32:42 INFO - PROCESS | 23308 | 09:32:44 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34336/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:32:44 INFO - PROCESS | 23308 | RSS: Main: 167833600 09:32:44 INFO - PROCESS | 23308 | 09:32:46 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:32:47 INFO - PROCESS | 23308 | RSS: Main: 166166528 09:32:47 INFO - PROCESS | 23308 | 09:32:48 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:32:49 INFO - PROCESS | 23308 | RSS: Main: 169861120 09:32:49 INFO - PROCESS | 23308 | 09:32:51 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:32:52 INFO - PROCESS | 23308 | RSS: Main: 174768128 09:32:52 INFO - PROCESS | 23308 | 09:32:54 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:32:55 INFO - PROCESS | 23308 | RSS: Main: 174596096 09:32:55 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | Cycle 1(1): loaded http://localhost:34336/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34336/tests/kraken/driver.html?testName=ai-astar) 09:32:57 INFO - PROCESS | 23308 | RSS: Main: 236658688 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | __start_tp_report 09:32:57 INFO - PROCESS | 23308 | _x_x_mozilla_page_load 09:32:57 INFO - PROCESS | 23308 | _x_x_mozilla_page_load_details 09:32:57 INFO - PROCESS | 23308 | |i|pagename|runs| 09:32:57 INFO - PROCESS | 23308 | |0;ai-astar;109;110;106;110;110;110;99;109;109;108 09:32:57 INFO - PROCESS | 23308 | |1;audio-beat-detection;152;122;155;169;136;160;150;127;177;124 09:32:57 INFO - PROCESS | 23308 | |2;audio-dft;158;160;159;162;159;159;168;163;161;159 09:32:57 INFO - PROCESS | 23308 | |3;audio-fft;76;76;75;152;74;76;72;73;147;73 09:32:57 INFO - PROCESS | 23308 | |4;audio-oscillator;95;95;139;94;94;96;135;95;94;136 09:32:57 INFO - PROCESS | 23308 | |5;imaging-gaussian-blur;109;109;110;110;109;109;108;109;109;109 09:32:57 INFO - PROCESS | 23308 | |6;imaging-darkroom;146;146;145;145;145;145;145;145;145;146 09:32:57 INFO - PROCESS | 23308 | |7;imaging-desaturate;96;96;95;96;96;96;96;96;96;95 09:32:57 INFO - PROCESS | 23308 | |8;json-parse-financial;56;53;55;53;53;55;56;53;52;52 09:32:57 INFO - PROCESS | 23308 | |9;json-stringify-tinderbox;65;65;65;65;66;65;65;65;73;66 09:32:57 INFO - PROCESS | 23308 | |10;stanford-crypto-aes;78;93;80;79;80;79;80;78;78;78 09:32:57 INFO - PROCESS | 23308 | |11;stanford-crypto-ccm;107;110;109;114;118;109;108;111;113;114 09:32:57 INFO - PROCESS | 23308 | |12;stanford-crypto-pbkdf2;136;126;134;134;132;126;134;136;143;131 09:32:57 INFO - PROCESS | 23308 | |13;stanford-crypto-sha256-iterative;69;65;65;65;66;69;67;66;65;64 09:32:57 INFO - PROCESS | 23308 | __end_tp_report 09:32:57 INFO - PROCESS | 23308 | __start_cc_report 09:32:57 INFO - PROCESS | 23308 | _x_x_mozilla_cycle_collect,936 09:32:57 INFO - PROCESS | 23308 | __end_cc_report 09:32:57 INFO - PROCESS | 23308 | __startTimestamp1459528377375__endTimestamp 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | ------- Summary: start ------- 09:32:57 INFO - PROCESS | 23308 | Number of tests: 14 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#0] ai-astar Cycles:10 Average:108.00 Median:110.00 stddev:3.40 (3.1%) stddev-sans-first:3.59 09:32:57 INFO - PROCESS | 23308 | Values: 109.0 110.0 106.0 110.0 110.0 110.0 99.0 109.0 109.0 108.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#1] audio-beat-detection Cycles:10 Average:147.20 Median:153.50 stddev:19.22 (12.5%) stddev-sans-first:20.31 09:32:57 INFO - PROCESS | 23308 | Values: 152.0 122.0 155.0 169.0 136.0 160.0 150.0 127.0 177.0 124.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#2] audio-dft Cycles:10 Average:160.80 Median:160.50 stddev:2.97 (1.9%) stddev-sans-first:2.98 09:32:57 INFO - PROCESS | 23308 | Values: 158.0 160.0 159.0 162.0 159.0 159.0 168.0 163.0 161.0 159.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#3] audio-fft Cycles:10 Average:89.40 Median:74.50 stddev:31.73 (42.6%) stddev-sans-first:33.28 09:32:57 INFO - PROCESS | 23308 | Values: 76.0 76.0 75.0 152.0 74.0 76.0 72.0 73.0 147.0 73.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#4] audio-oscillator Cycles:10 Average:107.30 Median:94.50 stddev:20.30 (21.5%) stddev-sans-first:21.04 09:32:57 INFO - PROCESS | 23308 | Values: 95.0 95.0 139.0 94.0 94.0 96.0 135.0 95.0 94.0 136.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#5] imaging-gaussian-blur Cycles:10 Average:109.10 Median:109.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 09:32:57 INFO - PROCESS | 23308 | Values: 109.0 109.0 110.0 110.0 109.0 109.0 108.0 109.0 109.0 109.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 09:32:57 INFO - PROCESS | 23308 | Values: 146.0 146.0 145.0 145.0 145.0 145.0 145.0 145.0 145.0 146.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 09:32:57 INFO - PROCESS | 23308 | Values: 96.0 96.0 95.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#8] json-parse-financial Cycles:10 Average:53.80 Median:54.00 stddev:1.55 (2.9%) stddev-sans-first:1.42 09:32:57 INFO - PROCESS | 23308 | Values: 56.0 53.0 55.0 53.0 53.0 55.0 56.0 53.0 52.0 52.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#9] json-stringify-tinderbox Cycles:10 Average:66.00 Median:65.00 stddev:2.49 (3.8%) stddev-sans-first:2.62 09:32:57 INFO - PROCESS | 23308 | Values: 65.0 65.0 65.0 65.0 66.0 65.0 65.0 65.0 73.0 66.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#10] stanford-crypto-aes Cycles:10 Average:80.30 Median:79.50 stddev:4.55 (5.7%) stddev-sans-first:4.75 09:32:57 INFO - PROCESS | 23308 | Values: 78.0 93.0 80.0 79.0 80.0 79.0 80.0 78.0 78.0 78.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#11] stanford-crypto-ccm Cycles:10 Average:111.30 Median:112.00 stddev:3.40 (3.0%) stddev-sans-first:3.23 09:32:57 INFO - PROCESS | 23308 | Values: 107.0 110.0 109.0 114.0 118.0 109.0 108.0 111.0 113.0 114.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:133.20 Median:134.00 stddev:4.98 (3.7%) stddev-sans-first:5.18 09:32:57 INFO - PROCESS | 23308 | Values: 136.0 126.0 134.0 134.0 132.0 126.0 134.0 136.0 143.0 131.0 09:32:57 INFO - PROCESS | 23308 | 09:32:57 INFO - PROCESS | 23308 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.10 Median:66.00 stddev:1.73 (2.6%) stddev-sans-first:1.48 09:32:57 INFO - PROCESS | 23308 | Values: 69.0 65.0 65.0 65.0 66.0 69.0 67.0 66.0 65.0 64.0 09:32:57 INFO - PROCESS | 23308 | -------- Summary: end -------- 09:32:57 INFO - PROCESS | 23308 | 09:32:58 INFO - TEST-INFO | 23308: exit 0 09:32:58 INFO - TEST-OK | kraken | took 58388ms 09:32:58 INFO - TEST-START | v8_7 09:32:58 INFO - operating with platform_type : linux_ 09:32:58 INFO - Initialising browser for v8_7 test... 09:32:58 INFO - TEST-INFO | started process 23563 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpfXlJwx/profile http://localhost:34336/getInfo.html) 09:33:02 INFO - PROCESS | 23563 | __metrics Screen width/height:1600/1200 09:33:02 INFO - PROCESS | 23563 | colorDepth:24 09:33:02 INFO - PROCESS | 23563 | Browser inner width/height: 1024/697 09:33:02 INFO - PROCESS | 23563 | __metrics 09:33:02 INFO - PROCESS | 23563 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:33:03 INFO - TEST-INFO | 23563: exit 0 09:33:03 INFO - Browser initialized. 09:33:03 INFO - Running cycle 1/1 for v8_7 test... 09:33:03 INFO - TEST-INFO | started process 23650 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpfXlJwx/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:33:15 INFO - PROCESS | 23650 | RSS: Main: 136888320 09:33:15 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | Cycle 1(1): loaded http://localhost:34336/tests/v8_7/run.html (next: http://localhost:34336/tests/v8_7/run.html) 09:33:37 INFO - PROCESS | 23650 | RSS: Main: 420483072 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | __start_tp_report 09:33:37 INFO - PROCESS | 23650 | _x_x_mozilla_page_load 09:33:37 INFO - PROCESS | 23650 | _x_x_mozilla_page_load_details 09:33:37 INFO - PROCESS | 23650 | |i|pagename|runs| 09:33:37 INFO - PROCESS | 23650 | |0;Richards;166.03021749958492 09:33:37 INFO - PROCESS | 23650 | |1;DeltaBlue;169.72165648336727 09:33:37 INFO - PROCESS | 23650 | |2;Encrypt;278.55153203342616 09:33:37 INFO - PROCESS | 23650 | |3;Decrypt;5273.684210526316 09:33:37 INFO - PROCESS | 23650 | |4;RayTrace;951.4747859181732 09:33:37 INFO - PROCESS | 23650 | |5;Earley;561.7977528089888 09:33:37 INFO - PROCESS | 23650 | |6;Boyer;10610.526315789473 09:33:37 INFO - PROCESS | 23650 | |7;RegExp;41204.08163265306 09:33:37 INFO - PROCESS | 23650 | |8;Splay;495.785820525533 09:33:37 INFO - PROCESS | 23650 | |9;NavierStokes;4840.579710144928 09:33:37 INFO - PROCESS | 23650 | __end_tp_report 09:33:37 INFO - PROCESS | 23650 | __startTimestamp1459528417643__endTimestamp 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | ------- Summary: start ------- 09:33:37 INFO - PROCESS | 23650 | Number of tests: 10 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#0] Richards Cycles:1 Average:166.03 Median:166.03 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 166.0 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#1] DeltaBlue Cycles:1 Average:169.72 Median:169.72 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 169.7 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#2] Encrypt Cycles:1 Average:278.55 Median:278.55 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 278.6 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#3] Decrypt Cycles:1 Average:5273.68 Median:5273.68 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 5273.7 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#4] RayTrace Cycles:1 Average:951.47 Median:951.47 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 951.5 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#5] Earley Cycles:1 Average:561.80 Median:561.80 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 561.8 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#6] Boyer Cycles:1 Average:10610.53 Median:10610.53 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 10610.5 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#7] RegExp Cycles:1 Average:41204.08 Median:41204.08 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 41204.1 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#8] Splay Cycles:1 Average:495.79 Median:495.79 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 495.8 09:33:37 INFO - PROCESS | 23650 | 09:33:37 INFO - PROCESS | 23650 | [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 09:33:37 INFO - PROCESS | 23650 | Values: 4840.6 09:33:37 INFO - PROCESS | 23650 | -------- Summary: end -------- 09:33:37 INFO - PROCESS | 23650 | 09:33:38 INFO - TEST-INFO | 23650: exit 0 09:33:38 INFO - TEST-OK | v8_7 | took 40243ms 09:33:38 INFO - SUITE-END | took 1209s 09:33:38 INFO - Completed test suite (00:20:09) 09:33:38 INFO - Working with test: dromaeo_css 09:33:38 INFO - Generating results file: dromaeo_css 09:33:38 INFO - Working with test: kraken 09:33:38 INFO - Generating results file: kraken 09:33:38 INFO - javascript benchmark 09:33:38 INFO - Working with test: v8_7 09:33:38 INFO - Generating results file: v8_7 09:33:38 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:33:38 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,53,35]] 09:33:38 INFO - process_Request line: dromaeo_css 7208.05 graph.html#tests=[[72,53,35]] 09:33:38 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:33:38 INFO - process_Request line: kraken 1473.60 graph.html#tests=[[232,53,35]] 09:33:38 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:33:38 INFO - process_Request line: v8_7 22054.83 graph.html#tests=[[230,53,35]] 09:33:38 INFO - RETURN: dromaeo_css: 7208.05 09:33:38 INFO - RETURN: kraken: 1473.60 09:33:38 INFO - RETURN: v8_7: 22054.83 09:33:38 INFO - javascript benchmark 09:33:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3236.724878385337, 3287.3425314937017, 3316.9336613267737, 3320.1201681554376, 3354.4297469430185, 5233.084210263199, 5263.052650522909, 5264.526192642671, 5272.630915835893, 5296.152615581508, 5258.605604579653, 5263.447338029499, 5295.232191332255, 5304.734763261831, 5324.148136298183, 4801.831935882245, 4817.325574419584, 4839.951600483985, 4888.804447822101, 4902.215645496722, 4835.2505361669, 4836.250381190904, 4856.368672072644, 4865.781039853215, 4902.558769710726, 4828.420589529262, 4866.58634016109, 4876.366072410582, 4877.975610121945, 4898.608111351084, 4787.305840653085, 4837.758112094416, 4854.660173787836, 4871.8782030449165, 4882.121218180726, 4716.622670186377, 4731.313959475857, 4785.042991401733, 4814.350062741555, 4824.710517368934, 5168.09558327295, 5185.274061631375, 5202.791888324463, 5214.843554693365, 5256.789728410859, 5578.358488773762, 5738.42615738427, 5745.511631511326, 5747.195392645033, 5756.7121643917635, 5630.577706671975, 5689.203511508392, 5711.514521265697, 5723.942760572382, 5764.308283006066, 5403.297571315743, 5411.485908838615, 5412.485813847678, 5418.45815418455, 5419.918701219485, 5618.831435056954, 5715.571332150105, 5824.213731146326, 5858.53131749459, 5878.265216847894, 5639.8590035249445, 5646.491815736604, 5650.689212093374, 5659.518940890071, 5690.317161940594, 5624.21261023457, 5666.206731057655, 5666.744996475169, 5667.149927510906, 5670.461306175906, 5518.862028449241, 5589.189567512769, 5605.607607467519, 5622.550195984311, 5724.513416359573, 5663.8867222656145, 5666.036773748473, 5670.064439367458, 5705.400932902068, 5707.315122185364, 4380.540043295472, 4408.294672852392, 4409.735415875058, 4412.3160910059, 4441.244988351988, 3920.2747491714126, 3976.065624578222, 3979.005248687828, 3986.5016872890887, 3991.980040099839, 5354.464553544614, 5367.516923476827, 5374.758135883894, 5429.864253393618, 5437.809676661298, 5722.914156287659, 5750.511206547407, 5752.13717942312, 5756.769729210785, 5761.164631128463, 5293.258943747878, 5404.489791851413, 5447.891042179134, 5454.781808727606, 5468.48049435303, 4867.561919427269, 4886.511348865156, 4945.134601444733, 4949.7772600233075, 4977.477364876636, 5843.0, 5850.531957443394, 5851.970740146272, 5861.501772349398, 5865.20819689345, 5537.8061767839545, 5599.748011339418, 5643.858903527363, 5691.430856914276, 5732.57005724564, 5864.706764661835, 5913.911291330547, 5917.733701983507, 5920.73356698941, 5926.0, 5636.408177141505, 5683.090705487102, 5683.687397193029, 5688.601797874109, 5691.914621280601, 5664.433556644302, 5676.914846277226, 5730.369659337553, 5746.454086861741, 5746.482816546531, 5578.49793518569, 5579.637323573955, 5584.636998595079, 5590.636608620427, 5594.832155035356, 5493.505584497414, 5496.560275177896, 5557.861053473695, 5561.972190139023, 5567.0, 5417.377001644862, 5453.7545810439415, 5489.258950041853, 5494.203340515683, 5537.307836520435, 5590.329160500766, 5594.300712410949, 5607.523360514402, 5623.184638227516, 5636.0, 5478.068728316275, 5483.5064844162625, 5484.0, 5489.313835770528, 5505.6696598204235], "unit": "score", "name": "dojo.html", "value": 5263.141273376534}, {"lowerIsBetter": false, "replicates": [539.3797133296708, 561.2423228641335, 584.5060923519626, 598.4135547163779, 619.0590302739838, 30125.0, 37090.0, 37890.431643525335, 37995.430068548994, 38048.42927356092, 41384.79307603458, 41732.37401438981, 41826.16347673045, 41863.58136418635, 41926.37110443338, 8701.260392866614, 8879.644814207424, 8924.330675199353, 8928.330375221853, 8930.062343453941, 8637.395382323208, 8776.341774366916, 8782.604782784758, 8784.341174411913, 8991.550422478882, 8990.325725570608, 9066.274698024143, 9073.228775554086, 9076.31927605429, 9109.68116115936, 8991.55042247885, 9031.051739567316, 9070.77323066922, 9081.818363632723, 9089.500077495735, 8780.121987801169, 9020.097990200993, 9026.23277021454, 9032.729018129467, 9036.367454278203, 42129.36805947913, 42537.0, 42566.0, 42658.146837063396, 42676.359854602204, 3707.353793277643, 3724.571674257468, 3725.5529336479526, 3747.475353450519, 3912.256671232485, 31884.521732174035, 32106.35787284241, 32262.677373226437, 32309.83845080783, 32469.51295730566, 4332.0, 4361.323994780814, 4386.670999675037, 4415.20526305265, 4537.727736335831, 293199.0, 294194.0, 294566.0, 294729.0, 294937.0, 62889.37110628835, 64420.355796441436, 64558.354416456175, 64613.0, 64635.0, 67792.6610366945, 67824.0, 67951.0, 68041.65979170073, 68132.3186768126, 18156.63686726258, 18543.072846357896, 18602.81397186011, 18666.253349866125, 18692.813071869106, 14158.150510969375, 14438.0, 14446.277686115653, 14459.566213013626, 14491.347889345005, 21566.059054685153, 21983.560328793334, 22070.88964555199, 22196.0, 22201.0, 7476.738314159087, 7724.729634462767, 7755.1469338372735, 7758.922410775933, 7790.493617914817, 1010.141379827141, 1036.4506811389974, 1057.0919044047268, 1093.7211011192255, 1166.381817636654, 30002.399952000836, 30085.849570752005, 30652.0, 30656.08031759051, 31095.0, 1027.5222021759917, 1038.8026275007724, 1091.263397206898, 1130.37829193943, 1194.1879521925, 13333.533326333532, 14121.699196326053, 14855.2572371381, 14868.182249976355, 15425.84574154244, 358896.0, 362452.0, 363775.0, 363783.0, 364471.0, 57431.0, 57585.0, 57732.0, 57744.0, 57865.421345786846, 1362.611655678127, 1478.8151481064867, 1490.2474250503426, 1493.9850601493845, 1495.9775603365958, 30826.845865771425, 30892.0, 31228.687713122577, 31590.526142108345, 31709.0, 50261.74869125631, 50829.237561437345, 50895.49104509056, 50975.74512127416, 50986.49013509966, 326087.0, 327058.0, 327368.0, 328295.0, 329242.0, 29702.405951881272, 30083.0, 32427.0, 34904.82547587348, 35122.0, 40220.59779402168, 40507.39238911478, 41541.0, 41651.0, 43532.347014795436, 36802.0, 37245.4413183797, 38049.239015218984, 38292.0, 38520.0, 26293.868530657226, 36565.81717091504, 37743.0, 38062.0, 38107.809460952514, 35202.0, 35207.0, 35234.8238258807, 35307.117322067155, 35353.82323088368, 28427.573586396633, 30359.24101897382, 31596.842015789774, 31821.0, 32046.67953320437, 25462.872685637194, 26139.477210455305, 26415.735842641327, 26427.735722642527, 26646.0], "unit": "score", "name": "ext.html", "value": 19515.855302560914}, {"lowerIsBetter": false, "replicates": [366.3460722610141, 366.3863029425713, 371.7137803891004, 374.07230069427817, 374.37105662487045, 14022.43910243589, 14848.406063757464, 16935.576610584743, 17918.910405447972, 18715.157817898194, 16879.40922067728, 16990.7451388229, 17383.13084345784, 17519.299228030894, 17791.64416711665, 5402.594805389592, 5577.358603760558, 5581.972090139544, 5594.944050559483, 5598.720063996804, 4057.3508238681816, 4215.241256573816, 4228.879346973054, 4229.34445160999, 5438.809641662542, 4202.411662367271, 5652.886942261152, 5736.282964629421, 5884.499817515516, 5903.734331955073, 5954.4938680212235, 5977.641341519523, 5981.611195272315, 5998.910016349758, 6014.8797024059495, 5066.240063990394, 5293.153095504701, 5300.92048619271, 5305.336832895888, 5310.654807437543, 19922.0, 19987.400377988684, 20019.39941801748, 20176.39470815878, 21105.577888442298, 2465.7041155061506, 2483.3170878008514, 2493.1772515070165, 2515.5849284867977, 2553.706323772771, 13286.53497127596, 13607.659808504768, 13673.316334183251, 14125.646858828612, 14205.289735513286, 1926.7109933509946, 1969.5371587676884, 1976.7529058867642, 1978.4163671716879, 2016.7781544030145, 59749.0, 60029.0, 62414.37585624131, 62611.060834087526, 63007.369926300606, 9806.264530160266, 10125.59497620087, 10414.114800241912, 10425.322354046963, 10475.947620262003, 13509.59471215865, 13802.516911908035, 13827.585172444842, 13828.93085534566, 13885.028048036742, 8332.208440198172, 8338.916610833936, 8369.874451883226, 8414.663413463393, 8437.734339848948, 8326.958365208257, 8384.496930184208, 8388.916110838936, 8461.323094152453, 8482.915170848337, 6197.411245931629, 6264.906026409608, 6280.2777680566405, 6290.937090629127, 6357.0, 1687.8987260764393, 1755.683976884173, 1792.6952418088695, 1800.4958611588777, 1841.1806745997903, 1012.7771890184148, 1046.5970601318547, 1065.7974984753027, 1084.9186311026704, 1136.6476392318407, 16753.91623041877, 17699.823001770073, 18302.450926472226, 18588.721169182474, 19210.231590736494, 942.5098948546718, 1075.5912753153752, 1083.257968291707, 1119.617035586417, 1142.257532603814, 10103.989601039837, 10457.581696732046, 10458.424786636655, 10469.528871200815, 10502.632407865842, 514190.0, 516030.0, 525530.0, 555299.0, 610584.0, 49590.0, 62886.685566571876, 74079.88880166801, 80279.59860200662, 83823.16176838275, 1217.1358335581658, 1233.7039110613389, 1249.375312343828, 1252.0296770003138, 1264.690150913032, 15874.60313492172, 15875.603109921882, 16013.51959441172, 16341.0, 16371.0, 34303.82848085744, 35134.29731405307, 35228.119297016754, 35521.82239088788, 35569.82215088908, 46770.76614616905, 47132.0, 47936.0, 48179.5182048189, 50622.74688626533, 7641.88537171954, 7777.57223352721, 7896.644650990834, 7925.881111783213, 8017.238362355567, 9218.032106628976, 10229.232807539316, 11530.711732206762, 11971.16201865861, 11975.520979160736, 9540.427574345284, 9944.45305508204, 9961.900380996098, 10084.596616135272, 10254.794904101727, 3048.100810260934, 6659.966700166468, 6799.266187122252, 10103.0, 10165.390076595428, 10458.738531536772, 10645.627403040857, 10789.676309710721, 10868.565257389615, 11076.280041797258, 7798.6490607923915, 7810.453268271166, 7877.960610196912, 7901.209879012053, 7911.327537159406, 10269.74325641865, 10321.0, 10586.735331616463, 10754.516046777757, 10759.08547773448], "unit": "score", "name": "jquery.html", "value": 8700.737189541838}, {"lowerIsBetter": false, "replicates": [1418.7233489469559, 1532.899927099873, 1540.869026132779, 1732.2205007746518, 1847.8706490545658, 7124.893126603105, 7801.726939557117, 7929.246721561457, 7936.92063079369, 7952.840943181147, 7739.613019349024, 7923.168067352932, 7967.641456134474, 7969.721059762909, 7974.32218261447, 2367.7277113131954, 2401.7598240176017, 2405.0500052479347, 2406.74729153439, 2407.2417188585628, 2342.7188737351544, 2384.070212617081, 2434.099383228208, 2438.17102185257, 2443.499082688045, 2344.9531009379803, 2367.715874095102, 2368.301351101429, 2390.270967354956, 2404.158544509425, 2329.77867102625, 2333.603287441139, 2341.356127065054, 2343.8124950004044, 2369.3484291819714, 2330.6154484510034, 2347.225415612844, 2360.6104992676187, 2360.8701521416315, 2361.1971929543865, 7948.284654381076, 8001.439899207058, 8046.235607617267, 8049.476784009021, 8056.436049476539, 4986.326845875797, 5089.058524173003, 5099.056674515189, 5102.209157580581, 5104.515071068243, 3123.5314702794535, 3147.9685203147906, 3149.5590617313596, 3157.778955473118, 3247.9188020299443, 993.6323560282742, 1008.8234558952154, 1019.7858449725567, 1044.7440377107582, 1050.821360368739, 11217.439128043647, 11225.943870280596, 11228.101751859831, 11242.831357529643, 11282.830757538644, 4381.9123617527475, 4390.275604525282, 4454.510003899569, 4460.821567137343, 4462.776861156929, 9613.759656008655, 9737.951310243403, 9757.512124393752, 9762.072603102693, 9786.314957952874, 4981.153203955264, 5023.271625614266, 5028.5977121830165, 5029.497050295015, 5038.118329292359, 3932.6264004919485, 4019.8593049243136, 4021.155557332934, 4376.868693939187, 4585.060062687141, 3869.8645547406268, 3874.9418758718643, 3891.105045839473, 3892.4355968384425, 3938.074552480165, 1201.8738032506635, 1203.6569577670323, 1207.3963018490754, 1208.1361826294242, 1227.1226073357593, 1377.304461247084, 1399.0276757653332, 1406.7538180818317, 1435.6841494871112, 1436.3536408616164, 7461.813454663677, 7690.2694244046725, 7694.461387702807, 7697.153313135551, 7704.614769261514, 1175.7178277213407, 1190.190670344157, 1195.2410219510673, 1199.1545960098285, 1207.6316723399448, 5811.128330750421, 5865.853353666193, 5885.793997210077, 5889.764409423575, 5890.087036509348, 9470.57382417779, 9938.403695778277, 9944.751381215383, 9953.25350598708, 10088.596456141671, 9854.50727463624, 9943.651972180938, 9946.80106397868, 9949.850752238723, 9984.650537231162, 7243.855122897513, 7329.5968721719755, 7385.076865391826, 7385.6307184640555, 7408.073990751156, 7484.139323977594, 7510.286522780327, 7517.887231691639, 7527.397808175442, 7630.580318082559, 8784.165504277084, 8974.41666291715, 9069.455832650063, 9070.501122438329, 9072.410293330913, 9005.324600654845, 9052.954735226282, 9097.363184577016, 9182.586783594888, 9284.396514226553, 6361.7137228823885, 6598.04328372393, 6946.340097690711, 7029.26192749754, 7134.429245660231, 7742.0, 7753.612319383896, 7762.844743105219, 7807.375409967075, 7818.765437036898, 6873.518853680394, 7234.891476627749, 7306.4885458017425, 7317.963410182915, 7542.057242844645, 7251.746188883364, 7328.267173282842, 7398.667059982421, 7429.33136017761, 7489.213632568501, 7288.3076107769675, 7333.230010848997, 7334.119905611361, 7338.486305958531, 7357.558546487228, 6813.7955861324235, 6814.0800991867445, 6855.143107111611, 6856.451483881177, 6876.69054892541, 6573.80278591643, 6582.473402127723, 6600.900986485302, 6611.504137189826, 6667.766628167991], "unit": "score", "name": "mootools.html", "value": 4694.680850418411}, {"lowerIsBetter": false, "replicates": [354.40990750400584, 361.8823882238273, 364.3132694870169, 368.46388504725627, 371.6265153520713, 6077.0884367344925, 6091.0, 6108.664023478706, 6141.754329826807, 6191.690415479219, 5750.223719797837, 5882.205902203202, 5888.793892213774, 6044.8488787780325, 6079.270487541501, 4705.388299521058, 4716.009637976021, 4720.952790472103, 4727.739974301412, 4754.952450475503, 4468.597826195642, 4738.265568836836, 4749.311349854269, 4750.833720819772, 4763.523647635226, 4499.527549607294, 4511.458624965009, 4602.2636378179495, 4676.532346765331, 4690.742009189493, 4691.437027556715, 4693.36639553661, 4695.929561056587, 4701.811927522929, 4704.882377940562, 4165.708400411972, 4177.373393990925, 4180.163967206571, 4180.519240287345, 4188.91622167558, 5605.691686957216, 5760.308762948473, 5763.337216220147, 5767.250257466502, 5777.393373695785, 5451.863703407446, 5454.263674403945, 5457.672539647634, 5465.617406781527, 5478.397376288605, 6486.578372405778, 6491.51313651478, 6498.772542960974, 6500.902486462707, 6513.120728701612, 4554.476235232957, 4581.244094724367, 4581.839635612738, 4585.105904348653, 4590.288505281686, 6545.149130613037, 6650.334966503311, 6681.699323530502, 6720.865582688319, 6721.294264102247, 4661.766911654404, 4670.252759558454, 4676.298555216745, 4680.087382960358, 4680.906381872343, 4726.905461890743, 4730.526947305242, 4737.028909073631, 4738.64460165489, 4739.691920025256, 5432.67403955756, 5449.182622606561, 5454.699991500505, 5457.045017121988, 5457.508824205841, 6283.874322513524, 6492.383223593751, 6508.088867558546, 6512.05575191604, 6516.218053833571, 1655.6605895791333, 1664.0847533856331, 1674.715298399275, 1676.0614056128363, 1676.3210899585688, 1108.490094556513, 1116.525476672411, 1133.4955944604737, 1136.6419577832955, 1138.231693606812, 6282.905756413657, 6288.276848162428, 6296.835085509196, 6299.370062993664, 6300.464460520907, 6426.646534440651, 6671.432928201158, 6690.598564086073, 6693.464522838161, 6703.262641109572, 6160.383961603804, 6195.938040619626, 6268.2478102627065, 6341.541445467568, 6345.524085693592, 3579.1231148368815, 3623.85848457735, 3629.310431018151, 3631.5642122945414, 3633.0, 6736.696848641823, 6890.586564806128, 6892.862142757117, 6896.3103689631635, 6897.586144831226, 6841.281665425158, 6847.246802851682, 6861.451083913275, 6900.2409734929115, 6903.309669033057, 6875.518713689994, 6887.931120688829, 6902.344277293649, 6910.48171387148, 6916.515843890879, 6500.252470965899, 6654.3012983637955, 6683.7660681875905, 6687.331266873273, 6694.330566943267, 6571.868562628816, 6621.735130594915, 6687.866242675216, 6694.765683201064, 6702.932970670426, 6938.722451101899, 6955.547889387173, 6963.0251764751965, 6964.965175174092, 6974.5466544676465, 4628.39830821991, 4662.930056049094, 4700.341952126637, 4703.294505824154, 4706.364640773451, 6741.797746067626, 6751.56114852533, 6753.189617245962, 6756.763513277012, 6758.763443279461, 6571.047198156145, 6571.704273307617, 6572.14562106923, 6576.210854697467, 6586.242582103119, 6421.197350331208, 6537.215534135934, 6538.411542961157, 6540.934590654223, 6553.344665533408, 6424.839379015562, 6426.164598602152, 6429.517786165963, 6430.228372595318, 6433.324500927335, 6556.409923106943, 6584.637844918576, 6588.0, 6645.966770166118, 6663.733450661919, 6291.528135389955, 6353.14232578596, 6390.5526613136635, 6394.424501794861, 6403.903941440975], "unit": "score", "name": "prototype.html", "value": 4923.976953319911}, {"lowerIsBetter": false, "replicates": [830.6137645994611, 854.6111519258737, 926.8934072581651, 927.5223260021089, 947.6067432015716, 12854.935725321371, 12877.162984406006, 13014.47942082318, 13028.609141725752, 13041.8043729344, 13474.258915759654, 15253.847461525382, 15457.45898893539, 15476.148811815345, 15493.457728979489, 730.6200775596686, 893.5844832153064, 905.6875377994581, 905.85053466178, 908.5411867007185, 730.6127752291294, 870.8650159225331, 883.960221790021, 892.2995448572872, 892.848215803315, 922.9446233226028, 938.7277689470045, 939.3471537281592, 939.7321763297462, 940.6002448959165, 773.1611201845976, 782.0849605961039, 917.6512925088457, 922.9861552076724, 929.066288380177, 680.8978653202009, 687.2508965227926, 687.5118665747325, 687.9931200687979, 688.5765254368578, 14863.777043344358, 14909.850901491063, 14944.775828362583, 14952.700945981129, 14956.476523321631, 13274.203547787163, 13534.661633459144, 13814.309284535833, 13837.100588461717, 13931.58205253844, 10837.403942783143, 11293.491792869341, 11400.144989125765, 11410.71473213168, 11537.077033837273, 3863.265979463893, 3897.5517815451303, 3929.626685464876, 3929.9017524561827, 3955.6835453163676, 52049.47950520484, 52404.21393679098, 52667.999999999614, 52887.47112528864, 52915.0, 11014.669559913216, 11202.49588768491, 11215.775684486265, 11218.158638102175, 11388.715282118013, 19292.517687057934, 19436.51408714765, 19480.70778938317, 19482.4155275342, 19484.610307793766, 7697.345725613385, 7920.960395197987, 8023.759287221393, 8190.631421585924, 8488.278496327881, 4579.793909274024, 4604.079184163181, 4657.510961349078, 4673.509281525459, 4763.309320148559, 3401.506781516716, 3409.7954122752712, 3417.0, 3426.0920855973186, 3434.5363375944426, 585.4730742331935, 630.9053641953652, 635.707574515728, 637.0317117980643, 637.0857819029707, 615.8121772859231, 664.867026594683, 702.4275215699291, 705.8306006558389, 713.5183750968076, 9178.862317065115, 9186.632534698538, 9252.167304942588, 9530.904690953003, 9574.329796914288, 634.4480302137079, 659.7690808217086, 717.178830239373, 733.7321877514776, 734.6951015328578, 4280.422143010716, 4378.190034843564, 4420.557944205618, 4506.909861802746, 4541.874117559595, 58357.0, 59008.409915900294, 59250.40749592535, 59273.70363148156, 59398.0, 52685.7365713169, 53691.463085369425, 54434.45565544373, 54756.0, 54796.17805732917, 46548.5345146551, 47104.76447617808, 47105.29342059872, 47300.29049564259, 47882.76058619685, 8534.658613655385, 8798.0, 8869.334799890163, 8889.64441422336, 9041.77395565116, 34917.650823491436, 36250.27499450049, 36398.27203455969, 36723.44914826333, 37046.07384815401, 40297.59702402938, 44805.0, 45927.540724593666, 45940.54059459363, 45941.08117837692, 11712.472938717608, 11827.704307392383, 11950.641480755592, 12256.571020014613, 12347.506099756269, 13361.799573006607, 13395.598132056053, 13458.461661533429, 13770.311484425538, 13846.792298115737, 12358.44387002569, 12406.565770198, 12653.936730316289, 12959.222446653232, 13015.609531713684, 12581.508648731708, 12762.68093297675, 12995.350232488148, 13086.607401777961, 13134.408951597392, 10299.639512617023, 11575.0, 11596.304221746723, 12088.0, 12931.094823362651, 10011.199104071802, 10193.184545236512, 10252.948735256276, 10585.523651435858, 11212.958437646535, 9876.45679487635, 10526.0, 10744.83882741775, 10824.458777061272, 10877.891221087688], "unit": "score", "name": "yui.html", "value": 6788.242872792295}], "name": "dromaeo_css", "value": 7208.047880651473}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 110.0, 106.0, 110.0, 110.0, 110.0, 99.0, 109.0, 109.0, 108.0], "unit": "score", "name": "ai-astar", "value": 108.0}, {"lowerIsBetter": true, "replicates": [152.0, 122.0, 155.0, 169.0, 136.0, 160.0, 150.0, 127.0, 177.0, 124.0], "unit": "score", "name": "audio-beat-detection", "value": 147.2}, {"lowerIsBetter": true, "replicates": [158.0, 160.0, 159.0, 162.0, 159.0, 159.0, 168.0, 163.0, 161.0, 159.0], "unit": "score", "name": "audio-dft", "value": 160.8}, {"lowerIsBetter": true, "replicates": [76.0, 76.0, 75.0, 152.0, 74.0, 76.0, 72.0, 73.0, 147.0, 73.0], "unit": "score", "name": "audio-fft", "value": 89.4}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 139.0, 94.0, 94.0, 96.0, 135.0, 95.0, 94.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 107.3}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 110.0, 110.0, 109.0, 109.0, 108.0, 109.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.1}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 145.0, 145.0, 145.0, 145.0, 145.0, 145.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.3}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [56.0, 53.0, 55.0, 53.0, 53.0, 55.0, 56.0, 53.0, 52.0, 52.0], "unit": "score", "name": "json-parse-financial", "value": 53.8}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 65.0, 65.0, 66.0, 65.0, 65.0, 65.0, 73.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.0}, {"lowerIsBetter": true, "replicates": [78.0, 93.0, 80.0, 79.0, 80.0, 79.0, 80.0, 78.0, 78.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.3}, {"lowerIsBetter": true, "replicates": [107.0, 110.0, 109.0, 114.0, 118.0, 109.0, 108.0, 111.0, 113.0, 114.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 111.3}, {"lowerIsBetter": true, "replicates": [136.0, 126.0, 134.0, 134.0, 132.0, 126.0, 134.0, 136.0, 143.0, 131.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 133.2}, {"lowerIsBetter": true, "replicates": [69.0, 65.0, 65.0, 65.0, 66.0, 69.0, 67.0, 66.0, 65.0, 64.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.1}], "name": "kraken", "value": 1473.5999999999997}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.03021749958492], "unit": "score", "name": "Richards", "value": 212.62394600000007}, {"lowerIsBetter": false, "replicates": [169.72165648336727], "unit": "score", "name": "DeltaBlue", "value": 389.56725600000016}, {"lowerIsBetter": false, "replicates": [278.55153203342616], "unit": "score", "name": "Encrypt", "value": 955.5897900000004}, {"lowerIsBetter": false, "replicates": [5273.684210526316], "unit": "score", "name": "Decrypt", "value": 50.47344311377245}, {"lowerIsBetter": false, "replicates": [951.4747859181732], "unit": "score", "name": "RayTrace", "value": 777.728439}, {"lowerIsBetter": false, "replicates": [561.7977528089888], "unit": "score", "name": "Earley", "value": 1186.3041400000002}, {"lowerIsBetter": false, "replicates": [10610.526315789473], "unit": "score", "name": "Boyer", "value": 62.81149305555559}, {"lowerIsBetter": false, "replicates": [41204.08163265306], "unit": "score", "name": "RegExp", "value": 22.10909608717188}, {"lowerIsBetter": false, "replicates": [495.785820525533], "unit": "score", "name": "Splay", "value": 164.36734700000002}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 22054.83493614648}]} 09:33:39 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,53,35]]", "result": "22054.83"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,53,35]]", "result": "1473.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,53,35]]", "result": "7208.05"}}} 09:33:39 INFO - Return code: 0 09:33:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 09:33:39 INFO - # TBPL SUCCESS # 09:33:39 INFO - Running post-action listener: _resource_record_post_action 09:33:39 INFO - Running post-run listener: _resource_record_post_run 09:33:40 INFO - Total resource usage - Wall time: 1224s; CPU: 13.0%; Read bytes: 4096; Write bytes: 467161088; Read time: 12; Write time: 485384 09:33:40 INFO - install - Wall time: 13s; CPU: 13.0%; Read bytes: 0; Write bytes: 126984192; Read time: 0; Write time: 182420 09:33:40 INFO - run-tests - Wall time: 1211s; CPU: 13.0%; Read bytes: 4096; Write bytes: 220368896; Read time: 12; Write time: 209424 09:33:40 INFO - Running post-run listener: _upload_blobber_files 09:33:40 INFO - Blob upload gear active. 09:33:40 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 09:33:40 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 09:33:40 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-Beta', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 09:33:40 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-Beta -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 09:33:40 INFO - (blobuploader) - INFO - Open directory for files ... 09:33:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 09:33:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:33:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:33:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:33:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:33:41 INFO - (blobuploader) - INFO - Done attempting. 09:33:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:33:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:33:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:33:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:33:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:33:42 INFO - (blobuploader) - INFO - Done attempting. 09:33:42 INFO - (blobuploader) - INFO - Iteration through files over. 09:33:42 INFO - Return code: 0 09:33:42 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 09:33:42 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 09:33:42 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e4ccb6180223455f4777712f66458738358e3d8418eecd0033f71436b3d9fd6c8975b8ff207c2728dee6f0b0b4d07101a3746d1a7ac9db391fd561e6d2857116", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/209489c9e904241fdaca1747f8f5f35bde0b8cd90d4ab4870b0bd1889d0706101f11d9427a0260db4814ac4056a6f323c592d2cda7765814d475b9f2b0c4c46d"} 09:33:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 09:33:42 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 09:33:42 INFO - Contents: 09:33:42 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e4ccb6180223455f4777712f66458738358e3d8418eecd0033f71436b3d9fd6c8975b8ff207c2728dee6f0b0b4d07101a3746d1a7ac9db391fd561e6d2857116", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/209489c9e904241fdaca1747f8f5f35bde0b8cd90d4ab4870b0bd1889d0706101f11d9427a0260db4814ac4056a6f323c592d2cda7765814d475b9f2b0c4c46d"} 09:33:42 INFO - Running post-run listener: copy_logs_to_upload_dir 09:33:42 INFO - Copying logs to upload dir... 09:33:42 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 09:33:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1266.412253 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2016-04-01 09:33:42.334144) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:33:42.338057) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e4ccb6180223455f4777712f66458738358e3d8418eecd0033f71436b3d9fd6c8975b8ff207c2728dee6f0b0b4d07101a3746d1a7ac9db391fd561e6d2857116", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/209489c9e904241fdaca1747f8f5f35bde0b8cd90d4ab4870b0bd1889d0706101f11d9427a0260db4814ac4056a6f323c592d2cda7765814d475b9f2b0c4c46d"} build_url:https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011459 build_url: 'https://queue.taskcluster.net/v1/task/SyXBWRn_TP2GjXIIOzsgrA/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/e4ccb6180223455f4777712f66458738358e3d8418eecd0033f71436b3d9fd6c8975b8ff207c2728dee6f0b0b4d07101a3746d1a7ac9db391fd561e6d2857116", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/209489c9e904241fdaca1747f8f5f35bde0b8cd90d4ab4870b0bd1889d0706101f11d9427a0260db4814ac4056a6f323c592d2cda7765814d475b9f2b0c4c46d"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:33:42.367027) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:33:42.367759) ========= 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=fa44defc139c4ba8574fe040000001db-1459527115.432883-256497652 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004557 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:33:42.447383) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:33:42.447718) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:33:42.448019) ========= ========= Total master_lag: 0.28 =========