builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-021 starttime: 1456255368.52 results: success (0) buildid: 20160223083417 builduid: b5fa5175fab141c0b1dcd2741ee6a6c3 revision: bc194ea89e64784a573c4bb45dcd516beecd8c27 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.520877) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.521345) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.521628) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.008097 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.541399) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.541693) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.548956) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.549260) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.002966 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.595073) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.595383) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.595735) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.596002) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-23 11:22:49-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 217M=0s 2016-02-23 11:22:49 (217 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.165203 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.773275) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.773602) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014334 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.823075) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:48.823444) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev bc194ea89e64784a573c4bb45dcd516beecd8c27 --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 bc194ea89e64784a573c4bb45dcd516beecd8c27 --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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-23 11:22:49,597 truncating revision to first 12 chars 2016-02-23 11:22:49,597 Setting DEBUG logging. 2016-02-23 11:22:49,597 attempt 1/10 2016-02-23 11:22:49,597 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/bc194ea89e64?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-23 11:22:49,877 unpacking tar archive at: fx-team-bc194ea89e64/testing/mozharness/ program finished with exit code 0 elapsedTime=0.566083 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:49.402281) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:49.402639) ========= echo bc194ea89e64784a573c4bb45dcd516beecd8c27 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'bc194ea89e64784a573c4bb45dcd516beecd8c27'] 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False bc194ea89e64784a573c4bb45dcd516beecd8c27 program finished with exit code 0 elapsedTime=0.004117 script_repo_revision: 'bc194ea89e64784a573c4bb45dcd516beecd8c27' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:49.451005) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:49.451347) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-23 11:22:49.460976) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2016-02-23 11:22:49.461279) ========= /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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:22:50 INFO - MultiFileLogger online at 20160223 11:22:50 in /builds/slave/test-pgo 11:22:50 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 11:22:50 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 11:22:50 INFO - {'append_to_log': False, 11:22:50 INFO - 'base_work_dir': '/builds/slave/test-pgo', 11:22:50 INFO - 'blob_upload_branch': 'Fx-Team', 11:22:50 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 11:22:50 INFO - 'branch': 'Fx-Team', 11:22:50 INFO - 'buildbot_json_path': 'buildprops.json', 11:22:50 INFO - 'config_files': ('talos/linux_config.py',), 11:22:50 INFO - 'default_actions': ('clobber', 11:22:50 INFO - 'read-buildbot-config', 11:22:50 INFO - 'download-and-extract', 11:22:50 INFO - 'populate-webroot', 11:22:50 INFO - 'create-virtualenv', 11:22:50 INFO - 'install', 11:22:50 INFO - 'run-tests'), 11:22:50 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:22:50 INFO - 'download_minidump_stackwalk': True, 11:22:50 INFO - 'download_symbols': 'ondemand', 11:22:50 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:22:50 INFO - 'tooltool.py': '/tools/tooltool.py', 11:22:50 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:22:50 INFO - '/tools/misc-python/virtualenv.py')}, 11:22:50 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:22:50 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:22:50 INFO - 'installer_path': 'installer.exe', 11:22:50 INFO - 'log_level': 'info', 11:22:50 INFO - 'log_name': 'talos', 11:22:50 INFO - 'log_to_console': True, 11:22:50 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:22:50 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:22:50 INFO - 'opt_config_files': (), 11:22:50 INFO - 'pip_index': False, 11:22:50 INFO - 'sps_profile': False, 11:22:50 INFO - 'sps_profile_interval': 0, 11:22:50 INFO - 'suite': 'dromaeojs', 11:22:50 INFO - 'system_bits': '32', 11:22:50 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:22:50 INFO - 'title': 'talos-linux64-ix-021', 11:22:50 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:22:50 INFO - 'use_talos_json': True, 11:22:50 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 11:22:50 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:22:50 INFO - 'work_dir': 'build'} 11:22:50 INFO - ##### 11:22:50 INFO - ##### Running clobber step. 11:22:50 INFO - ##### 11:22:50 INFO - Running pre-action listener: _resource_record_pre_action 11:22:50 INFO - Running main action method: clobber 11:22:50 INFO - rmtree: /builds/slave/test-pgo/build 11:22:50 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 11:22:51 INFO - Running post-action listener: _resource_record_post_action 11:22:51 INFO - ##### 11:22:51 INFO - ##### Running read-buildbot-config step. 11:22:51 INFO - ##### 11:22:51 INFO - Running pre-action listener: _resource_record_pre_action 11:22:51 INFO - Running main action method: read_buildbot_config 11:22:51 INFO - Using buildbot properties: 11:22:51 INFO - { 11:22:51 INFO - "project": "", 11:22:51 INFO - "product": "firefox", 11:22:51 INFO - "script_repo_revision": "production", 11:22:51 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:22:51 INFO - "repository": "", 11:22:51 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 11:22:51 INFO - "buildid": "20160223083417", 11:22:51 INFO - "pgo_build": "True", 11:22:51 INFO - "basedir": "/builds/slave/test-pgo", 11:22:51 INFO - "buildnumber": 664, 11:22:51 INFO - "slavename": "talos-linux64-ix-021", 11:22:51 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:22:51 INFO - "platform": "ubuntu64_hw", 11:22:51 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:22:51 INFO - "branch": "fx-team", 11:22:51 INFO - "repo_path": "integration/fx-team", 11:22:51 INFO - "revision": "bc194ea89e64784a573c4bb45dcd516beecd8c27", 11:22:51 INFO - "stage_platform": "linux64-pgo", 11:22:51 INFO - "builduid": "b5fa5175fab141c0b1dcd2741ee6a6c3", 11:22:51 INFO - "slavebuilddir": "test" 11:22:51 INFO - } 11:22:51 INFO - Found installer url https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 11:22:51 INFO - Running post-action listener: _resource_record_post_action 11:22:51 INFO - ##### 11:22:51 INFO - ##### Running download-and-extract step. 11:22:51 INFO - ##### 11:22:51 INFO - Running pre-action listener: _resource_record_pre_action 11:22:51 INFO - Running main action method: download_and_extract 11:22:51 INFO - mkdir: /builds/slave/test-pgo/build/tests 11:22:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:22:51 INFO - https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 11:22:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/test_packages.json 11:22:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/test_packages.json 11:22:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 11:22:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 11:22:51 INFO - Downloaded 1448 bytes. 11:22:51 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 11:22:51 INFO - Using the following test package requirements: 11:22:51 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:22:51 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:22:51 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:22:51 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'jsshell-linux-x86_64.zip'], 11:22:51 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:22:51 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:22:51 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:22:51 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:22:51 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:22:51 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 11:22:51 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 11:22:51 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:22:51 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:22:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:22:51 INFO - https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:22:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:22:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:22:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:53 INFO - Downloaded 23366760 bytes. 11:22:53 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'] 11:22:53 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 11:22:54 INFO - Return code: 0 11:22:54 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 11:22:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:22:54 INFO - https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:22:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:22:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 11:22:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:55 INFO - Downloaded 23366760 bytes. 11:22:55 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'] 11:22:55 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 11:22:57 INFO - Return code: 0 11:22:57 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')]} 11:22:57 INFO - https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:22:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 11:22:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 11:22:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:58 INFO - Downloaded 10707015 bytes. 11:22:58 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'] 11:22:58 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 11:22:58 INFO - Return code: 0 11:22:58 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')]} 11:22:58 INFO - https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:22:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:22:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:22:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:22:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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 11:23:00 INFO - Downloaded 56628420 bytes. 11:23:00 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:23:00 INFO - mkdir: /builds/slave/test-pgo/properties 11:23:00 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 11:23:00 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 11:23:00 INFO - Contents: 11:23:00 INFO - build_url:https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 11:23:01 INFO - Running post-action listener: _resource_record_post_action 11:23:01 INFO - Running post-action listener: set_extra_try_arguments 11:23:01 INFO - ##### 11:23:01 INFO - ##### Running populate-webroot step. 11:23:01 INFO - ##### 11:23:01 INFO - Running pre-action listener: _resource_record_pre_action 11:23:01 INFO - Running main action method: populate_webroot 11:23:01 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:23:01 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:23:01 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:23:01 INFO - '--tppagecycles', 11:23:01 INFO - '7'], 11:23:01 INFO - 'tests': ['tsvgm']}}, 11:23:01 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 11:23:01 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:23:01 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 11:23:01 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:23:01 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:23:01 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:23:01 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'tests': ['damp', 'tps']}, 11:23:01 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['damp', 'tps']}, 11:23:01 INFO - 'g3': {'tests': ['dromaeo_dom']}, 11:23:01 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:23:01 INFO - 'other': {'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'other-e10s': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'other_l64': {'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'other_nol64': {'tests': ['a11yr', 11:23:01 INFO - 'ts_paint', 11:23:01 INFO - 'tpaint', 11:23:01 INFO - 'sessionrestore', 11:23:01 INFO - 'sessionrestore_no_auto_restore']}, 11:23:01 INFO - 'svgr': {'tests': ['tsvgx', 11:23:01 INFO - 'tsvgr_opacity', 11:23:01 INFO - 'tart', 11:23:01 INFO - 'tscrollx', 11:23:01 INFO - 'cart']}, 11:23:01 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['tsvgx', 11:23:01 INFO - 'tsvgr_opacity', 11:23:01 INFO - 'tart', 11:23:01 INFO - 'tscrollx', 11:23:01 INFO - 'cart']}, 11:23:01 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'tests': ['tp5o']}, 11:23:01 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'talos_options': ['--e10s'], 11:23:01 INFO - 'tests': ['tp5o']}, 11:23:01 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'talos_options': ['--xperf_path', 11:23:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:23:01 INFO - 'tests': ['tp5n']}, 11:23:01 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:23:01 INFO - 'talos_options': ['--e10s', 11:23:01 INFO - '--xperf_path', 11:23:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:23:01 INFO - 'tests': ['tp5n']}}, 11:23:01 INFO - 'talos.zip': {'path': '', 11:23:01 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:23:01 INFO - Running post-action listener: _resource_record_post_action 11:23:01 INFO - ##### 11:23:01 INFO - ##### Running create-virtualenv step. 11:23:01 INFO - ##### 11:23:01 INFO - Running pre-action listener: _resource_record_pre_action 11:23:01 INFO - Running main action method: create_virtualenv 11:23:01 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 11:23: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 11:23:01 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 11:23:01 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:23:01 INFO - Using real prefix '/usr' 11:23:01 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 11:23:01 INFO - Installing distribute.............................................................................................................................................................................................done. 11:23:03 INFO - Installing pip.................done. 11:23:03 INFO - Return code: 0 11:23:03 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 11:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:03 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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23:03 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 11:23:03 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 11:23:03 INFO - Using env: {'DISPLAY': ':0', 11:23:03 INFO - 'HOME': '/home/cltbld', 11:23:03 INFO - 'LANG': 'en_US.UTF-8', 11:23:03 INFO - 'LANGUAGE': 'en_US:en', 11:23:03 INFO - 'LOGNAME': 'cltbld', 11:23:03 INFO - 'MAIL': '/var/mail/cltbld', 11:23:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:03 INFO - 'MOZ_NO_REMOTE': '1', 11:23:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:03 INFO - 'NO_EM_RESTART': '1', 11:23:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:03 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:03 INFO - 'SHELL': '/bin/bash', 11:23:03 INFO - 'SHLVL': '1', 11:23:03 INFO - 'TERM': 'linux', 11:23:03 INFO - 'TMOUT': '86400', 11:23:03 INFO - 'USER': 'cltbld', 11:23:03 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:03 INFO - '_': '/tools/buildbot/bin/python'} 11:23:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:03 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 11:23:03 INFO - Cleaning up... 11:23:03 INFO - Return code: 0 11:23:03 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 11:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:03 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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23:03 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 11:23:03 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 11:23:03 INFO - Using env: {'DISPLAY': ':0', 11:23:03 INFO - 'HOME': '/home/cltbld', 11:23:03 INFO - 'LANG': 'en_US.UTF-8', 11:23:03 INFO - 'LANGUAGE': 'en_US:en', 11:23:03 INFO - 'LOGNAME': 'cltbld', 11:23:03 INFO - 'MAIL': '/var/mail/cltbld', 11:23:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:03 INFO - 'MOZ_NO_REMOTE': '1', 11:23:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:03 INFO - 'NO_EM_RESTART': '1', 11:23:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:03 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:03 INFO - 'SHELL': '/bin/bash', 11:23:03 INFO - 'SHLVL': '1', 11:23:03 INFO - 'TERM': 'linux', 11:23:03 INFO - 'TMOUT': '86400', 11:23:03 INFO - 'USER': 'cltbld', 11:23:03 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:03 INFO - '_': '/tools/buildbot/bin/python'} 11:23:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:04 INFO - Downloading/unpacking psutil>=0.7.1 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 11:23:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:23:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:23:06 INFO - Installing collected packages: psutil 11:23:06 INFO - Running setup.py install for psutil 11:23:06 INFO - building 'psutil._psutil_linux' extension 11:23: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 11:23: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 11:23:06 INFO - building 'psutil._psutil_posix' extension 11:23: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 11:23: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 11:23:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:23:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:23:06 INFO - Successfully installed psutil 11:23:06 INFO - Cleaning up... 11:23:06 INFO - Return code: 0 11:23:06 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 11:23:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:23:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:06 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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23:06 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 11:23:06 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 11:23:06 INFO - Using env: {'DISPLAY': ':0', 11:23:06 INFO - 'HOME': '/home/cltbld', 11:23:06 INFO - 'LANG': 'en_US.UTF-8', 11:23:06 INFO - 'LANGUAGE': 'en_US:en', 11:23:06 INFO - 'LOGNAME': 'cltbld', 11:23:06 INFO - 'MAIL': '/var/mail/cltbld', 11:23:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:06 INFO - 'MOZ_NO_REMOTE': '1', 11:23:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:06 INFO - 'NO_EM_RESTART': '1', 11:23:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:06 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:06 INFO - 'SHELL': '/bin/bash', 11:23:06 INFO - 'SHLVL': '1', 11:23:06 INFO - 'TERM': 'linux', 11:23:06 INFO - 'TMOUT': '86400', 11:23:06 INFO - 'USER': 'cltbld', 11:23:06 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:06 INFO - '_': '/tools/buildbot/bin/python'} 11:23:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:06 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:23:06 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 11:23:06 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 11:23:06 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 11:23:06 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 11:23:06 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 11:23:06 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 11:23:08 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:23:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:23:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:23:08 INFO - Installing collected packages: mozsystemmonitor 11:23:08 INFO - Running setup.py install for mozsystemmonitor 11:23:08 INFO - Successfully installed mozsystemmonitor 11:23:08 INFO - Cleaning up... 11:23:08 INFO - Return code: 0 11:23:08 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 11:23:08 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')]} 11:23:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:08 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')]} 11:23:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23:08 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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23:08 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 11:23:08 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 11:23:08 INFO - Using env: {'DISPLAY': ':0', 11:23:08 INFO - 'HOME': '/home/cltbld', 11:23:08 INFO - 'LANG': 'en_US.UTF-8', 11:23:08 INFO - 'LANGUAGE': 'en_US:en', 11:23:08 INFO - 'LOGNAME': 'cltbld', 11:23:08 INFO - 'MAIL': '/var/mail/cltbld', 11:23:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:08 INFO - 'MOZ_NO_REMOTE': '1', 11:23:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:08 INFO - 'NO_EM_RESTART': '1', 11:23:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:08 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:08 INFO - 'SHELL': '/bin/bash', 11:23:08 INFO - 'SHLVL': '1', 11:23:08 INFO - 'TERM': 'linux', 11:23:08 INFO - 'TMOUT': '86400', 11:23:08 INFO - 'USER': 'cltbld', 11:23:08 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:08 INFO - '_': '/tools/buildbot/bin/python'} 11:23:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:09 INFO - Downloading/unpacking blobuploader==1.2.4 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:10 INFO - Downloading blobuploader-1.2.4.tar.gz 11:23:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:23:10 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:23:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:23:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:23:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:23:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:23:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:23:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:23:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 11:23:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:11 INFO - Downloading docopt-0.6.1.tar.gz 11:23:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 11:23:11 INFO - Installing collected packages: blobuploader, requests, docopt 11:23:11 INFO - Running setup.py install for blobuploader 11:23:11 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:23:11 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 11:23:12 INFO - Running setup.py install for requests 11:23:12 INFO - Running setup.py install for docopt 11:23:12 INFO - Successfully installed blobuploader requests docopt 11:23:12 INFO - Cleaning up... 11:23:12 INFO - Return code: 0 11:23:12 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:23: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')]} 11:23:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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')]} 11:23:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23: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 11:23: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 11:23:12 INFO - Using env: {'DISPLAY': ':0', 11:23:12 INFO - 'HOME': '/home/cltbld', 11:23:12 INFO - 'LANG': 'en_US.UTF-8', 11:23:12 INFO - 'LANGUAGE': 'en_US:en', 11:23:12 INFO - 'LOGNAME': 'cltbld', 11:23:12 INFO - 'MAIL': '/var/mail/cltbld', 11:23:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:12 INFO - 'MOZ_NO_REMOTE': '1', 11:23:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:12 INFO - 'NO_EM_RESTART': '1', 11:23:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:12 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:12 INFO - 'SHELL': '/bin/bash', 11:23:12 INFO - 'SHLVL': '1', 11:23:12 INFO - 'TERM': 'linux', 11:23:12 INFO - 'TMOUT': '86400', 11:23:12 INFO - 'USER': 'cltbld', 11:23:12 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:12 INFO - '_': '/tools/buildbot/bin/python'} 11:23:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:23:12 INFO - Running setup.py (path:/tmp/pip-H6ReAn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:23:13 INFO - Running setup.py (path:/tmp/pip-wjgqVd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:23:13 INFO - Running setup.py (path:/tmp/pip-aOl3ws-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:23:13 INFO - Running setup.py (path:/tmp/pip-oCR5K7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:23:13 INFO - Running setup.py (path:/tmp/pip-DIWul9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:23:13 INFO - Running setup.py (path:/tmp/pip-Ll_wqo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:23:13 INFO - Running setup.py (path:/tmp/pip-j0HyTe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:23:13 INFO - Running setup.py (path:/tmp/pip-sZdYlO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:23:13 INFO - Running setup.py (path:/tmp/pip-fskJHj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:23:13 INFO - Running setup.py (path:/tmp/pip-uWMFQh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:23:13 INFO - Running setup.py (path:/tmp/pip-g9AqJl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:23:13 INFO - Running setup.py (path:/tmp/pip-RxZ7yA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:23:13 INFO - Running setup.py (path:/tmp/pip-YNwSTE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:23:13 INFO - Running setup.py (path:/tmp/pip-kFpRwj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:23:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:23:13 INFO - Running setup.py (path:/tmp/pip-MVnkut-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:23:14 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:23:14 INFO - Running setup.py (path:/tmp/pip-D251c0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:23:14 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:23:14 INFO - Running setup.py (path:/tmp/pip-Vf5j2P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:23:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:23:14 INFO - Running setup.py install for manifestparser 11:23:14 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Running setup.py install for mozcrash 11:23:14 INFO - Running setup.py install for mozdebug 11:23:14 INFO - Running setup.py install for mozdevice 11:23:14 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Running setup.py install for mozfile 11:23:14 INFO - Running setup.py install for mozhttpd 11:23:14 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Running setup.py install for mozinfo 11:23:14 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Running setup.py install for mozInstall 11:23:14 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 11:23:14 INFO - Running setup.py install for mozleak 11:23:15 INFO - Running setup.py install for mozlog 11:23:15 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Running setup.py install for moznetwork 11:23:15 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Running setup.py install for mozprocess 11:23:15 INFO - Running setup.py install for mozprofile 11:23:15 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Running setup.py install for mozrunner 11:23:15 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Running setup.py install for mozscreenshot 11:23:15 INFO - Running setup.py install for moztest 11:23:15 INFO - Running setup.py install for mozversion 11:23:15 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 11:23:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:23:15 INFO - Cleaning up... 11:23:15 INFO - Return code: 0 11:23:15 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:23: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')]} 11:23:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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')]} 11:23:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23: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 11:23: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 11:23:15 INFO - Using env: {'DISPLAY': ':0', 11:23:15 INFO - 'HOME': '/home/cltbld', 11:23:15 INFO - 'LANG': 'en_US.UTF-8', 11:23:15 INFO - 'LANGUAGE': 'en_US:en', 11:23:15 INFO - 'LOGNAME': 'cltbld', 11:23:15 INFO - 'MAIL': '/var/mail/cltbld', 11:23:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:15 INFO - 'MOZ_NO_REMOTE': '1', 11:23:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:15 INFO - 'NO_EM_RESTART': '1', 11:23:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:15 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:15 INFO - 'SHELL': '/bin/bash', 11:23:15 INFO - 'SHLVL': '1', 11:23:15 INFO - 'TERM': 'linux', 11:23:15 INFO - 'TMOUT': '86400', 11:23:15 INFO - 'USER': 'cltbld', 11:23:15 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:15 INFO - '_': '/tools/buildbot/bin/python'} 11:23:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:23:16 INFO - Running setup.py (path:/tmp/pip-ZaIqi0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:23:16 INFO - Running setup.py (path:/tmp/pip-m4GqZt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:23:16 INFO - Running setup.py (path:/tmp/pip-ZiAmD4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:23:16 INFO - Running setup.py (path:/tmp/pip-BM3v7o-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:23:16 INFO - Running setup.py (path:/tmp/pip-t30qb2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:23:16 INFO - Running setup.py (path:/tmp/pip-P2mYgM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:23:16 INFO - Running setup.py (path:/tmp/pip-YEvmU6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:23:16 INFO - Running setup.py (path:/tmp/pip-uZ_zHg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:23:16 INFO - Running setup.py (path:/tmp/pip-gMVfPh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:23:16 INFO - Running setup.py (path:/tmp/pip-JvhiHx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:23: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)) 11:23:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:23:16 INFO - Running setup.py (path:/tmp/pip-u9ruWs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:23:17 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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:23:17 INFO - Running setup.py (path:/tmp/pip-TKi8Um-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:23:17 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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:23:17 INFO - Running setup.py (path:/tmp/pip-bCJ3YB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:23:17 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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:23:17 INFO - Running setup.py (path:/tmp/pip-1cMeKq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:23: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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:23:17 INFO - Running setup.py (path:/tmp/pip-NkChDX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:23: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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:23:17 INFO - Running setup.py (path:/tmp/pip-cmC1pB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:23: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)) 11:23:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:23:17 INFO - Running setup.py (path:/tmp/pip-IbN9fN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:19 INFO - Downloading blessings-1.6.tar.gz 11:23:19 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 11:23:19 INFO - Installing collected packages: blessings 11:23:19 INFO - Running setup.py install for blessings 11:23:19 INFO - Successfully installed blessings 11:23:19 INFO - Cleaning up... 11:23:19 INFO - Return code: 0 11:23:19 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 11:23:19 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:23:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:23:19 INFO - Reading from file tmpfile_stdout 11:23:19 INFO - Current package versions: 11:23:19 INFO - argparse == 1.2.1 11:23:19 INFO - blessings == 1.6 11:23:19 INFO - blobuploader == 1.2.4 11:23:19 INFO - docopt == 0.6.1 11:23:19 INFO - manifestparser == 1.1 11:23:19 INFO - mozInstall == 1.12 11:23:19 INFO - mozcrash == 0.16 11:23:19 INFO - mozdebug == 0.1 11:23:19 INFO - mozdevice == 0.48 11:23:19 INFO - mozfile == 1.2 11:23:19 INFO - mozhttpd == 0.7 11:23:19 INFO - mozinfo == 0.9 11:23:19 INFO - mozleak == 0.1 11:23:19 INFO - mozlog == 3.1 11:23:19 INFO - moznetwork == 0.27 11:23:19 INFO - mozprocess == 0.22 11:23:19 INFO - mozprofile == 0.28 11:23:19 INFO - mozrunner == 6.11 11:23:19 INFO - mozscreenshot == 0.1 11:23:19 INFO - mozsystemmonitor == 0.0 11:23:19 INFO - moztest == 0.7 11:23:19 INFO - mozversion == 1.4 11:23:19 INFO - psutil == 3.1.1 11:23:19 INFO - requests == 1.2.3 11:23:19 INFO - wsgiref == 0.1.2 11:23:19 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:23: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')]} 11:23:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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')]} 11:23:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23: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 11:23: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 11:23:19 INFO - Using env: {'DISPLAY': ':0', 11:23:19 INFO - 'HOME': '/home/cltbld', 11:23:19 INFO - 'LANG': 'en_US.UTF-8', 11:23:19 INFO - 'LANGUAGE': 'en_US:en', 11:23:19 INFO - 'LOGNAME': 'cltbld', 11:23:19 INFO - 'MAIL': '/var/mail/cltbld', 11:23:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:19 INFO - 'MOZ_NO_REMOTE': '1', 11:23:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:19 INFO - 'NO_EM_RESTART': '1', 11:23:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:19 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:19 INFO - 'SHELL': '/bin/bash', 11:23:19 INFO - 'SHLVL': '1', 11:23:19 INFO - 'TERM': 'linux', 11:23:19 INFO - 'TMOUT': '86400', 11:23:19 INFO - 'USER': 'cltbld', 11:23:19 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:19 INFO - '_': '/tools/buildbot/bin/python'} 11:23:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23: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)) 11:23:19 INFO - Cleaning up... 11:23:19 INFO - Return code: 0 11:23:19 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 11:23: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')]} 11:23:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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')]} 11:23:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23: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 11:23: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 11:23:19 INFO - Using env: {'DISPLAY': ':0', 11:23:19 INFO - 'HOME': '/home/cltbld', 11:23:19 INFO - 'LANG': 'en_US.UTF-8', 11:23:19 INFO - 'LANGUAGE': 'en_US:en', 11:23:19 INFO - 'LOGNAME': 'cltbld', 11:23:19 INFO - 'MAIL': '/var/mail/cltbld', 11:23:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:19 INFO - 'MOZ_NO_REMOTE': '1', 11:23:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:19 INFO - 'NO_EM_RESTART': '1', 11:23:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:19 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:19 INFO - 'SHELL': '/bin/bash', 11:23:19 INFO - 'SHLVL': '1', 11:23:19 INFO - 'TERM': 'linux', 11:23:19 INFO - 'TMOUT': '86400', 11:23:19 INFO - 'USER': 'cltbld', 11:23:19 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:19 INFO - '_': '/tools/buildbot/bin/python'} 11:23:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:20 INFO - Downloading/unpacking jsonschema 11:23:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:23:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:23:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:23:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:23:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:23:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:23:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:23:21 INFO - Downloading/unpacking functools32 (from jsonschema) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:22 INFO - Downloading functools32-3.2.3-2.tar.gz 11:23:22 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 11:23:22 INFO - warning: no files found matching '*.txt' 11:23:22 INFO - no previously-included directories found matching 'build' 11:23:22 INFO - no previously-included directories found matching 'dist' 11:23:22 INFO - no previously-included directories found matching '.git*' 11:23:22 INFO - Installing collected packages: jsonschema, functools32 11:23:22 INFO - Running setup.py install for functools32 11:23:22 INFO - warning: no files found matching '*.txt' 11:23:22 INFO - no previously-included directories found matching 'build' 11:23:22 INFO - no previously-included directories found matching 'dist' 11:23:22 INFO - no previously-included directories found matching '.git*' 11:23:22 INFO - Successfully installed jsonschema functools32 11:23:22 INFO - Cleaning up... 11:23:22 INFO - Return code: 0 11:23:22 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 11:23: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')]} 11:23:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:23:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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')]} 11:23:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:23:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:23: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 0x7fc4ea2d6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xcdd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdaa670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, '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': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', '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 11:23: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 11:23: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 11:23:22 INFO - Using env: {'DISPLAY': ':0', 11:23:22 INFO - 'HOME': '/home/cltbld', 11:23:22 INFO - 'LANG': 'en_US.UTF-8', 11:23:22 INFO - 'LANGUAGE': 'en_US:en', 11:23:22 INFO - 'LOGNAME': 'cltbld', 11:23:22 INFO - 'MAIL': '/var/mail/cltbld', 11:23:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:22 INFO - 'MOZ_NO_REMOTE': '1', 11:23:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:22 INFO - 'NO_EM_RESTART': '1', 11:23:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:22 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:22 INFO - 'SHELL': '/bin/bash', 11:23:22 INFO - 'SHLVL': '1', 11:23:22 INFO - 'TERM': 'linux', 11:23:22 INFO - 'TMOUT': '86400', 11:23:22 INFO - 'USER': 'cltbld', 11:23:22 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:22 INFO - '_': '/tools/buildbot/bin/python'} 11:23:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:23:22 INFO - Downloading/unpacking flake8 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:24 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:23:24 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:24 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:23:24 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:24 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23: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 11:23:25 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 11:23:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:23:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:23:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:23:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:23:25 INFO - no previously-included directories found matching 'docs/_build' 11:23:25 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:23:25 INFO - Running setup.py install for pep8 11:23:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:23:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:23:25 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:23:25 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:23:25 INFO - no previously-included directories found matching 'docs/_build' 11:23:25 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 11:23:25 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:23:25 INFO - Cleaning up... 11:23:25 INFO - Return code: 0 11:23:25 INFO - Running post-action listener: _resource_record_post_action 11:23:25 INFO - Running post-action listener: _start_resource_monitoring 11:23:25 INFO - Starting resource monitoring. 11:23:25 INFO - ##### 11:23:25 INFO - ##### Running install step. 11:23:25 INFO - ##### 11:23:25 INFO - Running pre-action listener: _resource_record_pre_action 11:23:25 INFO - Running main action method: install 11:23:25 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:23:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:23:25 INFO - Reading from file tmpfile_stdout 11:23:25 INFO - Detecting whether we're running mozinstall >=1.0... 11:23:25 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 11:23:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 11:23:25 INFO - Reading from file tmpfile_stdout 11:23:25 INFO - Output received: 11:23:25 INFO - Usage: mozinstall [options] installer 11:23:25 INFO - Options: 11:23:25 INFO - -h, --help show this help message and exit 11:23:25 INFO - -d DEST, --destination=DEST 11:23:25 INFO - Directory to install application into. [default: 11:23:25 INFO - "/builds/slave/test-pgo"] 11:23:25 INFO - --app=APP Application being installed. [default: firefox] 11:23:25 INFO - mkdir: /builds/slave/test-pgo/build/application 11:23: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'] 11:23: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 11:23:42 INFO - Reading from file tmpfile_stdout 11:23:42 INFO - Output received: 11:23:42 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 11:23:42 INFO - Running post-action listener: _resource_record_post_action 11:23:42 INFO - ##### 11:23:42 INFO - ##### Running run-tests step. 11:23:42 INFO - ##### 11:23:42 INFO - Running pre-action listener: _resource_record_pre_action 11:23:42 INFO - Running main action method: run_tests 11:23:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 11:23:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 11:23:42 INFO - Python 2.7.3 11:23:42 INFO - Return code: 0 11:23:42 INFO - grabbing minidump binary from tooltool 11:23:42 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')]} 11:23:42 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 0xe398c0>, '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 0xe3a7c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe3ac50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 11:23:42 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 11:23:42 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 11:23:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:23:42 INFO - Return code: 0 11:23:42 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 11:23:42 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 11:23:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 11:23:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 11:23:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 11:23:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 11:23:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 11:23:43 INFO - Return code: 0 11:23:43 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/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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 11:23:43 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/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --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 11:23:43 INFO - Using env: {'DISPLAY': ':0', 11:23:43 INFO - 'HOME': '/home/cltbld', 11:23:43 INFO - 'LANG': 'en_US.UTF-8', 11:23:43 INFO - 'LANGUAGE': 'en_US:en', 11:23:43 INFO - 'LOGNAME': 'cltbld', 11:23:43 INFO - 'MAIL': '/var/mail/cltbld', 11:23:43 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:23:43 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 11:23:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:23:43 INFO - 'MOZ_NO_REMOTE': '1', 11:23:43 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:23:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:23:43 INFO - 'NO_EM_RESTART': '1', 11:23:43 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:23:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:23:43 INFO - 'PWD': '/builds/slave/test-pgo', 11:23:43 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 11:23:43 INFO - 'SHELL': '/bin/bash', 11:23:43 INFO - 'SHLVL': '1', 11:23:43 INFO - 'TERM': 'linux', 11:23:43 INFO - 'TMOUT': '86400', 11:23:43 INFO - 'USER': 'cltbld', 11:23:43 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1456255367.286208-22499475', 11:23:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:23:43 INFO - '_': '/tools/buildbot/bin/python'} 11:23:43 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/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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 11:23:43 INFO - mozversion application_buildid: 20160223083417 11:23:43 INFO - mozversion application_changeset: bc194ea89e64784a573c4bb45dcd516beecd8c27 11:23:43 INFO - mozversion application_display_name: Nightly 11:23:43 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:23:43 INFO - mozversion application_name: Firefox 11:23:43 INFO - mozversion application_remotingname: firefox 11:23:43 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:23:43 INFO - mozversion application_vendor: Mozilla 11:23:43 INFO - mozversion application_version: 47.0a1 11:23:43 INFO - mozversion platform_buildid: 20160223083417 11:23:43 INFO - mozversion platform_changeset: bc194ea89e64784a573c4bb45dcd516beecd8c27 11:23:43 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:23:43 INFO - mozversion platform_version: 47.0a1 11:23:43 INFO - using testdate: 1456255423 11:23:43 INFO - actual date: 1456255423 11:23:43 INFO - starting webserver on 'localhost:51344' 11:23:43 INFO - SUITE-START | Running 2 tests 11:23:43 INFO - TEST-START | dromaeo_css 11:23:43 INFO - operating with platform_type : linux_ 11:23:43 INFO - Initialising browser for dromaeo_css test... 11:23:43 INFO - TEST-INFO | started process 6465 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpywiZh4/profile http://localhost:51344/getInfo.html) 11:23:48 INFO - PROCESS | 6465 | __metrics Screen width/height:1600/1200 11:23:48 INFO - PROCESS | 6465 | colorDepth:24 11:23:48 INFO - PROCESS | 6465 | Browser inner width/height: 1024/697 11:23:48 INFO - PROCESS | 6465 | __metrics 11:23:49 INFO - PROCESS | 6465 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:23:49 INFO - PROCESS | 6465 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 11:23:50 INFO - TEST-INFO | 6465: exit 0 11:23:50 INFO - Browser initialized. 11:23:50 INFO - Running cycle 1/1 for dromaeo_css test... 11:23:50 INFO - TEST-INFO | started process 6563 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpywiZh4/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:24:02 INFO - PROCESS | 6563 | RSS: Main: 147689472 11:24:02 INFO - PROCESS | 6563 | 11:24:53 INFO - PROCESS | 6563 | 1456255493817 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] 11:27:01 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51344/tests/dromaeo/cssquery-ext.html) 11:27:02 INFO - PROCESS | 6563 | RSS: Main: 279072768 11:27:02 INFO - PROCESS | 6563 | 11:30:05 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-ext.html (next: http://localhost:51344/tests/dromaeo/cssquery-jquery.html) 11:30:05 INFO - PROCESS | 6563 | RSS: Main: 239808512 11:30:05 INFO - PROCESS | 6563 | 11:33:07 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51344/tests/dromaeo/cssquery-mootools.html) 11:33:08 INFO - PROCESS | 6563 | RSS: Main: 235913216 11:33:08 INFO - PROCESS | 6563 | 11:36:10 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51344/tests/dromaeo/cssquery-prototype.html) 11:36:10 INFO - PROCESS | 6563 | RSS: Main: 210821120 11:36:10 INFO - PROCESS | 6563 | 11:39:13 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51344/tests/dromaeo/cssquery-yui.html) 11:39:14 INFO - PROCESS | 6563 | RSS: Main: 204361728 11:39:14 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | Cycle 1(1): loaded http://localhost:51344/tests/dromaeo/cssquery-yui.html (next: http://localhost:51344/tests/dromaeo/cssquery-dojo.html) 11:42:16 INFO - PROCESS | 6563 | RSS: Main: 282210304 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | __start_tp_report 11:42:16 INFO - PROCESS | 6563 | _x_x_mozilla_page_load 11:42:16 INFO - PROCESS | 6563 | _x_x_mozilla_page_load_details 11:42:16 INFO - PROCESS | 6563 | |i|pagename|runs| 11:42:16 INFO - PROCESS | 6563 | |0;dojo.html;3033.6056312679357;3077.7691673124523;3115.610548681415;3120.5475206095116;3141.1361875484245;4969.180085285928;5009.8246561370315;5012.624053196007;5024.623153263502;5104.157813960701;5037.77330020149;5069.645124841262;5073.797048118071;5082.03441346144;5147.510986456281;4675.392199014141;4693.788779504914;4714.811407543694;4735.644826637998;4765.380500534926;4587.357769912215;4686.7656617169005;4697.365855609501;4698.812047518095;4815.085133824562;4656.394668693082;4667.113248482794;4681.438227412698;4710.3405523226775;4710.69380490267;4633.791479383436;4683.063387322549;4684.414448193976;4695.906081878377;4744.857654270378;4570.680052396334;4651.2557990721325;4670.1126785910565;4737.38414006177;4760.500147484534;4968.428630707443;4968.527989840959;4993.625478089158;4993.750312484398;5035.295058691786;5407.621466497347;5499.807506737245;5510.393856675762;5523.972380138114;5532.170174473821;5448.346198456171;5469.589780766459;5483;5509.201165830932;5551.72241387929;5189.714565698885;5202.661826981234;5204.323437953042;5209.270702101709;5212.400573934008;5446.809361672323;5536.667799932017;5658.462446067617;5688.459596338341;5709.400512946081;5393.838184854382;5398.6220964532895;5404.675719456845;5415.431379705153;5415.729213539307;5469.890602187934;5486.6982315973;5488.670679759148;5489.505944465017;5545.168224766237;5308.0445519806035;5430.701311427831;5444.183372494158;5479.342478902558;5522.144067669517;5366.329208848894;5366.892662146814;5370.838874833761;5371.973140134274;5376.301080859542;4185.434966279513;4201.075763332062;4246.235677578004;4253.76604286761;4281.01536646573;3834.616538346199;3836.5779764225913;3854.3640299350295;3860.613938606117;3878.825452854628;5142.074426603247;5144.125498665236;5149.150390185652;5151.5363617274625;5157.174852023658;5329.360476742816;5406.162044883049;5453.182022696627;5466.453354664502;5491.2312276281355;5011.799528018912;5051.368578927634;5057.317262169634;5080.390353157644;5081.568066714371;4645.094206629742;4645.512221216723;4646.442426908792;4685.390899183084;4689.906201875943;5531.0873705838085;5612.382637909908;5672.09246520563;5682.374938756733;5731.254936858182;5336.493033161843;5343.893122137613;5344.919826202688;5349.170878513836;5351.812686555952;5493.285872836505;5516.062269414289;5539.418361072029;5567.582431317748;5591.860203494945;5391.703456309784;5473.042217611823;5491.203775452617;5494.697791621499;5495.175723641486;5475.835724928099;5476.09644408684;5476.534494568006;5485.067538518541;5533.529649979797;5337.973310133424;5356.089464791073;5357.812476563302;5369.5167434931045;5456.863578410572;5375.113106337567;5379.220013098157;5380.461953804588;5380.865478363072;5382.703951282717;5292.364916210079;5307.01820163271;5307.097793375058;5315.521603055744;5343.492368225013;5261.973690131525;5316.122839731401;5323.973380133075;5349.3848207455085;5412.972935135299;5135.614828887774;5162.5095615916425;5225.608079394136;5243.947560524346;5262.815801446931 11:42:16 INFO - PROCESS | 6563 | |1;ext.html;514.7117614136083;530.7107626343645;534.6070638081012;540.4595404595404;560.140184816307;29138.562921556168;29422.264443388925;29460.263493412676;29503.40993180135;29514.852425737896;37019.259614807685;37444.81277593608;37641.24717505648;37709.24581508375;37857;8766.167214114665;8952.68665596701;8972.371933964625;8974.641014359418;8978.955105224464;8689.652413903435;8791.428557143765;8821.691240806573;8822.823543529126;8823.647054117828;8807.515586642732;8839;8873.112688731107;8878;8878.200961913426;8762.079981601935;8812.471251724854;8826.823463530725;8828.735137945807;8836.469811811312;8787.516686582236;8909.109089091104;8911.331650126267;8917.375783695144;8918.152775486318;41313.586864131576;41616.583834161574;41624;41724;41811.581884181374;3307.107081088117;3344.6807665968627;3387.0685561470546;3390.1016230698883;3441.4493681010917;31274.687253127406;31452.52821207684;31597;31732.841335793404;32924.835375823204;3929;3945.3884647879627;3966.960330396688;3975.52293724752;3995.98002009991;218481;220264.493387665;220288;221427;221438.9999999984;42528.362074568904;43158.784206078766;43287.134257314676;43477.347839781796;43555;41517.58482415198;41779.373309400384;41796.37305440421;41803.79098104551;41828.372574411405;14446.494372697116;14579.562613121623;14579.92710036443;14596.197209153386;14602.34289456977;12071.094667899943;12143;12149.08881833866;12155.696107597381;12158.513659453523;14156.575302740934;14178.078424902555;14182.290885455686;14207.36066876993;14278.07192532482;5741.1388291756575;5753.453421924911;5769.394213607511;5805.88388232233;5819.243498345273;969.7672558585889;969.8157350103457;992.3450522655157;1032.9431881246453;1100.944952752359;26189;28156.577651335247;28310.71689283081;28379.432411351656;28541.429171416454;937.9718608441758;1029.7940411917646;1089.4824958144977;1137.7610701752724;1159.8434211381525;14733.852661473247;15014.24928753558;15015.849841501446;15198.924005379902;15227.238638068275;620729;727296;736008;737809;738527;56833.43166568364;57428;57567;57724.71137644285;57873;1328.4287756264898;1336.9665758355925;1350.338334216227;1352.9864701353058;1394.4282844033899;28006.71993280041;29946.70053299439;30025;30470;30548.236294092825;44561.554384457035;44968.55031449644;45329.77335113303;45382.09235815331;45395.09209815719;229179;300431;304065;304746;373384;30915;31007.84496077505;31104.688953111083;31112.68887311098;31130.22174445657;43905.56094439015;44518;44712;45656.31515527203;45692.77153614211;36593.18917622573;36938.07654808544;37139;38087.23825523419;38557.228855423295;37087.118600026115;37098.8145059273;37982.620173797906;38269.4259586112;38470;36268.45597315989;36972;37248.62751372452;37299.62700372961;37438.438423423126;32678.509822352207;34120.83945330957;34226;34229.144271393416;34704;26103.08639197619;26638.866805665846;26883.731162688124;26899.86550067237;26945.461090777684 11:42:16 INFO - PROCESS | 6563 | |2;jquery.html;351.6149815951533;355.7865280831501;358.75604588879565;359.7679496724611;359.8542590250946;13912.443502259897;16740.58148546287;16745;17089.57276068099;18549.629007419844;16421.42525011625;16707.331706731715;16972.15139243039;17165.570860728487;17178.484645460623;5292.629515933886;5491.258680078178;5515.586331025189;5520.558355331584;5537.640053396516;3744.569374521924;3844.3656796628525;5187.092258854705;5437.972810135944;5564.749586268607;5552.305961754781;5570.164475328693;5571.4428557144365;5573.136163894603;5591.580631452637;5407.134858422653;5573.832785016456;5680.403557626451;5688.11834165705;5694.2312787773535;5368.651037682577;5391.272178255925;5430.402655707869;5430.647007944511;5432.91850622241;12105.394730263451;18526.814731852777;20675.172993080258;20760;20788.168473261052;2087.895605219748;2288.1762565476415;2313.456337760625;2333.3233362324904;2562.2441379792817;8880.73357799267;9468;9555.61777528898;9604.08761167688;9837.852432213522;1773.911304434773;1859.581594141321;1906.4566598519355;1926.0658580588404;1929.951751206217;60344;68465.31534684639;68622;69746.99999999949;69903.3009669902;9862.358946668444;9872.210223182128;9907.504624768733;9970.401775893324;9988.25088118394;12870.420831062625;13027.609171724864;13044.673883152996;13070;13107.344632768323;7547.433942454338;7594.5063570867715;7602.581857997863;7652.579108148994;7662.1571627120975;7699.422543309162;7700.152983171846;7738.922610773933;7769.961150194213;7830.373570114377;4197.853075142355;4268.935965960513;4299.806508707115;4302.634276086505;4345.847895323648;1614.8304428035121;1657.2542355939875;1703.5911381268406;1755.2101554300616;1802.180008096313;926.3746970794687;929.3958926697701;969.8399764038995;1000.4447531619875;1003.8243307421172;15264.771028434583;15621.297041633154;16261.105639189722;16697.666046678998;16849.747253791204;796.9920300797033;921.3044151665583;926.786839027014;934.6261495401893;990.069334825262;9256.814863702688;9601.279904007228;9660.516974151264;9820.607175712892;9899.307048506535;392196;401826;402303;404883;406890;68434;69930.30069699339;70361.64819175974;71098.64450677714;71731.2826871735;1053.5101177952135;1059.2373491086405;1062.8565143705655;1094.8795632480421;1096.8720681877132;14514.201718905562;14840.554783356516;16177.272022758769;16415.179241037662;16468.189841632706;33678.663213368534;34197.82901085479;34782.65217347794;35148.12129696778;35228.47157292694;42315.15369692527;45139;45372.77313613411;45503;45567.088658227316;7261.891071634035;7368.778936631909;7490.962545187239;7534.6609402578115;7713.267239612228;11117.22179447431;11793.233439826385;12233.388330583613;12564.308963007123;12881.677958051123;10468.528916198637;10574.471276435994;10575.894241057798;10635.415052171895;10869.184811139037;10321.948390258001;10535.736606584896;10629.309094908805;10991.120710342993;11098.66703998849;7580.620968951641;8192.344612430872;10659.360438373722;10758.838617420588;11111.333320000826;7734.342580880688;8020.438569300326;8085.959570202347;8109;8447.324214062983;8753.29973602123;10922.29005114665;11023.503942322775;11246;11393.316401015965 11:42:16 INFO - PROCESS | 6563 | |3;mootools.html;1299.2464370665016;1446.3852862533424;1454.2292584929985;1609.64587790686;1802.3601621424393;7271.163816161143;7433.628318584069;7443.292887175723;7448.4041276697735;7461.216572259916;7350;7497.550146991171;7505.249475052492;7512.361449276818;7514.211007844166;1958.9118489667999;2226.0094258055174;2241.1147596699293;2259.017327462559;2282.691836602054;2256.627656436694;2277.6925115109416;2288.7367952685404;2290.1297506947335;2294.254367330616;2277.646964720471;2286.4055345610095;2287.954240915181;2288.496530763229;2288.5079707862806;2166.696662467248;2209.3482422685347;2222.6888235646943;2228.064213030531;2229.453783822974;2227.164813195052;2242.495438526335;2242.5178586603956;2277.7836105569945;2279.350385140244;7814.0623125224765;7890.526568405857;7893;7902.051753789525;7912.09010963735;4514.0971805639;4620.930686039712;4628.32889231063;4654.4647365553055;4660.557247061523;3075.123589776903;3125.109343837018;3127.1712996056062;3145.9685403145904;3169.6513383527795;966.9122237482832;1020.6070662794878;1027.1115485105404;1032.148477506053;1048.811213981483;10726.570937162503;10770.084542813871;10776.4611769412;10779.784404311948;10789.460526973699;4066.959330406717;4149.564295748964;4171.666266698657;4198.097409057006;4236.279832428495;8358.331333493306;8379.203975622428;8436.620352084172;8444.57777111142;8450.19723126302;4061.878143655695;4478.440194975628;4484.0583477469445;4520.751358675238;4528.275475923836;4218.156368726206;4264.360345948133;4264.573542645772;4265.189613973335;4284.078923031563;3418.282160746271;3438.2435864109857;3453.067671728619;3478.3043391321835;3494.6370915343036;997.07272236819;1014.4369874719454;1015.1523477895892;1023.3041531758327;1042.525650828871;1339.8124262603244;1341.6444642169834;1360.59182245326;1374.0587697427095;1375.085568097224;7355.889661655079;7474.7757567273065;7485.812854678567;7490.925090749131;7511.098668159856;493.5903200343706;505.27745324186765;505.4642079395852;507.9847604571869;509.95410413063;5402.324709411324;5434.239206511092;5436.537894278951;5436.728163591804;5480.808171713971;9068.183863452321;9117.498537580364;9147.359684821999;9206.953965230265;9285.48929808867;9070.909290907139;9140.908590914005;9142.542872856331;9174.587143578556;9182.311326650528;7290.45321600882;7290.599017054007;7420.6289685516585;7509.249075092447;7510.774676759706;7332.413406927326;7358.22738612438;7363.963180184065;7381.077365329334;7383.704651813868;8302.501849889026;8411.074781774123;8544.273736732448;8569.271611913056;8723.869141963003;8603.698870539502;8721;8742.082081381617;8888.422252553562;8903.777405564913;6320.778772742932;6530;6599.340065993554;7039.9296007039275;7139.464540159405;7239.095113110861;7249.492535522674;7256.818579535343;7281.453890958305;7293.817654558678;6423.229212494531;6546.8363290918105;6617.669116544057;6663.100481434944;6746.460283177432;6507.837304067436;6525.575837570543;6534.869302613826;6539;6563.638999855054;6900.068490753884;6923.515353925177;6943.79168624942;6948.33990770876;6951.20061192949;6270.561060725888;6420.807375778734;6424.100625912282;6433.646149461824;6438.871222575616;6395.520335974914;6509.869802603826;6509.902351464826;6515.218173819172;6519.511036672174 11:42:16 INFO - PROCESS | 6563 | |4;prototype.html;323.0760026324711;329.4235088594959;333.9615944166422;336.85346874109763;340.10213037580775;5823.184754134425;5851.239338885949;5856.531477481802;5883;5935.554833387502;5844.444777746118;5848.239728835256;5850.648961062339;5852.385499522553;5856.795012174574;4582.1293954148605;4582.999999999984;4586.082783443308;4586.380838586798;4587.793549290282;4588.495265520807;4589.082183563284;4589.65577581681;4595.563421474954;4595.655325850575;4333;4396.472423309207;4539.954600453986;4543.250363689987;4550.658700597452;4529.796159172845;4555.316702494619;4556.977215113903;4562.270036794113;4564.475085365192;3931.0958479549863;3970.7617542947514;3999;4010.959890401117;4012.9197416051516;5325.1479763238085;5454.263674403984;5605.579581531401;5606.24315717377;5620.185073164368;5277.920831187535;5279.366476022902;5280.841574752763;5286.97356513215;5287.101192797195;6154.415330543591;6167.938320616781;6222.408871157233;6241.531885108635;6242.469390101847;4417.779111044467;4426.800793964279;4430.335449682573;4434.822607095744;4440.733555986619;6329.905051424233;6475.74097036118;6487.57830741005;6501.382368674968;6503.187101612299;4558.521355257716;4576.88557786058;4586.6789324747615;4590.609798167193;4601.516840731675;4623.884402889955;4627.629789616823;4631.0506346198945;4634.814607415733;4635.860924172281;5244.501772331622;5283.498067683564;5283.550898173621;5286.312779338661;5293.867653308698;6266.780662676784;6273.749050038039;6277.686115694289;6279.529035322369;6282.4974002079725;1603.6311648320952;1636.5990332368647;1637.148682684997;1638.8852780305504;1639.7294446416447;1106.2311693373028;1106.9612563560236;1118.697951553076;1120.4005856866538;1151.228676786555;5951.345352011275;5980.282366116094;5982.700864956735;5982.880342393128;5988.880222395528;6267.2479302484;6352.4918006559365;6432.292447830735;6448.838779030561;6519.348065193442;6049.78825741097;6056.606320589148;6057.787977420858;6058.818235452944;6062.878742425127;3455.8963231103107;3490.5462289902152;3493.0917961330238;3497.0557949353533;3504.737144714157;6756.020377045301;6756.76351327711;6767.864642707217;6767.966160169168;6771.5259931805285;6472.805815825533;6580.901286480706;6624.56940298879;6628.237752658506;6635.734570617218;6729.125213722283;6752.358525940126;6760.628165450849;6765.9661701691175;6772.5936443813525;6501.2198536175965;6502.772402965874;6506.3818937200895;6507.089007539043;6510.0885875976455;6413.326600706859;6420.967895160495;6421.197350331208;6424.710888010144;6426.4216220540375;6698.062271282122;6733.192016957801;6733.225679046776;6756.256811750802;6756.324367563205;4260.913467065879;4399.626031787334;4411.536788637147;4412.8014239359945;4415;6332.461740751904;6403.135576697086;6439.645819479973;6439.678016099083;6449.193850768654;6242.906356404748;6248.937680594219;6254.437100660963;6259.3427690091885;6264.655443950444;6242.968785156045;6258.0925765762795;6265.780697675559;6267.6866156692895;6270.686465676789;6034.7284372202475;6180.969095154495;6181.072839074175;6225.28409232944;6244.438000579969;6352.776528215088;6385.8722825544155;6386.61680299165;6388.201474815648;6388.552801303864;6211.782587609412;6221.813345599639;6228;6228;6229.750809967551 11:42:16 INFO - PROCESS | 6563 | |5;yui.html;754.724525548175;773.7291947818261;796.8758507020922;827.1108558299829;829.4069740135802;13975;14094.78857817131;14172.220527870963;14239.572812815606;14264.857351426495;13475;13583.93208033961;13659.248741319223;13668.589942301722;13681.794773078387;696.6586372677377;816.0696805641574;834.6244190114443;846.6867259114136;849.9362547808909;846.0270688708005;848.5545088828353;850.3027517435705;850.7660393391805;851.3912552524944;889.2752406788479;894.186290475664;894.2220268366531;894.4499133033203;894.7136916186823;725.1407082607127;872.5462759365126;887.6449420231894;889.9943064337322;890.7773056735816;642.5149012495583;644.3234603666132;644.4425571880337;644.5939058393183;644.9709763060673;13140.737185256241;13149.934250328688;13153.276569788657;13193.208407495486;13193.47226110964;13270.800937985938;13756.518521851687;13759.656008599764;13769;13855.484524714318;10799.460026998619;10943.194372928458;10949.671509854717;11250.943745281222;11331.490082946288;3665.9450108248398;3678.9080272993124;3701.8889433317045;3760.172761992357;3825.598312177209;49225;49453;49559.50440495585;50554.747226264;50567.24149137766;9703.854442183372;9738.561764720464;9789.510524473748;10727.570897164025;10799.352038877692;17585.12074396275;17761;17822.732659010126;17829.375971840924;17857.642847143245;8017.238362355567;8051.376583219445;8167.673293068329;8318.958405208055;8320.750377488685;4355.3684715716045;4372.0162963333;4383.846565370197;4390.341448782644;4493.887652808706;3185.61772587291;3214.469612513956;3223.580934478503;3234.8382580871335;3247.0908145719236;601.9036954087325;603.0200923499314;618.4495798739126;626.2203556572097;655.8425977765302;544.4103218601692;549.9010178167888;614.8616561273767;665.2383021440423;672.831792051987;8967.417117887317;8996.190342869173;9101.590428430736;9159;9209.033051529626;621.7668374359615;646.5118835279334;647.0682217606725;662.7978466567744;681.0635376357509;4041.636252737209;4252.213340532012;4281.446399488417;4470.552944705503;4509.210888094636;52522.21216681753;52776.208356874675;53291.73354133205;53355.46644533583;53692.19461708077;48683.75658121687;48867.511324887004;49283.75358123187;49527.50472495301;49717.75141124344;43871.34192987171;44240.3363949541;44316.11367772691;45777.77111114423;45933.31100033502;8722.345824063093;8896.510691912006;8981;9003.054679258583;9057.230135438562;32631.510527341634;33844.492332614536;34891.4766278501;35394.46908296326;35529.934101976985;41640.79179604082;41824.581754182065;42054.579454205064;42412;42939.785301073294;10677.893221068001;10748.516316765608;10951.671449856518;11000.834987475355;11143.665690029313;12620.55828046014;12679.366031698193;12736.363181841056;12796.936015319863;13263.204207747565;11285.097192224766;11537.538498459968;11752.471138798604;12128.272303661808;12212.206206596542;11659.591914283299;11936.224145430519;12054.457549410474;12288.989197646633;12391.504339826666;11319.603813866475;11567.305961642329;11572.016378607912;11927.701807454536;11986.041116710816;9226.861597075915;9758;9871.40771553709;9968.816463320796;10329.431881246303;9583.712488625353;9647;10395.740106497096;10468.895311047097;10491.947540262556 11:42:16 INFO - PROCESS | 6563 | __end_tp_report 11:42:16 INFO - PROCESS | 6563 | __start_cc_report 11:42:16 INFO - PROCESS | 6563 | _x_x_mozilla_cycle_collect,1014 11:42:16 INFO - PROCESS | 6563 | __end_cc_report 11:42:16 INFO - PROCESS | 6563 | __startTimestamp1456256536969__endTimestamp 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | ------- Summary: start ------- 11:42:16 INFO - PROCESS | 6563 | Number of tests: 6 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#0] dojo.html Cycles:165 Average:5080.35 Median:5307.02 stddev:541.91 (10.2%) stddev-sans-first:519.24 11:42:16 INFO - PROCESS | 6563 | Values: 3033.6 3077.8 3115.6 3120.5 3141.1 4969.2 5009.8 5012.6 5024.6 5104.2 5037.8 5069.6 5073.8 5082.0 5147.5 4675.4 4693.8 4714.8 4735.6 4765.4 4587.4 4686.8 4697.4 4698.8 4815.1 4656.4 4667.1 4681.4 4710.3 4710.7 4633.8 4683.1 4684.4 4695.9 4744.9 4570.7 4651.3 4670.1 4737.4 4760.5 4968.4 4968.5 4993.6 4993.8 5035.3 5407.6 5499.8 5510.4 5524.0 5532.2 5448.3 5469.6 5483.0 5509.2 5551.7 5189.7 5202.7 5204.3 5209.3 5212.4 5446.8 5536.7 5658.5 5688.5 5709.4 5393.8 5398.6 5404.7 5415.4 5415.7 5469.9 5486.7 5488.7 5489.5 5545.2 5308.0 5430.7 5444.2 5479.3 5522.1 5366.3 5366.9 5370.8 5372.0 5376.3 4185.4 4201.1 4246.2 4253.8 4281.0 3834.6 3836.6 3854.4 3860.6 3878.8 5142.1 5144.1 5149.2 5151.5 5157.2 5329.4 5406.2 5453.2 5466.5 5491.2 5011.8 5051.4 5057.3 5080.4 5081.6 4645.1 4645.5 4646.4 4685.4 4689.9 5531.1 5612.4 5672.1 5682.4 5731.3 5336.5 5343.9 5344.9 5349.2 5351.8 5493.3 5516.1 5539.4 5567.6 5591.9 5391.7 5473.0 5491.2 5494.7 5495.2 5475.8 5476.1 5476.5 5485.1 5533.5 5338.0 5356.1 5357.8 5369.5 5456.9 5375.1 5379.2 5380.5 5380.9 5382.7 5292.4 5307.0 5307.1 5315.5 5343.5 5262.0 5316.1 5324.0 5349.4 5413.0 5135.6 5162.5 5225.6 5243.9 5262.8 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#1] ext.html Cycles:180 Average:55185.28 Median:205411.22 stddev:125907.14 (61.3%) stddev-sans-first:126193.43 11:42:16 INFO - PROCESS | 6563 | Values: 514.7 530.7 534.6 540.5 560.1 29138.6 29422.3 29460.3 29503.4 29514.9 37019.3 37444.8 37641.2 37709.2 37857.0 8766.2 8952.7 8972.4 8974.6 8979.0 8689.7 8791.4 8821.7 8822.8 8823.6 8807.5 8839.0 8873.1 8878.0 8878.2 8762.1 8812.5 8826.8 8828.7 8836.5 8787.5 8909.1 8911.3 8917.4 8918.2 41313.6 41616.6 41624.0 41724.0 41811.6 3307.1 3344.7 3387.1 3390.1 3441.4 31274.7 31452.5 31597.0 31732.8 32924.8 3929.0 3945.4 3967.0 3975.5 3996.0 218481.0 220264.5 220288.0 221427.0 221439.0 42528.4 43158.8 43287.1 43477.3 43555.0 41517.6 41779.4 41796.4 41803.8 41828.4 14446.5 14579.6 14579.9 14596.2 14602.3 12071.1 12143.0 12149.1 12155.7 12158.5 14156.6 14178.1 14182.3 14207.4 14278.1 5741.1 5753.5 5769.4 5805.9 5819.2 969.8 969.8 992.3 1032.9 1100.9 26189.0 28156.6 28310.7 28379.4 28541.4 938.0 1029.8 1089.5 1137.8 1159.8 14733.9 15014.2 15015.8 15198.9 15227.2 620729.0 727296.0 736008.0 737809.0 738527.0 56833.4 57428.0 57567.0 57724.7 57873.0 1328.4 1337.0 1350.3 1353.0 1394.4 28006.7 29946.7 30025.0 30470.0 30548.2 44561.6 44968.6 45329.8 45382.1 45395.1 229179.0 300431.0 304065.0 304746.0 373384.0 30915.0 31007.8 31104.7 31112.7 31130.2 43905.6 44518.0 44712.0 45656.3 45692.8 36593.2 36938.1 37139.0 38087.2 38557.2 37087.1 37098.8 37982.6 38269.4 38470.0 36268.5 36972.0 37248.6 37299.6 37438.4 32678.5 34120.8 34226.0 34229.1 34704.0 26103.1 26638.9 26883.7 26899.9 26945.5 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#2] jquery.html Cycles:180 Average:24158.29 Median:205543.93 stddev:65990.83 (32.1%) stddev-sans-first:66151.74 11:42:16 INFO - PROCESS | 6563 | Values: 351.6 355.8 358.8 359.8 359.9 13912.4 16740.6 16745.0 17089.6 18549.6 16421.4 16707.3 16972.2 17165.6 17178.5 5292.6 5491.3 5515.6 5520.6 5537.6 3744.6 3844.4 5187.1 5438.0 5564.7 5552.3 5570.2 5571.4 5573.1 5591.6 5407.1 5573.8 5680.4 5688.1 5694.2 5368.7 5391.3 5430.4 5430.6 5432.9 12105.4 18526.8 20675.2 20760.0 20788.2 2087.9 2288.2 2313.5 2333.3 2562.2 8880.7 9468.0 9555.6 9604.1 9837.9 1773.9 1859.6 1906.5 1926.1 1930.0 60344.0 68465.3 68622.0 69747.0 69903.3 9862.4 9872.2 9907.5 9970.4 9988.3 12870.4 13027.6 13044.7 13070.0 13107.3 7547.4 7594.5 7602.6 7652.6 7662.2 7699.4 7700.2 7738.9 7770.0 7830.4 4197.9 4268.9 4299.8 4302.6 4345.8 1614.8 1657.3 1703.6 1755.2 1802.2 926.4 929.4 969.8 1000.4 1003.8 15264.8 15621.3 16261.1 16697.7 16849.7 797.0 921.3 926.8 934.6 990.1 9256.8 9601.3 9660.5 9820.6 9899.3 392196.0 401826.0 402303.0 404883.0 406890.0 68434.0 69930.3 70361.6 71098.6 71731.3 1053.5 1059.2 1062.9 1094.9 1096.9 14514.2 14840.6 16177.3 16415.2 16468.2 33678.7 34197.8 34782.7 35148.1 35228.5 42315.2 45139.0 45372.8 45503.0 45567.1 7261.9 7368.8 7491.0 7534.7 7713.3 11117.2 11793.2 12233.4 12564.3 12881.7 10468.5 10574.5 10575.9 10635.4 10869.2 10321.9 10535.7 10629.3 10991.1 11098.7 7580.6 8192.3 10659.4 10758.8 11111.3 7734.3 8020.4 8086.0 8109.0 8447.3 8753.3 10922.3 11023.5 11246.0 11393.3 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#3] mootools.html Cycles:180 Average:5356.78 Median:6408.16 stddev:2813.18 (43.9%) stddev-sans-first:2804.54 11:42:16 INFO - PROCESS | 6563 | Values: 1299.2 1446.4 1454.2 1609.6 1802.4 7271.2 7433.6 7443.3 7448.4 7461.2 7350.0 7497.6 7505.2 7512.4 7514.2 1958.9 2226.0 2241.1 2259.0 2282.7 2256.6 2277.7 2288.7 2290.1 2294.3 2277.6 2286.4 2288.0 2288.5 2288.5 2166.7 2209.3 2222.7 2228.1 2229.5 2227.2 2242.5 2242.5 2277.8 2279.4 7814.1 7890.5 7893.0 7902.1 7912.1 4514.1 4620.9 4628.3 4654.5 4660.6 3075.1 3125.1 3127.2 3146.0 3169.7 966.9 1020.6 1027.1 1032.1 1048.8 10726.6 10770.1 10776.5 10779.8 10789.5 4067.0 4149.6 4171.7 4198.1 4236.3 8358.3 8379.2 8436.6 8444.6 8450.2 4061.9 4478.4 4484.1 4520.8 4528.3 4218.2 4264.4 4264.6 4265.2 4284.1 3418.3 3438.2 3453.1 3478.3 3494.6 997.1 1014.4 1015.2 1023.3 1042.5 1339.8 1341.6 1360.6 1374.1 1375.1 7355.9 7474.8 7485.8 7490.9 7511.1 493.6 505.3 505.5 508.0 510.0 5402.3 5434.2 5436.5 5436.7 5480.8 9068.2 9117.5 9147.4 9207.0 9285.5 9070.9 9140.9 9142.5 9174.6 9182.3 7290.5 7290.6 7420.6 7509.2 7510.8 7332.4 7358.2 7364.0 7381.1 7383.7 8302.5 8411.1 8544.3 8569.3 8723.9 8603.7 8721.0 8742.1 8888.4 8903.8 6320.8 6530.0 6599.3 7039.9 7139.5 7239.1 7249.5 7256.8 7281.5 7293.8 6423.2 6546.8 6617.7 6663.1 6746.5 6507.8 6525.6 6534.9 6539.0 6563.6 6900.1 6923.5 6943.8 6948.3 6951.2 6270.6 6420.8 6424.1 6433.6 6438.9 6395.5 6509.9 6509.9 6515.2 6519.5 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#4] prototype.html Cycles:180 Average:5262.34 Median:5965.81 stddev:1568.13 (26.3%) stddev-sans-first:1528.07 11:42:16 INFO - PROCESS | 6563 | Values: 323.1 329.4 334.0 336.9 340.1 5823.2 5851.2 5856.5 5883.0 5935.6 5844.4 5848.2 5850.6 5852.4 5856.8 4582.1 4583.0 4586.1 4586.4 4587.8 4588.5 4589.1 4589.7 4595.6 4595.7 4333.0 4396.5 4540.0 4543.3 4550.7 4529.8 4555.3 4557.0 4562.3 4564.5 3931.1 3970.8 3999.0 4011.0 4012.9 5325.1 5454.3 5605.6 5606.2 5620.2 5277.9 5279.4 5280.8 5287.0 5287.1 6154.4 6167.9 6222.4 6241.5 6242.5 4417.8 4426.8 4430.3 4434.8 4440.7 6329.9 6475.7 6487.6 6501.4 6503.2 4558.5 4576.9 4586.7 4590.6 4601.5 4623.9 4627.6 4631.1 4634.8 4635.9 5244.5 5283.5 5283.6 5286.3 5293.9 6266.8 6273.7 6277.7 6279.5 6282.5 1603.6 1636.6 1637.1 1638.9 1639.7 1106.2 1107.0 1118.7 1120.4 1151.2 5951.3 5980.3 5982.7 5982.9 5988.9 6267.2 6352.5 6432.3 6448.8 6519.3 6049.8 6056.6 6057.8 6058.8 6062.9 3455.9 3490.5 3493.1 3497.1 3504.7 6756.0 6756.8 6767.9 6768.0 6771.5 6472.8 6580.9 6624.6 6628.2 6635.7 6729.1 6752.4 6760.6 6766.0 6772.6 6501.2 6502.8 6506.4 6507.1 6510.1 6413.3 6421.0 6421.2 6424.7 6426.4 6698.1 6733.2 6733.2 6756.3 6756.3 4260.9 4399.6 4411.5 4412.8 4415.0 6332.5 6403.1 6439.6 6439.7 6449.2 6242.9 6248.9 6254.4 6259.3 6264.7 6243.0 6258.1 6265.8 6267.7 6270.7 6034.7 6181.0 6181.1 6225.3 6244.4 6352.8 6385.9 6386.6 6388.2 6388.6 6211.8 6221.8 6228.0 6228.0 6229.8 11:42:16 INFO - PROCESS | 6563 | 11:42:16 INFO - PROCESS | 6563 | [#5] yui.html Cycles:180 Average:13751.13 Median:24393.33 stddev:15309.39 (62.8%) stddev-sans-first:15321.23 11:42:16 INFO - PROCESS | 6563 | Values: 754.7 773.7 796.9 827.1 829.4 13975.0 14094.8 14172.2 14239.6 14264.9 13475.0 13583.9 13659.2 13668.6 13681.8 696.7 816.1 834.6 846.7 849.9 846.0 848.6 850.3 850.8 851.4 889.3 894.2 894.2 894.4 894.7 725.1 872.5 887.6 890.0 890.8 642.5 644.3 644.4 644.6 645.0 13140.7 13149.9 13153.3 13193.2 13193.5 13270.8 13756.5 13759.7 13769.0 13855.5 10799.5 10943.2 10949.7 11250.9 11331.5 3665.9 3678.9 3701.9 3760.2 3825.6 49225.0 49453.0 49559.5 50554.7 50567.2 9703.9 9738.6 9789.5 10727.6 10799.4 17585.1 17761.0 17822.7 17829.4 17857.6 8017.2 8051.4 8167.7 8319.0 8320.8 4355.4 4372.0 4383.8 4390.3 4493.9 3185.6 3214.5 3223.6 3234.8 3247.1 601.9 603.0 618.4 626.2 655.8 544.4 549.9 614.9 665.2 672.8 8967.4 8996.2 9101.6 9159.0 9209.0 621.8 646.5 647.1 662.8 681.1 4041.6 4252.2 4281.4 4470.6 4509.2 52522.2 52776.2 53291.7 53355.5 53692.2 48683.8 48867.5 49283.8 49527.5 49717.8 43871.3 44240.3 44316.1 45777.8 45933.3 8722.3 8896.5 8981.0 9003.1 9057.2 32631.5 33844.5 34891.5 35394.5 35529.9 41640.8 41824.6 42054.6 42412.0 42939.8 10677.9 10748.5 10951.7 11000.8 11143.7 12620.6 12679.4 12736.4 12796.9 13263.2 11285.1 11537.5 11752.5 12128.3 12212.2 11659.6 11936.2 12054.5 12289.0 12391.5 11319.6 11567.3 11572.0 11927.7 11986.0 9226.9 9758.0 9871.4 9968.8 10329.4 9583.7 9647.0 10395.7 10468.9 10491.9 11:42:16 INFO - PROCESS | 6563 | -------- Summary: end -------- 11:42:16 INFO - PROCESS | 6563 | 11:42:17 INFO - TEST-INFO | 6563: exit 0 11:42:17 INFO - TEST-OK | dromaeo_css | took 1114342ms 11:42:17 INFO - TEST-START | kraken 11:42:17 INFO - operating with platform_type : linux_ 11:42:17 INFO - Initialising browser for kraken test... 11:42:17 INFO - TEST-INFO | started process 6748 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp6ndzQc/profile http://localhost:51344/getInfo.html) 11:42:22 INFO - PROCESS | 6748 | __metrics Screen width/height:1600/1200 11:42:22 INFO - PROCESS | 6748 | colorDepth:24 11:42:22 INFO - PROCESS | 6748 | Browser inner width/height: 1024/697 11:42:22 INFO - PROCESS | 6748 | __metrics 11:42:23 INFO - PROCESS | 6748 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:42:24 INFO - TEST-INFO | 6748: exit 0 11:42:24 INFO - Browser initialized. 11:42:24 INFO - Running cycle 1/1 for kraken test... 11:42:24 INFO - TEST-INFO | started process 6834 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp6ndzQc/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:42:36 INFO - PROCESS | 6834 | RSS: Main: 147714048 11:42:36 INFO - PROCESS | 6834 | 11:42:39 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51344/tests/kraken/driver.html?testName=audio-beat-detection) 11:42:39 INFO - PROCESS | 6834 | RSS: Main: 191209472 11:42:39 INFO - PROCESS | 6834 | 11:42:42 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51344/tests/kraken/driver.html?testName=audio-dft) 11:42:43 INFO - PROCESS | 6834 | RSS: Main: 180727808 11:42:43 INFO - PROCESS | 6834 | 11:42:46 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51344/tests/kraken/driver.html?testName=audio-fft) 11:42:46 INFO - PROCESS | 6834 | RSS: Main: 164511744 11:42:46 INFO - PROCESS | 6834 | 11:42:48 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51344/tests/kraken/driver.html?testName=audio-oscillator) 11:42:49 INFO - PROCESS | 6834 | RSS: Main: 167383040 11:42:49 INFO - PROCESS | 6834 | 11:42:51 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51344/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:42:51 INFO - PROCESS | 6834 | RSS: Main: 170958848 11:42:51 INFO - PROCESS | 6834 | 11:42:54 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51344/tests/kraken/driver.html?testName=imaging-darkroom) 11:42:55 INFO - PROCESS | 6834 | RSS: Main: 168468480 11:42:55 INFO - PROCESS | 6834 | 11:42:58 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51344/tests/kraken/driver.html?testName=imaging-desaturate) 11:42:59 INFO - PROCESS | 6834 | RSS: Main: 171028480 11:42:59 INFO - PROCESS | 6834 | 11:43:02 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51344/tests/kraken/driver.html?testName=json-parse-financial) 11:43:02 INFO - PROCESS | 6834 | RSS: Main: 170721280 11:43:02 INFO - PROCESS | 6834 | 11:43:04 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51344/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:43:05 INFO - PROCESS | 6834 | RSS: Main: 188194816 11:43:05 INFO - PROCESS | 6834 | 11:43:06 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:43:07 INFO - PROCESS | 6834 | RSS: Main: 182104064 11:43:07 INFO - PROCESS | 6834 | 11:43:09 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:43:10 INFO - PROCESS | 6834 | RSS: Main: 196726784 11:43:10 INFO - PROCESS | 6834 | 11:43:12 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:43:13 INFO - PROCESS | 6834 | RSS: Main: 200085504 11:43:13 INFO - PROCESS | 6834 | 11:43:15 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:43:16 INFO - PROCESS | 6834 | RSS: Main: 200896512 11:43:16 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | Cycle 1(1): loaded http://localhost:51344/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51344/tests/kraken/driver.html?testName=ai-astar) 11:43:18 INFO - PROCESS | 6834 | RSS: Main: 260759552 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | __start_tp_report 11:43:18 INFO - PROCESS | 6834 | _x_x_mozilla_page_load 11:43:18 INFO - PROCESS | 6834 | _x_x_mozilla_page_load_details 11:43:18 INFO - PROCESS | 6834 | |i|pagename|runs| 11:43:18 INFO - PROCESS | 6834 | |0;ai-astar;111;112;107;113;113;111;98;113;111;110 11:43:18 INFO - PROCESS | 6834 | |1;audio-beat-detection;162;127;155;168;129;155;147;130;171;126 11:43:18 INFO - PROCESS | 6834 | |2;audio-dft;163;161;161;161;161;162;160;162;162;160 11:43:18 INFO - PROCESS | 6834 | |3;audio-fft;81;75;94;94;74;73;74;107;90;73 11:43:18 INFO - PROCESS | 6834 | |4;audio-oscillator;97;96;148;96;96;96;144;96;95;137 11:43:18 INFO - PROCESS | 6834 | |5;imaging-gaussian-blur;118;115;115;115;115;114;115;115;114;114 11:43:18 INFO - PROCESS | 6834 | |6;imaging-darkroom;146;145;146;146;146;146;146;146;147;147 11:43:18 INFO - PROCESS | 6834 | |7;imaging-desaturate;96;95;95;97;95;96;96;95;95;96 11:43:18 INFO - PROCESS | 6834 | |8;json-parse-financial;59;59;60;59;59;59;60;68;58;58 11:43:18 INFO - PROCESS | 6834 | |9;json-stringify-tinderbox;69;67;68;68;68;68;67;68;68;69 11:43:18 INFO - PROCESS | 6834 | |10;stanford-crypto-aes;81;80;82;83;82;82;83;90;83;84 11:43:18 INFO - PROCESS | 6834 | |11;stanford-crypto-ccm;131;122;114;116;120;114;122;115;122;123 11:43:18 INFO - PROCESS | 6834 | |12;stanford-crypto-pbkdf2;152;143;150;151;152;145;150;148;166;144 11:43:18 INFO - PROCESS | 6834 | |13;stanford-crypto-sha256-iterative;68;69;68;68;69;68;67;68;67;68 11:43:18 INFO - PROCESS | 6834 | __end_tp_report 11:43:18 INFO - PROCESS | 6834 | __start_cc_report 11:43:18 INFO - PROCESS | 6834 | _x_x_mozilla_cycle_collect,961 11:43:18 INFO - PROCESS | 6834 | __end_cc_report 11:43:18 INFO - PROCESS | 6834 | __startTimestamp1456256598290__endTimestamp 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | ------- Summary: start ------- 11:43:18 INFO - PROCESS | 6834 | Number of tests: 14 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#0] ai-astar Cycles:10 Average:109.90 Median:112.50 stddev:4.56 (4.1%) stddev-sans-first:4.82 11:43:18 INFO - PROCESS | 6834 | Values: 111.0 112.0 107.0 113.0 113.0 111.0 98.0 113.0 111.0 110.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#1] audio-beat-detection Cycles:10 Average:147.00 Median:155.00 stddev:17.71 (11.4%) stddev-sans-first:17.94 11:43:18 INFO - PROCESS | 6834 | Values: 162.0 127.0 155.0 168.0 129.0 155.0 147.0 130.0 171.0 126.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.95 (0.6%) stddev-sans-first:0.78 11:43:18 INFO - PROCESS | 6834 | Values: 163.0 161.0 161.0 161.0 161.0 162.0 160.0 162.0 162.0 160.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#3] audio-fft Cycles:10 Average:83.50 Median:78.00 stddev:11.99 (15.4%) stddev-sans-first:12.69 11:43:18 INFO - PROCESS | 6834 | Values: 81.0 75.0 94.0 94.0 74.0 73.0 74.0 107.0 90.0 73.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#4] audio-oscillator Cycles:10 Average:110.10 Median:96.00 stddev:22.86 (23.8%) stddev-sans-first:23.75 11:43:18 INFO - PROCESS | 6834 | Values: 97.0 96.0 148.0 96.0 96.0 96.0 144.0 96.0 95.0 137.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#5] imaging-gaussian-blur Cycles:10 Average:115.00 Median:115.00 stddev:1.15 (1.0%) stddev-sans-first:0.50 11:43:18 INFO - PROCESS | 6834 | Values: 118.0 115.0 115.0 115.0 115.0 114.0 115.0 115.0 114.0 114.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#6] imaging-darkroom Cycles:10 Average:146.10 Median:146.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 11:43:18 INFO - PROCESS | 6834 | Values: 146.0 145.0 146.0 146.0 146.0 146.0 146.0 146.0 147.0 147.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.73 11:43:18 INFO - PROCESS | 6834 | Values: 96.0 95.0 95.0 97.0 95.0 96.0 96.0 95.0 95.0 96.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#8] json-parse-financial Cycles:10 Average:59.90 Median:59.00 stddev:2.92 (5.0%) stddev-sans-first:3.08 11:43:18 INFO - PROCESS | 6834 | Values: 59.0 59.0 60.0 59.0 59.0 59.0 60.0 68.0 58.0 58.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#9] json-stringify-tinderbox Cycles:10 Average:68.00 Median:68.00 stddev:0.67 (1.0%) stddev-sans-first:0.60 11:43:18 INFO - PROCESS | 6834 | Values: 69.0 67.0 68.0 68.0 68.0 68.0 67.0 68.0 68.0 69.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#10] stanford-crypto-aes Cycles:10 Average:83.00 Median:83.00 stddev:2.71 (3.3%) stddev-sans-first:2.77 11:43:18 INFO - PROCESS | 6834 | Values: 81.0 80.0 82.0 83.0 82.0 82.0 83.0 90.0 83.0 84.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#11] stanford-crypto-ccm Cycles:10 Average:119.90 Median:122.00 stddev:5.32 (4.4%) stddev-sans-first:3.84 11:43:18 INFO - PROCESS | 6834 | Values: 131.0 122.0 114.0 116.0 120.0 114.0 122.0 115.0 122.0 123.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.10 Median:150.50 stddev:6.49 (4.3%) stddev-sans-first:6.85 11:43:18 INFO - PROCESS | 6834 | Values: 152.0 143.0 150.0 151.0 152.0 145.0 150.0 148.0 166.0 144.0 11:43:18 INFO - PROCESS | 6834 | 11:43:18 INFO - PROCESS | 6834 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.00 Median:68.00 stddev:0.67 (1.0%) stddev-sans-first:0.71 11:43:18 INFO - PROCESS | 6834 | Values: 68.0 69.0 68.0 68.0 69.0 68.0 67.0 68.0 67.0 68.0 11:43:18 INFO - PROCESS | 6834 | -------- Summary: end -------- 11:43:18 INFO - PROCESS | 6834 | 11:43:19 INFO - TEST-INFO | 6834: exit 0 11:43:19 INFO - TEST-OK | kraken | took 61524ms 11:43:19 INFO - SUITE-END | took 1175s 11:43:19 INFO - Completed test suite (00:19:36) 11:43:19 INFO - Working with test: dromaeo_css 11:43:19 INFO - Generating results file: dromaeo_css 11:43:19 INFO - Working with test: kraken 11:43:19 INFO - Generating results file: kraken 11:43:19 INFO - javascript benchmark 11:43:19 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:43:19 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 11:43:19 INFO - process_Request line: dromaeo_css 6822.33 graph.html#tests=[[72,64,35]] 11:43:19 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:43:19 INFO - process_Request line: kraken 1517.40 graph.html#tests=[[232,64,35]] 11:43:19 INFO - RETURN: dromaeo_css: 6822.33 11:43:19 INFO - RETURN: kraken: 1517.40 11:43:19 INFO - javascript benchmark 11:43:19 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3033.6056312679357, 3077.7691673124523, 3115.610548681415, 3120.5475206095116, 3141.1361875484245, 4969.180085285928, 5009.8246561370315, 5012.624053196007, 5024.623153263502, 5104.157813960701, 5037.77330020149, 5069.645124841262, 5073.797048118071, 5082.03441346144, 5147.510986456281, 4675.392199014141, 4693.788779504914, 4714.811407543694, 4735.644826637998, 4765.380500534926, 4587.357769912215, 4686.7656617169005, 4697.365855609501, 4698.812047518095, 4815.085133824562, 4656.394668693082, 4667.113248482794, 4681.438227412698, 4710.3405523226775, 4710.69380490267, 4633.791479383436, 4683.063387322549, 4684.414448193976, 4695.906081878377, 4744.857654270378, 4570.680052396334, 4651.2557990721325, 4670.1126785910565, 4737.38414006177, 4760.500147484534, 4968.428630707443, 4968.527989840959, 4993.625478089158, 4993.750312484398, 5035.295058691786, 5407.621466497347, 5499.807506737245, 5510.393856675762, 5523.972380138114, 5532.170174473821, 5448.346198456171, 5469.589780766459, 5483.0, 5509.201165830932, 5551.72241387929, 5189.714565698885, 5202.661826981234, 5204.323437953042, 5209.270702101709, 5212.400573934008, 5446.809361672323, 5536.667799932017, 5658.462446067617, 5688.459596338341, 5709.400512946081, 5393.838184854382, 5398.6220964532895, 5404.675719456845, 5415.431379705153, 5415.729213539307, 5469.890602187934, 5486.6982315973, 5488.670679759148, 5489.505944465017, 5545.168224766237, 5308.0445519806035, 5430.701311427831, 5444.183372494158, 5479.342478902558, 5522.144067669517, 5366.329208848894, 5366.892662146814, 5370.838874833761, 5371.973140134274, 5376.301080859542, 4185.434966279513, 4201.075763332062, 4246.235677578004, 4253.76604286761, 4281.01536646573, 3834.616538346199, 3836.5779764225913, 3854.3640299350295, 3860.613938606117, 3878.825452854628, 5142.074426603247, 5144.125498665236, 5149.150390185652, 5151.5363617274625, 5157.174852023658, 5329.360476742816, 5406.162044883049, 5453.182022696627, 5466.453354664502, 5491.2312276281355, 5011.799528018912, 5051.368578927634, 5057.317262169634, 5080.390353157644, 5081.568066714371, 4645.094206629742, 4645.512221216723, 4646.442426908792, 4685.390899183084, 4689.906201875943, 5531.0873705838085, 5612.382637909908, 5672.09246520563, 5682.374938756733, 5731.254936858182, 5336.493033161843, 5343.893122137613, 5344.919826202688, 5349.170878513836, 5351.812686555952, 5493.285872836505, 5516.062269414289, 5539.418361072029, 5567.582431317748, 5591.860203494945, 5391.703456309784, 5473.042217611823, 5491.203775452617, 5494.697791621499, 5495.175723641486, 5475.835724928099, 5476.09644408684, 5476.534494568006, 5485.067538518541, 5533.529649979797, 5337.973310133424, 5356.089464791073, 5357.812476563302, 5369.5167434931045, 5456.863578410572, 5375.113106337567, 5379.220013098157, 5380.461953804588, 5380.865478363072, 5382.703951282717, 5292.364916210079, 5307.01820163271, 5307.097793375058, 5315.521603055744, 5343.492368225013, 5261.973690131525, 5316.122839731401, 5323.973380133075, 5349.3848207455085, 5412.972935135299, 5135.614828887774, 5162.5095615916425, 5225.608079394136, 5243.947560524346, 5262.815801446931], "unit": "score", "name": "dojo.html", "value": 5046.624704244439}, {"lowerIsBetter": false, "replicates": [514.7117614136083, 530.7107626343645, 534.6070638081012, 540.4595404595404, 560.140184816307, 29138.562921556168, 29422.264443388925, 29460.263493412676, 29503.40993180135, 29514.852425737896, 37019.259614807685, 37444.81277593608, 37641.24717505648, 37709.24581508375, 37857.0, 8766.167214114665, 8952.68665596701, 8972.371933964625, 8974.641014359418, 8978.955105224464, 8689.652413903435, 8791.428557143765, 8821.691240806573, 8822.823543529126, 8823.647054117828, 8807.515586642732, 8839.0, 8873.112688731107, 8878.0, 8878.200961913426, 8762.079981601935, 8812.471251724854, 8826.823463530725, 8828.735137945807, 8836.469811811312, 8787.516686582236, 8909.109089091104, 8911.331650126267, 8917.375783695144, 8918.152775486318, 41313.586864131576, 41616.583834161574, 41624.0, 41724.0, 41811.581884181374, 3307.107081088117, 3344.6807665968627, 3387.0685561470546, 3390.1016230698883, 3441.4493681010917, 31274.687253127406, 31452.52821207684, 31597.0, 31732.841335793404, 32924.835375823204, 3929.0, 3945.3884647879627, 3966.960330396688, 3975.52293724752, 3995.98002009991, 218481.0, 220264.493387665, 220288.0, 221427.0, 221438.9999999984, 42528.362074568904, 43158.784206078766, 43287.134257314676, 43477.347839781796, 43555.0, 41517.58482415198, 41779.373309400384, 41796.37305440421, 41803.79098104551, 41828.372574411405, 14446.494372697116, 14579.562613121623, 14579.92710036443, 14596.197209153386, 14602.34289456977, 12071.094667899943, 12143.0, 12149.08881833866, 12155.696107597381, 12158.513659453523, 14156.575302740934, 14178.078424902555, 14182.290885455686, 14207.36066876993, 14278.07192532482, 5741.1388291756575, 5753.453421924911, 5769.394213607511, 5805.88388232233, 5819.243498345273, 969.7672558585889, 969.8157350103457, 992.3450522655157, 1032.9431881246453, 1100.944952752359, 26189.0, 28156.577651335247, 28310.71689283081, 28379.432411351656, 28541.429171416454, 937.9718608441758, 1029.7940411917646, 1089.4824958144977, 1137.7610701752724, 1159.8434211381525, 14733.852661473247, 15014.24928753558, 15015.849841501446, 15198.924005379902, 15227.238638068275, 620729.0, 727296.0, 736008.0, 737809.0, 738527.0, 56833.43166568364, 57428.0, 57567.0, 57724.71137644285, 57873.0, 1328.4287756264898, 1336.9665758355925, 1350.338334216227, 1352.9864701353058, 1394.4282844033899, 28006.71993280041, 29946.70053299439, 30025.0, 30470.0, 30548.236294092825, 44561.554384457035, 44968.55031449644, 45329.77335113303, 45382.09235815331, 45395.09209815719, 229179.0, 300431.0, 304065.0, 304746.0, 373384.0, 30915.0, 31007.84496077505, 31104.688953111083, 31112.68887311098, 31130.22174445657, 43905.56094439015, 44518.0, 44712.0, 45656.31515527203, 45692.77153614211, 36593.18917622573, 36938.07654808544, 37139.0, 38087.23825523419, 38557.228855423295, 37087.118600026115, 37098.8145059273, 37982.620173797906, 38269.4259586112, 38470.0, 36268.45597315989, 36972.0, 37248.62751372452, 37299.62700372961, 37438.438423423126, 32678.509822352207, 34120.83945330957, 34226.0, 34229.144271393416, 34704.0, 26103.08639197619, 26638.866805665846, 26883.731162688124, 26899.86550067237, 26945.461090777684], "unit": "score", "name": "ext.html", "value": 18186.72054674305}, {"lowerIsBetter": false, "replicates": [351.6149815951533, 355.7865280831501, 358.75604588879565, 359.7679496724611, 359.8542590250946, 13912.443502259897, 16740.58148546287, 16745.0, 17089.57276068099, 18549.629007419844, 16421.42525011625, 16707.331706731715, 16972.15139243039, 17165.570860728487, 17178.484645460623, 5292.629515933886, 5491.258680078178, 5515.586331025189, 5520.558355331584, 5537.640053396516, 3744.569374521924, 3844.3656796628525, 5187.092258854705, 5437.972810135944, 5564.749586268607, 5552.305961754781, 5570.164475328693, 5571.4428557144365, 5573.136163894603, 5591.580631452637, 5407.134858422653, 5573.832785016456, 5680.403557626451, 5688.11834165705, 5694.2312787773535, 5368.651037682577, 5391.272178255925, 5430.402655707869, 5430.647007944511, 5432.91850622241, 12105.394730263451, 18526.814731852777, 20675.172993080258, 20760.0, 20788.168473261052, 2087.895605219748, 2288.1762565476415, 2313.456337760625, 2333.3233362324904, 2562.2441379792817, 8880.73357799267, 9468.0, 9555.61777528898, 9604.08761167688, 9837.852432213522, 1773.911304434773, 1859.581594141321, 1906.4566598519355, 1926.0658580588404, 1929.951751206217, 60344.0, 68465.31534684639, 68622.0, 69746.99999999949, 69903.3009669902, 9862.358946668444, 9872.210223182128, 9907.504624768733, 9970.401775893324, 9988.25088118394, 12870.420831062625, 13027.609171724864, 13044.673883152996, 13070.0, 13107.344632768323, 7547.433942454338, 7594.5063570867715, 7602.581857997863, 7652.579108148994, 7662.1571627120975, 7699.422543309162, 7700.152983171846, 7738.922610773933, 7769.961150194213, 7830.373570114377, 4197.853075142355, 4268.935965960513, 4299.806508707115, 4302.634276086505, 4345.847895323648, 1614.8304428035121, 1657.2542355939875, 1703.5911381268406, 1755.2101554300616, 1802.180008096313, 926.3746970794687, 929.3958926697701, 969.8399764038995, 1000.4447531619875, 1003.8243307421172, 15264.771028434583, 15621.297041633154, 16261.105639189722, 16697.666046678998, 16849.747253791204, 796.9920300797033, 921.3044151665583, 926.786839027014, 934.6261495401893, 990.069334825262, 9256.814863702688, 9601.279904007228, 9660.516974151264, 9820.607175712892, 9899.307048506535, 392196.0, 401826.0, 402303.0, 404883.0, 406890.0, 68434.0, 69930.30069699339, 70361.64819175974, 71098.64450677714, 71731.2826871735, 1053.5101177952135, 1059.2373491086405, 1062.8565143705655, 1094.8795632480421, 1096.8720681877132, 14514.201718905562, 14840.554783356516, 16177.272022758769, 16415.179241037662, 16468.189841632706, 33678.663213368534, 34197.82901085479, 34782.65217347794, 35148.12129696778, 35228.47157292694, 42315.15369692527, 45139.0, 45372.77313613411, 45503.0, 45567.088658227316, 7261.891071634035, 7368.778936631909, 7490.962545187239, 7534.6609402578115, 7713.267239612228, 11117.22179447431, 11793.233439826385, 12233.388330583613, 12564.308963007123, 12881.677958051123, 10468.528916198637, 10574.471276435994, 10575.894241057798, 10635.415052171895, 10869.184811139037, 10321.948390258001, 10535.736606584896, 10629.309094908805, 10991.120710342993, 11098.66703998849, 7580.620968951641, 8192.344612430872, 10659.360438373722, 10758.838617420588, 11111.333320000826, 7734.342580880688, 8020.438569300326, 8085.959570202347, 8109.0, 8447.324214062983, 8753.29973602123, 10922.29005114665, 11023.503942322775, 11246.0, 11393.316401015965], "unit": "score", "name": "jquery.html", "value": 8277.665788037039}, {"lowerIsBetter": false, "replicates": [1299.2464370665016, 1446.3852862533424, 1454.2292584929985, 1609.64587790686, 1802.3601621424393, 7271.163816161143, 7433.628318584069, 7443.292887175723, 7448.4041276697735, 7461.216572259916, 7350.0, 7497.550146991171, 7505.249475052492, 7512.361449276818, 7514.211007844166, 1958.9118489667999, 2226.0094258055174, 2241.1147596699293, 2259.017327462559, 2282.691836602054, 2256.627656436694, 2277.6925115109416, 2288.7367952685404, 2290.1297506947335, 2294.254367330616, 2277.646964720471, 2286.4055345610095, 2287.954240915181, 2288.496530763229, 2288.5079707862806, 2166.696662467248, 2209.3482422685347, 2222.6888235646943, 2228.064213030531, 2229.453783822974, 2227.164813195052, 2242.495438526335, 2242.5178586603956, 2277.7836105569945, 2279.350385140244, 7814.0623125224765, 7890.526568405857, 7893.0, 7902.051753789525, 7912.09010963735, 4514.0971805639, 4620.930686039712, 4628.32889231063, 4654.4647365553055, 4660.557247061523, 3075.123589776903, 3125.109343837018, 3127.1712996056062, 3145.9685403145904, 3169.6513383527795, 966.9122237482832, 1020.6070662794878, 1027.1115485105404, 1032.148477506053, 1048.811213981483, 10726.570937162503, 10770.084542813871, 10776.4611769412, 10779.784404311948, 10789.460526973699, 4066.959330406717, 4149.564295748964, 4171.666266698657, 4198.097409057006, 4236.279832428495, 8358.331333493306, 8379.203975622428, 8436.620352084172, 8444.57777111142, 8450.19723126302, 4061.878143655695, 4478.440194975628, 4484.0583477469445, 4520.751358675238, 4528.275475923836, 4218.156368726206, 4264.360345948133, 4264.573542645772, 4265.189613973335, 4284.078923031563, 3418.282160746271, 3438.2435864109857, 3453.067671728619, 3478.3043391321835, 3494.6370915343036, 997.07272236819, 1014.4369874719454, 1015.1523477895892, 1023.3041531758327, 1042.525650828871, 1339.8124262603244, 1341.6444642169834, 1360.59182245326, 1374.0587697427095, 1375.085568097224, 7355.889661655079, 7474.7757567273065, 7485.812854678567, 7490.925090749131, 7511.098668159856, 493.5903200343706, 505.27745324186765, 505.4642079395852, 507.9847604571869, 509.95410413063, 5402.324709411324, 5434.239206511092, 5436.537894278951, 5436.728163591804, 5480.808171713971, 9068.183863452321, 9117.498537580364, 9147.359684821999, 9206.953965230265, 9285.48929808867, 9070.909290907139, 9140.908590914005, 9142.542872856331, 9174.587143578556, 9182.311326650528, 7290.45321600882, 7290.599017054007, 7420.6289685516585, 7509.249075092447, 7510.774676759706, 7332.413406927326, 7358.22738612438, 7363.963180184065, 7381.077365329334, 7383.704651813868, 8302.501849889026, 8411.074781774123, 8544.273736732448, 8569.271611913056, 8723.869141963003, 8603.698870539502, 8721.0, 8742.082081381617, 8888.422252553562, 8903.777405564913, 6320.778772742932, 6530.0, 6599.340065993554, 7039.9296007039275, 7139.464540159405, 7239.095113110861, 7249.492535522674, 7256.818579535343, 7281.453890958305, 7293.817654558678, 6423.229212494531, 6546.8363290918105, 6617.669116544057, 6663.100481434944, 6746.460283177432, 6507.837304067436, 6525.575837570543, 6534.869302613826, 6539.0, 6563.638999855054, 6900.068490753884, 6923.515353925177, 6943.79168624942, 6948.33990770876, 6951.20061192949, 6270.561060725888, 6420.807375778734, 6424.100625912282, 6433.646149461824, 6438.871222575616, 6395.520335974914, 6509.869802603826, 6509.902351464826, 6515.218173819172, 6519.511036672174], "unit": "score", "name": "mootools.html", "value": 4327.747130541035}, {"lowerIsBetter": false, "replicates": [323.0760026324711, 329.4235088594959, 333.9615944166422, 336.85346874109763, 340.10213037580775, 5823.184754134425, 5851.239338885949, 5856.531477481802, 5883.0, 5935.554833387502, 5844.444777746118, 5848.239728835256, 5850.648961062339, 5852.385499522553, 5856.795012174574, 4582.1293954148605, 4582.999999999984, 4586.082783443308, 4586.380838586798, 4587.793549290282, 4588.495265520807, 4589.082183563284, 4589.65577581681, 4595.563421474954, 4595.655325850575, 4333.0, 4396.472423309207, 4539.954600453986, 4543.250363689987, 4550.658700597452, 4529.796159172845, 4555.316702494619, 4556.977215113903, 4562.270036794113, 4564.475085365192, 3931.0958479549863, 3970.7617542947514, 3999.0, 4010.959890401117, 4012.9197416051516, 5325.1479763238085, 5454.263674403984, 5605.579581531401, 5606.24315717377, 5620.185073164368, 5277.920831187535, 5279.366476022902, 5280.841574752763, 5286.97356513215, 5287.101192797195, 6154.415330543591, 6167.938320616781, 6222.408871157233, 6241.531885108635, 6242.469390101847, 4417.779111044467, 4426.800793964279, 4430.335449682573, 4434.822607095744, 4440.733555986619, 6329.905051424233, 6475.74097036118, 6487.57830741005, 6501.382368674968, 6503.187101612299, 4558.521355257716, 4576.88557786058, 4586.6789324747615, 4590.609798167193, 4601.516840731675, 4623.884402889955, 4627.629789616823, 4631.0506346198945, 4634.814607415733, 4635.860924172281, 5244.501772331622, 5283.498067683564, 5283.550898173621, 5286.312779338661, 5293.867653308698, 6266.780662676784, 6273.749050038039, 6277.686115694289, 6279.529035322369, 6282.4974002079725, 1603.6311648320952, 1636.5990332368647, 1637.148682684997, 1638.8852780305504, 1639.7294446416447, 1106.2311693373028, 1106.9612563560236, 1118.697951553076, 1120.4005856866538, 1151.228676786555, 5951.345352011275, 5980.282366116094, 5982.700864956735, 5982.880342393128, 5988.880222395528, 6267.2479302484, 6352.4918006559365, 6432.292447830735, 6448.838779030561, 6519.348065193442, 6049.78825741097, 6056.606320589148, 6057.787977420858, 6058.818235452944, 6062.878742425127, 3455.8963231103107, 3490.5462289902152, 3493.0917961330238, 3497.0557949353533, 3504.737144714157, 6756.020377045301, 6756.76351327711, 6767.864642707217, 6767.966160169168, 6771.5259931805285, 6472.805815825533, 6580.901286480706, 6624.56940298879, 6628.237752658506, 6635.734570617218, 6729.125213722283, 6752.358525940126, 6760.628165450849, 6765.9661701691175, 6772.5936443813525, 6501.2198536175965, 6502.772402965874, 6506.3818937200895, 6507.089007539043, 6510.0885875976455, 6413.326600706859, 6420.967895160495, 6421.197350331208, 6424.710888010144, 6426.4216220540375, 6698.062271282122, 6733.192016957801, 6733.225679046776, 6756.256811750802, 6756.324367563205, 4260.913467065879, 4399.626031787334, 4411.536788637147, 4412.8014239359945, 4415.0, 6332.461740751904, 6403.135576697086, 6439.645819479973, 6439.678016099083, 6449.193850768654, 6242.906356404748, 6248.937680594219, 6254.437100660963, 6259.3427690091885, 6264.655443950444, 6242.968785156045, 6258.0925765762795, 6265.780697675559, 6267.6866156692895, 6270.686465676789, 6034.7284372202475, 6180.969095154495, 6181.072839074175, 6225.28409232944, 6244.438000579969, 6352.776528215088, 6385.8722825544155, 6386.61680299165, 6388.201474815648, 6388.552801303864, 6211.782587609412, 6221.813345599639, 6228.0, 6228.0, 6229.750809967551], "unit": "score", "name": "prototype.html", "value": 4756.299518441676}, {"lowerIsBetter": false, "replicates": [754.724525548175, 773.7291947818261, 796.8758507020922, 827.1108558299829, 829.4069740135802, 13975.0, 14094.78857817131, 14172.220527870963, 14239.572812815606, 14264.857351426495, 13475.0, 13583.93208033961, 13659.248741319223, 13668.589942301722, 13681.794773078387, 696.6586372677377, 816.0696805641574, 834.6244190114443, 846.6867259114136, 849.9362547808909, 846.0270688708005, 848.5545088828353, 850.3027517435705, 850.7660393391805, 851.3912552524944, 889.2752406788479, 894.186290475664, 894.2220268366531, 894.4499133033203, 894.7136916186823, 725.1407082607127, 872.5462759365126, 887.6449420231894, 889.9943064337322, 890.7773056735816, 642.5149012495583, 644.3234603666132, 644.4425571880337, 644.5939058393183, 644.9709763060673, 13140.737185256241, 13149.934250328688, 13153.276569788657, 13193.208407495486, 13193.47226110964, 13270.800937985938, 13756.518521851687, 13759.656008599764, 13769.0, 13855.484524714318, 10799.460026998619, 10943.194372928458, 10949.671509854717, 11250.943745281222, 11331.490082946288, 3665.9450108248398, 3678.9080272993124, 3701.8889433317045, 3760.172761992357, 3825.598312177209, 49225.0, 49453.0, 49559.50440495585, 50554.747226264, 50567.24149137766, 9703.854442183372, 9738.561764720464, 9789.510524473748, 10727.570897164025, 10799.352038877692, 17585.12074396275, 17761.0, 17822.732659010126, 17829.375971840924, 17857.642847143245, 8017.238362355567, 8051.376583219445, 8167.673293068329, 8318.958405208055, 8320.750377488685, 4355.3684715716045, 4372.0162963333, 4383.846565370197, 4390.341448782644, 4493.887652808706, 3185.61772587291, 3214.469612513956, 3223.580934478503, 3234.8382580871335, 3247.0908145719236, 601.9036954087325, 603.0200923499314, 618.4495798739126, 626.2203556572097, 655.8425977765302, 544.4103218601692, 549.9010178167888, 614.8616561273767, 665.2383021440423, 672.831792051987, 8967.417117887317, 8996.190342869173, 9101.590428430736, 9159.0, 9209.033051529626, 621.7668374359615, 646.5118835279334, 647.0682217606725, 662.7978466567744, 681.0635376357509, 4041.636252737209, 4252.213340532012, 4281.446399488417, 4470.552944705503, 4509.210888094636, 52522.21216681753, 52776.208356874675, 53291.73354133205, 53355.46644533583, 53692.19461708077, 48683.75658121687, 48867.511324887004, 49283.75358123187, 49527.50472495301, 49717.75141124344, 43871.34192987171, 44240.3363949541, 44316.11367772691, 45777.77111114423, 45933.31100033502, 8722.345824063093, 8896.510691912006, 8981.0, 9003.054679258583, 9057.230135438562, 32631.510527341634, 33844.492332614536, 34891.4766278501, 35394.46908296326, 35529.934101976985, 41640.79179604082, 41824.581754182065, 42054.579454205064, 42412.0, 42939.785301073294, 10677.893221068001, 10748.516316765608, 10951.671449856518, 11000.834987475355, 11143.665690029313, 12620.55828046014, 12679.366031698193, 12736.363181841056, 12796.936015319863, 13263.204207747565, 11285.097192224766, 11537.538498459968, 11752.471138798604, 12128.272303661808, 12212.206206596542, 11659.591914283299, 11936.224145430519, 12054.457549410474, 12288.989197646633, 12391.504339826666, 11319.603813866475, 11567.305961642329, 11572.016378607912, 11927.701807454536, 11986.041116710816, 9226.861597075915, 9758.0, 9871.40771553709, 9968.816463320796, 10329.431881246303, 9583.712488625353, 9647.0, 10395.740106497096, 10468.895311047097, 10491.947540262556], "unit": "score", "name": "yui.html", "value": 6447.088876776846}], "name": "dromaeo_css", "value": 6822.333017895551}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 107.0, 113.0, 113.0, 111.0, 98.0, 113.0, 111.0, 110.0], "unit": "score", "name": "ai-astar", "value": 109.9}, {"lowerIsBetter": true, "replicates": [162.0, 127.0, 155.0, 168.0, 129.0, 155.0, 147.0, 130.0, 171.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 147.0}, {"lowerIsBetter": true, "replicates": [163.0, 161.0, 161.0, 161.0, 161.0, 162.0, 160.0, 162.0, 162.0, 160.0], "unit": "score", "name": "audio-dft", "value": 161.3}, {"lowerIsBetter": true, "replicates": [81.0, 75.0, 94.0, 94.0, 74.0, 73.0, 74.0, 107.0, 90.0, 73.0], "unit": "score", "name": "audio-fft", "value": 83.5}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 148.0, 96.0, 96.0, 96.0, 144.0, 96.0, 95.0, 137.0], "unit": "score", "name": "audio-oscillator", "value": 110.1}, {"lowerIsBetter": true, "replicates": [118.0, 115.0, 115.0, 115.0, 115.0, 114.0, 115.0, 115.0, 114.0, 114.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.0}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 147.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.1}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 95.0, 97.0, 95.0, 96.0, 96.0, 95.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [59.0, 59.0, 60.0, 59.0, 59.0, 59.0, 60.0, 68.0, 58.0, 58.0], "unit": "score", "name": "json-parse-financial", "value": 59.9}, {"lowerIsBetter": true, "replicates": [69.0, 67.0, 68.0, 68.0, 68.0, 68.0, 67.0, 68.0, 68.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.0}, {"lowerIsBetter": true, "replicates": [81.0, 80.0, 82.0, 83.0, 82.0, 82.0, 83.0, 90.0, 83.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.0}, {"lowerIsBetter": true, "replicates": [131.0, 122.0, 114.0, 116.0, 120.0, 114.0, 122.0, 115.0, 122.0, 123.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.9}, {"lowerIsBetter": true, "replicates": [152.0, 143.0, 150.0, 151.0, 152.0, 145.0, 150.0, 148.0, 166.0, 144.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.1}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 68.0, 68.0, 69.0, 68.0, 67.0, 68.0, 67.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.0}], "name": "kraken", "value": 1517.4}]} 11:43:19 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1517.40"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6822.33"}}} 11:43:19 INFO - Return code: 0 11:43:19 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 11:43:19 INFO - # TBPL SUCCESS # 11:43:19 INFO - Running post-action listener: _resource_record_post_action 11:43:19 INFO - Running post-run listener: _resource_record_post_run 11:43:20 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 0; Write bytes: 535314432; Read time: 0; Write time: 951752 11:43:20 INFO - install - Wall time: 17s; CPU: 16.0%; Read bytes: 0; Write bytes: 241000448; Read time: 0; Write time: 620208 11:43:20 INFO - run-tests - Wall time: 1178s; CPU: 13.0%; Read bytes: 0; Write bytes: 294313984; Read time: 0; Write time: 331544 11:43:20 INFO - Running post-run listener: _upload_blobber_files 11:43:20 INFO - Blob upload gear active. 11:43:20 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 11:43:20 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 11:43:20 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'] 11:43:20 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 11:43:21 INFO - (blobuploader) - INFO - Open directory for files ... 11:43:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 11:43:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:43:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:43:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:43:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:43:22 INFO - (blobuploader) - INFO - Done attempting. 11:43:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:43:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:43:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:43:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:43:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:43:22 INFO - (blobuploader) - INFO - Done attempting. 11:43:22 INFO - (blobuploader) - INFO - Iteration through files over. 11:43:22 INFO - Return code: 0 11:43:22 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 11:43:22 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 11:43:22 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/98be33c39fa39af3c44abbcd8564639573ecd03e71b4e8bec5b04c5d404f6dc238f8d55695d32cd81cdf61038739237f5ce43685d7bb53f24ca25d6fadc21ee1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9a5e34df52156145712ff47308c1aff2ac6aa5a50d3e90415cbb05b4302ad6e21655cda36b4ab2b829ef75343521d658876d4488014f1920ef5dabaeeccc85a2"} 11:43:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 11:43:22 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 11:43:22 INFO - Contents: 11:43:22 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/98be33c39fa39af3c44abbcd8564639573ecd03e71b4e8bec5b04c5d404f6dc238f8d55695d32cd81cdf61038739237f5ce43685d7bb53f24ca25d6fadc21ee1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9a5e34df52156145712ff47308c1aff2ac6aa5a50d3e90415cbb05b4302ad6e21655cda36b4ab2b829ef75343521d658876d4488014f1920ef5dabaeeccc85a2"} 11:43:22 INFO - Running post-run listener: copy_logs_to_upload_dir 11:43:22 INFO - Copying logs to upload dir... 11:43:22 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 11:43:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1232.622676 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 32 secs) (at 2016-02-23 11:43:22.101205) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-23 11:43:22.104638) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 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/98be33c39fa39af3c44abbcd8564639573ecd03e71b4e8bec5b04c5d404f6dc238f8d55695d32cd81cdf61038739237f5ce43685d7bb53f24ca25d6fadc21ee1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9a5e34df52156145712ff47308c1aff2ac6aa5a50d3e90415cbb05b4302ad6e21655cda36b4ab2b829ef75343521d658876d4488014f1920ef5dabaeeccc85a2"} build_url:https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011557 build_url: 'https://queue.taskcluster.net/v1/task/EIT2sSrHR8Wen7czaGE6Dw/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/98be33c39fa39af3c44abbcd8564639573ecd03e71b4e8bec5b04c5d404f6dc238f8d55695d32cd81cdf61038739237f5ce43685d7bb53f24ca25d6fadc21ee1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/9a5e34df52156145712ff47308c1aff2ac6aa5a50d3e90415cbb05b4302ad6e21655cda36b4ab2b829ef75343521d658876d4488014f1920ef5dabaeeccc85a2"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-23 11:43:22.129204) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:43:22.129530) ========= 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=df17445c3590ff7897617a0e00000225-1456255367.286208-22499475 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004462 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-23 11:43:22.215064) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-23 11:43:22.215391) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-23 11:43:22.215718) ========= ========= Total master_lag: 0.27 =========