builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-043 starttime: 1453964853.46 results: success (0) buildid: 20160127203724 builduid: c87fab1076a5459caa4e5934f305ba73 revision: 0ecd7d72f232304da046b352c457e039e35ceed7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.461658) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.462095) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.462373) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006368 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.07 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.535896) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.536178) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.671049) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.671564) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.032783 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.765237) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.765570) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.767315) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.767610) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-27 23:07:33-- 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% 83.1M=0s 2016-01-27 23:07:34 (83.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.176976 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.985778) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:33.986053) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.146877 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.160168) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.162407) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 0ecd7d72f232304da046b352c457e039e35ceed7 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 0ecd7d72f232304da046b352c457e039e35ceed7 --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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-27 23:07:34,358 truncating revision to first 12 chars 2016-01-27 23:07:34,358 Setting DEBUG logging. 2016-01-27 23:07:34,358 attempt 1/10 2016-01-27 23:07:34,358 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/0ecd7d72f232?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-27 23:07:34,618 unpacking tar archive at: fx-team-0ecd7d72f232/testing/mozharness/ program finished with exit code 0 elapsedTime=0.534969 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.723489) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.723807) ========= echo 0ecd7d72f232304da046b352c457e039e35ceed7 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'0ecd7d72f232304da046b352c457e039e35ceed7'] 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 0ecd7d72f232304da046b352c457e039e35ceed7 program finished with exit code 0 elapsedTime=0.004091 script_repo_revision: '0ecd7d72f232304da046b352c457e039e35ceed7' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.782567) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.782848) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-27 23:07:34.885539) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2016-01-27 23:07:34.885822) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:07:35 INFO - MultiFileLogger online at 20160127 23:07:35 in /builds/slave/test-pgo 23:07:35 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 23:07:35 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 23:07:35 INFO - {'append_to_log': False, 23:07:35 INFO - 'base_work_dir': '/builds/slave/test-pgo', 23:07:35 INFO - 'blob_upload_branch': 'Fx-Team', 23:07:35 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 23:07:35 INFO - 'branch': 'Fx-Team', 23:07:35 INFO - 'buildbot_json_path': 'buildprops.json', 23:07:35 INFO - 'config_files': ('talos/linux_config.py',), 23:07:35 INFO - 'default_actions': ('clobber', 23:07:35 INFO - 'read-buildbot-config', 23:07:35 INFO - 'download-and-extract', 23:07:35 INFO - 'populate-webroot', 23:07:35 INFO - 'create-virtualenv', 23:07:35 INFO - 'install', 23:07:35 INFO - 'run-tests'), 23:07:35 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:07:35 INFO - 'download_minidump_stackwalk': True, 23:07:35 INFO - 'download_symbols': 'ondemand', 23:07:35 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:07:35 INFO - 'tooltool.py': '/tools/tooltool.py', 23:07:35 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:07:35 INFO - '/tools/misc-python/virtualenv.py')}, 23:07:35 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:07:35 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:07:35 INFO - 'installer_path': 'installer.exe', 23:07:35 INFO - 'log_level': 'info', 23:07:35 INFO - 'log_name': 'talos', 23:07:35 INFO - 'log_to_console': True, 23:07:35 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:07:35 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:07:35 INFO - 'opt_config_files': (), 23:07:35 INFO - 'pip_index': False, 23:07:35 INFO - 'sps_profile': False, 23:07:35 INFO - 'sps_profile_interval': 0, 23:07:35 INFO - 'suite': 'dromaeojs', 23:07:35 INFO - 'system_bits': '32', 23:07:35 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:07:35 INFO - 'title': 'talos-linux64-ix-043', 23:07:35 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:07:35 INFO - 'use_talos_json': True, 23:07:35 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 23:07:35 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:07:35 INFO - 'work_dir': 'build'} 23:07:35 INFO - ##### 23:07:35 INFO - ##### Running clobber step. 23:07:35 INFO - ##### 23:07:35 INFO - Running pre-action listener: _resource_record_pre_action 23:07:35 INFO - Running main action method: clobber 23:07:35 INFO - rmtree: /builds/slave/test-pgo/build 23:07:35 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 23:07:36 INFO - Running post-action listener: _resource_record_post_action 23:07:36 INFO - ##### 23:07:36 INFO - ##### Running read-buildbot-config step. 23:07:36 INFO - ##### 23:07:36 INFO - Running pre-action listener: _resource_record_pre_action 23:07:36 INFO - Running main action method: read_buildbot_config 23:07:36 INFO - Using buildbot properties: 23:07:36 INFO - { 23:07:36 INFO - "project": "", 23:07:36 INFO - "product": "firefox", 23:07:36 INFO - "script_repo_revision": "production", 23:07:36 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 23:07:36 INFO - "repository": "", 23:07:36 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 23:07:36 INFO - "buildid": "20160127203724", 23:07:36 INFO - "pgo_build": "True", 23:07:36 INFO - "basedir": "/builds/slave/test-pgo", 23:07:36 INFO - "buildnumber": 457, 23:07:36 INFO - "slavename": "talos-linux64-ix-043", 23:07:36 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 23:07:36 INFO - "platform": "ubuntu64_hw", 23:07:36 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 23:07:36 INFO - "branch": "fx-team", 23:07:36 INFO - "repo_path": "integration/fx-team", 23:07:36 INFO - "revision": "0ecd7d72f232304da046b352c457e039e35ceed7", 23:07:36 INFO - "stage_platform": "linux64-pgo", 23:07:36 INFO - "builduid": "c87fab1076a5459caa4e5934f305ba73", 23:07:36 INFO - "slavebuilddir": "test" 23:07:36 INFO - } 23:07:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 23:07:36 INFO - Running post-action listener: _resource_record_post_action 23:07:36 INFO - ##### 23:07:36 INFO - ##### Running download-and-extract step. 23:07:36 INFO - ##### 23:07:36 INFO - Running pre-action listener: _resource_record_pre_action 23:07:36 INFO - Running main action method: download_and_extract 23:07:36 INFO - mkdir: /builds/slave/test-pgo/build/tests 23:07:36 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')]} 23:07:36 INFO - https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 23:07:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/test_packages.json 23:07:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/test_packages.json 23:07:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 23:07:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 23:07:43 INFO - Downloaded 1448 bytes. 23:07:43 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 23:07:43 INFO - Using the following test package requirements: 23:07:43 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:07:43 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 23:07:43 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 23:07:43 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'jsshell-linux-x86_64.zip'], 23:07:43 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 23:07:43 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:07:43 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 23:07:43 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 23:07:43 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 23:07:43 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 23:07:43 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 23:07:43 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 23:07:43 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:07: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')]} 23:07:43 INFO - https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:07:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:07:54 INFO - Downloaded 22503329 bytes. 23:07:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:07:54 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:07:55 INFO - Return code: 0 23:07:55 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:07:55 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')]} 23:07:55 INFO - https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:07:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 23:07:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:07:57 INFO - Downloaded 22503329 bytes. 23:07:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:07:57 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 23:07:59 INFO - Return code: 0 23:07:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:07:59 INFO - https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:07:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:07:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:07:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 23:07:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:08:00 INFO - Downloaded 10706572 bytes. 23:08:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 23:08:00 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 23:08:00 INFO - Return code: 0 23:08: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')]} 23:08:00 INFO - https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:08:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:08:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:08:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:08:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:08:01 INFO - Downloaded 55983946 bytes. 23:08:01 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:08:01 INFO - mkdir: /builds/slave/test-pgo/properties 23:08:01 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 23:08:01 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 23:08:01 INFO - Contents: 23:08:01 INFO - build_url:https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 23:08:01 INFO - Running post-action listener: _resource_record_post_action 23:08:01 INFO - Running post-action listener: set_extra_try_arguments 23:08:01 INFO - ##### 23:08:01 INFO - ##### Running populate-webroot step. 23:08:01 INFO - ##### 23:08:01 INFO - Running pre-action listener: _resource_record_pre_action 23:08:01 INFO - Running main action method: populate_webroot 23:08:01 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:08:01 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:08:01 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:08:01 INFO - '--tppagecycles', 23:08:01 INFO - '7'], 23:08:01 INFO - 'tests': ['tsvgm']}}, 23:08:01 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 23:08:01 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:08:01 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 23:08:01 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 23:08:01 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:08:01 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:08:01 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'tests': ['damp', 'tps']}, 23:08:01 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['damp', 'tps']}, 23:08:01 INFO - 'g3': {'tests': ['dromaeo_dom']}, 23:08:01 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:08:01 INFO - 'other': {'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'other-e10s': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'other_l64': {'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'other_nol64': {'tests': ['a11yr', 23:08:01 INFO - 'ts_paint', 23:08:01 INFO - 'tpaint', 23:08:01 INFO - 'sessionrestore', 23:08:01 INFO - 'sessionrestore_no_auto_restore']}, 23:08:01 INFO - 'svgr': {'tests': ['tsvgx', 23:08:01 INFO - 'tsvgr_opacity', 23:08:01 INFO - 'tart', 23:08:01 INFO - 'tscrollx', 23:08:01 INFO - 'cart']}, 23:08:01 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['tsvgx', 23:08:01 INFO - 'tsvgr_opacity', 23:08:01 INFO - 'tart', 23:08:01 INFO - 'tscrollx', 23:08:01 INFO - 'cart']}, 23:08:01 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'tests': ['tp5o']}, 23:08:01 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'talos_options': ['--e10s'], 23:08:01 INFO - 'tests': ['tp5o']}, 23:08:01 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'talos_options': ['--xperf_path', 23:08:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:08:01 INFO - 'tests': ['tp5n']}, 23:08:01 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:08:01 INFO - 'talos_options': ['--e10s', 23:08:01 INFO - '--xperf_path', 23:08:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:08:01 INFO - 'tests': ['tp5n']}}, 23:08:01 INFO - 'talos.zip': {'path': '', 23:08:01 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:08:01 INFO - Running post-action listener: _resource_record_post_action 23:08:01 INFO - ##### 23:08:01 INFO - ##### Running create-virtualenv step. 23:08:01 INFO - ##### 23:08:01 INFO - Running pre-action listener: _resource_record_pre_action 23:08:01 INFO - Running main action method: create_virtualenv 23:08:01 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 23:08:01 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 23:08:01 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 23:08:01 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:08:01 INFO - Using real prefix '/usr' 23:08:01 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 23:08:02 INFO - Installing distribute.............................................................................................................................................................................................done. 23:08:04 INFO - Installing pip.................done. 23:08:04 INFO - Return code: 0 23:08:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 23:08:04 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')]} 23:08:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:04 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')]} 23:08:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:04 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:04 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 23:08:04 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 23:08:04 INFO - Using env: {'DISPLAY': ':0', 23:08:04 INFO - 'HOME': '/home/cltbld', 23:08:04 INFO - 'LANG': 'en_US.UTF-8', 23:08:04 INFO - 'LANGUAGE': 'en_US:en', 23:08:04 INFO - 'LOGNAME': 'cltbld', 23:08:04 INFO - 'MAIL': '/var/mail/cltbld', 23:08:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:04 INFO - 'MOZ_NO_REMOTE': '1', 23:08:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:04 INFO - 'NO_EM_RESTART': '1', 23:08:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:04 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:04 INFO - 'SHELL': '/bin/bash', 23:08:04 INFO - 'SHLVL': '1', 23:08:04 INFO - 'TERM': 'linux', 23:08:04 INFO - 'TMOUT': '86400', 23:08:04 INFO - 'USER': 'cltbld', 23:08:04 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:04 INFO - '_': '/tools/buildbot/bin/python'} 23:08:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:04 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 23:08:04 INFO - Cleaning up... 23:08:04 INFO - Return code: 0 23:08:04 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 23:08:04 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')]} 23:08:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:04 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')]} 23:08:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:04 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:04 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 23:08:04 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 23:08:04 INFO - Using env: {'DISPLAY': ':0', 23:08:04 INFO - 'HOME': '/home/cltbld', 23:08:04 INFO - 'LANG': 'en_US.UTF-8', 23:08:04 INFO - 'LANGUAGE': 'en_US:en', 23:08:04 INFO - 'LOGNAME': 'cltbld', 23:08:04 INFO - 'MAIL': '/var/mail/cltbld', 23:08:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:04 INFO - 'MOZ_NO_REMOTE': '1', 23:08:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:04 INFO - 'NO_EM_RESTART': '1', 23:08:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:04 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:04 INFO - 'SHELL': '/bin/bash', 23:08:04 INFO - 'SHLVL': '1', 23:08:04 INFO - 'TERM': 'linux', 23:08:04 INFO - 'TMOUT': '86400', 23:08:04 INFO - 'USER': 'cltbld', 23:08:04 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:04 INFO - '_': '/tools/buildbot/bin/python'} 23:08:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:04 INFO - Downloading/unpacking psutil>=0.7.1 23:08: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 23:08: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 23:08: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 23:08: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 23:08: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 23:08: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 23:08:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 23:08:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:08:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:08:06 INFO - Installing collected packages: psutil 23:08:06 INFO - Running setup.py install for psutil 23:08:06 INFO - building 'psutil._psutil_linux' extension 23:08:06 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 23:08:06 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 23:08:06 INFO - building 'psutil._psutil_posix' extension 23:08:06 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 23:08:06 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 23:08:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:08:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:08:07 INFO - Successfully installed psutil 23:08:07 INFO - Cleaning up... 23:08:07 INFO - Return code: 0 23:08:07 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 23:08: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')]} 23:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08: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')]} 23:08:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08: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', '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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 23:08: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 mozsystemmonitor==0.0.0 23:08:07 INFO - Using env: {'DISPLAY': ':0', 23:08:07 INFO - 'HOME': '/home/cltbld', 23:08:07 INFO - 'LANG': 'en_US.UTF-8', 23:08:07 INFO - 'LANGUAGE': 'en_US:en', 23:08:07 INFO - 'LOGNAME': 'cltbld', 23:08:07 INFO - 'MAIL': '/var/mail/cltbld', 23:08:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:07 INFO - 'MOZ_NO_REMOTE': '1', 23:08:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:07 INFO - 'NO_EM_RESTART': '1', 23:08:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:07 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:07 INFO - 'SHELL': '/bin/bash', 23:08:07 INFO - 'SHLVL': '1', 23:08:07 INFO - 'TERM': 'linux', 23:08:07 INFO - 'TMOUT': '86400', 23:08:07 INFO - 'USER': 'cltbld', 23:08:07 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:07 INFO - '_': '/tools/buildbot/bin/python'} 23:08:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:07 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 23:08: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 23:08: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 23:08: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 23:08: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 23:08: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 23:08: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 23:08:09 INFO - Downloading mozsystemmonitor-0.0.tar.gz 23:08:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:08:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 23:08:09 INFO - Installing collected packages: mozsystemmonitor 23:08:09 INFO - Running setup.py install for mozsystemmonitor 23:08:09 INFO - Successfully installed mozsystemmonitor 23:08:09 INFO - Cleaning up... 23:08:09 INFO - Return code: 0 23:08:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 23:08:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:09 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:09 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 23:08:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:08:09 INFO - Using env: {'DISPLAY': ':0', 23:08:09 INFO - 'HOME': '/home/cltbld', 23:08:09 INFO - 'LANG': 'en_US.UTF-8', 23:08:09 INFO - 'LANGUAGE': 'en_US:en', 23:08:09 INFO - 'LOGNAME': 'cltbld', 23:08:09 INFO - 'MAIL': '/var/mail/cltbld', 23:08:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:09 INFO - 'MOZ_NO_REMOTE': '1', 23:08:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:09 INFO - 'NO_EM_RESTART': '1', 23:08:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:09 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:09 INFO - 'SHELL': '/bin/bash', 23:08:09 INFO - 'SHLVL': '1', 23:08:09 INFO - 'TERM': 'linux', 23:08:09 INFO - 'TMOUT': '86400', 23:08:09 INFO - 'USER': 'cltbld', 23:08:09 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:09 INFO - '_': '/tools/buildbot/bin/python'} 23:08:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:09 INFO - Downloading/unpacking blobuploader==1.2.4 23:08:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:11 INFO - Downloading blobuploader-1.2.4.tar.gz 23:08:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:08:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 23:08:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:11 INFO - Downloading docopt-0.6.1.tar.gz 23:08:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 23:08:11 INFO - Installing collected packages: blobuploader, requests, docopt 23:08:11 INFO - Running setup.py install for blobuploader 23:08:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:08:12 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 23:08:12 INFO - Running setup.py install for requests 23:08:12 INFO - Running setup.py install for docopt 23:08:12 INFO - Successfully installed blobuploader requests docopt 23:08:12 INFO - Cleaning up... 23:08:12 INFO - Return code: 0 23:08:12 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:08:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:12 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:12 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 23:08:12 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 23:08:12 INFO - Using env: {'DISPLAY': ':0', 23:08:12 INFO - 'HOME': '/home/cltbld', 23:08:12 INFO - 'LANG': 'en_US.UTF-8', 23:08:12 INFO - 'LANGUAGE': 'en_US:en', 23:08:12 INFO - 'LOGNAME': 'cltbld', 23:08:12 INFO - 'MAIL': '/var/mail/cltbld', 23:08:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:12 INFO - 'MOZ_NO_REMOTE': '1', 23:08:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:12 INFO - 'NO_EM_RESTART': '1', 23:08:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:12 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:12 INFO - 'SHELL': '/bin/bash', 23:08:12 INFO - 'SHLVL': '1', 23:08:12 INFO - 'TERM': 'linux', 23:08:12 INFO - 'TMOUT': '86400', 23:08:12 INFO - 'USER': 'cltbld', 23:08:12 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:12 INFO - '_': '/tools/buildbot/bin/python'} 23:08:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:08:12 INFO - Running setup.py (path:/tmp/pip-zVlJno-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:08:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:08:12 INFO - Running setup.py (path:/tmp/pip-U8g_gf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:08:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:08:12 INFO - Running setup.py (path:/tmp/pip-11GxlD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:08:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:08:12 INFO - Running setup.py (path:/tmp/pip-mcV5VZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:08:13 INFO - Running setup.py (path:/tmp/pip-ADwl8H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:08:13 INFO - Running setup.py (path:/tmp/pip-YFExuR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:08:13 INFO - Running setup.py (path:/tmp/pip-eg7ys9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:08:13 INFO - Running setup.py (path:/tmp/pip-tROB84-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:08:13 INFO - Running setup.py (path:/tmp/pip-Vz4CuF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:08:13 INFO - Running setup.py (path:/tmp/pip-DStM9L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:08:13 INFO - Running setup.py (path:/tmp/pip-2f6bOP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:08:13 INFO - Running setup.py (path:/tmp/pip-j8wbcr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:08:13 INFO - Running setup.py (path:/tmp/pip-kXMRJf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:08:13 INFO - Running setup.py (path:/tmp/pip-_CeLXT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:08:13 INFO - Running setup.py (path:/tmp/pip-Lf5wTj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:08:13 INFO - Running setup.py (path:/tmp/pip-dY4Los-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:08:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:08:13 INFO - Running setup.py (path:/tmp/pip-VdCZaq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:08:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:08:14 INFO - Running setup.py install for manifestparser 23:08:14 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Running setup.py install for mozcrash 23:08:14 INFO - Running setup.py install for mozdebug 23:08:14 INFO - Running setup.py install for mozdevice 23:08:14 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Running setup.py install for mozfile 23:08:14 INFO - Running setup.py install for mozhttpd 23:08:14 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Running setup.py install for mozinfo 23:08:14 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Running setup.py install for mozInstall 23:08:14 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 23:08:14 INFO - Running setup.py install for mozleak 23:08:14 INFO - Running setup.py install for mozlog 23:08:15 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Running setup.py install for moznetwork 23:08:15 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Running setup.py install for mozprocess 23:08:15 INFO - Running setup.py install for mozprofile 23:08:15 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Running setup.py install for mozrunner 23:08:15 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Running setup.py install for mozscreenshot 23:08:15 INFO - Running setup.py install for moztest 23:08:15 INFO - Running setup.py install for mozversion 23:08:15 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 23:08:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:08:15 INFO - Cleaning up... 23:08:15 INFO - Return code: 0 23:08:15 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:08:15 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')]} 23:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:15 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')]} 23:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:15 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:15 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 23:08:15 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 23:08:15 INFO - Using env: {'DISPLAY': ':0', 23:08:15 INFO - 'HOME': '/home/cltbld', 23:08:15 INFO - 'LANG': 'en_US.UTF-8', 23:08:15 INFO - 'LANGUAGE': 'en_US:en', 23:08:15 INFO - 'LOGNAME': 'cltbld', 23:08:15 INFO - 'MAIL': '/var/mail/cltbld', 23:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:15 INFO - 'MOZ_NO_REMOTE': '1', 23:08:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:15 INFO - 'NO_EM_RESTART': '1', 23:08:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:15 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:15 INFO - 'SHELL': '/bin/bash', 23:08:15 INFO - 'SHLVL': '1', 23:08:15 INFO - 'TERM': 'linux', 23:08:15 INFO - 'TMOUT': '86400', 23:08:15 INFO - 'USER': 'cltbld', 23:08:15 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:15 INFO - '_': '/tools/buildbot/bin/python'} 23:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:08:16 INFO - Running setup.py (path:/tmp/pip-BKKyay-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:08:16 INFO - Running setup.py (path:/tmp/pip-GdQspz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:08:16 INFO - Running setup.py (path:/tmp/pip-iChAW_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:08:16 INFO - Running setup.py (path:/tmp/pip-rgYwex-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 23:08:16 INFO - Running setup.py (path:/tmp/pip-Xn4FEd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:08:16 INFO - Running setup.py (path:/tmp/pip-fUw6Ha-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:08:16 INFO - Running setup.py (path:/tmp/pip-XyIR1E-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:08:16 INFO - Running setup.py (path:/tmp/pip-9q3RZK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 23:08:16 INFO - Running setup.py (path:/tmp/pip-_ng9sf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 23:08:16 INFO - Running setup.py (path:/tmp/pip-TVBFup-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:08:16 INFO - Running setup.py (path:/tmp/pip-7w5bXw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:08:16 INFO - Running setup.py (path:/tmp/pip-AYNokW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:08:16 INFO - Running setup.py (path:/tmp/pip-4eN2a2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 23:08:16 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)) 23:08:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:08:16 INFO - Running setup.py (path:/tmp/pip-049Cvb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 23:08:17 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)) 23:08:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:08:17 INFO - Running setup.py (path:/tmp/pip-_iLjfh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 23:08:17 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)) 23:08:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 23:08:17 INFO - Running setup.py (path:/tmp/pip-k1hJ7R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 23:08:17 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)) 23:08:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 23:08:17 INFO - Running setup.py (path:/tmp/pip-dDvDYR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 23:08:17 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)) 23:08:17 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)) 23:08:17 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)) 23:08:17 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)) 23:08:17 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)) 23:08:17 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)) 23:08:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 23:08:17 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 23:08:17 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 23:08:17 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 23:08:17 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 23:08:17 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 23:08:17 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 23:08:18 INFO - Downloading blessings-1.6.tar.gz 23:08:18 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 23:08:19 INFO - Installing collected packages: blessings 23:08:19 INFO - Running setup.py install for blessings 23:08:19 INFO - Successfully installed blessings 23:08:19 INFO - Cleaning up... 23:08:19 INFO - Return code: 0 23:08:19 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 23:08:19 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:08:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:08:19 INFO - Reading from file tmpfile_stdout 23:08:19 INFO - Current package versions: 23:08:19 INFO - argparse == 1.2.1 23:08:19 INFO - blessings == 1.6 23:08:19 INFO - blobuploader == 1.2.4 23:08:19 INFO - docopt == 0.6.1 23:08:19 INFO - manifestparser == 1.1 23:08:19 INFO - mozInstall == 1.12 23:08:19 INFO - mozcrash == 0.16 23:08:19 INFO - mozdebug == 0.1 23:08:19 INFO - mozdevice == 0.48 23:08:19 INFO - mozfile == 1.2 23:08:19 INFO - mozhttpd == 0.7 23:08:19 INFO - mozinfo == 0.9 23:08:19 INFO - mozleak == 0.1 23:08:19 INFO - mozlog == 3.1 23:08:19 INFO - moznetwork == 0.27 23:08:19 INFO - mozprocess == 0.22 23:08:19 INFO - mozprofile == 0.28 23:08:19 INFO - mozrunner == 6.11 23:08:19 INFO - mozscreenshot == 0.1 23:08:19 INFO - mozsystemmonitor == 0.0 23:08:19 INFO - moztest == 0.7 23:08:19 INFO - mozversion == 1.4 23:08:19 INFO - psutil == 3.1.1 23:08:19 INFO - requests == 1.2.3 23:08:19 INFO - wsgiref == 0.1.2 23:08:19 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 23:08:19 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')]} 23:08:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:19 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')]} 23:08:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:19 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:19 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 23:08:19 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 23:08:19 INFO - Using env: {'DISPLAY': ':0', 23:08:19 INFO - 'HOME': '/home/cltbld', 23:08:19 INFO - 'LANG': 'en_US.UTF-8', 23:08:19 INFO - 'LANGUAGE': 'en_US:en', 23:08:19 INFO - 'LOGNAME': 'cltbld', 23:08:19 INFO - 'MAIL': '/var/mail/cltbld', 23:08:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:19 INFO - 'MOZ_NO_REMOTE': '1', 23:08:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:19 INFO - 'NO_EM_RESTART': '1', 23:08:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:19 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:19 INFO - 'SHELL': '/bin/bash', 23:08:19 INFO - 'SHLVL': '1', 23:08:19 INFO - 'TERM': 'linux', 23:08:19 INFO - 'TMOUT': '86400', 23:08:19 INFO - 'USER': 'cltbld', 23:08:19 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:19 INFO - '_': '/tools/buildbot/bin/python'} 23:08:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 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)) 23:08:19 INFO - Cleaning up... 23:08:19 INFO - Return code: 0 23:08:19 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 23:08:19 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')]} 23:08:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:19 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')]} 23:08:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:19 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:19 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 23:08:19 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 23:08:19 INFO - Using env: {'DISPLAY': ':0', 23:08:19 INFO - 'HOME': '/home/cltbld', 23:08:19 INFO - 'LANG': 'en_US.UTF-8', 23:08:19 INFO - 'LANGUAGE': 'en_US:en', 23:08:19 INFO - 'LOGNAME': 'cltbld', 23:08:19 INFO - 'MAIL': '/var/mail/cltbld', 23:08:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:19 INFO - 'MOZ_NO_REMOTE': '1', 23:08:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:19 INFO - 'NO_EM_RESTART': '1', 23:08:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:19 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:19 INFO - 'SHELL': '/bin/bash', 23:08:19 INFO - 'SHLVL': '1', 23:08:19 INFO - 'TERM': 'linux', 23:08:19 INFO - 'TMOUT': '86400', 23:08:19 INFO - 'USER': 'cltbld', 23:08:19 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:19 INFO - '_': '/tools/buildbot/bin/python'} 23:08:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:19 INFO - Downloading/unpacking jsonschema 23:08:19 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 23:08:19 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 23:08:19 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 23:08:19 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 23:08:19 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 23:08:19 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 23:08:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:08:21 INFO - Downloading/unpacking functools32 (from jsonschema) 23:08:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:08:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:08:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:08:21 INFO - Downloading functools32-3.2.3-2.tar.gz 23:08:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 23:08:21 INFO - warning: no files found matching '*.txt' 23:08:21 INFO - no previously-included directories found matching 'build' 23:08:21 INFO - no previously-included directories found matching 'dist' 23:08:21 INFO - no previously-included directories found matching '.git*' 23:08:21 INFO - Installing collected packages: jsonschema, functools32 23:08:21 INFO - Running setup.py install for functools32 23:08:21 INFO - warning: no files found matching '*.txt' 23:08:21 INFO - no previously-included directories found matching 'build' 23:08:21 INFO - no previously-included directories found matching 'dist' 23:08:21 INFO - no previously-included directories found matching '.git*' 23:08:22 INFO - Successfully installed jsonschema functools32 23:08:22 INFO - Cleaning up... 23:08:22 INFO - Return code: 0 23:08:22 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 23:08:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:08:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:08:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:08:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:08:22 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 0x7feb5ac19f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15b78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1687630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, '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': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', '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 23:08:22 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 23:08:22 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 23:08:22 INFO - Using env: {'DISPLAY': ':0', 23:08:22 INFO - 'HOME': '/home/cltbld', 23:08:22 INFO - 'LANG': 'en_US.UTF-8', 23:08:22 INFO - 'LANGUAGE': 'en_US:en', 23:08:22 INFO - 'LOGNAME': 'cltbld', 23:08:22 INFO - 'MAIL': '/var/mail/cltbld', 23:08:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:22 INFO - 'MOZ_NO_REMOTE': '1', 23:08:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:22 INFO - 'NO_EM_RESTART': '1', 23:08:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:22 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:22 INFO - 'SHELL': '/bin/bash', 23:08:22 INFO - 'SHLVL': '1', 23:08:22 INFO - 'TERM': 'linux', 23:08:22 INFO - 'TMOUT': '86400', 23:08:22 INFO - 'USER': 'cltbld', 23:08:22 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:22 INFO - '_': '/tools/buildbot/bin/python'} 23:08:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:08:22 INFO - Downloading/unpacking flake8 23:08:22 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 23:08:22 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 23:08:22 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 23:08:22 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 23:08:22 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 23:08:22 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 23:08:24 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:08:24 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:08:24 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 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 23:08:24 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 23:08:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:08:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:08:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:08:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:08:24 INFO - no previously-included directories found matching 'docs/_build' 23:08:24 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:08:25 INFO - Running setup.py install for pep8 23:08:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:08:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:08:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:08:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:08:25 INFO - no previously-included directories found matching 'docs/_build' 23:08:25 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 23:08:25 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:08:25 INFO - Cleaning up... 23:08:25 INFO - Return code: 0 23:08:25 INFO - Running post-action listener: _resource_record_post_action 23:08:25 INFO - Running post-action listener: _start_resource_monitoring 23:08:25 INFO - Starting resource monitoring. 23:08:25 INFO - ##### 23:08:25 INFO - ##### Running install step. 23:08:25 INFO - ##### 23:08:25 INFO - Running pre-action listener: _resource_record_pre_action 23:08:25 INFO - Running main action method: install 23:08:25 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 23:08:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 23:08:25 INFO - Reading from file tmpfile_stdout 23:08:25 INFO - Detecting whether we're running mozinstall >=1.0... 23:08:25 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 23:08:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 23:08:25 INFO - Reading from file tmpfile_stdout 23:08:25 INFO - Output received: 23:08:25 INFO - Usage: mozinstall [options] installer 23:08:25 INFO - Options: 23:08:25 INFO - -h, --help show this help message and exit 23:08:25 INFO - -d DEST, --destination=DEST 23:08:25 INFO - Directory to install application into. [default: 23:08:25 INFO - "/builds/slave/test-pgo"] 23:08:25 INFO - --app=APP Application being installed. [default: firefox] 23:08:25 INFO - mkdir: /builds/slave/test-pgo/build/application 23:08:25 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 23:08:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 23:08:41 INFO - Reading from file tmpfile_stdout 23:08:41 INFO - Output received: 23:08:41 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 23:08:41 INFO - Running post-action listener: _resource_record_post_action 23:08:41 INFO - ##### 23:08:41 INFO - ##### Running run-tests step. 23:08:41 INFO - ##### 23:08:41 INFO - Running pre-action listener: _resource_record_pre_action 23:08:41 INFO - Running main action method: run_tests 23:08:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 23:08:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 23:08:41 INFO - Python 2.7.3 23:08:41 INFO - Return code: 0 23:08:41 INFO - grabbing minidump binary from tooltool 23:08: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')]} 23:08:41 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 0x1718840>, '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 0x16856b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1685b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 23:08:41 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 23:08:41 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 23:08:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:08:41 INFO - Return code: 0 23:08:41 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 23:08:41 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 23:08:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 23:08:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 23:08:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 23:08:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 23:08:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 23:08:42 INFO - Return code: 0 23:08:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 23:08:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-043 --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 23:08:42 INFO - Using env: {'DISPLAY': ':0', 23:08:42 INFO - 'HOME': '/home/cltbld', 23:08:42 INFO - 'LANG': 'en_US.UTF-8', 23:08:42 INFO - 'LANGUAGE': 'en_US:en', 23:08:42 INFO - 'LOGNAME': 'cltbld', 23:08:42 INFO - 'MAIL': '/var/mail/cltbld', 23:08:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:08:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 23:08:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:08:42 INFO - 'MOZ_NO_REMOTE': '1', 23:08:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 23:08:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:08:42 INFO - 'NO_EM_RESTART': '1', 23:08:42 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:08:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 23:08:42 INFO - 'PWD': '/builds/slave/test-pgo', 23:08:42 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 23:08:42 INFO - 'SHELL': '/bin/bash', 23:08:42 INFO - 'SHLVL': '1', 23:08:42 INFO - 'TERM': 'linux', 23:08:42 INFO - 'TMOUT': '86400', 23:08:42 INFO - 'USER': 'cltbld', 23:08:42 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606', 23:08:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:08:42 INFO - '_': '/tools/buildbot/bin/python'} 23:08:42 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 23:08:42 INFO - mozversion application_buildid: 20160127203724 23:08:42 INFO - mozversion application_changeset: 0ecd7d72f232304da046b352c457e039e35ceed7 23:08:42 INFO - mozversion application_display_name: Nightly 23:08:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:08:42 INFO - mozversion application_name: Firefox 23:08:42 INFO - mozversion application_remotingname: firefox 23:08:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 23:08:42 INFO - mozversion application_vendor: Mozilla 23:08:42 INFO - mozversion application_version: 47.0a1 23:08:42 INFO - mozversion platform_buildid: 20160127203724 23:08:42 INFO - mozversion platform_changeset: 0ecd7d72f232304da046b352c457e039e35ceed7 23:08:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 23:08:42 INFO - mozversion platform_version: 47.0a1 23:08:42 INFO - using testdate: 1453964922 23:08:42 INFO - actual date: 1453964922 23:08:42 INFO - starting webserver on 'localhost:51454' 23:08:42 INFO - SUITE-START | Running 3 tests 23:08:42 INFO - TEST-START | dromaeo_css 23:08:42 INFO - operating with platform_type : linux_ 23:08:42 INFO - Initialising browser for dromaeo_css test... 23:08:43 INFO - TEST-INFO | started process 7020 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUwjckF/profile http://localhost:51454/getInfo.html) 23:08:47 INFO - PROCESS | 7020 | __metrics Screen width/height:1600/1200 23:08:47 INFO - PROCESS | 7020 | colorDepth:24 23:08:47 INFO - PROCESS | 7020 | Browser inner width/height: 1024/697 23:08:47 INFO - PROCESS | 7020 | __metrics 23:08:47 INFO - PROCESS | 7020 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 23:08:47 INFO - PROCESS | 7020 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:08:48 INFO - TEST-INFO | 7020: exit 0 23:08:48 INFO - Browser initialized. 23:08:48 INFO - Running cycle 1/1 for dromaeo_css test... 23:08:48 INFO - TEST-INFO | started process 7114 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUwjckF/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:09:00 INFO - PROCESS | 7114 | RSS: Main: 148213760 23:09:00 INFO - PROCESS | 7114 | 23:09:51 INFO - PROCESS | 7114 | 1453964991901 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] 23:11:59 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51454/tests/dromaeo/cssquery-ext.html) 23:12:01 INFO - PROCESS | 7114 | RSS: Main: 280141824 23:12:01 INFO - PROCESS | 7114 | 23:15:03 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-ext.html (next: http://localhost:51454/tests/dromaeo/cssquery-jquery.html) 23:15:04 INFO - PROCESS | 7114 | RSS: Main: 236679168 23:15:04 INFO - PROCESS | 7114 | 23:18:06 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51454/tests/dromaeo/cssquery-mootools.html) 23:18:06 INFO - PROCESS | 7114 | RSS: Main: 229916672 23:18:06 INFO - PROCESS | 7114 | 23:21:08 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51454/tests/dromaeo/cssquery-prototype.html) 23:21:09 INFO - PROCESS | 7114 | RSS: Main: 213430272 23:21:09 INFO - PROCESS | 7114 | 23:24:11 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51454/tests/dromaeo/cssquery-yui.html) 23:24:12 INFO - PROCESS | 7114 | RSS: Main: 218873856 23:24:12 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | Cycle 1(1): loaded http://localhost:51454/tests/dromaeo/cssquery-yui.html (next: http://localhost:51454/tests/dromaeo/cssquery-dojo.html) 23:27:15 INFO - PROCESS | 7114 | RSS: Main: 262270976 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | __start_tp_report 23:27:15 INFO - PROCESS | 7114 | _x_x_mozilla_page_load 23:27:15 INFO - PROCESS | 7114 | _x_x_mozilla_page_load_details 23:27:15 INFO - PROCESS | 7114 | |i|pagename|runs| 23:27:15 INFO - PROCESS | 7114 | |0;dojo.html;3144.622645282566;3169.271067654438;3206.615206175259;3212.518122281659;3245.610526736791;5126.948730512694;5134.743262836852;5186.896262074756;5202.55778258848;5202.921956170651;5016.673916195445;5018.598512119031;5040.97479512602;5132.20450830121;5201.037808005522;4684.391029166203;4699.882502937419;4729;4757.333973243749;4809.1343558159515;4768.451628062782;4792.83225087122;4819.228923372244;4836.347093142434;4851.078295123915;4613.884652883671;4624.167649823031;4666.603338716213;4689.460712018127;4693.413323334583;4673.299005149221;4686.133065382881;4716.056788642285;4722.551357621055;4730.053989202173;4506.59440650343;4692.202325604655;4695.413073365829;4709.740964246965;4742.241241401393;4891.437484689271;4928.901421971576;4934.235193545006;4954.504549545017;4996.850094497171;5407.810726624549;5414.269073675082;5415.593830462731;5430.294061771984;5473.17902314652;5409.486098820645;5415.83752487426;5471.23402723619;5491;5512;5229.633925625208;5241.554467870197;5279.44565820591;5281.471852814688;5291.920621190685;5615.522680572197;5616.606837521416;5619.719014049281;5624.240727501817;5660.037793575019;5325.121354976463;5399.136138217867;5403.648762830403;5406.351237851404;5406.756695948692;5417.322834645669;5496.532794712494;5498.45015498455;5534.086875665551;5540.002799496049;5386.784528618889;5389.191621256765;5391.838244852661;5392.083345831218;5395;5323.520883120537;5382.542483888913;5383.67697938125;5443.319585051869;5480.91778623321;4198.769067701306;4263.381809637585;4281.721688090264;4293.785310734451;4302.67729920251;3824.3116239077235;3854.190619969782;3854.7301688881507;3884.8057597120596;3886.980565097213;5000.399952005782;5082.974585127051;5154.433012368637;5154.664946778447;5198.428172900978;5491.615586908958;5510.641808282529;5518.613697041169;5585.134304182858;5606.55147588192;5068.087744206078;5068.23976403535;5097.490250974947;5110.770015349318;5130.256112863689;4575.10785396851;4659.487456379796;4667.673262871566;4667.95332046682;4698.083873644607;5760.251167348301;5774.220480235199;5777.335606405317;5778.422157784188;5829.679367634736;5530.5022547970875;5560.1103823389685;5562.054450743302;5562.9443705564045;5566.304211973504;5660.320761508646;5691.4877661010705;5748.712564371848;5768.913466298093;5779.624324418899;5437.429069947599;5438.021156191923;5442.2108794225405;5468.835934921959;5483.917741233805;5459.880724451398;5477.808276710296;5487.067198576172;5495.285612870462;5504.174373843955;5273.367195936359;5337.786488540415;5392.838214853561;5433.347998240237;5454.618176727749;5458.1266997280245;5465.289512363367;5466.781328746805;5470.288862447856;5472.863178420572;5347.705876176848;5364.597655175799;5365.597580181424;5374.892502150014;5417.404085550507;5270.077736396192;5298.44366341544;5306.6550674206055;5357.919631205613;5420.783168673209;5267;5330.54690351309;5374.3013408256675;5376.892462150813;5385.246065550904 23:27:15 INFO - PROCESS | 7114 | |1;ext.html;521.324884274864;529.0767610519642;530.7160669042061;541.5505130741484;558.5364147757361;27976.86011569942;28568.28579285519;38606.42090368647;39308.60691393085;39351.21297574047;41801.790991045076;42240.15519689604;42256;42323;42362.36456453148;8532.274756645676;8668.60991255395;8738.563071846414;8740.825183496327;8746.825063498727;8461.746147615582;8567.35744819138;8585.914140858575;8586.441881277697;8599.6130174142;8633.309335253165;8686.087960764124;8701.434406763572;8701.47791132534;8709.912900870973;8556.058833528306;8616.396852220347;8631.309495240366;8631.784205394853;8635.69775057873;8569.185927336894;8722.38943273971;8725.650973961034;8729.60716767747;8737.47575145487;39208.41187382192;39707.40438893419;39738;39740.006499837735;39873.60126398728;3247.7077063064203;3322.6178989416285;3335.8332083395735;3400.2179498715186;3974.105826189113;26878.865605672043;27456.588151177748;27499.725002749918;27512;27524.724752752416;3826.9234615307814;3982.422548730418;3984.382420724792;3990.940135897964;4132.524759652649;260765;260974.9999999981;263552;263667;264372;59153.70423147943;59291;59471;59648.70175649094;59689.403105968384;64592;64706;64706.67646661736;64737.676311619085;64848.35151648518;12957.574666786646;13026.869731302755;13055.869441305465;13064.673383165307;13068.738625227443;10727;10782.191335649857;10807.135429165648;10810.189235807346;10810.837837432446;19325.710114348298;20177.798222017886;20414.489637759176;20508.38474845757;20510.487237818874;6470.514711396664;7843.607819609111;7931.801704957307;7996;8061.6372263248295;874.7200895713438;900.8603666431713;945.5414124149781;1028.547439126782;1042.3641578637025;26504.46991060168;26723.465530689668;27096.593551096354;27229.319267018484;27234.863825680746;979.4466126638426;1010.8281592129356;1025.395016939994;1031.7369070887025;1094.392612100276;14934.40262389514;15011.924940375227;15078.321475533408;15256.389744410099;15298.694026119416;287595;290922;311663;315303;317981;50097;50746.49253507492;51132.48867511352;51138.74430627823;51180;1161.4076820821442;1245.5649205802633;1257.7610254051701;1273.2424207596466;1297.7145028093805;22372.32883013512;27136.864315678296;27722.168334949984;29082.418351632426;29242.561361580018;48108.27837582369;48282.517174829205;48627.756861215465;48680.26979595238;48680.75659621821;263985;269136;284063;286258;392246;32455.350892981536;32526.02421927346;32544.186395340304;32578.83710581432;32924.835375822964;42013;42966;43014;43647.34528982004;43926.78036609796;36483.635163648025;36974.63025369712;37237.6276237245;37374;38161.04597385087;37299.25401491901;38023;38951.22097557976;39725;40099.79950100231;32373.838130809196;32927.341453171284;33098.50352244767;33176.50235246521;33275.83362083174;29205.269868252613;32344.31007503946;32462.513062304555;32800.343993119524;32836.179095522806;24917.50164996726;25024.37439064038;25147.49705005853;25429.23712288634;25676.486470270862 23:27:15 INFO - PROCESS | 7114 | |2;jquery.html;351.7432274439661;358.1672611179008;363.60912019578956;363.69449662283677;363.96542328478785;13419.664508387295;13703.246321452316;15406.229688515572;16508.669826603462;17947.192376343064;14723.779143312859;15140.621484462894;15189.392424303041;16499.752503712454;16583.83416165838;5305.071612467812;5500.42245564216;5502.422245664207;5506.284183056197;5506.91739623906;3942.940855887164;4076.5923407659143;5379.757910894;5476.452354764511;5672;5819.67991760453;5963.582549221556;6018.759249630031;6036.275646922353;6039.365866584011;5991.820245392645;6023.126646636213;6025.0058740307795;6030.276366835964;6036.034234522477;5150.175971844525;5324.068288049614;5400.08198606234;5401.243825864342;5410.134378499461;19536.21855125793;19586.80413195864;19979.80121192733;20854.37436876896;20858.79141208599;2065.2565076572423;2101.9060670237945;2121.4060063182333;2132.3070002249333;2210.049678638185;12589.370531473389;12921.612351629467;13020.34898255093;13048.673783155402;13083.345832708326;1797.73034044893;1808.493621785902;1812.28414776164;1826.4246762269843;1840.55826601616;49894.50105498935;50614.493855061344;55790.16314755282;57125.42874571243;57318.42681573214;14012.229327387091;14435.92782036083;14436.855631443552;14443.855561444461;14498.275086245645;21876.23433179863;21950.121995120015;21993.7009448584;22122.668159977613;22125;8260.463069900437;8345.123762005023;8364.03813561436;8389.95805020971;8412.200840920103;7003.3346832050875;7027.472939529555;7060.293970603001;7067.717291308393;7068.717251309993;7469.058044908363;7584.431167662337;7604.467687261838;7604.657790399446;7764.883526747103;2527.279725278287;2864.8281103133877;2889.118818760256;2938.735513803768;2963.6295463067117;421.588950773;840.3529282452478;925.6760133953197;947.218544700611;1042.2652030318607;9958.900410995797;10292.549215051084;10627.415492148006;10781.08360789326;10843.891561084445;438.1150076844756;439.49238629383115;447.0634021724482;451.039286320136;462.75936513013045;5863.208466857005;5887.4406931341455;5939.07944268639;6021.126936594257;6264.9373506265265;369015;371214;374698;376525;578317.3252401217;67538.32461675418;69633.3036669637;72247.63876180585;72437.63781181061;73099.63450182715;502.48495292325657;510.9514596113363;511.63929429751937;512.9871753206199;513.0380536494074;8682.348823838363;9806.509674516388;10094.394336339843;10137.18902487814;10203.94898025505;29146.854265728536;30361;30630.387392252476;30898.073057808302;31115;39683.20633587254;40037;40688.59311406966;42091;42831.57168428276;7407.888881666671;7611.124720657195;7665.923340766744;7670.654820532978;7835.059792824897;9731.610735570497;11609.941950290533;11863.694993550529;12099.092568057607;12119.575814846437;2985.4924662807807;4955.72743499111;5024.120778863758;9471.431714097176;10076.345037572535;10325.535350909076;10418;10538.524606554935;10696.090832279344;10821.18841086906;10045.347052441568;10264.743381415525;10390.948045259725;10566.894331056592;10667.413292269;7370.336669699753;7826.2173782621285;7864.2922137007945;7892.4080693947035;7894.960525197337;9512.476813775032;9760.804783904141;10058;10221.437820919624;10557.9472102639 23:27:15 INFO - PROCESS | 7114 | |3;mootools.html;1312.4487715159632;1493.8954273200877;1506.0888162661593;1682.59617691754;1819.0450013742784;6556.73773049078;7617.8476430471355;7771.067471903372;7775.3779697624195;7783.766487005385;7277.454190935675;7416.0729908761405;7446.813829654261;7459.104907411118;7466.178720340758;1997.6703843865816;2056.557840064386;2238.5858616155983;2272.363738153316;2283.394900351408;2319.7680231976838;2325.1861848353024;2326.499802542453;2326.9767302327014;2331.207389487574;2268.8638681679154;2330.0330362899376;2331.405491599648;2332.1604222479896;2335.311083230443;2240.1599400224914;2279.099755596538;2296.5062511559927;2298.4943312471314;2299.735530414007;2246.6068438023444;2265.7651579888834;2267.0705010945435;2267.0931627349028;2311.341267738703;7634.809129771745;7704.576248306341;7708.460407771458;7708.768736937901;7722.652480638385;4449.599536041772;4532.5240849710635;4538.115067561826;4568.177728008957;4568.817247310104;2850.857457127135;2917.5040243158714;2961.141269031978;2967.614210152688;2973.5242361222317;882.0473888200792;885.2961895293257;892.1435421994893;894.592960203106;895.2748273898163;10589.364638121737;10607.098396636295;10608.15134789215;10622.09712174466;10630.893691063146;4429.11417716458;4433.179861725591;4482.843100491467;4527.366168736379;4528.049109686936;9017.143371379709;9026.548672566345;9044.638214471479;9044.773880653036;9059.773505662411;4854.68444551103;4890.779914903838;4898.608111351155;4907.141250281258;4910.091633047898;4460.241758900995;4461.531539188403;4464.441944756905;4465.173942820588;4468.865934021985;3378.476336167898;3453.188500702333;3639.2721455708966;3755.4366844972924;3756.1360886996144;1191.2614179208947;1199.2444759801444;1202.5310129049678;1205.73473835756;1241.3482921466302;989.2481713897346;1011.7925825205815;1013.3970287678819;1131.1798945764256;1340.879320861127;7034.19106802714;7124.750633727795;7161.319674630901;7161.89257161143;7174.031505746658;1076.252004856617;1100.2408338246585;1100.834874768791;1109.6060898380958;1127.577158565538;5698.8290351289525;5783.71081445926;5816.912746308809;5818.80714453536;5823.417658234142;8826.955865220762;9383.061693830563;9439.292053095907;9509.001554836643;9515;9345.112214339626;9354.579043943038;9408.247340212767;9440.197583205505;9477.194438472668;7093.3970612498515;7415.555066696015;7422.554646721214;7440.813979650444;7512.962435187898;7016.36852683261;7089.893651595127;7121.893171602534;7122.216556178712;7125.893111603434;8393.034800997963;8571.871421928801;8665.306775458075;8753.562321883754;8831.293496520391;8383.455075420079;8686.739397818075;8708.521031343336;8708.956455217683;8718.82562348762;6051;6930;7015.36861682451;7022.403095736715;7023.859522809413;6577.736890524326;7053.294670532906;7230.602316872622;7232.276772322725;7239.4932354734665;6689.866202675822;6843.486738494533;6846.144231971004;6852.965735171292;6893.414059804973;6637.834054148491;6712.39588437043;6781.491388146008;6841.692123854339;6883.65581720922;6640.800775976729;6662.06731057662;6667.166604174478;6671;6687.531872768859;6340.9365906340345;6369.777057802955;6386.808395748135;6412;6427.421532062137;6368.52236082305;6410.935890641221;6411.711472983634;6416.133821934166;6417.48660107181 23:27:15 INFO - PROCESS | 7114 | |4;prototype.html;329.85980958092813;331.60538958639233;335.6911641290013;339.0236119974473;343.8005956545204;5667.4049224831415;5816.418358164176;5826.096954971981;5832.650040997538;5879.647221166733;5600.327960644719;5722.399148089443;5731.455511726379;5732.656040637565;5779.913301300473;4528.3207518872105;4529.207388706971;4531.546845315475;4535.909281814378;4540.2054640437955;4337.327714204303;4413.073254616518;4424.867253982386;4505.3917721107555;4541.250693635546;4423.380726698265;4432.268675668527;4448.354988526662;4456.732596044248;4461.598456138947;4474.0380818124095;4487.977560112195;4489.977550112261;4490.146872094324;4506.076254367847;3985.501812273466;3987.3620220764537;3989.7606143631474;3991.022199561126;3992.500937382827;5401.945980540184;5503.724813759296;5509.531689806371;5598.300212473441;5606.299212598426;5165.302684137631;5201.55786758126;5202.687838729688;5207.921881171786;5212.270282160463;5902.32123305821;6215.1609532712955;6216.813495595139;6229.595076320024;6239.438450539428;4260.808263628113;4268.701190916637;4351.6953813233085;4355.4337936068105;4355.60799528044;6362.236531616236;6470.935290647128;6471.902921456229;6471.967640161816;6479.254885688159;4412.6690498212765;4414.580614841585;4418.801153948016;4419.535948725402;4427.335899615084;4338.110687309094;4474.149911516866;4480.327950807405;4480.641548676098;4483.641308695296;5166.3800343958965;5172.301739265151;5172.689638621695;5173.948260517422;5177.3269474968765;6230.844228894314;6238.220222472191;6242.533004743882;6244.812655620339;6252.155958945484;1563.5543869996995;1580.9604759880865;1581.5571639940836;1582.2168026826794;1585.952421427359;1066.5573786878513;1067.1676092647747;1068.1454836131063;1070.55571937645;1095.9945200273949;5869.911951320733;5886.205362276123;5887.1463637772285;5890.764369425175;5891.675957822275;6395.584287021329;6397.84838729024;6404.135441715402;6411.551191416649;6415.230172379344;5872.706364681749;5884.970575147183;5888.735006924699;5888.970555147197;5890.440408161304;3341.913877989663;3470.4273794824076;3473.4268845640186;3482.529858469125;3483.860645574199;6736.6631668416385;6738.225104112992;6745.123133992648;6746.0892779475125;6755.425788807908;6560.179977502812;6594.681063787261;6597.637129957899;6600.504962127764;6606.405423511907;6562.343765623399;6714.630695311805;6733.8989915151315;6747.05541224229;6749.527533072638;6131.4481696645735;6323.399277068671;6439.967800160969;6440.645764482999;6444.709988050456;6219.440250377488;6358.364163583605;6377.266614339224;6391;6397.584157029778;6722.630255336004;6729.831754206184;6730.394264516217;6733.865322693421;6735.966320168368;4299.355096735515;4409.492908315457;4442.51132375432;4442.51132375432;4444.4888837784065;6347.460465860454;6352.396522330371;6376.075469056868;6393.200849893763;6407.2631647359285;6246.593971391845;6257.124002639725;6257.342978987323;6259.3427690091885;6262.248530176408;6058.363871793398;6219.875602488016;6233.252009758858;6237.656928868774;6244.625322480666;6154.78458253959;6163.414475624809;6165.3526379731275;6167.938320616737;6170.074488826712;6286.811395658137;6298.905516417166;6309.90535141964;6310.368963103653;6316.431521163117;6063.939360606514;6102.328743838086;6133.693315334304;6144.692765361803;6151.72317245716 23:27:15 INFO - PROCESS | 7114 | |5;yui.html;602.7679343452771;659.9175103112111;677.847484316029;682.3040498691332;722.609790713015;13675.452981880726;13750.106243094204;13791.586252412431;13838.169709817394;13840.792388114187;10966;12652.62042138735;12654.873451265485;12768.42542085606;12804.359782010908;634.6192284629232;800.383704547498;806.5040000399741;812.191869090253;812.5409143833745;790.612599826084;798.632628990665;800.4476910931468;800.5276886636883;801.8556659801234;683.1017212365748;692.608676098003;842.4818736477084;843.2452954605624;844.2486187293314;832.1636755061155;840.9915900840974;843.3969711656196;844.9112843151473;845.2941793602319;627.7645882793952;629.6002038705456;630.2342653675806;631.0817760158958;631.2677294338591;13189.934050329686;13224.6693832654;13292.202467851863;13312.86687133126;13320.333983300796;12206.511739530408;12475.126741128124;12934;12965.740685186338;13366.532171374052;10549.10332621728;10630.574777008987;10637.46812659364;10638.148948084212;10813.405262710548;3584.354816133095;3646.7994260315672;3662.8168591570316;3692.8892133236045;3767.6232376762377;44632.55367446349;44702.55297447016;44949;44964.10071798546;46165.307520387556;10050.648227312155;10129.290949633601;10139.949300253451;10140.188784897191;10416.479176041168;18403.631927361646;18515.537111572048;18557.628847422977;18588.907055464635;18609.627807443776;7461.813454663677;7540.622968851536;7612.619369031526;7656.693732250759;7669.923300767033;4134.235166494208;4183.163367326486;4193.790310484464;4243.766592837424;4294.205571969195;3038.848057597111;3071.6314042315066;3078.122735020553;3078.492048811921;3084.8457577121503;578.1991941161522;581.0209796492923;582.3884920833108;588.364566268429;603.2399177036878;469.4671547793279;497.8257609836528;544.5888354292563;546.137103376664;587.7149582452507;8342.749717508485;8474.1525847416;8905.866412003825;9219.354645174773;9277.48973806447;503.61725088931945;611.5535658968888;614.5605891787393;624.3257282135284;626.692920468976;3675.503806986076;3774.1319496515957;3823.541175058955;3827.2536855312946;3847.615238476186;53968.460315397126;54053;54181.1872821908;55258.17112743312;56384;48298.517014829406;48763.512364875896;48913.26630100551;49148.75425622849;49227.75386123046;43722.34416483755;43752.781236093615;44586.77706611446;45590.77204613956;45740;8246.83506329858;8266.751997440086;8396.832063358577;8580.34710950181;8751.562421878753;32499.512507311938;33250.833745831114;33619.663803361655;34680.826595866856;37525.4371184427;41458.170836583704;42729.572704272556;42903.785481073646;43315.35026974535;44294;10373.481325933522;10399.740006499898;10452.895471045193;10474.266801323834;10486;10730.825933077804;11147.88852111501;11177.049950754277;11344.546218151181;11396.088312935111;10747.838782418114;10759.677209683721;11254.879030041475;11283.774324513628;11372.260803047775;10352.378857268588;10668.62659806903;10757.892421075689;10791.082757965662;11315.773684526428;10386.74033149147;10401.115905148146;10638.202134839763;10872.782544348911;10899.128069754559;8475.660973560989;8542.30062403811;8582.227599516074;8688.087750786077;9145.131212534798;9155.221806146552;9196.908030919605;9348;9423.151916327564;9478.24174066087 23:27:15 INFO - PROCESS | 7114 | __end_tp_report 23:27:15 INFO - PROCESS | 7114 | __start_cc_report 23:27:15 INFO - PROCESS | 7114 | _x_x_mozilla_cycle_collect,1016 23:27:15 INFO - PROCESS | 7114 | __end_cc_report 23:27:15 INFO - PROCESS | 7114 | __startTimestamp1453966035636__endTimestamp 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | ------- Summary: start ------- 23:27:15 INFO - PROCESS | 7114 | Number of tests: 6 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#0] dojo.html Cycles:165 Average:5117.43 Median:5330.55 stddev:546.09 (10.2%) stddev-sans-first:525.38 23:27:15 INFO - PROCESS | 7114 | Values: 3144.6 3169.3 3206.6 3212.5 3245.6 5126.9 5134.7 5186.9 5202.6 5202.9 5016.7 5018.6 5041.0 5132.2 5201.0 4684.4 4699.9 4729.0 4757.3 4809.1 4768.5 4792.8 4819.2 4836.3 4851.1 4613.9 4624.2 4666.6 4689.5 4693.4 4673.3 4686.1 4716.1 4722.6 4730.1 4506.6 4692.2 4695.4 4709.7 4742.2 4891.4 4928.9 4934.2 4954.5 4996.9 5407.8 5414.3 5415.6 5430.3 5473.2 5409.5 5415.8 5471.2 5491.0 5512.0 5229.6 5241.6 5279.4 5281.5 5291.9 5615.5 5616.6 5619.7 5624.2 5660.0 5325.1 5399.1 5403.6 5406.4 5406.8 5417.3 5496.5 5498.5 5534.1 5540.0 5386.8 5389.2 5391.8 5392.1 5395.0 5323.5 5382.5 5383.7 5443.3 5480.9 4198.8 4263.4 4281.7 4293.8 4302.7 3824.3 3854.2 3854.7 3884.8 3887.0 5000.4 5083.0 5154.4 5154.7 5198.4 5491.6 5510.6 5518.6 5585.1 5606.6 5068.1 5068.2 5097.5 5110.8 5130.3 4575.1 4659.5 4667.7 4668.0 4698.1 5760.3 5774.2 5777.3 5778.4 5829.7 5530.5 5560.1 5562.1 5562.9 5566.3 5660.3 5691.5 5748.7 5768.9 5779.6 5437.4 5438.0 5442.2 5468.8 5483.9 5459.9 5477.8 5487.1 5495.3 5504.2 5273.4 5337.8 5392.8 5433.3 5454.6 5458.1 5465.3 5466.8 5470.3 5472.9 5347.7 5364.6 5365.6 5374.9 5417.4 5270.1 5298.4 5306.7 5357.9 5420.8 5267.0 5330.5 5374.3 5376.9 5385.2 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#1] ext.html Cycles:180 Average:45867.21 Median:37698.50 stddev:76113.93 (201.9%) stddev-sans-first:76251.30 23:27:15 INFO - PROCESS | 7114 | Values: 521.3 529.1 530.7 541.6 558.5 27976.9 28568.3 38606.4 39308.6 39351.2 41801.8 42240.2 42256.0 42323.0 42362.4 8532.3 8668.6 8738.6 8740.8 8746.8 8461.7 8567.4 8585.9 8586.4 8599.6 8633.3 8686.1 8701.4 8701.5 8709.9 8556.1 8616.4 8631.3 8631.8 8635.7 8569.2 8722.4 8725.7 8729.6 8737.5 39208.4 39707.4 39738.0 39740.0 39873.6 3247.7 3322.6 3335.8 3400.2 3974.1 26878.9 27456.6 27499.7 27512.0 27524.7 3826.9 3982.4 3984.4 3990.9 4132.5 260765.0 260975.0 263552.0 263667.0 264372.0 59153.7 59291.0 59471.0 59648.7 59689.4 64592.0 64706.0 64706.7 64737.7 64848.4 12957.6 13026.9 13055.9 13064.7 13068.7 10727.0 10782.2 10807.1 10810.2 10810.8 19325.7 20177.8 20414.5 20508.4 20510.5 6470.5 7843.6 7931.8 7996.0 8061.6 874.7 900.9 945.5 1028.5 1042.4 26504.5 26723.5 27096.6 27229.3 27234.9 979.4 1010.8 1025.4 1031.7 1094.4 14934.4 15011.9 15078.3 15256.4 15298.7 287595.0 290922.0 311663.0 315303.0 317981.0 50097.0 50746.5 51132.5 51138.7 51180.0 1161.4 1245.6 1257.8 1273.2 1297.7 22372.3 27136.9 27722.2 29082.4 29242.6 48108.3 48282.5 48627.8 48680.3 48680.8 263985.0 269136.0 284063.0 286258.0 392246.0 32455.4 32526.0 32544.2 32578.8 32924.8 42013.0 42966.0 43014.0 43647.3 43926.8 36483.6 36974.6 37237.6 37374.0 38161.0 37299.3 38023.0 38951.2 39725.0 40099.8 32373.8 32927.3 33098.5 33176.5 33275.8 29205.3 32344.3 32462.5 32800.3 32836.2 24917.5 25024.4 25147.5 25429.2 25676.5 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#2] jquery.html Cycles:180 Average:23927.26 Median:23083.80 stddev:69127.12 (299.5%) stddev-sans-first:69298.38 23:27:15 INFO - PROCESS | 7114 | Values: 351.7 358.2 363.6 363.7 364.0 13419.7 13703.2 15406.2 16508.7 17947.2 14723.8 15140.6 15189.4 16499.8 16583.8 5305.1 5500.4 5502.4 5506.3 5506.9 3942.9 4076.6 5379.8 5476.5 5672.0 5819.7 5963.6 6018.8 6036.3 6039.4 5991.8 6023.1 6025.0 6030.3 6036.0 5150.2 5324.1 5400.1 5401.2 5410.1 19536.2 19586.8 19979.8 20854.4 20858.8 2065.3 2101.9 2121.4 2132.3 2210.0 12589.4 12921.6 13020.3 13048.7 13083.3 1797.7 1808.5 1812.3 1826.4 1840.6 49894.5 50614.5 55790.2 57125.4 57318.4 14012.2 14435.9 14436.9 14443.9 14498.3 21876.2 21950.1 21993.7 22122.7 22125.0 8260.5 8345.1 8364.0 8390.0 8412.2 7003.3 7027.5 7060.3 7067.7 7068.7 7469.1 7584.4 7604.5 7604.7 7764.9 2527.3 2864.8 2889.1 2938.7 2963.6 421.6 840.4 925.7 947.2 1042.3 9958.9 10292.5 10627.4 10781.1 10843.9 438.1 439.5 447.1 451.0 462.8 5863.2 5887.4 5939.1 6021.1 6264.9 369015.0 371214.0 374698.0 376525.0 578317.3 67538.3 69633.3 72247.6 72437.6 73099.6 502.5 511.0 511.6 513.0 513.0 8682.3 9806.5 10094.4 10137.2 10203.9 29146.9 30361.0 30630.4 30898.1 31115.0 39683.2 40037.0 40688.6 42091.0 42831.6 7407.9 7611.1 7665.9 7670.7 7835.1 9731.6 11609.9 11863.7 12099.1 12119.6 2985.5 4955.7 5024.1 9471.4 10076.3 10325.5 10418.0 10538.5 10696.1 10821.2 10045.3 10264.7 10390.9 10566.9 10667.4 7370.3 7826.2 7864.3 7892.4 7895.0 9512.5 9760.8 10058.0 10221.4 10557.9 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#3] mootools.html Cycles:180 Average:5409.30 Median:6411.86 stddev:2797.24 (43.6%) stddev-sans-first:2788.14 23:27:15 INFO - PROCESS | 7114 | Values: 1312.4 1493.9 1506.1 1682.6 1819.0 6556.7 7617.8 7771.1 7775.4 7783.8 7277.5 7416.1 7446.8 7459.1 7466.2 1997.7 2056.6 2238.6 2272.4 2283.4 2319.8 2325.2 2326.5 2327.0 2331.2 2268.9 2330.0 2331.4 2332.2 2335.3 2240.2 2279.1 2296.5 2298.5 2299.7 2246.6 2265.8 2267.1 2267.1 2311.3 7634.8 7704.6 7708.5 7708.8 7722.7 4449.6 4532.5 4538.1 4568.2 4568.8 2850.9 2917.5 2961.1 2967.6 2973.5 882.0 885.3 892.1 894.6 895.3 10589.4 10607.1 10608.2 10622.1 10630.9 4429.1 4433.2 4482.8 4527.4 4528.0 9017.1 9026.5 9044.6 9044.8 9059.8 4854.7 4890.8 4898.6 4907.1 4910.1 4460.2 4461.5 4464.4 4465.2 4468.9 3378.5 3453.2 3639.3 3755.4 3756.1 1191.3 1199.2 1202.5 1205.7 1241.3 989.2 1011.8 1013.4 1131.2 1340.9 7034.2 7124.8 7161.3 7161.9 7174.0 1076.3 1100.2 1100.8 1109.6 1127.6 5698.8 5783.7 5816.9 5818.8 5823.4 8827.0 9383.1 9439.3 9509.0 9515.0 9345.1 9354.6 9408.2 9440.2 9477.2 7093.4 7415.6 7422.6 7440.8 7513.0 7016.4 7089.9 7121.9 7122.2 7125.9 8393.0 8571.9 8665.3 8753.6 8831.3 8383.5 8686.7 8708.5 8709.0 8718.8 6051.0 6930.0 7015.4 7022.4 7023.9 6577.7 7053.3 7230.6 7232.3 7239.5 6689.9 6843.5 6846.1 6853.0 6893.4 6637.8 6712.4 6781.5 6841.7 6883.7 6640.8 6662.1 6667.2 6671.0 6687.5 6340.9 6369.8 6386.8 6412.0 6427.4 6368.5 6410.9 6411.7 6416.1 6417.5 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#4] prototype.html Cycles:180 Average:5201.90 Median:5876.18 stddev:1566.38 (26.7%) stddev-sans-first:1527.50 23:27:15 INFO - PROCESS | 7114 | Values: 329.9 331.6 335.7 339.0 343.8 5667.4 5816.4 5826.1 5832.7 5879.6 5600.3 5722.4 5731.5 5732.7 5779.9 4528.3 4529.2 4531.5 4535.9 4540.2 4337.3 4413.1 4424.9 4505.4 4541.3 4423.4 4432.3 4448.4 4456.7 4461.6 4474.0 4488.0 4490.0 4490.1 4506.1 3985.5 3987.4 3989.8 3991.0 3992.5 5401.9 5503.7 5509.5 5598.3 5606.3 5165.3 5201.6 5202.7 5207.9 5212.3 5902.3 6215.2 6216.8 6229.6 6239.4 4260.8 4268.7 4351.7 4355.4 4355.6 6362.2 6470.9 6471.9 6472.0 6479.3 4412.7 4414.6 4418.8 4419.5 4427.3 4338.1 4474.1 4480.3 4480.6 4483.6 5166.4 5172.3 5172.7 5173.9 5177.3 6230.8 6238.2 6242.5 6244.8 6252.2 1563.6 1581.0 1581.6 1582.2 1586.0 1066.6 1067.2 1068.1 1070.6 1096.0 5869.9 5886.2 5887.1 5890.8 5891.7 6395.6 6397.8 6404.1 6411.6 6415.2 5872.7 5885.0 5888.7 5889.0 5890.4 3341.9 3470.4 3473.4 3482.5 3483.9 6736.7 6738.2 6745.1 6746.1 6755.4 6560.2 6594.7 6597.6 6600.5 6606.4 6562.3 6714.6 6733.9 6747.1 6749.5 6131.4 6323.4 6440.0 6440.6 6444.7 6219.4 6358.4 6377.3 6391.0 6397.6 6722.6 6729.8 6730.4 6733.9 6736.0 4299.4 4409.5 4442.5 4442.5 4444.5 6347.5 6352.4 6376.1 6393.2 6407.3 6246.6 6257.1 6257.3 6259.3 6262.2 6058.4 6219.9 6233.3 6237.7 6244.6 6154.8 6163.4 6165.4 6167.9 6170.1 6286.8 6298.9 6309.9 6310.4 6316.4 6063.9 6102.3 6133.7 6144.7 6151.7 23:27:15 INFO - PROCESS | 7114 | 23:27:15 INFO - PROCESS | 7114 | [#5] yui.html Cycles:180 Average:13337.69 Median:44023.39 stddev:15225.12 (34.6%) stddev-sans-first:15237.79 23:27:15 INFO - PROCESS | 7114 | Values: 602.8 659.9 677.8 682.3 722.6 13675.5 13750.1 13791.6 13838.2 13840.8 10966.0 12652.6 12654.9 12768.4 12804.4 634.6 800.4 806.5 812.2 812.5 790.6 798.6 800.4 800.5 801.9 683.1 692.6 842.5 843.2 844.2 832.2 841.0 843.4 844.9 845.3 627.8 629.6 630.2 631.1 631.3 13189.9 13224.7 13292.2 13312.9 13320.3 12206.5 12475.1 12934.0 12965.7 13366.5 10549.1 10630.6 10637.5 10638.1 10813.4 3584.4 3646.8 3662.8 3692.9 3767.6 44632.6 44702.6 44949.0 44964.1 46165.3 10050.6 10129.3 10139.9 10140.2 10416.5 18403.6 18515.5 18557.6 18588.9 18609.6 7461.8 7540.6 7612.6 7656.7 7669.9 4134.2 4183.2 4193.8 4243.8 4294.2 3038.8 3071.6 3078.1 3078.5 3084.8 578.2 581.0 582.4 588.4 603.2 469.5 497.8 544.6 546.1 587.7 8342.7 8474.2 8905.9 9219.4 9277.5 503.6 611.6 614.6 624.3 626.7 3675.5 3774.1 3823.5 3827.3 3847.6 53968.5 54053.0 54181.2 55258.2 56384.0 48298.5 48763.5 48913.3 49148.8 49227.8 43722.3 43752.8 44586.8 45590.8 45740.0 8246.8 8266.8 8396.8 8580.3 8751.6 32499.5 33250.8 33619.7 34680.8 37525.4 41458.2 42729.6 42903.8 43315.4 44294.0 10373.5 10399.7 10452.9 10474.3 10486.0 10730.8 11147.9 11177.0 11344.5 11396.1 10747.8 10759.7 11254.9 11283.8 11372.3 10352.4 10668.6 10757.9 10791.1 11315.8 10386.7 10401.1 10638.2 10872.8 10899.1 8475.7 8542.3 8582.2 8688.1 9145.1 9155.2 9196.9 9348.0 9423.2 9478.2 23:27:15 INFO - PROCESS | 7114 | -------- Summary: end -------- 23:27:15 INFO - PROCESS | 7114 | 23:27:16 INFO - TEST-INFO | 7114: exit 0 23:27:16 INFO - TEST-OK | dromaeo_css | took 1113326ms 23:27:16 INFO - TEST-START | kraken 23:27:16 INFO - operating with platform_type : linux_ 23:27:16 INFO - Initialising browser for kraken test... 23:27:16 INFO - TEST-INFO | started process 7321 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9HERS1/profile http://localhost:51454/getInfo.html) 23:27:20 INFO - PROCESS | 7321 | __metrics Screen width/height:1600/1200 23:27:20 INFO - PROCESS | 7321 | colorDepth:24 23:27:20 INFO - PROCESS | 7321 | Browser inner width/height: 1024/697 23:27:20 INFO - PROCESS | 7321 | __metrics 23:27:20 INFO - PROCESS | 7321 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 23:27:20 INFO - PROCESS | 7321 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:27:21 INFO - TEST-INFO | 7321: exit 0 23:27:21 INFO - Browser initialized. 23:27:21 INFO - Running cycle 1/1 for kraken test... 23:27:21 INFO - TEST-INFO | started process 7406 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9HERS1/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:27:33 INFO - PROCESS | 7406 | RSS: Main: 149073920 23:27:33 INFO - PROCESS | 7406 | 23:27:35 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51454/tests/kraken/driver.html?testName=audio-beat-detection) 23:27:36 INFO - PROCESS | 7406 | RSS: Main: 187875328 23:27:36 INFO - PROCESS | 7406 | 23:27:38 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51454/tests/kraken/driver.html?testName=audio-dft) 23:27:39 INFO - PROCESS | 7406 | RSS: Main: 178368512 23:27:39 INFO - PROCESS | 7406 | 23:27:42 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51454/tests/kraken/driver.html?testName=audio-fft) 23:27:42 INFO - PROCESS | 7406 | RSS: Main: 163454976 23:27:42 INFO - PROCESS | 7406 | 23:27:44 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51454/tests/kraken/driver.html?testName=audio-oscillator) 23:27:45 INFO - PROCESS | 7406 | RSS: Main: 165220352 23:27:45 INFO - PROCESS | 7406 | 23:27:47 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51454/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:27:48 INFO - PROCESS | 7406 | RSS: Main: 167157760 23:27:48 INFO - PROCESS | 7406 | 23:27:51 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51454/tests/kraken/driver.html?testName=imaging-darkroom) 23:27:51 INFO - PROCESS | 7406 | RSS: Main: 168480768 23:27:51 INFO - PROCESS | 7406 | 23:27:55 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51454/tests/kraken/driver.html?testName=imaging-desaturate) 23:27:55 INFO - PROCESS | 7406 | RSS: Main: 169668608 23:27:55 INFO - PROCESS | 7406 | 23:27:58 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51454/tests/kraken/driver.html?testName=json-parse-financial) 23:27:59 INFO - PROCESS | 7406 | RSS: Main: 169586688 23:27:59 INFO - PROCESS | 7406 | 23:28:00 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51454/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:28:01 INFO - PROCESS | 7406 | RSS: Main: 180920320 23:28:01 INFO - PROCESS | 7406 | 23:28:02 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:28:03 INFO - PROCESS | 7406 | RSS: Main: 177119232 23:28:03 INFO - PROCESS | 7406 | 23:28:05 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:28:06 INFO - PROCESS | 7406 | RSS: Main: 188030976 23:28:06 INFO - PROCESS | 7406 | 23:28:08 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:28:09 INFO - PROCESS | 7406 | RSS: Main: 197632000 23:28:09 INFO - PROCESS | 7406 | 23:28:11 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:28:12 INFO - PROCESS | 7406 | RSS: Main: 196927488 23:28:12 INFO - PROCESS | 7406 | 23:28:13 INFO - PROCESS | 7406 | Cycle 1(1): loaded http://localhost:51454/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51454/tests/kraken/driver.html?testName=ai-astar) 23:28:14 INFO - PROCESS | 7406 | RSS: Main: 256438272 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | __start_tp_report 23:28:14 INFO - PROCESS | 7406 | _x_x_mozilla_page_load 23:28:14 INFO - PROCESS | 7406 | _x_x_mozilla_page_load_details 23:28:14 INFO - PROCESS | 7406 | |i|pagename|runs| 23:28:14 INFO - PROCESS | 7406 | |0;ai-astar;111;112;107;110;110;110;110;110;103;109 23:28:14 INFO - PROCESS | 7406 | |1;audio-beat-detection;153;130;148;164;128;160;153;126;159;127 23:28:14 INFO - PROCESS | 7406 | |2;audio-dft;162;160;160;162;161;162;162;159;160;162 23:28:14 INFO - PROCESS | 7406 | |3;audio-fft;73;73;98;95;71;80;74;119;106;73 23:28:14 INFO - PROCESS | 7406 | |4;audio-oscillator;97;95;139;96;96;96;143;95;96;138 23:28:14 INFO - PROCESS | 7406 | |5;imaging-gaussian-blur;119;115;115;114;115;115;115;114;115;114 23:28:14 INFO - PROCESS | 7406 | |6;imaging-darkroom;146;145;146;145;146;146;145;145;145;145 23:28:14 INFO - PROCESS | 7406 | |7;imaging-desaturate;96;96;96;96;95;97;97;97;95;96 23:28:14 INFO - PROCESS | 7406 | |8;json-parse-financial;59;57;56;57;57;57;57;57;59;55 23:28:14 INFO - PROCESS | 7406 | |9;json-stringify-tinderbox;66;66;65;67;67;67;67;67;67;68 23:28:14 INFO - PROCESS | 7406 | |10;stanford-crypto-aes;82;82;82;81;82;83;82;82;82;83 23:28:14 INFO - PROCESS | 7406 | |11;stanford-crypto-ccm;115;114;113;115;113;116;115;112;118;123 23:28:14 INFO - PROCESS | 7406 | |12;stanford-crypto-pbkdf2;145;135;144;149;144;132;145;144;144;144 23:28:14 INFO - PROCESS | 7406 | |13;stanford-crypto-sha256-iterative;67;67;67;66;66;66;67;70;65;66 23:28:14 INFO - PROCESS | 7406 | __end_tp_report 23:28:14 INFO - PROCESS | 7406 | __start_cc_report 23:28:14 INFO - PROCESS | 7406 | _x_x_mozilla_cycle_collect,952 23:28:14 INFO - PROCESS | 7406 | __end_cc_report 23:28:14 INFO - PROCESS | 7406 | __startTimestamp1453966094141__endTimestamp 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | ------- Summary: start ------- 23:28:14 INFO - PROCESS | 7406 | Number of tests: 14 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#0] ai-astar Cycles:10 Average:109.20 Median:110.00 stddev:2.53 (2.3%) stddev-sans-first:2.60 23:28:14 INFO - PROCESS | 7406 | Values: 111.0 112.0 107.0 110.0 110.0 110.0 110.0 110.0 103.0 109.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#1] audio-beat-detection Cycles:10 Average:144.80 Median:153.00 stddev:15.34 (10.0%) stddev-sans-first:15.98 23:28:14 INFO - PROCESS | 7406 | Values: 153.0 130.0 148.0 164.0 128.0 160.0 153.0 126.0 159.0 127.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#2] audio-dft Cycles:10 Average:161.00 Median:162.00 stddev:1.15 (0.7%) stddev-sans-first:1.17 23:28:14 INFO - PROCESS | 7406 | Values: 162.0 160.0 160.0 162.0 161.0 162.0 162.0 159.0 160.0 162.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#3] audio-fft Cycles:10 Average:86.20 Median:73.50 stddev:17.08 (23.2%) stddev-sans-first:17.44 23:28:14 INFO - PROCESS | 7406 | Values: 73.0 73.0 98.0 95.0 71.0 80.0 74.0 119.0 106.0 73.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#4] audio-oscillator Cycles:10 Average:109.10 Median:96.00 stddev:21.37 (22.3%) stddev-sans-first:22.21 23:28:14 INFO - PROCESS | 7406 | Values: 97.0 95.0 139.0 96.0 96.0 96.0 143.0 95.0 96.0 138.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#5] imaging-gaussian-blur Cycles:10 Average:115.10 Median:115.00 stddev:1.45 (1.3%) stddev-sans-first:0.50 23:28:14 INFO - PROCESS | 7406 | Values: 119.0 115.0 115.0 114.0 115.0 115.0 115.0 114.0 115.0 114.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#6] imaging-darkroom Cycles:10 Average:145.40 Median:145.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 23:28:14 INFO - PROCESS | 7406 | Values: 146.0 145.0 146.0 145.0 146.0 146.0 145.0 145.0 145.0 145.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.78 23:28:14 INFO - PROCESS | 7406 | Values: 96.0 96.0 96.0 96.0 95.0 97.0 97.0 97.0 95.0 96.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:57.00 stddev:1.20 (2.1%) stddev-sans-first:1.05 23:28:14 INFO - PROCESS | 7406 | Values: 59.0 57.0 56.0 57.0 57.0 57.0 57.0 57.0 59.0 55.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#9] json-stringify-tinderbox Cycles:10 Average:66.70 Median:67.00 stddev:0.82 (1.2%) stddev-sans-first:0.83 23:28:14 INFO - PROCESS | 7406 | Values: 66.0 66.0 65.0 67.0 67.0 67.0 67.0 67.0 67.0 68.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#10] stanford-crypto-aes Cycles:10 Average:82.10 Median:82.00 stddev:0.57 (0.7%) stddev-sans-first:0.60 23:28:14 INFO - PROCESS | 7406 | Values: 82.0 82.0 82.0 81.0 82.0 83.0 82.0 82.0 82.0 83.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#11] stanford-crypto-ccm Cycles:10 Average:115.40 Median:115.00 stddev:3.17 (2.8%) stddev-sans-first:3.36 23:28:14 INFO - PROCESS | 7406 | Values: 115.0 114.0 113.0 115.0 113.0 116.0 115.0 112.0 118.0 123.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.60 Median:144.00 stddev:5.08 (3.5%) stddev-sans-first:5.32 23:28:14 INFO - PROCESS | 7406 | Values: 145.0 135.0 144.0 149.0 144.0 132.0 145.0 144.0 144.0 144.0 23:28:14 INFO - PROCESS | 7406 | 23:28:14 INFO - PROCESS | 7406 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.70 Median:67.00 stddev:1.34 (2.0%) stddev-sans-first:1.41 23:28:14 INFO - PROCESS | 7406 | Values: 67.0 67.0 67.0 66.0 66.0 66.0 67.0 70.0 65.0 66.0 23:28:14 INFO - PROCESS | 7406 | -------- Summary: end -------- 23:28:14 INFO - PROCESS | 7406 | 23:28:15 INFO - TEST-INFO | 7406: exit 0 23:28:15 INFO - TEST-OK | kraken | took 58761ms 23:28:15 INFO - TEST-START | v8_7 23:28:15 INFO - operating with platform_type : linux_ 23:28:15 INFO - Initialising browser for v8_7 test... 23:28:15 INFO - TEST-INFO | started process 7655 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvYHpYe/profile http://localhost:51454/getInfo.html) 23:28:18 INFO - PROCESS | 7655 | __metrics Screen width/height:1600/1200 23:28:18 INFO - PROCESS | 7655 | colorDepth:24 23:28:18 INFO - PROCESS | 7655 | Browser inner width/height: 1024/697 23:28:18 INFO - PROCESS | 7655 | __metrics 23:28:19 INFO - PROCESS | 7655 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 23:28:19 INFO - PROCESS | 7655 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 23:28:20 INFO - TEST-INFO | 7655: exit 0 23:28:20 INFO - Browser initialized. 23:28:20 INFO - Running cycle 1/1 for v8_7 test... 23:28:20 INFO - TEST-INFO | started process 7735 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvYHpYe/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:28:31 INFO - PROCESS | 7735 | RSS: Main: 148844544 23:28:31 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | Cycle 1(1): loaded http://localhost:51454/tests/v8_7/run.html (next: http://localhost:51454/tests/v8_7/run.html) 23:28:54 INFO - PROCESS | 7735 | RSS: Main: 538222592 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | __start_tp_report 23:28:54 INFO - PROCESS | 7735 | _x_x_mozilla_page_load 23:28:54 INFO - PROCESS | 7735 | _x_x_mozilla_page_load_details 23:28:54 INFO - PROCESS | 7735 | |i|pagename|runs| 23:28:54 INFO - PROCESS | 7735 | |0;Richards;167.95431642593215 23:28:54 INFO - PROCESS | 7735 | |1;DeltaBlue;191.131498470948 23:28:54 INFO - PROCESS | 7735 | |2;Encrypt;273.224043715847 23:28:54 INFO - PROCESS | 7735 | |3;Decrypt;5291.005291005291 23:28:54 INFO - PROCESS | 7735 | |4;RayTrace;1116.0714285714287 23:28:54 INFO - PROCESS | 7735 | |5;Earley;775.1937984496124 23:28:54 INFO - PROCESS | 7735 | |6;Boyer;12120.481927710844 23:28:54 INFO - PROCESS | 7735 | |7;RegExp;42122.448979591834 23:28:54 INFO - PROCESS | 7735 | |8;Splay;585.8230814294083 23:28:54 INFO - PROCESS | 7735 | |9;NavierStokes;4822.115384615385 23:28:54 INFO - PROCESS | 7735 | __end_tp_report 23:28:54 INFO - PROCESS | 7735 | __startTimestamp1453966134719__endTimestamp 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | ------- Summary: start ------- 23:28:54 INFO - PROCESS | 7735 | Number of tests: 10 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#0] Richards Cycles:1 Average:167.95 Median:167.95 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 168.0 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#1] DeltaBlue Cycles:1 Average:191.13 Median:191.13 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 191.1 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#2] Encrypt Cycles:1 Average:273.22 Median:273.22 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 273.2 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#3] Decrypt Cycles:1 Average:5291.01 Median:5291.01 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 5291.0 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#4] RayTrace Cycles:1 Average:1116.07 Median:1116.07 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 1116.1 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#5] Earley Cycles:1 Average:775.19 Median:775.19 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 775.2 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#6] Boyer Cycles:1 Average:12120.48 Median:12120.48 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 12120.5 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#7] RegExp Cycles:1 Average:42122.45 Median:42122.45 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 42122.4 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#8] Splay Cycles:1 Average:585.82 Median:585.82 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 585.8 23:28:54 INFO - PROCESS | 7735 | 23:28:54 INFO - PROCESS | 7735 | [#9] NavierStokes Cycles:1 Average:4822.12 Median:4822.12 stddev:0.00 (0.0%) 23:28:54 INFO - PROCESS | 7735 | Values: 4822.1 23:28:54 INFO - PROCESS | 7735 | -------- Summary: end -------- 23:28:54 INFO - PROCESS | 7735 | 23:28:55 INFO - TEST-INFO | 7735: exit 0 23:28:55 INFO - TEST-OK | v8_7 | took 40528ms 23:28:55 INFO - SUITE-END | took 1212s 23:28:55 INFO - Completed test suite (00:20:12) 23:28:55 INFO - Working with test: dromaeo_css 23:28:55 INFO - Generating results file: dromaeo_css 23:28:55 INFO - Working with test: kraken 23:28:55 INFO - Generating results file: kraken 23:28:55 INFO - javascript benchmark 23:28:55 INFO - Working with test: v8_7 23:28:55 INFO - Generating results file: v8_7 23:28:55 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 23:28:55 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 23:28:55 INFO - process_Request line: dromaeo_css 6726.82 graph.html#tests=[[72,64,35]] 23:28:55 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 23:28:55 INFO - process_Request line: kraken 1497.50 graph.html#tests=[[232,64,35]] 23:28:55 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 23:28:55 INFO - process_Request line: v8_7 20130.33 graph.html#tests=[[230,64,35]] 23:28:55 INFO - RETURN: dromaeo_css: 6726.82 23:28:55 INFO - RETURN: kraken: 1497.50 23:28:55 INFO - RETURN: v8_7: 20130.33 23:28:55 INFO - javascript benchmark 23:28:55 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3144.622645282566, 3169.271067654438, 3206.615206175259, 3212.518122281659, 3245.610526736791, 5126.948730512694, 5134.743262836852, 5186.896262074756, 5202.55778258848, 5202.921956170651, 5016.673916195445, 5018.598512119031, 5040.97479512602, 5132.20450830121, 5201.037808005522, 4684.391029166203, 4699.882502937419, 4729.0, 4757.333973243749, 4809.1343558159515, 4768.451628062782, 4792.83225087122, 4819.228923372244, 4836.347093142434, 4851.078295123915, 4613.884652883671, 4624.167649823031, 4666.603338716213, 4689.460712018127, 4693.413323334583, 4673.299005149221, 4686.133065382881, 4716.056788642285, 4722.551357621055, 4730.053989202173, 4506.59440650343, 4692.202325604655, 4695.413073365829, 4709.740964246965, 4742.241241401393, 4891.437484689271, 4928.901421971576, 4934.235193545006, 4954.504549545017, 4996.850094497171, 5407.810726624549, 5414.269073675082, 5415.593830462731, 5430.294061771984, 5473.17902314652, 5409.486098820645, 5415.83752487426, 5471.23402723619, 5491.0, 5512.0, 5229.633925625208, 5241.554467870197, 5279.44565820591, 5281.471852814688, 5291.920621190685, 5615.522680572197, 5616.606837521416, 5619.719014049281, 5624.240727501817, 5660.037793575019, 5325.121354976463, 5399.136138217867, 5403.648762830403, 5406.351237851404, 5406.756695948692, 5417.322834645669, 5496.532794712494, 5498.45015498455, 5534.086875665551, 5540.002799496049, 5386.784528618889, 5389.191621256765, 5391.838244852661, 5392.083345831218, 5395.0, 5323.520883120537, 5382.542483888913, 5383.67697938125, 5443.319585051869, 5480.91778623321, 4198.769067701306, 4263.381809637585, 4281.721688090264, 4293.785310734451, 4302.67729920251, 3824.3116239077235, 3854.190619969782, 3854.7301688881507, 3884.8057597120596, 3886.980565097213, 5000.399952005782, 5082.974585127051, 5154.433012368637, 5154.664946778447, 5198.428172900978, 5491.615586908958, 5510.641808282529, 5518.613697041169, 5585.134304182858, 5606.55147588192, 5068.087744206078, 5068.23976403535, 5097.490250974947, 5110.770015349318, 5130.256112863689, 4575.10785396851, 4659.487456379796, 4667.673262871566, 4667.95332046682, 4698.083873644607, 5760.251167348301, 5774.220480235199, 5777.335606405317, 5778.422157784188, 5829.679367634736, 5530.5022547970875, 5560.1103823389685, 5562.054450743302, 5562.9443705564045, 5566.304211973504, 5660.320761508646, 5691.4877661010705, 5748.712564371848, 5768.913466298093, 5779.624324418899, 5437.429069947599, 5438.021156191923, 5442.2108794225405, 5468.835934921959, 5483.917741233805, 5459.880724451398, 5477.808276710296, 5487.067198576172, 5495.285612870462, 5504.174373843955, 5273.367195936359, 5337.786488540415, 5392.838214853561, 5433.347998240237, 5454.618176727749, 5458.1266997280245, 5465.289512363367, 5466.781328746805, 5470.288862447856, 5472.863178420572, 5347.705876176848, 5364.597655175799, 5365.597580181424, 5374.892502150014, 5417.404085550507, 5270.077736396192, 5298.44366341544, 5306.6550674206055, 5357.919631205613, 5420.783168673209, 5267.0, 5330.54690351309, 5374.3013408256675, 5376.892462150813, 5385.246065550904], "unit": "score", "name": "dojo.html", "value": 5083.932908807821}, {"lowerIsBetter": false, "replicates": [521.324884274864, 529.0767610519642, 530.7160669042061, 541.5505130741484, 558.5364147757361, 27976.86011569942, 28568.28579285519, 38606.42090368647, 39308.60691393085, 39351.21297574047, 41801.790991045076, 42240.15519689604, 42256.0, 42323.0, 42362.36456453148, 8532.274756645676, 8668.60991255395, 8738.563071846414, 8740.825183496327, 8746.825063498727, 8461.746147615582, 8567.35744819138, 8585.914140858575, 8586.441881277697, 8599.6130174142, 8633.309335253165, 8686.087960764124, 8701.434406763572, 8701.47791132534, 8709.912900870973, 8556.058833528306, 8616.396852220347, 8631.309495240366, 8631.784205394853, 8635.69775057873, 8569.185927336894, 8722.38943273971, 8725.650973961034, 8729.60716767747, 8737.47575145487, 39208.41187382192, 39707.40438893419, 39738.0, 39740.006499837735, 39873.60126398728, 3247.7077063064203, 3322.6178989416285, 3335.8332083395735, 3400.2179498715186, 3974.105826189113, 26878.865605672043, 27456.588151177748, 27499.725002749918, 27512.0, 27524.724752752416, 3826.9234615307814, 3982.422548730418, 3984.382420724792, 3990.940135897964, 4132.524759652649, 260765.0, 260974.9999999981, 263552.0, 263667.0, 264372.0, 59153.70423147943, 59291.0, 59471.0, 59648.70175649094, 59689.403105968384, 64592.0, 64706.0, 64706.67646661736, 64737.676311619085, 64848.35151648518, 12957.574666786646, 13026.869731302755, 13055.869441305465, 13064.673383165307, 13068.738625227443, 10727.0, 10782.191335649857, 10807.135429165648, 10810.189235807346, 10810.837837432446, 19325.710114348298, 20177.798222017886, 20414.489637759176, 20508.38474845757, 20510.487237818874, 6470.514711396664, 7843.607819609111, 7931.801704957307, 7996.0, 8061.6372263248295, 874.7200895713438, 900.8603666431713, 945.5414124149781, 1028.547439126782, 1042.3641578637025, 26504.46991060168, 26723.465530689668, 27096.593551096354, 27229.319267018484, 27234.863825680746, 979.4466126638426, 1010.8281592129356, 1025.395016939994, 1031.7369070887025, 1094.392612100276, 14934.40262389514, 15011.924940375227, 15078.321475533408, 15256.389744410099, 15298.694026119416, 287595.0, 290922.0, 311663.0, 315303.0, 317981.0, 50097.0, 50746.49253507492, 51132.48867511352, 51138.74430627823, 51180.0, 1161.4076820821442, 1245.5649205802633, 1257.7610254051701, 1273.2424207596466, 1297.7145028093805, 22372.32883013512, 27136.864315678296, 27722.168334949984, 29082.418351632426, 29242.561361580018, 48108.27837582369, 48282.517174829205, 48627.756861215465, 48680.26979595238, 48680.75659621821, 263985.0, 269136.0, 284063.0, 286258.0, 392246.0, 32455.350892981536, 32526.02421927346, 32544.186395340304, 32578.83710581432, 32924.835375822964, 42013.0, 42966.0, 43014.0, 43647.34528982004, 43926.78036609796, 36483.635163648025, 36974.63025369712, 37237.6276237245, 37374.0, 38161.04597385087, 37299.25401491901, 38023.0, 38951.22097557976, 39725.0, 40099.79950100231, 32373.838130809196, 32927.341453171284, 33098.50352244767, 33176.50235246521, 33275.83362083174, 29205.269868252613, 32344.31007503946, 32462.513062304555, 32800.343993119524, 32836.179095522806, 24917.50164996726, 25024.37439064038, 25147.49705005853, 25429.23712288634, 25676.486470270862], "unit": "score", "name": "ext.html", "value": 18145.7013499678}, {"lowerIsBetter": false, "replicates": [351.7432274439661, 358.1672611179008, 363.60912019578956, 363.69449662283677, 363.96542328478785, 13419.664508387295, 13703.246321452316, 15406.229688515572, 16508.669826603462, 17947.192376343064, 14723.779143312859, 15140.621484462894, 15189.392424303041, 16499.752503712454, 16583.83416165838, 5305.071612467812, 5500.42245564216, 5502.422245664207, 5506.284183056197, 5506.91739623906, 3942.940855887164, 4076.5923407659143, 5379.757910894, 5476.452354764511, 5672.0, 5819.67991760453, 5963.582549221556, 6018.759249630031, 6036.275646922353, 6039.365866584011, 5991.820245392645, 6023.126646636213, 6025.0058740307795, 6030.276366835964, 6036.034234522477, 5150.175971844525, 5324.068288049614, 5400.08198606234, 5401.243825864342, 5410.134378499461, 19536.21855125793, 19586.80413195864, 19979.80121192733, 20854.37436876896, 20858.79141208599, 2065.2565076572423, 2101.9060670237945, 2121.4060063182333, 2132.3070002249333, 2210.049678638185, 12589.370531473389, 12921.612351629467, 13020.34898255093, 13048.673783155402, 13083.345832708326, 1797.73034044893, 1808.493621785902, 1812.28414776164, 1826.4246762269843, 1840.55826601616, 49894.50105498935, 50614.493855061344, 55790.16314755282, 57125.42874571243, 57318.42681573214, 14012.229327387091, 14435.92782036083, 14436.855631443552, 14443.855561444461, 14498.275086245645, 21876.23433179863, 21950.121995120015, 21993.7009448584, 22122.668159977613, 22125.0, 8260.463069900437, 8345.123762005023, 8364.03813561436, 8389.95805020971, 8412.200840920103, 7003.3346832050875, 7027.472939529555, 7060.293970603001, 7067.717291308393, 7068.717251309993, 7469.058044908363, 7584.431167662337, 7604.467687261838, 7604.657790399446, 7764.883526747103, 2527.279725278287, 2864.8281103133877, 2889.118818760256, 2938.735513803768, 2963.6295463067117, 421.588950773, 840.3529282452478, 925.6760133953197, 947.218544700611, 1042.2652030318607, 9958.900410995797, 10292.549215051084, 10627.415492148006, 10781.08360789326, 10843.891561084445, 438.1150076844756, 439.49238629383115, 447.0634021724482, 451.039286320136, 462.75936513013045, 5863.208466857005, 5887.4406931341455, 5939.07944268639, 6021.126936594257, 6264.9373506265265, 369015.0, 371214.0, 374698.0, 376525.0, 578317.3252401217, 67538.32461675418, 69633.3036669637, 72247.63876180585, 72437.63781181061, 73099.63450182715, 502.48495292325657, 510.9514596113363, 511.63929429751937, 512.9871753206199, 513.0380536494074, 8682.348823838363, 9806.509674516388, 10094.394336339843, 10137.18902487814, 10203.94898025505, 29146.854265728536, 30361.0, 30630.387392252476, 30898.073057808302, 31115.0, 39683.20633587254, 40037.0, 40688.59311406966, 42091.0, 42831.57168428276, 7407.888881666671, 7611.124720657195, 7665.923340766744, 7670.654820532978, 7835.059792824897, 9731.610735570497, 11609.941950290533, 11863.694993550529, 12099.092568057607, 12119.575814846437, 2985.4924662807807, 4955.72743499111, 5024.120778863758, 9471.431714097176, 10076.345037572535, 10325.535350909076, 10418.0, 10538.524606554935, 10696.090832279344, 10821.18841086906, 10045.347052441568, 10264.743381415525, 10390.948045259725, 10566.894331056592, 10667.413292269, 7370.336669699753, 7826.2173782621285, 7864.2922137007945, 7892.4080693947035, 7894.960525197337, 9512.476813775032, 9760.804783904141, 10058.0, 10221.437820919624, 10557.9472102639], "unit": "score", "name": "jquery.html", "value": 7901.10131116739}, {"lowerIsBetter": false, "replicates": [1312.4487715159632, 1493.8954273200877, 1506.0888162661593, 1682.59617691754, 1819.0450013742784, 6556.73773049078, 7617.8476430471355, 7771.067471903372, 7775.3779697624195, 7783.766487005385, 7277.454190935675, 7416.0729908761405, 7446.813829654261, 7459.104907411118, 7466.178720340758, 1997.6703843865816, 2056.557840064386, 2238.5858616155983, 2272.363738153316, 2283.394900351408, 2319.7680231976838, 2325.1861848353024, 2326.499802542453, 2326.9767302327014, 2331.207389487574, 2268.8638681679154, 2330.0330362899376, 2331.405491599648, 2332.1604222479896, 2335.311083230443, 2240.1599400224914, 2279.099755596538, 2296.5062511559927, 2298.4943312471314, 2299.735530414007, 2246.6068438023444, 2265.7651579888834, 2267.0705010945435, 2267.0931627349028, 2311.341267738703, 7634.809129771745, 7704.576248306341, 7708.460407771458, 7708.768736937901, 7722.652480638385, 4449.599536041772, 4532.5240849710635, 4538.115067561826, 4568.177728008957, 4568.817247310104, 2850.857457127135, 2917.5040243158714, 2961.141269031978, 2967.614210152688, 2973.5242361222317, 882.0473888200792, 885.2961895293257, 892.1435421994893, 894.592960203106, 895.2748273898163, 10589.364638121737, 10607.098396636295, 10608.15134789215, 10622.09712174466, 10630.893691063146, 4429.11417716458, 4433.179861725591, 4482.843100491467, 4527.366168736379, 4528.049109686936, 9017.143371379709, 9026.548672566345, 9044.638214471479, 9044.773880653036, 9059.773505662411, 4854.68444551103, 4890.779914903838, 4898.608111351155, 4907.141250281258, 4910.091633047898, 4460.241758900995, 4461.531539188403, 4464.441944756905, 4465.173942820588, 4468.865934021985, 3378.476336167898, 3453.188500702333, 3639.2721455708966, 3755.4366844972924, 3756.1360886996144, 1191.2614179208947, 1199.2444759801444, 1202.5310129049678, 1205.73473835756, 1241.3482921466302, 989.2481713897346, 1011.7925825205815, 1013.3970287678819, 1131.1798945764256, 1340.879320861127, 7034.19106802714, 7124.750633727795, 7161.319674630901, 7161.89257161143, 7174.031505746658, 1076.252004856617, 1100.2408338246585, 1100.834874768791, 1109.6060898380958, 1127.577158565538, 5698.8290351289525, 5783.71081445926, 5816.912746308809, 5818.80714453536, 5823.417658234142, 8826.955865220762, 9383.061693830563, 9439.292053095907, 9509.001554836643, 9515.0, 9345.112214339626, 9354.579043943038, 9408.247340212767, 9440.197583205505, 9477.194438472668, 7093.3970612498515, 7415.555066696015, 7422.554646721214, 7440.813979650444, 7512.962435187898, 7016.36852683261, 7089.893651595127, 7121.893171602534, 7122.216556178712, 7125.893111603434, 8393.034800997963, 8571.871421928801, 8665.306775458075, 8753.562321883754, 8831.293496520391, 8383.455075420079, 8686.739397818075, 8708.521031343336, 8708.956455217683, 8718.82562348762, 6051.0, 6930.0, 7015.36861682451, 7022.403095736715, 7023.859522809413, 6577.736890524326, 7053.294670532906, 7230.602316872622, 7232.276772322725, 7239.4932354734665, 6689.866202675822, 6843.486738494533, 6846.144231971004, 6852.965735171292, 6893.414059804973, 6637.834054148491, 6712.39588437043, 6781.491388146008, 6841.692123854339, 6883.65581720922, 6640.800775976729, 6662.06731057662, 6667.166604174478, 6671.0, 6687.531872768859, 6340.9365906340345, 6369.777057802955, 6386.808395748135, 6412.0, 6427.421532062137, 6368.52236082305, 6410.935890641221, 6411.711472983634, 6416.133821934166, 6417.48660107181], "unit": "score", "name": "mootools.html", "value": 4441.17707494979}, {"lowerIsBetter": false, "replicates": [329.85980958092813, 331.60538958639233, 335.6911641290013, 339.0236119974473, 343.8005956545204, 5667.4049224831415, 5816.418358164176, 5826.096954971981, 5832.650040997538, 5879.647221166733, 5600.327960644719, 5722.399148089443, 5731.455511726379, 5732.656040637565, 5779.913301300473, 4528.3207518872105, 4529.207388706971, 4531.546845315475, 4535.909281814378, 4540.2054640437955, 4337.327714204303, 4413.073254616518, 4424.867253982386, 4505.3917721107555, 4541.250693635546, 4423.380726698265, 4432.268675668527, 4448.354988526662, 4456.732596044248, 4461.598456138947, 4474.0380818124095, 4487.977560112195, 4489.977550112261, 4490.146872094324, 4506.076254367847, 3985.501812273466, 3987.3620220764537, 3989.7606143631474, 3991.022199561126, 3992.500937382827, 5401.945980540184, 5503.724813759296, 5509.531689806371, 5598.300212473441, 5606.299212598426, 5165.302684137631, 5201.55786758126, 5202.687838729688, 5207.921881171786, 5212.270282160463, 5902.32123305821, 6215.1609532712955, 6216.813495595139, 6229.595076320024, 6239.438450539428, 4260.808263628113, 4268.701190916637, 4351.6953813233085, 4355.4337936068105, 4355.60799528044, 6362.236531616236, 6470.935290647128, 6471.902921456229, 6471.967640161816, 6479.254885688159, 4412.6690498212765, 4414.580614841585, 4418.801153948016, 4419.535948725402, 4427.335899615084, 4338.110687309094, 4474.149911516866, 4480.327950807405, 4480.641548676098, 4483.641308695296, 5166.3800343958965, 5172.301739265151, 5172.689638621695, 5173.948260517422, 5177.3269474968765, 6230.844228894314, 6238.220222472191, 6242.533004743882, 6244.812655620339, 6252.155958945484, 1563.5543869996995, 1580.9604759880865, 1581.5571639940836, 1582.2168026826794, 1585.952421427359, 1066.5573786878513, 1067.1676092647747, 1068.1454836131063, 1070.55571937645, 1095.9945200273949, 5869.911951320733, 5886.205362276123, 5887.1463637772285, 5890.764369425175, 5891.675957822275, 6395.584287021329, 6397.84838729024, 6404.135441715402, 6411.551191416649, 6415.230172379344, 5872.706364681749, 5884.970575147183, 5888.735006924699, 5888.970555147197, 5890.440408161304, 3341.913877989663, 3470.4273794824076, 3473.4268845640186, 3482.529858469125, 3483.860645574199, 6736.6631668416385, 6738.225104112992, 6745.123133992648, 6746.0892779475125, 6755.425788807908, 6560.179977502812, 6594.681063787261, 6597.637129957899, 6600.504962127764, 6606.405423511907, 6562.343765623399, 6714.630695311805, 6733.8989915151315, 6747.05541224229, 6749.527533072638, 6131.4481696645735, 6323.399277068671, 6439.967800160969, 6440.645764482999, 6444.709988050456, 6219.440250377488, 6358.364163583605, 6377.266614339224, 6391.0, 6397.584157029778, 6722.630255336004, 6729.831754206184, 6730.394264516217, 6733.865322693421, 6735.966320168368, 4299.355096735515, 4409.492908315457, 4442.51132375432, 4442.51132375432, 4444.4888837784065, 6347.460465860454, 6352.396522330371, 6376.075469056868, 6393.200849893763, 6407.2631647359285, 6246.593971391845, 6257.124002639725, 6257.342978987323, 6259.3427690091885, 6262.248530176408, 6058.363871793398, 6219.875602488016, 6233.252009758858, 6237.656928868774, 6244.625322480666, 6154.78458253959, 6163.414475624809, 6165.3526379731275, 6167.938320616737, 6170.074488826712, 6286.811395658137, 6298.905516417166, 6309.90535141964, 6310.368963103653, 6316.431521163117, 6063.939360606514, 6102.328743838086, 6133.693315334304, 6144.692765361803, 6151.72317245716], "unit": "score", "name": "prototype.html", "value": 4696.418390453773}, {"lowerIsBetter": false, "replicates": [602.7679343452771, 659.9175103112111, 677.847484316029, 682.3040498691332, 722.609790713015, 13675.452981880726, 13750.106243094204, 13791.586252412431, 13838.169709817394, 13840.792388114187, 10966.0, 12652.62042138735, 12654.873451265485, 12768.42542085606, 12804.359782010908, 634.6192284629232, 800.383704547498, 806.5040000399741, 812.191869090253, 812.5409143833745, 790.612599826084, 798.632628990665, 800.4476910931468, 800.5276886636883, 801.8556659801234, 683.1017212365748, 692.608676098003, 842.4818736477084, 843.2452954605624, 844.2486187293314, 832.1636755061155, 840.9915900840974, 843.3969711656196, 844.9112843151473, 845.2941793602319, 627.7645882793952, 629.6002038705456, 630.2342653675806, 631.0817760158958, 631.2677294338591, 13189.934050329686, 13224.6693832654, 13292.202467851863, 13312.86687133126, 13320.333983300796, 12206.511739530408, 12475.126741128124, 12934.0, 12965.740685186338, 13366.532171374052, 10549.10332621728, 10630.574777008987, 10637.46812659364, 10638.148948084212, 10813.405262710548, 3584.354816133095, 3646.7994260315672, 3662.8168591570316, 3692.8892133236045, 3767.6232376762377, 44632.55367446349, 44702.55297447016, 44949.0, 44964.10071798546, 46165.307520387556, 10050.648227312155, 10129.290949633601, 10139.949300253451, 10140.188784897191, 10416.479176041168, 18403.631927361646, 18515.537111572048, 18557.628847422977, 18588.907055464635, 18609.627807443776, 7461.813454663677, 7540.622968851536, 7612.619369031526, 7656.693732250759, 7669.923300767033, 4134.235166494208, 4183.163367326486, 4193.790310484464, 4243.766592837424, 4294.205571969195, 3038.848057597111, 3071.6314042315066, 3078.122735020553, 3078.492048811921, 3084.8457577121503, 578.1991941161522, 581.0209796492923, 582.3884920833108, 588.364566268429, 603.2399177036878, 469.4671547793279, 497.8257609836528, 544.5888354292563, 546.137103376664, 587.7149582452507, 8342.749717508485, 8474.1525847416, 8905.866412003825, 9219.354645174773, 9277.48973806447, 503.61725088931945, 611.5535658968888, 614.5605891787393, 624.3257282135284, 626.692920468976, 3675.503806986076, 3774.1319496515957, 3823.541175058955, 3827.2536855312946, 3847.615238476186, 53968.460315397126, 54053.0, 54181.1872821908, 55258.17112743312, 56384.0, 48298.517014829406, 48763.512364875896, 48913.26630100551, 49148.75425622849, 49227.75386123046, 43722.34416483755, 43752.781236093615, 44586.77706611446, 45590.77204613956, 45740.0, 8246.83506329858, 8266.751997440086, 8396.832063358577, 8580.34710950181, 8751.562421878753, 32499.512507311938, 33250.833745831114, 33619.663803361655, 34680.826595866856, 37525.4371184427, 41458.170836583704, 42729.572704272556, 42903.785481073646, 43315.35026974535, 44294.0, 10373.481325933522, 10399.740006499898, 10452.895471045193, 10474.266801323834, 10486.0, 10730.825933077804, 11147.88852111501, 11177.049950754277, 11344.546218151181, 11396.088312935111, 10747.838782418114, 10759.677209683721, 11254.879030041475, 11283.774324513628, 11372.260803047775, 10352.378857268588, 10668.62659806903, 10757.892421075689, 10791.082757965662, 11315.773684526428, 10386.74033149147, 10401.115905148146, 10638.202134839763, 10872.782544348911, 10899.128069754559, 8475.660973560989, 8542.30062403811, 8582.227599516074, 8688.087750786077, 9145.131212534798, 9155.221806146552, 9196.908030919605, 9348.0, 9423.151916327564, 9478.24174066087], "unit": "score", "name": "yui.html", "value": 6093.876569538582}], "name": "dromaeo_css", "value": 6726.818337450192}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 107.0, 110.0, 110.0, 110.0, 110.0, 110.0, 103.0, 109.0], "unit": "score", "name": "ai-astar", "value": 109.2}, {"lowerIsBetter": true, "replicates": [153.0, 130.0, 148.0, 164.0, 128.0, 160.0, 153.0, 126.0, 159.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 144.8}, {"lowerIsBetter": true, "replicates": [162.0, 160.0, 160.0, 162.0, 161.0, 162.0, 162.0, 159.0, 160.0, 162.0], "unit": "score", "name": "audio-dft", "value": 161.0}, {"lowerIsBetter": true, "replicates": [73.0, 73.0, 98.0, 95.0, 71.0, 80.0, 74.0, 119.0, 106.0, 73.0], "unit": "score", "name": "audio-fft", "value": 86.2}, {"lowerIsBetter": true, "replicates": [97.0, 95.0, 139.0, 96.0, 96.0, 96.0, 143.0, 95.0, 96.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 109.1}, {"lowerIsBetter": true, "replicates": [119.0, 115.0, 115.0, 114.0, 115.0, 115.0, 115.0, 114.0, 115.0, 114.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.1}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 146.0, 145.0, 146.0, 146.0, 145.0, 145.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.4}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 95.0, 97.0, 97.0, 97.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [59.0, 57.0, 56.0, 57.0, 57.0, 57.0, 57.0, 57.0, 59.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 65.0, 67.0, 67.0, 67.0, 67.0, 67.0, 67.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.7}, {"lowerIsBetter": true, "replicates": [82.0, 82.0, 82.0, 81.0, 82.0, 83.0, 82.0, 82.0, 82.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.1}, {"lowerIsBetter": true, "replicates": [115.0, 114.0, 113.0, 115.0, 113.0, 116.0, 115.0, 112.0, 118.0, 123.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.4}, {"lowerIsBetter": true, "replicates": [145.0, 135.0, 144.0, 149.0, 144.0, 132.0, 145.0, 144.0, 144.0, 144.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 142.6}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 66.0, 66.0, 66.0, 67.0, 70.0, 65.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.7}], "name": "kraken", "value": 1497.5}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.95431642593215], "unit": "score", "name": "Richards", "value": 210.18810800000006}, {"lowerIsBetter": false, "replicates": [191.131498470948], "unit": "score", "name": "DeltaBlue", "value": 345.9293760000001}, {"lowerIsBetter": false, "replicates": [273.224043715847], "unit": "score", "name": "Encrypt", "value": 974.2224600000001}, {"lowerIsBetter": false, "replicates": [5291.005291005291], "unit": "score", "name": "Decrypt", "value": 50.30820900000001}, {"lowerIsBetter": false, "replicates": [1116.0714285714287], "unit": "score", "name": "RayTrace", "value": 663.0301440000001}, {"lowerIsBetter": false, "replicates": [775.1937984496124], "unit": "score", "name": "Earley", "value": 859.7372699999999}, {"lowerIsBetter": false, "replicates": [12120.481927710844], "unit": "score", "name": "Boyer", "value": 54.9865099403579}, {"lowerIsBetter": false, "replicates": [42122.448979591834], "unit": "score", "name": "RegExp", "value": 21.62706637596898}, {"lowerIsBetter": false, "replicates": [585.8230814294083], "unit": "score", "name": "Splay", "value": 139.10513700000004}, {"lowerIsBetter": false, "replicates": [4822.115384615385], "unit": "score", "name": "NavierStokes", "value": 307.7487537387835}], "name": "v8_7", "value": 20130.33342500725}]} 23:28:55 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,35]]", "result": "20130.33"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1497.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6726.82"}}} 23:28:55 INFO - Return code: 0 23:28:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 23:28:55 INFO - # TBPL SUCCESS # 23:28:55 INFO - Running post-action listener: _resource_record_post_action 23:28:55 INFO - Running post-run listener: _resource_record_post_run 23:28:57 INFO - Total resource usage - Wall time: 1230s; CPU: 13.0%; Read bytes: 167936; Write bytes: 540352512; Read time: 48; Write time: 395552 23:28:57 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 236560384; Read time: 0; Write time: 221784 23:28:57 INFO - run-tests - Wall time: 1214s; CPU: 13.0%; Read bytes: 167936; Write bytes: 303792128; Read time: 48; Write time: 173768 23:28:57 INFO - Running post-run listener: _upload_blobber_files 23:28:57 INFO - Blob upload gear active. 23:28:57 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 23:28:57 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 23:28:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 23:28:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 23:28:57 INFO - (blobuploader) - INFO - Open directory for files ... 23:28:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 23:28:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:28:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:28:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 23:28:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:28:58 INFO - (blobuploader) - INFO - Done attempting. 23:28:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 23:28:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:28:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:28:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 23:28:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:28:59 INFO - (blobuploader) - INFO - Done attempting. 23:28:59 INFO - (blobuploader) - INFO - Iteration through files over. 23:28:59 INFO - Return code: 0 23:28:59 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 23:28:59 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 23:28:59 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b2fe64bbf5a4768835688b241a097c705dbe5da6a4efda7eba7c70304746c8e1e763c2a6f160f13ac1f37c85b9980b773cf25af30b416878491377a6f308747f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a9e1ec394e872cb5d76cb3860aefc831847a4828fb5664c1514b5ce977a5dfacaffac6545f2e17fe84658f45bf9d0d02eeb3e8920dbe96d462a6af6c475835b5"} 23:28:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 23:28:59 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 23:28:59 INFO - Contents: 23:28:59 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b2fe64bbf5a4768835688b241a097c705dbe5da6a4efda7eba7c70304746c8e1e763c2a6f160f13ac1f37c85b9980b773cf25af30b416878491377a6f308747f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a9e1ec394e872cb5d76cb3860aefc831847a4828fb5664c1514b5ce977a5dfacaffac6545f2e17fe84658f45bf9d0d02eeb3e8920dbe96d462a6af6c475835b5"} 23:28:59 INFO - Running post-run listener: copy_logs_to_upload_dir 23:28:59 INFO - Copying logs to upload dir... 23:28:59 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 23:28:59 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1284.222470 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2016-01-27 23:28:59.127361) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-27 23:28:59.130848) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b2fe64bbf5a4768835688b241a097c705dbe5da6a4efda7eba7c70304746c8e1e763c2a6f160f13ac1f37c85b9980b773cf25af30b416878491377a6f308747f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a9e1ec394e872cb5d76cb3860aefc831847a4828fb5664c1514b5ce977a5dfacaffac6545f2e17fe84658f45bf9d0d02eeb3e8920dbe96d462a6af6c475835b5"} build_url:https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011386 build_url: 'https://queue.taskcluster.net/v1/task/CJWGIg-HQMKXCME2o4qCGQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b2fe64bbf5a4768835688b241a097c705dbe5da6a4efda7eba7c70304746c8e1e763c2a6f160f13ac1f37c85b9980b773cf25af30b416878491377a6f308747f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a9e1ec394e872cb5d76cb3860aefc831847a4828fb5664c1514b5ce977a5dfacaffac6545f2e17fe84658f45bf9d0d02eeb3e8920dbe96d462a6af6c475835b5"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-27 23:28:59.157028) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:28:59.157325) ========= 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=d2a8c569965ab8367867b893000001a1-1453962379.242429-2085479606 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004447 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-27 23:28:59.240332) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-27 23:28:59.240702) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-27 23:28:59.241005) ========= ========= Total master_lag: 0.39 =========