builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-007 starttime: 1450171333.91 results: success (0) buildid: 20151214122127 builduid: 04ddcb15470f4a5cb735f14b38df8aff revision: e2031358e2a6d6d686b7a6b592d07cfb874bacae ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:13.906010) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:13.906638) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:13.907014) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006272 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.06 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:13.972443) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:13.972758) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.072072) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.072489) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004530 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.146681) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.147021) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.147487) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.147802) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-15 01:22:14-- 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% 221M=0s 2015-12-15 01:22:14 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.122791 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.295604) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.295949) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016065 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:14.348419) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-15 01:22:14.348805) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev e2031358e2a6d6d686b7a6b592d07cfb874bacae --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev e2031358e2a6d6d686b7a6b592d07cfb874bacae --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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-15 01:22:14,507 truncating revision to first 12 chars 2015-12-15 01:22:14,507 Setting DEBUG logging. 2015-12-15 01:22:14,507 attempt 1/10 2015-12-15 01:22:14,507 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/e2031358e2a6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-15 01:22:15,361 unpacking tar archive at: mozilla-aurora-e2031358e2a6/testing/mozharness/ program finished with exit code 0 elapsedTime=1.130887 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-15 01:22:15.494955) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:15.495299) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:15.506377) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:15.506673) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-15 01:22:15.507090) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2015-12-15 01:22:15.507445) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:22:15 INFO - MultiFileLogger online at 20151215 01:22:15 in /builds/slave/test-pgo 01:22:15 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 01:22:15 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 01:22:15 INFO - {'append_to_log': False, 01:22:15 INFO - 'base_work_dir': '/builds/slave/test-pgo', 01:22:15 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 01:22:15 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 01:22:15 INFO - 'branch': 'Mozilla-Aurora', 01:22:15 INFO - 'buildbot_json_path': 'buildprops.json', 01:22:15 INFO - 'config_files': ('talos/linux_config.py',), 01:22:15 INFO - 'default_actions': ('clobber', 01:22:15 INFO - 'read-buildbot-config', 01:22:15 INFO - 'download-and-extract', 01:22:15 INFO - 'populate-webroot', 01:22:15 INFO - 'create-virtualenv', 01:22:15 INFO - 'install', 01:22:15 INFO - 'run-tests'), 01:22:15 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:22:15 INFO - 'download_minidump_stackwalk': True, 01:22:15 INFO - 'download_symbols': 'ondemand', 01:22:15 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:22:15 INFO - 'tooltool.py': '/tools/tooltool.py', 01:22:15 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:22:15 INFO - '/tools/misc-python/virtualenv.py')}, 01:22:15 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:22:15 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:22:15 INFO - 'installer_path': 'installer.exe', 01:22:15 INFO - 'log_level': 'info', 01:22:15 INFO - 'log_name': 'talos', 01:22:15 INFO - 'log_to_console': True, 01:22:15 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:22:15 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:22:15 INFO - 'opt_config_files': (), 01:22:15 INFO - 'pip_index': False, 01:22:15 INFO - 'sps_profile': False, 01:22:15 INFO - 'sps_profile_interval': 0, 01:22:15 INFO - 'suite': 'dromaeojs-e10s', 01:22:15 INFO - 'system_bits': '64', 01:22:15 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:22:15 INFO - 'title': 'talos-linux64-ix-007', 01:22:15 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:22:15 INFO - 'use_talos_json': True, 01:22:15 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 01:22:15 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:22:15 INFO - 'work_dir': 'build'} 01:22:15 INFO - ##### 01:22:15 INFO - ##### Running clobber step. 01:22:15 INFO - ##### 01:22:15 INFO - Running pre-action listener: _resource_record_pre_action 01:22:15 INFO - Running main action method: clobber 01:22:15 INFO - rmtree: /builds/slave/test-pgo/build 01:22:15 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 01:22:16 INFO - Running post-action listener: _resource_record_post_action 01:22:16 INFO - ##### 01:22:16 INFO - ##### Running read-buildbot-config step. 01:22:16 INFO - ##### 01:22:16 INFO - Running pre-action listener: _resource_record_pre_action 01:22:16 INFO - Running main action method: read_buildbot_config 01:22:16 INFO - Using buildbot properties: 01:22:16 INFO - { 01:22:16 INFO - "properties": { 01:22:16 INFO - "buildnumber": 17, 01:22:16 INFO - "product": "firefox", 01:22:16 INFO - "script_repo_revision": "production", 01:22:16 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 01:22:16 INFO - "repository": "", 01:22:16 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 01:22:16 INFO - "buildid": "20151214122127", 01:22:16 INFO - "slavename": "talos-linux64-ix-007", 01:22:16 INFO - "pgo_build": "True", 01:22:16 INFO - "basedir": "/builds/slave/test-pgo", 01:22:16 INFO - "project": "", 01:22:16 INFO - "platform": "ubuntu64_hw", 01:22:16 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 01:22:16 INFO - "slavebuilddir": "test", 01:22:16 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 01:22:16 INFO - "branch": "mozilla-aurora", 01:22:16 INFO - "repo_path": "releases/mozilla-aurora", 01:22:16 INFO - "stage_platform": "linux64-pgo", 01:22:16 INFO - "builduid": "04ddcb15470f4a5cb735f14b38df8aff", 01:22:16 INFO - "revision": "e2031358e2a6d6d686b7a6b592d07cfb874bacae" 01:22:16 INFO - }, 01:22:16 INFO - "sourcestamp": { 01:22:16 INFO - "repository": "", 01:22:16 INFO - "hasPatch": false, 01:22:16 INFO - "project": "", 01:22:16 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 01:22:16 INFO - "changes": [ 01:22:16 INFO - { 01:22:16 INFO - "category": null, 01:22:16 INFO - "files": [ 01:22:16 INFO - { 01:22:16 INFO - "url": null, 01:22:16 INFO - "name": "https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2" 01:22:16 INFO - } 01:22:16 INFO - ], 01:22:16 INFO - "repository": "", 01:22:16 INFO - "rev": "e2031358e2a6d6d686b7a6b592d07cfb874bacae", 01:22:16 INFO - "who": "raliiev@mozilla.com", 01:22:16 INFO - "when": 1450133561, 01:22:16 INFO - "number": 7358969, 01:22:16 INFO - "comments": "Update configs. IGNORE BROKEN CHANGESETS CLOSED TREE NO BUG a=release ba=release", 01:22:16 INFO - "project": "", 01:22:16 INFO - "at": "Mon 14 Dec 2015 14:52:41", 01:22:16 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 01:22:16 INFO - "revlink": "", 01:22:16 INFO - "properties": [ 01:22:16 INFO - [ 01:22:16 INFO - "buildid", 01:22:16 INFO - "20151214122127", 01:22:16 INFO - "Change" 01:22:16 INFO - ], 01:22:16 INFO - [ 01:22:16 INFO - "builduid", 01:22:16 INFO - "04ddcb15470f4a5cb735f14b38df8aff", 01:22:16 INFO - "Change" 01:22:16 INFO - ], 01:22:16 INFO - [ 01:22:16 INFO - "pgo_build", 01:22:16 INFO - "True", 01:22:16 INFO - "Change" 01:22:16 INFO - ] 01:22:16 INFO - ], 01:22:16 INFO - "revision": "e2031358e2a6d6d686b7a6b592d07cfb874bacae" 01:22:16 INFO - } 01:22:16 INFO - ], 01:22:16 INFO - "revision": "e2031358e2a6d6d686b7a6b592d07cfb874bacae" 01:22:16 INFO - } 01:22:16 INFO - } 01:22:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2. 01:22:16 INFO - Running post-action listener: _resource_record_post_action 01:22:16 INFO - ##### 01:22:16 INFO - ##### Running download-and-extract step. 01:22:16 INFO - ##### 01:22:16 INFO - Running pre-action listener: _resource_record_pre_action 01:22:16 INFO - Running main action method: download_and_extract 01:22:16 INFO - mkdir: /builds/slave/test-pgo/build/tests 01:22:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:16 INFO - https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 01:22:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/test_packages.json 01:22:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/test_packages.json 01:22:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 01:22:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 01:22:18 INFO - Downloaded 1302 bytes. 01:22:18 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 01:22:18 INFO - Using the following test package requirements: 01:22:18 INFO - {u'common': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 01:22:18 INFO - u'cppunittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 01:22:18 INFO - u'jittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'jsshell-linux-x86_64.zip'], 01:22:18 INFO - u'mochitest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 01:22:18 INFO - u'mozbase': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 01:22:18 INFO - u'reftest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.reftest.tests.zip'], 01:22:18 INFO - u'talos': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'], 01:22:18 INFO - u'web-platform': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 01:22:18 INFO - u'webapprt': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 01:22:18 INFO - u'xpcshell': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 01:22:18 INFO - u'firefox-45.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 01:22:18 INFO - Downloading packages: [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 01:22:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:18 INFO - https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:22:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:22:20 INFO - Downloaded 23028976 bytes. 01:22:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 01:22:20 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:20 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 01:22:21 INFO - Return code: 0 01:22:21 INFO - Downloading packages: [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 01:22:21 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')]} 01:22:21 INFO - https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:22:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:22:23 INFO - Downloaded 23028976 bytes. 01:22:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 01:22:23 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 01:22:23 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 01:22:24 INFO - Return code: 0 01:22:24 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')]} 01:22:24 INFO - https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 01:22:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 01:22:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 01:22:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 01:22:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 01:22:25 INFO - Downloaded 11132038 bytes. 01:22:25 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 01:22:25 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 01:22:25 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 01:22:25 INFO - Return code: 0 01:22:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:25 INFO - https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 01:22:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 01:22:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 01:22:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 01:22:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 01:22:27 INFO - Downloaded 58079436 bytes. 01:22:27 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 01:22:27 INFO - mkdir: /builds/slave/test-pgo/properties 01:22:27 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 01:22:27 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 01:22:27 INFO - Contents: 01:22:27 INFO - build_url:https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 01:22:27 INFO - Running post-action listener: _resource_record_post_action 01:22:27 INFO - Running post-action listener: set_extra_try_arguments 01:22:27 INFO - ##### 01:22:27 INFO - ##### Running populate-webroot step. 01:22:27 INFO - ##### 01:22:27 INFO - Running pre-action listener: _resource_record_pre_action 01:22:27 INFO - Running main action method: populate_webroot 01:22:27 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:22:27 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:22:27 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:22:27 INFO - '--tppagecycles', 01:22:27 INFO - '7'], 01:22:27 INFO - 'tests': ['tsvgm']}}, 01:22:27 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 01:22:27 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:22:27 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:22:27 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:22:27 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:22:27 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:22:27 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'tests': ['damp', 'tps']}, 01:22:27 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['damp', 'tps']}, 01:22:27 INFO - 'g3': {'tests': ['dromaeo_dom']}, 01:22:27 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:22:27 INFO - 'other': {'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'other-e10s': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'other_l64': {'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'other_nol64': {'tests': ['a11yr', 01:22:27 INFO - 'ts_paint', 01:22:27 INFO - 'tpaint', 01:22:27 INFO - 'sessionrestore', 01:22:27 INFO - 'sessionrestore_no_auto_restore']}, 01:22:27 INFO - 'svgr': {'tests': ['tsvgx', 01:22:27 INFO - 'tsvgr_opacity', 01:22:27 INFO - 'tart', 01:22:27 INFO - 'tscrollx', 01:22:27 INFO - 'cart']}, 01:22:27 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['tsvgx', 01:22:27 INFO - 'tsvgr_opacity', 01:22:27 INFO - 'tart', 01:22:27 INFO - 'tscrollx', 01:22:27 INFO - 'cart']}, 01:22:27 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'tests': ['tp5o']}, 01:22:27 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'talos_options': ['--e10s'], 01:22:27 INFO - 'tests': ['tp5o']}, 01:22:27 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'talos_options': ['--xperf_path', 01:22:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:22:27 INFO - 'tests': ['tp5n']}, 01:22:27 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:22:27 INFO - 'talos_options': ['--e10s', 01:22:27 INFO - '--xperf_path', 01:22:27 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:22:27 INFO - 'tests': ['tp5n']}}, 01:22:27 INFO - 'talos.zip': {'path': '', 01:22:27 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:22:27 INFO - Running post-action listener: _resource_record_post_action 01:22:27 INFO - ##### 01:22:27 INFO - ##### Running create-virtualenv step. 01:22:27 INFO - ##### 01:22:27 INFO - Running pre-action listener: _resource_record_pre_action 01:22:27 INFO - Running main action method: create_virtualenv 01:22:27 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 01:22:27 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 01:22:27 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 01:22:27 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:22:27 INFO - Using real prefix '/usr' 01:22:27 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 01:22:28 INFO - Installing distribute.............................................................................................................................................................................................done. 01:22:30 INFO - Installing pip.................done. 01:22:30 INFO - Return code: 0 01:22:30 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 01:22:30 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')]} 01:22:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:30 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')]} 01:22:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:30 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:30 INFO - Using env: {'DISPLAY': ':0', 01:22:30 INFO - 'HOME': '/home/cltbld', 01:22:30 INFO - 'LANG': 'en_US.UTF-8', 01:22:30 INFO - 'LANGUAGE': 'en_US:en', 01:22:30 INFO - 'LOGNAME': 'cltbld', 01:22:30 INFO - 'MAIL': '/var/mail/cltbld', 01:22:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:30 INFO - 'MOZ_NO_REMOTE': '1', 01:22:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:30 INFO - 'NO_EM_RESTART': '1', 01:22:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:30 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:30 INFO - 'SHELL': '/bin/bash', 01:22:30 INFO - 'SHLVL': '1', 01:22:30 INFO - 'TERM': 'linux', 01:22:30 INFO - 'TMOUT': '86400', 01:22:30 INFO - 'USER': 'cltbld', 01:22:30 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:30 INFO - '_': '/tools/buildbot/bin/python'} 01:22:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:30 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 01:22:30 INFO - Cleaning up... 01:22:30 INFO - Return code: 0 01:22:30 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 01:22:30 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')]} 01:22:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:30 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')]} 01:22:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:30 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:30 INFO - Using env: {'DISPLAY': ':0', 01:22:30 INFO - 'HOME': '/home/cltbld', 01:22:30 INFO - 'LANG': 'en_US.UTF-8', 01:22:30 INFO - 'LANGUAGE': 'en_US:en', 01:22:30 INFO - 'LOGNAME': 'cltbld', 01:22:30 INFO - 'MAIL': '/var/mail/cltbld', 01:22:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:30 INFO - 'MOZ_NO_REMOTE': '1', 01:22:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:30 INFO - 'NO_EM_RESTART': '1', 01:22:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:30 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:30 INFO - 'SHELL': '/bin/bash', 01:22:30 INFO - 'SHLVL': '1', 01:22:30 INFO - 'TERM': 'linux', 01:22:30 INFO - 'TMOUT': '86400', 01:22:30 INFO - 'USER': 'cltbld', 01:22:30 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:30 INFO - '_': '/tools/buildbot/bin/python'} 01:22:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:30 INFO - Downloading/unpacking psutil>=0.7.1 01:22:30 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 01:22:30 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 01:22:30 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 01:22:30 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 01:22:30 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 01:22:30 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 01:22:32 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 01:22:32 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 01:22:32 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 01:22:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:22:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:22:32 INFO - Installing collected packages: psutil 01:22:32 INFO - Running setup.py install for psutil 01:22:32 INFO - building 'psutil._psutil_linux' extension 01:22:32 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 01:22:32 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 01:22:32 INFO - building 'psutil._psutil_posix' extension 01:22:32 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 01:22:32 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 01:22:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:22:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:22:32 INFO - Successfully installed psutil 01:22:32 INFO - Cleaning up... 01:22:32 INFO - Return code: 0 01:22:32 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 01:22:32 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')]} 01:22:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:32 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')]} 01:22:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:32 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:33 INFO - Using env: {'DISPLAY': ':0', 01:22:33 INFO - 'HOME': '/home/cltbld', 01:22:33 INFO - 'LANG': 'en_US.UTF-8', 01:22:33 INFO - 'LANGUAGE': 'en_US:en', 01:22:33 INFO - 'LOGNAME': 'cltbld', 01:22:33 INFO - 'MAIL': '/var/mail/cltbld', 01:22:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:33 INFO - 'MOZ_NO_REMOTE': '1', 01:22:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:33 INFO - 'NO_EM_RESTART': '1', 01:22:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:33 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:33 INFO - 'SHELL': '/bin/bash', 01:22:33 INFO - 'SHLVL': '1', 01:22:33 INFO - 'TERM': 'linux', 01:22:33 INFO - 'TMOUT': '86400', 01:22:33 INFO - 'USER': 'cltbld', 01:22:33 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:33 INFO - '_': '/tools/buildbot/bin/python'} 01:22:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:33 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 01:22:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:22:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:22:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:22:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:22:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:22:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:22:34 INFO - Downloading mozsystemmonitor-0.0.tar.gz 01:22:34 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 01:22:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:22:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 01:22:34 INFO - Installing collected packages: mozsystemmonitor 01:22:34 INFO - Running setup.py install for mozsystemmonitor 01:22:35 INFO - Successfully installed mozsystemmonitor 01:22:35 INFO - Cleaning up... 01:22:35 INFO - Return code: 0 01:22:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 01:22:35 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')]} 01:22:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:35 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')]} 01:22:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:35 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:35 INFO - Using env: {'DISPLAY': ':0', 01:22:35 INFO - 'HOME': '/home/cltbld', 01:22:35 INFO - 'LANG': 'en_US.UTF-8', 01:22:35 INFO - 'LANGUAGE': 'en_US:en', 01:22:35 INFO - 'LOGNAME': 'cltbld', 01:22:35 INFO - 'MAIL': '/var/mail/cltbld', 01:22:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:35 INFO - 'MOZ_NO_REMOTE': '1', 01:22:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:35 INFO - 'NO_EM_RESTART': '1', 01:22:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:35 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:35 INFO - 'SHELL': '/bin/bash', 01:22:35 INFO - 'SHLVL': '1', 01:22:35 INFO - 'TERM': 'linux', 01:22:35 INFO - 'TMOUT': '86400', 01:22:35 INFO - 'USER': 'cltbld', 01:22:35 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:35 INFO - '_': '/tools/buildbot/bin/python'} 01:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:36 INFO - Downloading/unpacking blobuploader==1.2.4 01:22:36 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 01:22:36 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 01:22:36 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 01:22:36 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 01:22:36 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 01:22:36 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 01:22:37 INFO - Downloading blobuploader-1.2.4.tar.gz 01:22:37 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 01:22:37 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:22:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 01:22:38 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 01:22:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 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 01:22:38 INFO - Downloading docopt-0.6.1.tar.gz 01:22:38 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 01:22:38 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 01:22:38 INFO - Installing collected packages: blobuploader, requests, docopt 01:22:38 INFO - Running setup.py install for blobuploader 01:22:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:22:38 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 01:22:38 INFO - Running setup.py install for requests 01:22:39 INFO - Running setup.py install for docopt 01:22:39 INFO - Successfully installed blobuploader requests docopt 01:22:39 INFO - Cleaning up... 01:22:39 INFO - Return code: 0 01:22:39 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:22:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:39 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:39 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:39 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:39 INFO - Using env: {'DISPLAY': ':0', 01:22:39 INFO - 'HOME': '/home/cltbld', 01:22:39 INFO - 'LANG': 'en_US.UTF-8', 01:22:39 INFO - 'LANGUAGE': 'en_US:en', 01:22:39 INFO - 'LOGNAME': 'cltbld', 01:22:39 INFO - 'MAIL': '/var/mail/cltbld', 01:22:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:39 INFO - 'MOZ_NO_REMOTE': '1', 01:22:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:39 INFO - 'NO_EM_RESTART': '1', 01:22:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:39 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:39 INFO - 'SHELL': '/bin/bash', 01:22:39 INFO - 'SHLVL': '1', 01:22:39 INFO - 'TERM': 'linux', 01:22:39 INFO - 'TMOUT': '86400', 01:22:39 INFO - 'USER': 'cltbld', 01:22:39 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:39 INFO - '_': '/tools/buildbot/bin/python'} 01:22:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:22:39 INFO - Running setup.py (path:/tmp/pip-DWUOZv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:22:39 INFO - Running setup.py (path:/tmp/pip-P68Cl0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:22:39 INFO - Running setup.py (path:/tmp/pip-8CcemD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:22:39 INFO - Running setup.py (path:/tmp/pip-LU2uCV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:22:39 INFO - Running setup.py (path:/tmp/pip-8TGk3b-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:22:39 INFO - Running setup.py (path:/tmp/pip-K6Lklx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:22:39 INFO - Running setup.py (path:/tmp/pip-kNxGF3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:22:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:22:39 INFO - Running setup.py (path:/tmp/pip-Z7wDH6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:22:40 INFO - Running setup.py (path:/tmp/pip-61Hh13-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:22:40 INFO - Running setup.py (path:/tmp/pip-F3l1D1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:22:40 INFO - Running setup.py (path:/tmp/pip-S2QKCa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:22:40 INFO - Running setup.py (path:/tmp/pip-KQQJr8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:22:40 INFO - Running setup.py (path:/tmp/pip-Xc_SUa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:22:40 INFO - Running setup.py (path:/tmp/pip-3m8flk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:22:40 INFO - Running setup.py (path:/tmp/pip-qbWUE2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:22:40 INFO - Running setup.py (path:/tmp/pip-u2FX5P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:22:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:22:40 INFO - Running setup.py (path:/tmp/pip-4HwMSG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:22:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:22:40 INFO - Running setup.py install for manifestparser 01:22:40 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 01:22:40 INFO - Running setup.py install for mozcrash 01:22:40 INFO - Running setup.py install for mozdebug 01:22:40 INFO - Running setup.py install for mozdevice 01:22:41 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for mozfile 01:22:41 INFO - Running setup.py install for mozhttpd 01:22:41 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for mozinfo 01:22:41 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for mozInstall 01:22:41 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for mozleak 01:22:41 INFO - Running setup.py install for mozlog 01:22:41 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for moznetwork 01:22:41 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 01:22:41 INFO - Running setup.py install for mozprocess 01:22:41 INFO - Running setup.py install for mozprofile 01:22:42 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 01:22:42 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 01:22:42 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 01:22:42 INFO - Running setup.py install for mozrunner 01:22:42 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 01:22:42 INFO - Running setup.py install for mozscreenshot 01:22:42 INFO - Running setup.py install for moztest 01:22:42 INFO - Running setup.py install for mozversion 01:22:42 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 01:22:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:22:42 INFO - Cleaning up... 01:22:42 INFO - Return code: 0 01:22:42 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:22: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')]} 01:22:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22: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')]} 01:22:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:42 INFO - Using env: {'DISPLAY': ':0', 01:22:42 INFO - 'HOME': '/home/cltbld', 01:22:42 INFO - 'LANG': 'en_US.UTF-8', 01:22:42 INFO - 'LANGUAGE': 'en_US:en', 01:22:42 INFO - 'LOGNAME': 'cltbld', 01:22:42 INFO - 'MAIL': '/var/mail/cltbld', 01:22:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:42 INFO - 'MOZ_NO_REMOTE': '1', 01:22:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:42 INFO - 'NO_EM_RESTART': '1', 01:22:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:42 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:42 INFO - 'SHELL': '/bin/bash', 01:22:42 INFO - 'SHLVL': '1', 01:22:42 INFO - 'TERM': 'linux', 01:22:42 INFO - 'TMOUT': '86400', 01:22:42 INFO - 'USER': 'cltbld', 01:22:42 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:42 INFO - '_': '/tools/buildbot/bin/python'} 01:22:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:22:42 INFO - Running setup.py (path:/tmp/pip-vEv6Ww-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:22:42 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)) 01:22:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:22:42 INFO - Running setup.py (path:/tmp/pip-ylh5Hy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:22:42 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)) 01:22:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:22:42 INFO - Running setup.py (path:/tmp/pip-xaTEkM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:22:42 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)) 01:22:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:22:42 INFO - Running setup.py (path:/tmp/pip-FhY75X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:22:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 01:22:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:22:42 INFO - Running setup.py (path:/tmp/pip-D82J8s-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:22:43 INFO - Running setup.py (path:/tmp/pip-fBJe7D-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:22:43 INFO - Running setup.py (path:/tmp/pip-pC9M9K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:22:43 INFO - Running setup.py (path:/tmp/pip-EHXDe8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:22:43 INFO - Running setup.py (path:/tmp/pip-PNflpn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:22:43 INFO - Running setup.py (path:/tmp/pip-NAq6T9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:22:43 INFO - Running setup.py (path:/tmp/pip-YoCNKi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:22:43 INFO - Running setup.py (path:/tmp/pip-du8Bjg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:22:43 INFO - Running setup.py (path:/tmp/pip-v99rRV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:22:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:22:43 INFO - Running setup.py (path:/tmp/pip-arvtCO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:22:43 INFO - Running setup.py (path:/tmp/pip-RtkQwZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:22:43 INFO - Running setup.py (path:/tmp/pip-Y3RTgC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:22:43 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)) 01:22:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:22:43 INFO - Running setup.py (path:/tmp/pip-kpaMRe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:22:43 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)) 01:22:43 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)) 01:22:43 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)) 01:22:43 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)) 01:22:43 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.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 01:22:43 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.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 01:22:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 01:22:43 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 01:22:43 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 01:22:43 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 01:22:43 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 01:22:43 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 01:22:43 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 01:22:45 INFO - Downloading blessings-1.5.1.tar.gz 01:22:45 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 01:22:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 01:22:45 INFO - Installing collected packages: blessings 01:22:45 INFO - Running setup.py install for blessings 01:22:45 INFO - Successfully installed blessings 01:22:45 INFO - Cleaning up... 01:22:45 INFO - Return code: 0 01:22:45 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 01:22:45 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:22:45 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:22:46 INFO - Reading from file tmpfile_stdout 01:22:46 INFO - Current package versions: 01:22:46 INFO - argparse == 1.2.1 01:22:46 INFO - blessings == 1.5.1 01:22:46 INFO - blobuploader == 1.2.4 01:22:46 INFO - docopt == 0.6.1 01:22:46 INFO - manifestparser == 1.1 01:22:46 INFO - mozInstall == 1.12 01:22:46 INFO - mozcrash == 0.16 01:22:46 INFO - mozdebug == 0.1 01:22:46 INFO - mozdevice == 0.47 01:22:46 INFO - mozfile == 1.2 01:22:46 INFO - mozhttpd == 0.7 01:22:46 INFO - mozinfo == 0.9 01:22:46 INFO - mozleak == 0.1 01:22:46 INFO - mozlog == 3.1 01:22:46 INFO - moznetwork == 0.27 01:22:46 INFO - mozprocess == 0.22 01:22:46 INFO - mozprofile == 0.27 01:22:46 INFO - mozrunner == 6.11 01:22:46 INFO - mozscreenshot == 0.1 01:22:46 INFO - mozsystemmonitor == 0.0 01:22:46 INFO - moztest == 0.7 01:22:46 INFO - mozversion == 1.4 01:22:46 INFO - psutil == 3.1.1 01:22:46 INFO - requests == 1.2.3 01:22:46 INFO - wsgiref == 0.1.2 01:22:46 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:22:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:46 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:46 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:46 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:46 INFO - Using env: {'DISPLAY': ':0', 01:22:46 INFO - 'HOME': '/home/cltbld', 01:22:46 INFO - 'LANG': 'en_US.UTF-8', 01:22:46 INFO - 'LANGUAGE': 'en_US:en', 01:22:46 INFO - 'LOGNAME': 'cltbld', 01:22:46 INFO - 'MAIL': '/var/mail/cltbld', 01:22:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:46 INFO - 'MOZ_NO_REMOTE': '1', 01:22:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:46 INFO - 'NO_EM_RESTART': '1', 01:22:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:46 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:46 INFO - 'SHELL': '/bin/bash', 01:22:46 INFO - 'SHLVL': '1', 01:22:46 INFO - 'TERM': 'linux', 01:22:46 INFO - 'TMOUT': '86400', 01:22:46 INFO - 'USER': 'cltbld', 01:22:46 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:46 INFO - '_': '/tools/buildbot/bin/python'} 01:22:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:46 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 1)) 01:22:46 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 2)) 01:22:46 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 3)) 01:22:46 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 4)) 01:22:46 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 5)) 01:22:46 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 6)) 01:22:46 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 7)) 01:22:46 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 8)) 01:22:46 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.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 01:22:46 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 3)) 01:22:46 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.0->mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 01:22:46 INFO - Cleaning up... 01:22:46 INFO - Return code: 0 01:22:46 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 01:22:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:22:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:46 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:46 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:46 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:46 INFO - Using env: {'DISPLAY': ':0', 01:22:46 INFO - 'HOME': '/home/cltbld', 01:22:46 INFO - 'LANG': 'en_US.UTF-8', 01:22:46 INFO - 'LANGUAGE': 'en_US:en', 01:22:46 INFO - 'LOGNAME': 'cltbld', 01:22:46 INFO - 'MAIL': '/var/mail/cltbld', 01:22:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:46 INFO - 'MOZ_NO_REMOTE': '1', 01:22:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:46 INFO - 'NO_EM_RESTART': '1', 01:22:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:46 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:46 INFO - 'SHELL': '/bin/bash', 01:22:46 INFO - 'SHLVL': '1', 01:22:46 INFO - 'TERM': 'linux', 01:22:46 INFO - 'TMOUT': '86400', 01:22:46 INFO - 'USER': 'cltbld', 01:22:46 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:46 INFO - '_': '/tools/buildbot/bin/python'} 01:22:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:46 INFO - Downloading/unpacking jsonschema 01:22:46 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 01:22:46 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 01:22:46 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 01:22:46 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 01:22:46 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 01:22:46 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 01:22:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:22:48 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 01:22:48 INFO - Downloading/unpacking functools32 (from jsonschema) 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 INFO - Downloading functools32-3.2.3-2.tar.gz 01:22:48 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 01:22:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 01:22:48 INFO - warning: no files found matching '*.txt' 01:22:48 INFO - no previously-included directories found matching 'build' 01:22:48 INFO - no previously-included directories found matching 'dist' 01:22:48 INFO - no previously-included directories found matching '.git*' 01:22:48 INFO - Installing collected packages: jsonschema, functools32 01:22:48 INFO - Running setup.py install for functools32 01:22:48 INFO - warning: no files found matching '*.txt' 01:22:48 INFO - no previously-included directories found matching 'build' 01:22:48 INFO - no previously-included directories found matching 'dist' 01:22:48 INFO - no previously-included directories found matching '.git*' 01:22:48 INFO - Successfully installed jsonschema functools32 01:22:48 INFO - Cleaning up... 01:22:48 INFO - Return code: 0 01:22:48 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 01:22:48 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')]} 01:22:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:22:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:48 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')]} 01:22:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:22:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:22:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7f49ccb7ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf1c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfea450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, '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': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', '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 01:22:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 01:22:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --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 01:22:48 INFO - Using env: {'DISPLAY': ':0', 01:22:48 INFO - 'HOME': '/home/cltbld', 01:22:48 INFO - 'LANG': 'en_US.UTF-8', 01:22:48 INFO - 'LANGUAGE': 'en_US:en', 01:22:48 INFO - 'LOGNAME': 'cltbld', 01:22:48 INFO - 'MAIL': '/var/mail/cltbld', 01:22:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:22:48 INFO - 'MOZ_NO_REMOTE': '1', 01:22:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:22:48 INFO - 'NO_EM_RESTART': '1', 01:22:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:22:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:22:48 INFO - 'PWD': '/builds/slave/test-pgo', 01:22:48 INFO - 'SHELL': '/bin/bash', 01:22:48 INFO - 'SHLVL': '1', 01:22:48 INFO - 'TERM': 'linux', 01:22:48 INFO - 'TMOUT': '86400', 01:22:48 INFO - 'USER': 'cltbld', 01:22:48 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:22:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:22:48 INFO - '_': '/tools/buildbot/bin/python'} 01:22:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:22:48 INFO - Downloading/unpacking flake8 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:48 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 01:22:50 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 01:22:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 01:22:50 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 01:22:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 01:22:50 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 01:22:50 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:50 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 01:22:51 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 01:22:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 01:22:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:22:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:22:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:22:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:22:51 INFO - no previously-included directories found matching 'docs/_build' 01:22:51 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 01:22:51 INFO - Running setup.py install for pep8 01:22:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:22:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:22:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:22:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:22:51 INFO - no previously-included directories found matching 'docs/_build' 01:22:51 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 01:22:51 INFO - Successfully installed flake8 mccabe pyflakes pep8 01:22:51 INFO - Cleaning up... 01:22:51 INFO - Return code: 0 01:22:51 INFO - Running post-action listener: _resource_record_post_action 01:22:51 INFO - Running post-action listener: _start_resource_monitoring 01:22:51 INFO - Starting resource monitoring. 01:22:51 INFO - ##### 01:22:51 INFO - ##### Running install step. 01:22:51 INFO - ##### 01:22:51 INFO - Running pre-action listener: _resource_record_pre_action 01:22:51 INFO - Running main action method: install 01:22:51 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:22:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:22:51 INFO - Reading from file tmpfile_stdout 01:22:51 INFO - Detecting whether we're running mozinstall >=1.0... 01:22:51 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 01:22:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 01:22:51 INFO - Reading from file tmpfile_stdout 01:22:51 INFO - Output received: 01:22:51 INFO - Usage: mozinstall [options] installer 01:22:51 INFO - Options: 01:22:51 INFO - -h, --help show this help message and exit 01:22:51 INFO - -d DEST, --destination=DEST 01:22:51 INFO - Directory to install application into. [default: 01:22:51 INFO - "/builds/slave/test-pgo"] 01:22:51 INFO - --app=APP Application being installed. [default: firefox] 01:22:51 INFO - mkdir: /builds/slave/test-pgo/build/application 01:22:51 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 01:22:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 01:23:06 INFO - Reading from file tmpfile_stdout 01:23:06 INFO - Output received: 01:23:06 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 01:23:06 INFO - Running post-action listener: _resource_record_post_action 01:23:06 INFO - ##### 01:23:06 INFO - ##### Running run-tests step. 01:23:06 INFO - ##### 01:23:06 INFO - Running pre-action listener: _resource_record_pre_action 01:23:06 INFO - Running main action method: run_tests 01:23:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 01:23:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 01:23:06 INFO - Python 2.7.3 01:23:06 INFO - Return code: 0 01:23:06 INFO - grabbing minidump binary from tooltool 01: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')]} 01:23:06 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 0x107ca50>, '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 0xfe8550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfe89e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 01:23:06 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 01:23:06 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 01:23:06 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:23:06 INFO - Return code: 0 01:23:06 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 01:23:06 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 01:23:06 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 01:23:06 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 01:23:06 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 01:23:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 01:23:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 01:23:07 INFO - Return code: 0 01:23:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 01:23:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-007 --webServer localhost 01:23:07 INFO - Using env: {'DISPLAY': ':0', 01:23:07 INFO - 'HOME': '/home/cltbld', 01:23:07 INFO - 'LANG': 'en_US.UTF-8', 01:23:07 INFO - 'LANGUAGE': 'en_US:en', 01:23:07 INFO - 'LOGNAME': 'cltbld', 01:23:07 INFO - 'MAIL': '/var/mail/cltbld', 01:23:07 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:23:07 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 01:23:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:23:07 INFO - 'MOZ_NO_REMOTE': '1', 01:23:07 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:23:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:23:07 INFO - 'NO_EM_RESTART': '1', 01:23:07 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:23:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:23:07 INFO - 'PWD': '/builds/slave/test-pgo', 01:23:07 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 01:23:07 INFO - 'SHELL': '/bin/bash', 01:23:07 INFO - 'SHLVL': '1', 01:23:07 INFO - 'TERM': 'linux', 01:23:07 INFO - 'TMOUT': '86400', 01:23:07 INFO - 'USER': 'cltbld', 01:23:07 INFO - 'XDG_SESSION_COOKIE': '6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148', 01:23:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:23:07 INFO - '_': '/tools/buildbot/bin/python'} 01:23:07 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost'] with output_timeout 3600 01:23:07 INFO - mozversion INFO | application_buildid: 20151214122127 01:23:07 INFO - mozversion INFO | application_changeset: e2031358e2a6d6d686b7a6b592d07cfb874bacae 01:23:07 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 01:23:07 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:23:07 INFO - mozversion INFO | application_name: Firefox 01:23:07 INFO - mozversion INFO | application_remotingname: firefox-dev 01:23:07 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 01:23:07 INFO - mozversion INFO | application_vendor: Mozilla 01:23:07 INFO - mozversion INFO | application_version: 45.0a2 01:23:07 INFO - mozversion INFO | platform_buildid: 20151214122127 01:23:07 INFO - mozversion INFO | platform_changeset: e2031358e2a6d6d686b7a6b592d07cfb874bacae 01:23:07 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 01:23:07 INFO - mozversion INFO | platform_version: 45.0a2 01:23:07 INFO - 2015-12-15 01:23:07,501 DEBUG : using testdate: 1450171387 01:23:07 INFO - 2015-12-15 01:23:07,501 DEBUG : actual date: 1450171387 01:23:07 INFO - 2015-12-15 01:23:07,549 INFO : starting webserver on 'localhost:33777' 01:23:07 INFO - 2015-12-15 01:23:07,550 INFO : Starting test suite talos-linux64-ix-007.e 01:23:07 INFO - 2015-12-15 01:23:07,550 INFO : Starting test dromaeo_css 01:23:07 INFO - 2015-12-15 01:23:07,550 DEBUG : operating with platform_type : linux_ 01:23:07 INFO - 2015-12-15 01:23:07,551 INFO : Initialising browser for dromaeo_css test... 01:23:07 INFO - 2015-12-15 01:23:07,564 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUaYh6v/profile http://localhost:33777/getInfo.html 01:23:12 INFO - 2015-12-15 01:23:12,349 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:23:12 INFO - 2015-12-15 01:23:12,349 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:23:12 INFO - 2015-12-15 01:23:12,349 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:23:12 INFO - 2015-12-15 01:23:12,349 DEBUG : BROWSER_OUTPUT: __metrics 01:23:13 INFO - 2015-12-15 01:23:13,321 INFO : Browser initialized. 01:23:13 INFO - 2015-12-15 01:23:13,322 INFO : Running cycle 1/1 for dromaeo_css test... 01:23:13 INFO - 2015-12-15 01:23:13,322 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUaYh6v/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:23:25 INFO - 2015-12-15 01:23:25,142 DEBUG : BROWSER_OUTPUT: RSS: Main: 138522624 01:23:25 INFO - 2015-12-15 01:23:25,142 DEBUG : BROWSER_OUTPUT: 01:24:14 INFO - 2015-12-15 01:24:14,753 DEBUG : BROWSER_OUTPUT: 1450171454751 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] 01:26:22 INFO - 2015-12-15 01:26:22,829 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33777/tests/dromaeo/cssquery-ext.html) 01:26:23 INFO - 2015-12-15 01:26:23,894 DEBUG : BROWSER_OUTPUT: RSS: Main: 142069760 01:26:23 INFO - 2015-12-15 01:26:23,894 DEBUG : BROWSER_OUTPUT: 01:29:25 INFO - 2015-12-15 01:29:25,706 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-ext.html (next: http://localhost:33777/tests/dromaeo/cssquery-jquery.html) 01:29:26 INFO - 2015-12-15 01:29:26,287 DEBUG : BROWSER_OUTPUT: RSS: Main: 140222464 01:29:26 INFO - 2015-12-15 01:29:26,288 DEBUG : BROWSER_OUTPUT: 01:32:27 INFO - 2015-12-15 01:32:27,874 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33777/tests/dromaeo/cssquery-mootools.html) 01:32:28 INFO - 2015-12-15 01:32:28,455 DEBUG : BROWSER_OUTPUT: RSS: Main: 139051008 01:32:28 INFO - 2015-12-15 01:32:28,455 DEBUG : BROWSER_OUTPUT: 01:35:30 INFO - 2015-12-15 01:35:30,001 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33777/tests/dromaeo/cssquery-prototype.html) 01:35:30 INFO - 2015-12-15 01:35:30,588 DEBUG : BROWSER_OUTPUT: RSS: Main: 138932224 01:35:30 INFO - 2015-12-15 01:35:30,588 DEBUG : BROWSER_OUTPUT: 01:38:32 INFO - 2015-12-15 01:38:32,845 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33777/tests/dromaeo/cssquery-yui.html) 01:38:33 INFO - 2015-12-15 01:38:33,446 DEBUG : BROWSER_OUTPUT: RSS: Main: 139247616 01:38:33 INFO - 2015-12-15 01:38:33,447 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,465 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/dromaeo/cssquery-yui.html (next: http://localhost:33777/tests/dromaeo/cssquery-dojo.html) 01:41:35 INFO - 2015-12-15 01:41:35,711 DEBUG : BROWSER_OUTPUT: RSS: Main: 142393344 01:41:35 INFO - 2015-12-15 01:41:35,711 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,711 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:41:35 INFO - 2015-12-15 01:41:35,711 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:41:35 INFO - 2015-12-15 01:41:35,712 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:41:35 INFO - 2015-12-15 01:41:35,712 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:41:35 INFO - 2015-12-15 01:41:35,712 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3349.1124851914237;3410.3520331137083;3415.897523074308;3421.692047715705;3447.4311738563138;5650.152477128433;5654.943450565504;5669.348024977129;5672.886542269152;5680.715964201794;5682.744276507557;5708.37207907131;5730.79942202023;5736.913946290809;5739.913901291484;5213.869653258661;5230.633855630107;5254.92117618236;5292.285541451894;5306.442823503535;5141.665791723544;5163.225516172567;5235.397929238148;5287.576993840484;5324.627276090656;5206.531412172903;5305.283786688806;5313.20301954708;5315.734213289339;5317.521423071923;5325.600579956499;5370.248165256867;5373.785048598052;5377.569794416457;5391.218273350381;5053.646244762831;5117.692938423669;5143.485651434864;5270.446603106695;5275.947240527584;5561.610687251894;5569.972150139223;5605.579581531401;5609.186667933127;5630.859228519279;6214.067889816519;6230.971889638249;6255.280642726099;6276.058591211309;6282.717277722513;5948.583599148062;6065.514758819328;6125.632272693312;6282.87434251317;6311.7159727811895;5822.980978328776;5888.381719919433;5943.970280148572;5955.34491205967;5969.940300596982;6435.485161187094;6447.25856526496;6474.741010359533;6478.449331806849;6481.09264702942;5811.82564523065;5995.580309378389;6133.509319254449;6210.72051757672;6218.22272215973;6304.873902521924;6321.873562528724;6343.682815859189;6361.236651601837;6383.616982981036;6081.087836824512;6276.560640755103;6277.968610157011;6294.779682711083;6320.683965801783;6078.1186727924205;6099.024156134997;6158.568900176944;6208.161898143693;6214.161088253119;4738.336632871401;4754.09672162295;4756;4777.235642297216;4789.401324834395;4155.792210389468;4237.067845074079;4265.97867010663;4280.165367753259;4287.614114729689;5680.488756011896;5747.626404283708;5762.711864406763;5768.192453056576;5836.562257830595;6217.4715149212825;6232.56372053961;6240.500759939194;6244.188255526843;6252.03093520496;5707.6575405475805;5709.914351284734;5812.128180772918;5823.068309070529;5881.852953676193;5453.918191227135;5469.097598896137;5497.835064947978;5500.834974950758;5500.944990550123;6457.483401327882;6461.418472337512;6527.902081468782;6544.836379090466;6547.770828020996;6126.090206827809;6133.172021777182;6180.845478862884;6240.407161319849;6352.555321127476;6282.748690052346;6285.402886725754;6338.334474880071;6348.365163483615;6371.872562548816;6169.907451388143;6193.628382296896;6195.1636529068;6197.752089916353;6206.472449841814;6110.450059494667;6125.84596676928;6187.690615469119;6240.5319601031015;6243.906341404973;6129.754809807558;6179;6190.938090619036;6191.7523299069335;6238.563300568917;5843.181954526454;6182.969085154546;6186.505079593531;6237.5321850860455;6240.12638230639;5833;5899.144624029406;5918.408159184047;5920.644761314335;5941.22764040672;6058.27300723916;6137.508999279958;6182.690865456799;6195.2255968004;6195.690215489298;5664.518515926193;5850.912236316373;6039.456448919618;6057.061155520902;6061.060535616986 01:41:35 INFO - 2015-12-15 01:41:35,713 DEBUG : BROWSER_OUTPUT: |1;ext.html;583.2738240890093;613.8588124731309;631.8767840271146;634.451199712249;635.6408629124546;43063.78468107659;43683.34474982878;43727.78136109315;43757.78121109394;43786.56213437865;46769.7661511692;47262.29106563396;47286.52713472864;47295.52704472954;47648.52351476493;9108.726738197847;9270.21203197729;9288.071192880725;9352.205062569656;9372.109649583279;9047.457152570834;9117.179453849152;9169;9177.908220917805;9193.12665296799;9151.67969121081;9152.908470915272;9182.449053056804;9205.263578913704;9209.217216536603;9119.316051296146;9206.999999999967;9233.676821311288;9255.629774809;9271.026542213072;7834.529928204326;7841.529508229524;7849.882251766228;7872.055353357577;7888.842223155562;44000.11999760019;44509.554904451186;44548;44561.33158002632;44619.33071003937;3542.6280240574624;3667.908302292464;3671;3727.5713292971113;3770.773753574767;32491.350172996645;32723.836380817942;32816.17959551007;32987;33332.6666733332;3961.207758448293;3973.304671682444;4028.47629808126;4041.191761647682;4073.8981525461804;294158;294909;295523;295647;485687.57156214345;68120.65939670369;68429.31570684329;68556.31443685599;69003;69147;73081;73543.26456735471;73743;73748.26251737522;73904.26095739081;15836.841631583537;15983.840161598235;16004;16061.11663858499;16074.598135046717;12564.057695672862;12751.553695620609;12755.93622031884;12763.106582539318;12820.166689165175;22442.214522491635;22685.773142268696;22736.886315568318;22792.544149116926;22919.312420627408;8413.45312554682;8615.439996400339;8658.78353041179;8676.132386761274;8880.911190888008;1102.7188067042853;1105.5412004018403;1209.171717373602;1217.6468824040928;1236.0424833847874;29879.253018674706;29992.55011174834;30327.393452130833;30716.69283307138;30752.231194219876;1100.2738192792879;1111.8888111188817;1125.0999200639455;1216.7688139253514;1221.1940119521073;15694.372225110868;15765.515047906883;16053.117078560792;16161.757573636405;17431.825681743274;773763;781027;782795;784150;826174;61417;61536.07695884565;61652.38347616556;61760;61993;1386.5493714542813;1493.7908692783237;1494.484402881026;1495.9252037398087;1507.2915729607066;31919.840400797846;31956.6804331963;32561.674383256814;33472.33055338831;34620.82689586536;57068.143977841195;57806;57931.13103303538;57979.4202057974;58104;322114;325724;327831;328174;328748;45512.31731524096;45950.77024614989;46763.53236467728;46907.296390553485;47133.52866471291;49836.75081624569;50426.49573504218;51437;51650.22524662208;51870.48129518657;41790;42601.78699106609;43754.56245437632;43815.56184438242;43981.56018439903;42633.78683106565;42723.57276427196;43070.56929430665;43734.34398484089;43779.343309851014;41997;42731.786341068095;42849.57150428581;43072.35391469068;43129.35305970476;36483;36941.63058369382;37509.81245093757;37883.242335152594;38187;27910.16269511918;28297.57553636656;28422.28944276327;28511.28721781972;28525.857370713013 01:41:35 INFO - 2015-12-15 01:41:35,717 DEBUG : BROWSER_OUTPUT: |2;jquery.html;389.8421139438525;393.24496965825614;394.35522920025767;394.5718894998926;401.07752170008973;16074.276657550408;17322.220500077496;17533.03568303743;18803.05984700763;18901.527461813443;11071.446427678624;11596.304221746701;11651.41742912853;18057.458276251702;18086.728699069492;4988.975055124737;5006.974965125179;5119.12974794284;5130.948690513084;5140.922886156711;5052.4189718182515;5241.2400201970695;5385.892282154355;5424.349078110632;5426.457354264562;5275.182346736243;5299.231611416342;5301.0723123453245;5336.919946200791;5384.434634363394;5607.130894711327;5611.494965453088;5613.943860561383;5623.325200975889;5627.915581266284;5390.9191362129595;5426.891462170774;5468.043092458844;5590.944090559083;5606.635568688022;12416.62750117489;12445.066620003445;12490.375481225994;12504.687382815411;12861.87138128616;2268.478250002492;2279.088364654135;2294.4378627236433;2312.075169932024;2335.859848409101;9259.583318750605;9476;10036.94981525095;12166.878331216663;13940.093893896965;1956.2859556261863;2008.1666108564928;2034.4529975504736;2152.989235053815;2177.934661960144;59207;59441.10838337428;60905.39094609086;62982.37017629811;63151.36848631547;11134.220604557604;11247.437628118561;11270.887291126985;11284.32294062359;11353;14385.136891786526;14465.78301325481;14508;14524.49164279245;14571.907106967019;7979.640916158787;7999.480033797901;8030.116687164407;8063.879041814377;8091.716789912442;7798.454108212371;7921.1682773307975;7941.6029198539845;7977.3618110551015;8047.718329858427;4762.880927976828;4771.5467030632035;4802.447718512346;4898.583620392235;4926.45808961014;1739.869509786771;1785.580388608676;1800.1089460717028;1928.7299778031088;1961.6174845905198;452.15672770283186;474.2672570878002;484.2204051477119;1005.1506477026901;1041.5156952017348;11245.775084498428;11403.916627920335;11501.597444089417;11529.538818447336;11549.88450115505;499.65841714995355;935.373299889076;1033.245730616654;1038.2887721910515;1073.3291692692067;9654.131128198496;10036.949815250877;10074.445905475122;10259.640912568024;10368.377897326185;486182;487862;493254;558097;680875;84399;84530.57734711288;87454.56272718596;89065;90920;1206.5776978057609;1229.2317301686446;1236.4003458322707;1249.8625151233357;1252.3800718644147;16750.832491675414;16853.325866965184;16870.240839162023;16964.406245781338;17204.483865484057;37790.62209377871;38445.423318649686;39178.60821391863;39184.412233817086;39785.80107099446;50059.74970125126;51106;52149;54141.18788218101;55860.72069639626;10033.899661003297;10498.055175034284;10598.841017384899;10603.628872989408;10658.573657053632;14078.718425631225;15404.69190616159;17808.643827123127;17884.10579471047;18009.00950447738;14712.485063022743;14720.705585888436;14726.558203253919;14996.175210363535;15213.923930380277;14498.130112193303;14769.335379907716;14787.482438115045;14887.95784295089;15023.02350347224;14947.551573452814;15127.01674391161;15379.231038448257;15491.30289136969;15804.209789510709;10461.110805581611;10561;10602.469876506299;10624.096951759188;10675.626353077605;14898.702025959637;15524.922375388503;15586.06483610987;15779.132147731985;15852.048877067413 01:41:35 INFO - 2015-12-15 01:41:35,717 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1577.9763303550455;1595.0429742154708;1731.398456427804;1813.6735387630226;1871.2608519634741;7426.740064097758;7548.773536793891;7798.92201077989;8057.919420805798;8086.150954149818;7937.20627937206;8082.878756818638;8180.836383272346;8183.058948220956;8189.426740128179;2403.4592216751266;2441.401856545149;2447.5472037673;2448.0574978633176;2449.7795198432136;2458.557459657261;2471.666325046123;2479.404942813721;2488.5271798358344;2490.9750902490923;2367.171489978511;2404.843685160468;2406.7713567211085;2415.6014257647466;2445.76765207305;2360.8583484990786;2410.8794560272004;2419.14120487228;2425.963610545843;2442.31615147758;2387.5224955008894;2442.804575633945;2463.027104293812;2474.208253358926;2475.6781618389673;8313.41806073575;8360.414770966036;8377.539235342054;8400.495970241744;8434.114417986146;5047.520485553867;5113.565346945514;5120.411152717448;5138.2549530318265;5146.228065790124;3151.196444906557;3170.461021626329;3180.7296379807744;3236.996531075374;3254.251522149919;1037.3464717228098;1041.0526420956892;1042.5464922758624;1059.6185373265619;1064.9520771565299;11703.7074073148;11715.121365897592;11731.296122232694;11770.293782372999;11796.646100616996;4447.688661793708;4449.599536041772;4502.234620114588;4510.774461276923;4533.798543386005;9851.064148905842;9857.30998830075;9903.207743380512;9921.206303495703;9936.155426788804;5052.242163675478;5062.670926389773;5094.2103973884105;5102.897942041139;5110.591152707774;4467.5532446755715;4542.046170304273;4561.133384656904;4564.315352697122;4614.423197100363;3715.498407714924;3716.7398282119993;3720.739548231598;3745.6441638044344;3761.153740408441;1150.9021733152608;1151.2114201771813;1151.2344291046527;1152.3086148310947;1162.128403697227;1150.0339714639742;1164.0861923390098;1168.8538932633421;1178.6935396796894;1229.6987238126537;7997;8045.396595255263;8051.4766540174705;8091.797705057421;8128.512289262663;1160.1646814293695;1194.856617205941;1222.3643705273387;1224.74280401115;1231.8891299783063;6280.905786413207;6331.303556608769;6370.522210834206;6385.138006369174;6399.104125422445;10165.440900750382;10271.589136434608;10314.226433017404;10359.274850760374;10384;9902.108810206972;10142;10185.94907025475;10192.898071019343;10235.078842904175;7957.442978991415;7977.5612341321785;7993.520388776692;8064.516129032277;8083.7170699025255;7618.923810762043;7636.579988100486;7641.121271053677;7655.732049378245;7757.650905709143;8787.340949428946;9066.138716821892;9086.681966131153;9112.908870911206;9165.816683666157;9027.14242146995;9187.77030574241;9235.907640923504;9273.30450216223;9349.158575728217;7218.386437152691;7260.310270524292;7375.078115235596;7615.695372185272;7620.809479762828;8058.435909486514;8067.830164625979;8084.9191508086515;8094.473859199134;8096.919030809617;7512.173660897406;7750.379969602531;7760.146383897654;7762.573058481612;7855.293023627901;7575.0909890813455;7610.238976102345;7636.427267955037;7702.614869256627;7727;7612.619369031637;7662.655180516778;7669.271419215165;7677.193894640982;7680.884786728092;6851.588904665736;6917.23910369869;6932.653367331714;6951.0616066830335;7060.046893669494;6668.76659316941;6673.232578253563;6701.0953521274005;6706.698198580978;6711.161104861892 01:41:35 INFO - 2015-12-15 01:41:35,720 DEBUG : BROWSER_OUTPUT: |4;prototype.html;360.3909393125617;361.50473850824375;367.2416460010079;369.51962448816533;369.78737226094984;6404;6431.035344698297;6454.806355809322;6479.125318082051;6533.738650453976;6371.394717501841;6385.840353991141;6412.679366031692;6446.580972236801;6459.838504037401;4893.730844803535;4900;4903.166461701501;4910.361652985107;4916.237983112624;4907.043126590316;4915.8525244242555;4921.729304888229;4924.2121260598315;4931.358923339961;4728.385309909707;4746.928796068062;4799.376081109451;4802.83190088347;4803.207470767319;4771.23660214364;4781.569658730714;4785.641076919228;4790.5448982346625;4794.640401969867;4190.455240818674;4200.180964711883;4214.325707886754;4214.494260688706;4235.512916014667;6111.694415279218;6143.477804386633;6147.907781383283;6156.7845125420845;6164.3835616438;5528.55771538276;5641.153826925953;5642.069058605325;5659.717014149317;5669.149627555899;6738.898916516257;6751.932480675228;6785.117934668511;6804.795856124324;6807.489438292098;4669.015668340975;4680.859574212745;4683.320918466803;4683.555062269079;4690.906181876343;6865.794026179223;6995.965020174866;7023.33278338557;7062.929370706279;7121.2878712128895;4689.109069276827;4697.929531057037;4698.060387922429;4703.482616912137;4704.929426058612;4722.716637001791;4769.809207631725;4772.7136371817805;4777.570018698334;4777.737224452689;5554;5568.081266591048;5570.220169176318;5571.721413929287;5573.386927437979;6678.465722742169;6804.523683342119;6860.5540639858245;6861.2795656455355;6875.5530890491955;1699.031552015364;1724.5257554172704;1724.5947202407424;1726.3957614834708;1728.6456276463546;1145.828125781123;1163.1044096046166;1166.2069792540983;1173.642039178059;1178.80549709297;6533.967330163318;6548.952167653152;6557.639329836809;6585.275619681831;6617.735290588419;7042;7079.1505019398;7081.645917704094;7093.184283807325;7095.361417472349;6308.558400911984;6360.872782544323;6596.670166491656;6601.73593056282;6669.09967154428;3851.730378873508;3857.3828187489867;3859.6333348331864;3866.478025466582;3874.3994680824517;7279.672414741243;7294;7311;7323.084614423197;7354.154272258758;7173.92826071743;7280.890786638205;7311.817204569928;7319.743808966767;7343.3390994810725;7296.96351518239;7346.52247603904;7347.669354879044;7356.485046046832;7369.852602947911;7120.323569260912;7156.642167891689;7165.820854478679;7166.53417527859;7178.353948144692;6815.182178138655;7056.682449289691;7057.682404291717;7066.258042905421;7086.326798954091;7338.889916651147;7403.777886663409;7404.629768511445;7406.44451666138;7408.555486670817;4793.904121917472;4820.903581928412;4826.3243145958895;4835.419749630067;4836.250381190921;6948.305169483011;7130.465215108784;7149.499535032498;7182.712691492282;7194.028806111108;6968.7212511501;6973.5118541701595;6982.406495447944;6992.195897471653;6992.1958974718555;6805;6922;6952.339527744856;6968.303169682991;6986.720531178696;6756.256811750605;6779.186497620317;6811.9659401702675;6813.2846051163915;6815.284395138439;6972.198197207386;7013.438924886099;7015.052967849275;7026;7047.7180912762915;6702.865942681022;6822.590644561342;6837.62393068386;6844.828879278058;6853.828654283683 01:41:35 INFO - 2015-12-15 01:41:35,722 DEBUG : BROWSER_OUTPUT: |5;yui.html;768.3200367674606;781.6052893288888;848.1857416879795;865.3423398217353;935.7941252924359;14343.569692909216;14987.025843320176;14995;15059.397624095023;15075.77386339203;13583.117097388687;13719.725605487909;13726.656833579165;13741.450341986309;13744.312784360767;890.7461373508552;899.8155378147496;914.5381582300929;923.2014307623924;924.9075092490731;858.2704701004159;902.8916530016407;909.3180114913814;909.56340956341;914.0402577293814;951.7240000399876;956.2350119904083;956.6364781383064;956.7368973532265;958.8034452937131;936.3024546712709;945.1965829045291;949.8385274503316;951.7382719752054;954.2127744610724;704.2851505721696;708.1572928215408;709.9183593886718;710.733474946895;711.6228398948566;15020.248987550578;15061.322240499094;15144.242787860672;15151.621209469742;15156.621084472867;12930;12998.675033124153;13035.934820325932;13252.597055754886;13537.05240633156;11369.147313951487;11375.886241137565;11549.076073914151;11662.183647144704;11877.287362758263;3910.491636087319;4016.4376987221813;4019.5980401959864;4083.040485485938;4118.094019315746;53652.73173634146;54211.457885421034;54721;54723;54748.726256368864;10413.895861041292;10498.317609355367;10893.509792059376;10908.563657453613;11062.502187401586;19510.60978780445;19603;19620.70568941467;19629.31297404584;19639;7635.541867487968;7732.922670773332;7786.961065194638;7788.805279868048;7968.681252749941;4262.509811371732;4369.519352871245;4456.17560751262;4477.686561940698;4559;3354.463285874297;3357.916052098717;3372.983135084358;3395.864165433404;3399.6770306820813;622.0793226025507;626.7023163997156;629.0501342972145;641.5124505375948;642.6915080761167;701.4984286235264;704.2886684448641;704.5913370245246;708.5996412027188;719.9856002879914;8039.422457006693;8217.219364160395;8248.587570621445;8288.83422331562;8316.750497485085;718.3463048625725;728.1226122522348;756.6029222920306;757.3675980556187;773.439256539016;3966.8413263469715;4508.458984921765;4513.593089121068;4605.263157894721;4647.465541462708;57800.42199577951;61289.69355153285;62929.37070629235;65610.67194663997;66341;54513.45486545084;54664;56007;56335.71832140813;56712.716436417555;50187.74906125519;50866.74566627143;50979.49020509821;51025.48974510356;51096;9467.431954082776;9579;9646.565904534173;9659.71020869375;9692.75768105803;36705.816470917474;37728.81135594304;37881.24237515289;37993.62006380012;38949.22101558009;49118.26322605092;49271;49883;49995.250071248236;50601.49398505968;11745.588904388305;11874;11954.940225298818;12407.875921241033;12422.813657795321;13295.20228786276;13727.658097622569;13956.651083722989;14157.787633185304;14337.56987290383;12285.262884226975;12604.495820167458;12666.683332916382;12728.427220774902;12918.160319579198;11680.591179308683;11954.462049207981;11998.880011199777;12358.876411235773;12455.93772031134;12077.27536347822;12221.144519883523;12410.317432541297;12451.626451206479;12706.110572259853;10295.12491438236;10805.297655652357;11033.668989930315;11176.552937882394;11624.186306958432;10219.080282774587;10299.639512617023;10470.842937355794;10783.568657253621;10788.676339709822 01:41:35 INFO - 2015-12-15 01:41:35,722 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:41:35 INFO - 2015-12-15 01:41:35,722 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:41:35 INFO - 2015-12-15 01:41:35,723 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,293 01:41:35 INFO - 2015-12-15 01:41:35,723 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:41:35 INFO - 2015-12-15 01:41:35,723 DEBUG : BROWSER_OUTPUT: __startTimestamp1450172495710__endTimestamp 01:41:35 INFO - 2015-12-15 01:41:35,723 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,724 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:41:35 INFO - 2015-12-15 01:41:35,724 DEBUG : BROWSER_OUTPUT: Number of tests: 6 01:41:35 INFO - 2015-12-15 01:41:35,724 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,725 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5767.09 Median:5948.58 stddev:659.67 (11.1%) stddev-sans-first:633.84 01:41:35 INFO - 2015-12-15 01:41:35,725 DEBUG : BROWSER_OUTPUT: Values: 3349.1 3410.4 3415.9 3421.7 3447.4 5650.2 5654.9 5669.3 5672.9 5680.7 5682.7 5708.4 5730.8 5736.9 5739.9 5213.9 5230.6 5254.9 5292.3 5306.4 5141.7 5163.2 5235.4 5287.6 5324.6 5206.5 5305.3 5313.2 5315.7 5317.5 5325.6 5370.2 5373.8 5377.6 5391.2 5053.6 5117.7 5143.5 5270.4 5275.9 5561.6 5570.0 5605.6 5609.2 5630.9 6214.1 6231.0 6255.3 6276.1 6282.7 5948.6 6065.5 6125.6 6282.9 6311.7 5823.0 5888.4 5944.0 5955.3 5969.9 6435.5 6447.3 6474.7 6478.4 6481.1 5811.8 5995.6 6133.5 6210.7 6218.2 6304.9 6321.9 6343.7 6361.2 6383.6 6081.1 6276.6 6278.0 6294.8 6320.7 6078.1 6099.0 6158.6 6208.2 6214.2 4738.3 4754.1 4756.0 4777.2 4789.4 4155.8 4237.1 4266.0 4280.2 4287.6 5680.5 5747.6 5762.7 5768.2 5836.6 6217.5 6232.6 6240.5 6244.2 6252.0 5707.7 5709.9 5812.1 5823.1 5881.9 5453.9 5469.1 5497.8 5500.8 5500.9 6457.5 6461.4 6527.9 6544.8 6547.8 6126.1 6133.2 6180.8 6240.4 6352.6 6282.7 6285.4 6338.3 6348.4 6371.9 6169.9 6193.6 6195.2 6197.8 6206.5 6110.5 6125.8 6187.7 6240.5 6243.9 6129.8 6179.0 6190.9 6191.8 6238.6 5843.2 6183.0 6186.5 6237.5 6240.1 5833.0 5899.1 5918.4 5920.6 5941.2 6058.3 6137.5 6182.7 6195.2 6195.7 5664.5 5850.9 6039.5 6057.1 6061.1 01:41:35 INFO - 2015-12-15 01:41:35,725 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,725 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:65774.11 Median:43705.56 stddev:143011.36 (327.2%) stddev-sans-first:143328.78 01:41:35 INFO - 2015-12-15 01:41:35,727 DEBUG : BROWSER_OUTPUT: Values: 583.3 613.9 631.9 634.5 635.6 43063.8 43683.3 43727.8 43757.8 43786.6 46769.8 47262.3 47286.5 47295.5 47648.5 9108.7 9270.2 9288.1 9352.2 9372.1 9047.5 9117.2 9169.0 9177.9 9193.1 9151.7 9152.9 9182.4 9205.3 9209.2 9119.3 9207.0 9233.7 9255.6 9271.0 7834.5 7841.5 7849.9 7872.1 7888.8 44000.1 44509.6 44548.0 44561.3 44619.3 3542.6 3667.9 3671.0 3727.6 3770.8 32491.4 32723.8 32816.2 32987.0 33332.7 3961.2 3973.3 4028.5 4041.2 4073.9 294158.0 294909.0 295523.0 295647.0 485687.6 68120.7 68429.3 68556.3 69003.0 69147.0 73081.0 73543.3 73743.0 73748.3 73904.3 15836.8 15983.8 16004.0 16061.1 16074.6 12564.1 12751.6 12755.9 12763.1 12820.2 22442.2 22685.8 22736.9 22792.5 22919.3 8413.5 8615.4 8658.8 8676.1 8880.9 1102.7 1105.5 1209.2 1217.6 1236.0 29879.3 29992.6 30327.4 30716.7 30752.2 1100.3 1111.9 1125.1 1216.8 1221.2 15694.4 15765.5 16053.1 16161.8 17431.8 773763.0 781027.0 782795.0 784150.0 826174.0 61417.0 61536.1 61652.4 61760.0 61993.0 1386.5 1493.8 1494.5 1495.9 1507.3 31919.8 31956.7 32561.7 33472.3 34620.8 57068.1 57806.0 57931.1 57979.4 58104.0 322114.0 325724.0 327831.0 328174.0 328748.0 45512.3 45950.8 46763.5 46907.3 47133.5 49836.8 50426.5 51437.0 51650.2 51870.5 41790.0 42601.8 43754.6 43815.6 43981.6 42633.8 42723.6 43070.6 43734.3 43779.3 41997.0 42731.8 42849.6 43072.4 43129.4 36483.0 36941.6 37509.8 37883.2 38187.0 27910.2 28297.6 28422.3 28511.3 28525.9 01:41:35 INFO - 2015-12-15 01:41:35,727 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,727 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:29334.89 Median:1942.51 stddev:89476.16 (4606.2%) stddev-sans-first:89700.76 01:41:35 INFO - 2015-12-15 01:41:35,729 DEBUG : BROWSER_OUTPUT: Values: 389.8 393.2 394.4 394.6 401.1 16074.3 17322.2 17533.0 18803.1 18901.5 11071.4 11596.3 11651.4 18057.5 18086.7 4989.0 5007.0 5119.1 5130.9 5140.9 5052.4 5241.2 5385.9 5424.3 5426.5 5275.2 5299.2 5301.1 5336.9 5384.4 5607.1 5611.5 5613.9 5623.3 5627.9 5390.9 5426.9 5468.0 5590.9 5606.6 12416.6 12445.1 12490.4 12504.7 12861.9 2268.5 2279.1 2294.4 2312.1 2335.9 9259.6 9476.0 10036.9 12166.9 13940.1 1956.3 2008.2 2034.5 2153.0 2177.9 59207.0 59441.1 60905.4 62982.4 63151.4 11134.2 11247.4 11270.9 11284.3 11353.0 14385.1 14465.8 14508.0 14524.5 14571.9 7979.6 7999.5 8030.1 8063.9 8091.7 7798.5 7921.2 7941.6 7977.4 8047.7 4762.9 4771.5 4802.4 4898.6 4926.5 1739.9 1785.6 1800.1 1928.7 1961.6 452.2 474.3 484.2 1005.2 1041.5 11245.8 11403.9 11501.6 11529.5 11549.9 499.7 935.4 1033.2 1038.3 1073.3 9654.1 10036.9 10074.4 10259.6 10368.4 486182.0 487862.0 493254.0 558097.0 680875.0 84399.0 84530.6 87454.6 89065.0 90920.0 1206.6 1229.2 1236.4 1249.9 1252.4 16750.8 16853.3 16870.2 16964.4 17204.5 37790.6 38445.4 39178.6 39184.4 39785.8 50059.7 51106.0 52149.0 54141.2 55860.7 10033.9 10498.1 10598.8 10603.6 10658.6 14078.7 15404.7 17808.6 17884.1 18009.0 14712.5 14720.7 14726.6 14996.2 15213.9 14498.1 14769.3 14787.5 14888.0 15023.0 14947.6 15127.0 15379.2 15491.3 15804.2 10461.1 10561.0 10602.5 10624.1 10675.6 14898.7 15524.9 15586.1 15779.1 15852.0 01:41:35 INFO - 2015-12-15 01:41:35,729 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,729 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5875.68 Median:5116.99 stddev:3075.79 (60.1%) stddev-sans-first:3067.46 01:41:35 INFO - 2015-12-15 01:41:35,731 DEBUG : BROWSER_OUTPUT: Values: 1578.0 1595.0 1731.4 1813.7 1871.3 7426.7 7548.8 7798.9 8057.9 8086.2 7937.2 8082.9 8180.8 8183.1 8189.4 2403.5 2441.4 2447.5 2448.1 2449.8 2458.6 2471.7 2479.4 2488.5 2491.0 2367.2 2404.8 2406.8 2415.6 2445.8 2360.9 2410.9 2419.1 2426.0 2442.3 2387.5 2442.8 2463.0 2474.2 2475.7 8313.4 8360.4 8377.5 8400.5 8434.1 5047.5 5113.6 5120.4 5138.3 5146.2 3151.2 3170.5 3180.7 3237.0 3254.3 1037.3 1041.1 1042.5 1059.6 1065.0 11703.7 11715.1 11731.3 11770.3 11796.6 4447.7 4449.6 4502.2 4510.8 4533.8 9851.1 9857.3 9903.2 9921.2 9936.2 5052.2 5062.7 5094.2 5102.9 5110.6 4467.6 4542.0 4561.1 4564.3 4614.4 3715.5 3716.7 3720.7 3745.6 3761.2 1150.9 1151.2 1151.2 1152.3 1162.1 1150.0 1164.1 1168.9 1178.7 1229.7 7997.0 8045.4 8051.5 8091.8 8128.5 1160.2 1194.9 1222.4 1224.7 1231.9 6280.9 6331.3 6370.5 6385.1 6399.1 10165.4 10271.6 10314.2 10359.3 10384.0 9902.1 10142.0 10185.9 10192.9 10235.1 7957.4 7977.6 7993.5 8064.5 8083.7 7618.9 7636.6 7641.1 7655.7 7757.7 8787.3 9066.1 9086.7 9112.9 9165.8 9027.1 9187.8 9235.9 9273.3 9349.2 7218.4 7260.3 7375.1 7615.7 7620.8 8058.4 8067.8 8084.9 8094.5 8096.9 7512.2 7750.4 7760.1 7762.6 7855.3 7575.1 7610.2 7636.4 7702.6 7727.0 7612.6 7662.7 7669.3 7677.2 7680.9 6851.6 6917.2 6932.7 6951.1 7060.0 6668.8 6673.2 6701.1 6706.7 6711.2 01:41:35 INFO - 2015-12-15 01:41:35,731 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,731 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5717.11 Median:6506.43 stddev:1750.92 (26.9%) stddev-sans-first:1709.04 01:41:35 INFO - 2015-12-15 01:41:35,733 DEBUG : BROWSER_OUTPUT: Values: 360.4 361.5 367.2 369.5 369.8 6404.0 6431.0 6454.8 6479.1 6533.7 6371.4 6385.8 6412.7 6446.6 6459.8 4893.7 4900.0 4903.2 4910.4 4916.2 4907.0 4915.9 4921.7 4924.2 4931.4 4728.4 4746.9 4799.4 4802.8 4803.2 4771.2 4781.6 4785.6 4790.5 4794.6 4190.5 4200.2 4214.3 4214.5 4235.5 6111.7 6143.5 6147.9 6156.8 6164.4 5528.6 5641.2 5642.1 5659.7 5669.1 6738.9 6751.9 6785.1 6804.8 6807.5 4669.0 4680.9 4683.3 4683.6 4690.9 6865.8 6996.0 7023.3 7062.9 7121.3 4689.1 4697.9 4698.1 4703.5 4704.9 4722.7 4769.8 4772.7 4777.6 4777.7 5554.0 5568.1 5570.2 5571.7 5573.4 6678.5 6804.5 6860.6 6861.3 6875.6 1699.0 1724.5 1724.6 1726.4 1728.6 1145.8 1163.1 1166.2 1173.6 1178.8 6534.0 6549.0 6557.6 6585.3 6617.7 7042.0 7079.2 7081.6 7093.2 7095.4 6308.6 6360.9 6596.7 6601.7 6669.1 3851.7 3857.4 3859.6 3866.5 3874.4 7279.7 7294.0 7311.0 7323.1 7354.2 7173.9 7280.9 7311.8 7319.7 7343.3 7297.0 7346.5 7347.7 7356.5 7369.9 7120.3 7156.6 7165.8 7166.5 7178.4 6815.2 7056.7 7057.7 7066.3 7086.3 7338.9 7403.8 7404.6 7406.4 7408.6 4793.9 4820.9 4826.3 4835.4 4836.3 6948.3 7130.5 7149.5 7182.7 7194.0 6968.7 6973.5 6982.4 6992.2 6992.2 6805.0 6922.0 6952.3 6968.3 6986.7 6756.3 6779.2 6812.0 6813.3 6815.3 6972.2 7013.4 7015.1 7026.0 7047.7 6702.9 6822.6 6837.6 6844.8 6853.8 01:41:35 INFO - 2015-12-15 01:41:35,733 DEBUG : BROWSER_OUTPUT: 01:41:35 INFO - 2015-12-15 01:41:35,733 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:15108.47 Median:4511.03 stddev:17573.75 (389.6%) stddev-sans-first:17590.05 01:41:35 INFO - 2015-12-15 01:41:35,734 DEBUG : BROWSER_OUTPUT: Values: 768.3 781.6 848.2 865.3 935.8 14343.6 14987.0 14995.0 15059.4 15075.8 13583.1 13719.7 13726.7 13741.5 13744.3 890.7 899.8 914.5 923.2 924.9 858.3 902.9 909.3 909.6 914.0 951.7 956.2 956.6 956.7 958.8 936.3 945.2 949.8 951.7 954.2 704.3 708.2 709.9 710.7 711.6 15020.2 15061.3 15144.2 15151.6 15156.6 12930.0 12998.7 13035.9 13252.6 13537.1 11369.1 11375.9 11549.1 11662.2 11877.3 3910.5 4016.4 4019.6 4083.0 4118.1 53652.7 54211.5 54721.0 54723.0 54748.7 10413.9 10498.3 10893.5 10908.6 11062.5 19510.6 19603.0 19620.7 19629.3 19639.0 7635.5 7732.9 7787.0 7788.8 7968.7 4262.5 4369.5 4456.2 4477.7 4559.0 3354.5 3357.9 3373.0 3395.9 3399.7 622.1 626.7 629.1 641.5 642.7 701.5 704.3 704.6 708.6 720.0 8039.4 8217.2 8248.6 8288.8 8316.8 718.3 728.1 756.6 757.4 773.4 3966.8 4508.5 4513.6 4605.3 4647.5 57800.4 61289.7 62929.4 65610.7 66341.0 54513.5 54664.0 56007.0 56335.7 56712.7 50187.7 50866.7 50979.5 51025.5 51096.0 9467.4 9579.0 9646.6 9659.7 9692.8 36705.8 37728.8 37881.2 37993.6 38949.2 49118.3 49271.0 49883.0 49995.3 50601.5 11745.6 11874.0 11954.9 12407.9 12422.8 13295.2 13727.7 13956.7 14157.8 14337.6 12285.3 12604.5 12666.7 12728.4 12918.2 11680.6 11954.5 11998.9 12358.9 12455.9 12077.3 12221.1 12410.3 12451.6 12706.1 10295.1 10805.3 11033.7 11176.6 11624.2 10219.1 10299.6 10470.8 10783.6 10788.7 01:41:35 INFO - 2015-12-15 01:41:35,735 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:41:35 INFO - 2015-12-15 01:41:35,735 DEBUG : BROWSER_OUTPUT: 01:41:36 INFO - 2015-12-15 01:41:36,322 INFO : Browser exited with error code: 0 01:41:36 INFO - 2015-12-15 01:41:36,343 INFO : Completed test dromaeo_css (00:18:28) 01:41:36 INFO - 2015-12-15 01:41:36,343 INFO : Starting test kraken 01:41:36 INFO - 2015-12-15 01:41:36,343 DEBUG : operating with platform_type : linux_ 01:41:36 INFO - 2015-12-15 01:41:36,343 INFO : Initialising browser for kraken test... 01:41:36 INFO - 2015-12-15 01:41:36,349 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpwk1ACA/profile http://localhost:33777/getInfo.html 01:41:40 INFO - 2015-12-15 01:41:40,816 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:41:40 INFO - 2015-12-15 01:41:40,816 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:41:40 INFO - 2015-12-15 01:41:40,817 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:41:40 INFO - 2015-12-15 01:41:40,817 DEBUG : BROWSER_OUTPUT: __metrics 01:41:41 INFO - 2015-12-15 01:41:41,821 INFO : Browser initialized. 01:41:41 INFO - 2015-12-15 01:41:41,822 INFO : Running cycle 1/1 for kraken test... 01:41:41 INFO - 2015-12-15 01:41:41,822 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpwk1ACA/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:41:53 INFO - 2015-12-15 01:41:53,620 DEBUG : BROWSER_OUTPUT: RSS: Main: 138338304 01:41:53 INFO - 2015-12-15 01:41:53,620 DEBUG : BROWSER_OUTPUT: 01:41:56 INFO - 2015-12-15 01:41:56,080 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33777/tests/kraken/driver.html?testName=audio-beat-detection) 01:41:56 INFO - 2015-12-15 01:41:56,681 DEBUG : BROWSER_OUTPUT: RSS: Main: 140038144 01:41:56 INFO - 2015-12-15 01:41:56,681 DEBUG : BROWSER_OUTPUT: 01:41:59 INFO - 2015-12-15 01:41:59,281 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33777/tests/kraken/driver.html?testName=audio-dft) 01:41:59 INFO - 2015-12-15 01:41:59,875 DEBUG : BROWSER_OUTPUT: RSS: Main: 138690560 01:41:59 INFO - 2015-12-15 01:41:59,876 DEBUG : BROWSER_OUTPUT: 01:42:02 INFO - 2015-12-15 01:42:02,662 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33777/tests/kraken/driver.html?testName=audio-fft) 01:42:03 INFO - 2015-12-15 01:42:03,244 DEBUG : BROWSER_OUTPUT: RSS: Main: 138715136 01:42:03 INFO - 2015-12-15 01:42:03,244 DEBUG : BROWSER_OUTPUT: 01:42:05 INFO - 2015-12-15 01:42:05,243 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33777/tests/kraken/driver.html?testName=audio-oscillator) 01:42:05 INFO - 2015-12-15 01:42:05,829 DEBUG : BROWSER_OUTPUT: RSS: Main: 138715136 01:42:05 INFO - 2015-12-15 01:42:05,829 DEBUG : BROWSER_OUTPUT: 01:42:08 INFO - 2015-12-15 01:42:08,015 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33777/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:42:08 INFO - 2015-12-15 01:42:08,596 DEBUG : BROWSER_OUTPUT: RSS: Main: 138940416 01:42:08 INFO - 2015-12-15 01:42:08,596 DEBUG : BROWSER_OUTPUT: 01:42:11 INFO - 2015-12-15 01:42:11,541 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33777/tests/kraken/driver.html?testName=imaging-darkroom) 01:42:12 INFO - 2015-12-15 01:42:12,143 DEBUG : BROWSER_OUTPUT: RSS: Main: 139603968 01:42:12 INFO - 2015-12-15 01:42:12,143 DEBUG : BROWSER_OUTPUT: 01:42:15 INFO - 2015-12-15 01:42:15,485 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33777/tests/kraken/driver.html?testName=imaging-desaturate) 01:42:16 INFO - 2015-12-15 01:42:16,071 DEBUG : BROWSER_OUTPUT: RSS: Main: 139870208 01:42:16 INFO - 2015-12-15 01:42:16,071 DEBUG : BROWSER_OUTPUT: 01:42:18 INFO - 2015-12-15 01:42:18,818 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33777/tests/kraken/driver.html?testName=json-parse-financial) 01:42:19 INFO - 2015-12-15 01:42:19,411 DEBUG : BROWSER_OUTPUT: RSS: Main: 137871360 01:42:19 INFO - 2015-12-15 01:42:19,411 DEBUG : BROWSER_OUTPUT: 01:42:20 INFO - 2015-12-15 01:42:20,932 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33777/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:42:21 INFO - 2015-12-15 01:42:21,506 DEBUG : BROWSER_OUTPUT: RSS: Main: 138276864 01:42:21 INFO - 2015-12-15 01:42:21,506 DEBUG : BROWSER_OUTPUT: 01:42:23 INFO - 2015-12-15 01:42:23,281 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:42:23 INFO - 2015-12-15 01:42:23,894 DEBUG : BROWSER_OUTPUT: RSS: Main: 138940416 01:42:23 INFO - 2015-12-15 01:42:23,894 DEBUG : BROWSER_OUTPUT: 01:42:25 INFO - 2015-12-15 01:42:25,934 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:42:26 INFO - 2015-12-15 01:42:26,520 DEBUG : BROWSER_OUTPUT: RSS: Main: 138936320 01:42:26 INFO - 2015-12-15 01:42:26,520 DEBUG : BROWSER_OUTPUT: 01:42:28 INFO - 2015-12-15 01:42:28,935 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:42:29 INFO - 2015-12-15 01:42:29,522 DEBUG : BROWSER_OUTPUT: RSS: Main: 139722752 01:42:29 INFO - 2015-12-15 01:42:29,522 DEBUG : BROWSER_OUTPUT: 01:42:32 INFO - 2015-12-15 01:42:32,042 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:42:32 INFO - 2015-12-15 01:42:32,624 DEBUG : BROWSER_OUTPUT: RSS: Main: 140550144 01:42:32 INFO - 2015-12-15 01:42:32,624 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,279 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33777/tests/kraken/driver.html?testName=ai-astar) 01:42:34 INFO - 2015-12-15 01:42:34,529 DEBUG : BROWSER_OUTPUT: RSS: Main: 139673600 01:42:34 INFO - 2015-12-15 01:42:34,529 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,530 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:42:34 INFO - 2015-12-15 01:42:34,530 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:42:34 INFO - 2015-12-15 01:42:34,531 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:42:34 INFO - 2015-12-15 01:42:34,531 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:42:34 INFO - 2015-12-15 01:42:34,531 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;106;111;110;112;121;110;111;112;110 01:42:34 INFO - 2015-12-15 01:42:34,531 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;150;121;147;167;126;154;157;124;157;129 01:42:34 INFO - 2015-12-15 01:42:34,532 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;161;161;162;162;161;161;160;165;163 01:42:34 INFO - 2015-12-15 01:42:34,532 DEBUG : BROWSER_OUTPUT: |3;audio-fft;77;74;72;156;72;71;72;71;151;73 01:42:34 INFO - 2015-12-15 01:42:34,532 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;92;134;91;92;93;137;93;94;138 01:42:34 INFO - 2015-12-15 01:42:34,533 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;110;110;109;110;110;110;111;109;110 01:42:34 INFO - 2015-12-15 01:42:34,533 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;146;147;146;146;147;146;147;146;146 01:42:34 INFO - 2015-12-15 01:42:34,533 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;95;95;96;96;96;96;97;96 01:42:34 INFO - 2015-12-15 01:42:34,533 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;58;60;58;60;59;58;62;60;56;56 01:42:34 INFO - 2015-12-15 01:42:34,534 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;64;64;65;63;66;65;63;64;64;64 01:42:34 INFO - 2015-12-15 01:42:34,534 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;80;84;82;91;83;82;82;82;88;84 01:42:34 INFO - 2015-12-15 01:42:34,534 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;127;114;115;119;117;122;117;126;115;120 01:42:34 INFO - 2015-12-15 01:42:34,534 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;143;143;155;144;138;138;148;146;143;150 01:42:34 INFO - 2015-12-15 01:42:34,535 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;67;66;67;65;64;66;67;66;66;68 01:42:34 INFO - 2015-12-15 01:42:34,535 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:42:34 INFO - 2015-12-15 01:42:34,535 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:42:34 INFO - 2015-12-15 01:42:34,535 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,698 01:42:34 INFO - 2015-12-15 01:42:34,536 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:42:34 INFO - 2015-12-15 01:42:34,536 DEBUG : BROWSER_OUTPUT: __startTimestamp1450172554529__endTimestamp 01:42:34 INFO - 2015-12-15 01:42:34,536 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,537 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:42:34 INFO - 2015-12-15 01:42:34,537 DEBUG : BROWSER_OUTPUT: Number of tests: 14 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:111.30 Median:111.00 stddev:3.80 (3.4%) stddev-sans-first:4.00 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: Values: 110.0 106.0 111.0 110.0 112.0 121.0 110.0 111.0 112.0 110.0 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:143.20 Median:152.00 stddev:16.61 (10.9%) stddev-sans-first:17.44 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: Values: 150.0 121.0 147.0 167.0 126.0 154.0 157.0 124.0 157.0 129.0 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.70 Median:161.50 stddev:1.42 (0.9%) stddev-sans-first:1.48 01:42:34 INFO - 2015-12-15 01:42:34,538 DEBUG : BROWSER_OUTPUT: Values: 161.0 161.0 161.0 162.0 162.0 161.0 161.0 160.0 165.0 163.0 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:88.90 Median:72.00 stddev:34.11 (47.4%) stddev-sans-first:35.91 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: Values: 77.0 74.0 72.0 156.0 72.0 71.0 72.0 71.0 151.0 73.0 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.60 Median:92.00 stddev:21.25 (23.1%) stddev-sans-first:21.96 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: Values: 92.0 92.0 134.0 91.0 92.0 93.0 137.0 93.0 94.0 138.0 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,539 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.90 Median:110.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: Values: 110.0 110.0 110.0 109.0 110.0 110.0 110.0 111.0 109.0 110.0 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: Values: 147.0 146.0 147.0 146.0 146.0 147.0 146.0 147.0 146.0 146.0 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 95.0 95.0 96.0 96.0 96.0 96.0 97.0 96.0 01:42:34 INFO - 2015-12-15 01:42:34,540 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.70 Median:59.50 stddev:1.89 (3.2%) stddev-sans-first:1.99 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: Values: 58.0 60.0 58.0 60.0 59.0 58.0 62.0 60.0 56.0 56.0 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:64.20 Median:64.00 stddev:0.92 (1.4%) stddev-sans-first:0.97 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: Values: 64.0 64.0 65.0 63.0 66.0 65.0 63.0 64.0 64.0 64.0 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:83.80 Median:83.50 stddev:3.29 (3.9%) stddev-sans-first:3.19 01:42:34 INFO - 2015-12-15 01:42:34,541 DEBUG : BROWSER_OUTPUT: Values: 80.0 84.0 82.0 91.0 83.0 82.0 82.0 82.0 88.0 84.0 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:119.20 Median:119.50 stddev:4.57 (3.8%) stddev-sans-first:3.87 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: Values: 127.0 114.0 115.0 119.0 117.0 122.0 117.0 126.0 115.0 120.0 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.80 Median:145.00 stddev:5.22 (3.6%) stddev-sans-first:5.50 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: Values: 143.0 143.0 155.0 144.0 138.0 138.0 148.0 146.0 143.0 150.0 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.20 Median:66.50 stddev:1.14 (1.7%) stddev-sans-first:1.17 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: Values: 67.0 66.0 67.0 65.0 64.0 66.0 67.0 66.0 66.0 68.0 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:42:34 INFO - 2015-12-15 01:42:34,542 DEBUG : BROWSER_OUTPUT: 01:42:35 INFO - 2015-12-15 01:42:35,369 INFO : Browser exited with error code: 0 01:42:35 INFO - 2015-12-15 01:42:35,417 INFO : Completed test kraken (00:00:59) 01:42:35 INFO - 2015-12-15 01:42:35,417 INFO : Starting test v8_7 01:42:35 INFO - 2015-12-15 01:42:35,417 DEBUG : operating with platform_type : linux_ 01:42:35 INFO - 2015-12-15 01:42:35,418 INFO : Initialising browser for v8_7 test... 01:42:35 INFO - 2015-12-15 01:42:35,424 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxXw_yC/profile http://localhost:33777/getInfo.html 01:42:39 INFO - 2015-12-15 01:42:39,967 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:42:39 INFO - 2015-12-15 01:42:39,968 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:42:39 INFO - 2015-12-15 01:42:39,968 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:42:39 INFO - 2015-12-15 01:42:39,968 DEBUG : BROWSER_OUTPUT: __metrics 01:42:40 INFO - 2015-12-15 01:42:40,913 INFO : Browser initialized. 01:42:40 INFO - 2015-12-15 01:42:40,914 INFO : Running cycle 1/1 for v8_7 test... 01:42:40 INFO - 2015-12-15 01:42:40,914 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxXw_yC/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:42:52 INFO - 2015-12-15 01:42:52,706 DEBUG : BROWSER_OUTPUT: RSS: Main: 137846784 01:42:52 INFO - 2015-12-15 01:42:52,706 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,119 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:33777/tests/v8_7/run.html (next: http://localhost:33777/tests/v8_7/run.html) 01:43:14 INFO - 2015-12-15 01:43:14,369 DEBUG : BROWSER_OUTPUT: RSS: Main: 136282112 01:43:14 INFO - 2015-12-15 01:43:14,370 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,370 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:43:14 INFO - 2015-12-15 01:43:14,370 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:43:14 INFO - 2015-12-15 01:43:14,370 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:43:14 INFO - 2015-12-15 01:43:14,370 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:43:14 INFO - 2015-12-15 01:43:14,371 DEBUG : BROWSER_OUTPUT: |0;Richards;165.6451880072884 01:43:14 INFO - 2015-12-15 01:43:14,371 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;167.0564650851988 01:43:14 INFO - 2015-12-15 01:43:14,371 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.08676307007784 01:43:14 INFO - 2015-12-15 01:43:14,371 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5256.544502617801 01:43:14 INFO - 2015-12-15 01:43:14,372 DEBUG : BROWSER_OUTPUT: |4;RayTrace;918.2736455463728 01:43:14 INFO - 2015-12-15 01:43:14,372 DEBUG : BROWSER_OUTPUT: |5;Earley;542.0054200542005 01:43:14 INFO - 2015-12-15 01:43:14,372 DEBUG : BROWSER_OUTPUT: |6;Boyer;11098.901098901099 01:43:14 INFO - 2015-12-15 01:43:14,372 DEBUG : BROWSER_OUTPUT: |7;RegExp;23627.906976744187 01:43:14 INFO - 2015-12-15 01:43:14,373 DEBUG : BROWSER_OUTPUT: |8;Splay;531.9148936170212 01:43:14 INFO - 2015-12-15 01:43:14,373 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4830.917874396136 01:43:14 INFO - 2015-12-15 01:43:14,373 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:43:14 INFO - 2015-12-15 01:43:14,373 DEBUG : BROWSER_OUTPUT: __startTimestamp1450172594367__endTimestamp 01:43:14 INFO - 2015-12-15 01:43:14,374 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,374 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:43:14 INFO - 2015-12-15 01:43:14,374 DEBUG : BROWSER_OUTPUT: Number of tests: 10 01:43:14 INFO - 2015-12-15 01:43:14,374 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,375 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.65 Median:165.65 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,375 DEBUG : BROWSER_OUTPUT: Values: 165.6 01:43:14 INFO - 2015-12-15 01:43:14,375 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,375 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:167.06 Median:167.06 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,375 DEBUG : BROWSER_OUTPUT: Values: 167.1 01:43:14 INFO - 2015-12-15 01:43:14,376 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,376 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.09 Median:278.09 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,376 DEBUG : BROWSER_OUTPUT: Values: 278.1 01:43:14 INFO - 2015-12-15 01:43:14,376 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,376 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5256.54 Median:5256.54 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: Values: 5256.5 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:918.27 Median:918.27 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: Values: 918.3 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,377 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:542.01 Median:542.01 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: Values: 542.0 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11098.90 Median:11098.90 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: Values: 11098.9 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:23627.91 Median:23627.91 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: Values: 23627.9 01:43:14 INFO - 2015-12-15 01:43:14,378 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:531.91 Median:531.91 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: Values: 531.9 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: Values: 4830.9 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:43:14 INFO - 2015-12-15 01:43:14,379 DEBUG : BROWSER_OUTPUT: 01:43:15 INFO - 2015-12-15 01:43:15,249 INFO : Browser exited with error code: 0 01:43:15 INFO - 2015-12-15 01:43:15,266 INFO : Completed test v8_7 (00:00:39) 01:43:15 INFO - 2015-12-15 01:43:15,412 INFO : Completed test suite (00:20:07) 01:43:15 INFO - 2015-12-15 01:43:15,412 DEBUG : Working with test: dromaeo_css 01:43:15 INFO - 2015-12-15 01:43:15,412 DEBUG : Generating results file: dromaeo_css 01:43:15 INFO - 2015-12-15 01:43:15,413 DEBUG : Working with test: kraken 01:43:15 INFO - 2015-12-15 01:43:15,413 DEBUG : Generating results file: kraken 01:43:15 INFO - 2015-12-15 01:43:15,414 INFO : javascript benchmark 01:43:15 INFO - 2015-12-15 01:43:15,414 DEBUG : Working with test: v8_7 01:43:15 INFO - 2015-12-15 01:43:15,414 DEBUG : Generating results file: v8_7 01:43:15 INFO - 2015-12-15 01:43:15,414 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:43:15 INFO - 2015-12-15 01:43:15,463 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 01:43:15 INFO - 2015-12-15 01:43:15,463 DEBUG : process_Request line: dromaeo_css 7563.88 graph.html#tests=[[72,52,43]] 01:43:15 INFO - 2015-12-15 01:43:15,463 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:43:15 INFO - 2015-12-15 01:43:15,503 DEBUG : process_Request line: kraken 1499.80 graph.html#tests=[[232,52,43]] 01:43:15 INFO - 2015-12-15 01:43:15,503 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:43:15 INFO - 2015-12-15 01:43:15,536 DEBUG : process_Request line: v8_7 23236.34 graph.html#tests=[[230,52,43]] 01:43:15 INFO - 2015-12-15 01:43:15,537 INFO : javascript benchmark 01:43:15 INFO - 2015-12-15 01:43:15,541 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3349.1124851914237, 3410.3520331137083, 3415.897523074308, 3421.692047715705, 3447.4311738563138, 5650.152477128433, 5654.943450565504, 5669.348024977129, 5672.886542269152, 5680.715964201794, 5682.744276507557, 5708.37207907131, 5730.79942202023, 5736.913946290809, 5739.913901291484, 5213.869653258661, 5230.633855630107, 5254.92117618236, 5292.285541451894, 5306.442823503535, 5141.665791723544, 5163.225516172567, 5235.397929238148, 5287.576993840484, 5324.627276090656, 5206.531412172903, 5305.283786688806, 5313.20301954708, 5315.734213289339, 5317.521423071923, 5325.600579956499, 5370.248165256867, 5373.785048598052, 5377.569794416457, 5391.218273350381, 5053.646244762831, 5117.692938423669, 5143.485651434864, 5270.446603106695, 5275.947240527584, 5561.610687251894, 5569.972150139223, 5605.579581531401, 5609.186667933127, 5630.859228519279, 6214.067889816519, 6230.971889638249, 6255.280642726099, 6276.058591211309, 6282.717277722513, 5948.583599148062, 6065.514758819328, 6125.632272693312, 6282.87434251317, 6311.7159727811895, 5822.980978328776, 5888.381719919433, 5943.970280148572, 5955.34491205967, 5969.940300596982, 6435.485161187094, 6447.25856526496, 6474.741010359533, 6478.449331806849, 6481.09264702942, 5811.82564523065, 5995.580309378389, 6133.509319254449, 6210.72051757672, 6218.22272215973, 6304.873902521924, 6321.873562528724, 6343.682815859189, 6361.236651601837, 6383.616982981036, 6081.087836824512, 6276.560640755103, 6277.968610157011, 6294.779682711083, 6320.683965801783, 6078.1186727924205, 6099.024156134997, 6158.568900176944, 6208.161898143693, 6214.161088253119, 4738.336632871401, 4754.09672162295, 4756.0, 4777.235642297216, 4789.401324834395, 4155.792210389468, 4237.067845074079, 4265.97867010663, 4280.165367753259, 4287.614114729689, 5680.488756011896, 5747.626404283708, 5762.711864406763, 5768.192453056576, 5836.562257830595, 6217.4715149212825, 6232.56372053961, 6240.500759939194, 6244.188255526843, 6252.03093520496, 5707.6575405475805, 5709.914351284734, 5812.128180772918, 5823.068309070529, 5881.852953676193, 5453.918191227135, 5469.097598896137, 5497.835064947978, 5500.834974950758, 5500.944990550123, 6457.483401327882, 6461.418472337512, 6527.902081468782, 6544.836379090466, 6547.770828020996, 6126.090206827809, 6133.172021777182, 6180.845478862884, 6240.407161319849, 6352.555321127476, 6282.748690052346, 6285.402886725754, 6338.334474880071, 6348.365163483615, 6371.872562548816, 6169.907451388143, 6193.628382296896, 6195.1636529068, 6197.752089916353, 6206.472449841814, 6110.450059494667, 6125.84596676928, 6187.690615469119, 6240.5319601031015, 6243.906341404973, 6129.754809807558, 6179.0, 6190.938090619036, 6191.7523299069335, 6238.563300568917, 5843.181954526454, 6182.969085154546, 6186.505079593531, 6237.5321850860455, 6240.12638230639, 5833.0, 5899.144624029406, 5918.408159184047, 5920.644761314335, 5941.22764040672, 6058.27300723916, 6137.508999279958, 6182.690865456799, 6195.2255968004, 6195.690215489298, 5664.518515926193, 5850.912236316373, 6039.456448919618, 6057.061155520902, 6061.060535616986], "unit": "ms", "name": "dojo.html", "value": 5722.996375572014}, {"lowerIsBetter": false, "replicates": [583.2738240890093, 613.8588124731309, 631.8767840271146, 634.451199712249, 635.6408629124546, 43063.78468107659, 43683.34474982878, 43727.78136109315, 43757.78121109394, 43786.56213437865, 46769.7661511692, 47262.29106563396, 47286.52713472864, 47295.52704472954, 47648.52351476493, 9108.726738197847, 9270.21203197729, 9288.071192880725, 9352.205062569656, 9372.109649583279, 9047.457152570834, 9117.179453849152, 9169.0, 9177.908220917805, 9193.12665296799, 9151.67969121081, 9152.908470915272, 9182.449053056804, 9205.263578913704, 9209.217216536603, 9119.316051296146, 9206.999999999967, 9233.676821311288, 9255.629774809, 9271.026542213072, 7834.529928204326, 7841.529508229524, 7849.882251766228, 7872.055353357577, 7888.842223155562, 44000.11999760019, 44509.554904451186, 44548.0, 44561.33158002632, 44619.33071003937, 3542.6280240574624, 3667.908302292464, 3671.0, 3727.5713292971113, 3770.773753574767, 32491.350172996645, 32723.836380817942, 32816.17959551007, 32987.0, 33332.6666733332, 3961.207758448293, 3973.304671682444, 4028.47629808126, 4041.191761647682, 4073.8981525461804, 294158.0, 294909.0, 295523.0, 295647.0, 485687.57156214345, 68120.65939670369, 68429.31570684329, 68556.31443685599, 69003.0, 69147.0, 73081.0, 73543.26456735471, 73743.0, 73748.26251737522, 73904.26095739081, 15836.841631583537, 15983.840161598235, 16004.0, 16061.11663858499, 16074.598135046717, 12564.057695672862, 12751.553695620609, 12755.93622031884, 12763.106582539318, 12820.166689165175, 22442.214522491635, 22685.773142268696, 22736.886315568318, 22792.544149116926, 22919.312420627408, 8413.45312554682, 8615.439996400339, 8658.78353041179, 8676.132386761274, 8880.911190888008, 1102.7188067042853, 1105.5412004018403, 1209.171717373602, 1217.6468824040928, 1236.0424833847874, 29879.253018674706, 29992.55011174834, 30327.393452130833, 30716.69283307138, 30752.231194219876, 1100.2738192792879, 1111.8888111188817, 1125.0999200639455, 1216.7688139253514, 1221.1940119521073, 15694.372225110868, 15765.515047906883, 16053.117078560792, 16161.757573636405, 17431.825681743274, 773763.0, 781027.0, 782795.0, 784150.0, 826174.0, 61417.0, 61536.07695884565, 61652.38347616556, 61760.0, 61993.0, 1386.5493714542813, 1493.7908692783237, 1494.484402881026, 1495.9252037398087, 1507.2915729607066, 31919.840400797846, 31956.6804331963, 32561.674383256814, 33472.33055338831, 34620.82689586536, 57068.143977841195, 57806.0, 57931.13103303538, 57979.4202057974, 58104.0, 322114.0, 325724.0, 327831.0, 328174.0, 328748.0, 45512.31731524096, 45950.77024614989, 46763.53236467728, 46907.296390553485, 47133.52866471291, 49836.75081624569, 50426.49573504218, 51437.0, 51650.22524662208, 51870.48129518657, 41790.0, 42601.78699106609, 43754.56245437632, 43815.56184438242, 43981.56018439903, 42633.78683106565, 42723.57276427196, 43070.56929430665, 43734.34398484089, 43779.343309851014, 41997.0, 42731.786341068095, 42849.57150428581, 43072.35391469068, 43129.35305970476, 36483.0, 36941.63058369382, 37509.81245093757, 37883.242335152594, 38187.0, 27910.16269511918, 28297.57553636656, 28422.28944276327, 28511.28721781972, 28525.857370713013], "unit": "ms", "name": "ext.html", "value": 21266.314407875958}, {"lowerIsBetter": false, "replicates": [389.8421139438525, 393.24496965825614, 394.35522920025767, 394.5718894998926, 401.07752170008973, 16074.276657550408, 17322.220500077496, 17533.03568303743, 18803.05984700763, 18901.527461813443, 11071.446427678624, 11596.304221746701, 11651.41742912853, 18057.458276251702, 18086.728699069492, 4988.975055124737, 5006.974965125179, 5119.12974794284, 5130.948690513084, 5140.922886156711, 5052.4189718182515, 5241.2400201970695, 5385.892282154355, 5424.349078110632, 5426.457354264562, 5275.182346736243, 5299.231611416342, 5301.0723123453245, 5336.919946200791, 5384.434634363394, 5607.130894711327, 5611.494965453088, 5613.943860561383, 5623.325200975889, 5627.915581266284, 5390.9191362129595, 5426.891462170774, 5468.043092458844, 5590.944090559083, 5606.635568688022, 12416.62750117489, 12445.066620003445, 12490.375481225994, 12504.687382815411, 12861.87138128616, 2268.478250002492, 2279.088364654135, 2294.4378627236433, 2312.075169932024, 2335.859848409101, 9259.583318750605, 9476.0, 10036.94981525095, 12166.878331216663, 13940.093893896965, 1956.2859556261863, 2008.1666108564928, 2034.4529975504736, 2152.989235053815, 2177.934661960144, 59207.0, 59441.10838337428, 60905.39094609086, 62982.37017629811, 63151.36848631547, 11134.220604557604, 11247.437628118561, 11270.887291126985, 11284.32294062359, 11353.0, 14385.136891786526, 14465.78301325481, 14508.0, 14524.49164279245, 14571.907106967019, 7979.640916158787, 7999.480033797901, 8030.116687164407, 8063.879041814377, 8091.716789912442, 7798.454108212371, 7921.1682773307975, 7941.6029198539845, 7977.3618110551015, 8047.718329858427, 4762.880927976828, 4771.5467030632035, 4802.447718512346, 4898.583620392235, 4926.45808961014, 1739.869509786771, 1785.580388608676, 1800.1089460717028, 1928.7299778031088, 1961.6174845905198, 452.15672770283186, 474.2672570878002, 484.2204051477119, 1005.1506477026901, 1041.5156952017348, 11245.775084498428, 11403.916627920335, 11501.597444089417, 11529.538818447336, 11549.88450115505, 499.65841714995355, 935.373299889076, 1033.245730616654, 1038.2887721910515, 1073.3291692692067, 9654.131128198496, 10036.949815250877, 10074.445905475122, 10259.640912568024, 10368.377897326185, 486182.0, 487862.0, 493254.0, 558097.0, 680875.0, 84399.0, 84530.57734711288, 87454.56272718596, 89065.0, 90920.0, 1206.5776978057609, 1229.2317301686446, 1236.4003458322707, 1249.8625151233357, 1252.3800718644147, 16750.832491675414, 16853.325866965184, 16870.240839162023, 16964.406245781338, 17204.483865484057, 37790.62209377871, 38445.423318649686, 39178.60821391863, 39184.412233817086, 39785.80107099446, 50059.74970125126, 51106.0, 52149.0, 54141.18788218101, 55860.72069639626, 10033.899661003297, 10498.055175034284, 10598.841017384899, 10603.628872989408, 10658.573657053632, 14078.718425631225, 15404.69190616159, 17808.643827123127, 17884.10579471047, 18009.00950447738, 14712.485063022743, 14720.705585888436, 14726.558203253919, 14996.175210363535, 15213.923930380277, 14498.130112193303, 14769.335379907716, 14787.482438115045, 14887.95784295089, 15023.02350347224, 14947.551573452814, 15127.01674391161, 15379.231038448257, 15491.30289136969, 15804.209789510709, 10461.110805581611, 10561.0, 10602.469876506299, 10624.096951759188, 10675.626353077605, 14898.702025959637, 15524.922375388503, 15586.06483610987, 15779.132147731985, 15852.048877067413], "unit": "ms", "name": "jquery.html", "value": 9007.637281426496}, {"lowerIsBetter": false, "replicates": [1577.9763303550455, 1595.0429742154708, 1731.398456427804, 1813.6735387630226, 1871.2608519634741, 7426.740064097758, 7548.773536793891, 7798.92201077989, 8057.919420805798, 8086.150954149818, 7937.20627937206, 8082.878756818638, 8180.836383272346, 8183.058948220956, 8189.426740128179, 2403.4592216751266, 2441.401856545149, 2447.5472037673, 2448.0574978633176, 2449.7795198432136, 2458.557459657261, 2471.666325046123, 2479.404942813721, 2488.5271798358344, 2490.9750902490923, 2367.171489978511, 2404.843685160468, 2406.7713567211085, 2415.6014257647466, 2445.76765207305, 2360.8583484990786, 2410.8794560272004, 2419.14120487228, 2425.963610545843, 2442.31615147758, 2387.5224955008894, 2442.804575633945, 2463.027104293812, 2474.208253358926, 2475.6781618389673, 8313.41806073575, 8360.414770966036, 8377.539235342054, 8400.495970241744, 8434.114417986146, 5047.520485553867, 5113.565346945514, 5120.411152717448, 5138.2549530318265, 5146.228065790124, 3151.196444906557, 3170.461021626329, 3180.7296379807744, 3236.996531075374, 3254.251522149919, 1037.3464717228098, 1041.0526420956892, 1042.5464922758624, 1059.6185373265619, 1064.9520771565299, 11703.7074073148, 11715.121365897592, 11731.296122232694, 11770.293782372999, 11796.646100616996, 4447.688661793708, 4449.599536041772, 4502.234620114588, 4510.774461276923, 4533.798543386005, 9851.064148905842, 9857.30998830075, 9903.207743380512, 9921.206303495703, 9936.155426788804, 5052.242163675478, 5062.670926389773, 5094.2103973884105, 5102.897942041139, 5110.591152707774, 4467.5532446755715, 4542.046170304273, 4561.133384656904, 4564.315352697122, 4614.423197100363, 3715.498407714924, 3716.7398282119993, 3720.739548231598, 3745.6441638044344, 3761.153740408441, 1150.9021733152608, 1151.2114201771813, 1151.2344291046527, 1152.3086148310947, 1162.128403697227, 1150.0339714639742, 1164.0861923390098, 1168.8538932633421, 1178.6935396796894, 1229.6987238126537, 7997.0, 8045.396595255263, 8051.4766540174705, 8091.797705057421, 8128.512289262663, 1160.1646814293695, 1194.856617205941, 1222.3643705273387, 1224.74280401115, 1231.8891299783063, 6280.905786413207, 6331.303556608769, 6370.522210834206, 6385.138006369174, 6399.104125422445, 10165.440900750382, 10271.589136434608, 10314.226433017404, 10359.274850760374, 10384.0, 9902.108810206972, 10142.0, 10185.94907025475, 10192.898071019343, 10235.078842904175, 7957.442978991415, 7977.5612341321785, 7993.520388776692, 8064.516129032277, 8083.7170699025255, 7618.923810762043, 7636.579988100486, 7641.121271053677, 7655.732049378245, 7757.650905709143, 8787.340949428946, 9066.138716821892, 9086.681966131153, 9112.908870911206, 9165.816683666157, 9027.14242146995, 9187.77030574241, 9235.907640923504, 9273.30450216223, 9349.158575728217, 7218.386437152691, 7260.310270524292, 7375.078115235596, 7615.695372185272, 7620.809479762828, 8058.435909486514, 8067.830164625979, 8084.9191508086515, 8094.473859199134, 8096.919030809617, 7512.173660897406, 7750.379969602531, 7760.146383897654, 7762.573058481612, 7855.293023627901, 7575.0909890813455, 7610.238976102345, 7636.427267955037, 7702.614869256627, 7727.0, 7612.619369031637, 7662.655180516778, 7669.271419215165, 7677.193894640982, 7680.884786728092, 6851.588904665736, 6917.23910369869, 6932.653367331714, 6951.0616066830335, 7060.046893669494, 6668.76659316941, 6673.232578253563, 6701.0953521274005, 6706.698198580978, 6711.161104861892], "unit": "ms", "name": "mootools.html", "value": 4802.998698873381}, {"lowerIsBetter": false, "replicates": [360.3909393125617, 361.50473850824375, 367.2416460010079, 369.51962448816533, 369.78737226094984, 6404.0, 6431.035344698297, 6454.806355809322, 6479.125318082051, 6533.738650453976, 6371.394717501841, 6385.840353991141, 6412.679366031692, 6446.580972236801, 6459.838504037401, 4893.730844803535, 4900.0, 4903.166461701501, 4910.361652985107, 4916.237983112624, 4907.043126590316, 4915.8525244242555, 4921.729304888229, 4924.2121260598315, 4931.358923339961, 4728.385309909707, 4746.928796068062, 4799.376081109451, 4802.83190088347, 4803.207470767319, 4771.23660214364, 4781.569658730714, 4785.641076919228, 4790.5448982346625, 4794.640401969867, 4190.455240818674, 4200.180964711883, 4214.325707886754, 4214.494260688706, 4235.512916014667, 6111.694415279218, 6143.477804386633, 6147.907781383283, 6156.7845125420845, 6164.3835616438, 5528.55771538276, 5641.153826925953, 5642.069058605325, 5659.717014149317, 5669.149627555899, 6738.898916516257, 6751.932480675228, 6785.117934668511, 6804.795856124324, 6807.489438292098, 4669.015668340975, 4680.859574212745, 4683.320918466803, 4683.555062269079, 4690.906181876343, 6865.794026179223, 6995.965020174866, 7023.33278338557, 7062.929370706279, 7121.2878712128895, 4689.109069276827, 4697.929531057037, 4698.060387922429, 4703.482616912137, 4704.929426058612, 4722.716637001791, 4769.809207631725, 4772.7136371817805, 4777.570018698334, 4777.737224452689, 5554.0, 5568.081266591048, 5570.220169176318, 5571.721413929287, 5573.386927437979, 6678.465722742169, 6804.523683342119, 6860.5540639858245, 6861.2795656455355, 6875.5530890491955, 1699.031552015364, 1724.5257554172704, 1724.5947202407424, 1726.3957614834708, 1728.6456276463546, 1145.828125781123, 1163.1044096046166, 1166.2069792540983, 1173.642039178059, 1178.80549709297, 6533.967330163318, 6548.952167653152, 6557.639329836809, 6585.275619681831, 6617.735290588419, 7042.0, 7079.1505019398, 7081.645917704094, 7093.184283807325, 7095.361417472349, 6308.558400911984, 6360.872782544323, 6596.670166491656, 6601.73593056282, 6669.09967154428, 3851.730378873508, 3857.3828187489867, 3859.6333348331864, 3866.478025466582, 3874.3994680824517, 7279.672414741243, 7294.0, 7311.0, 7323.084614423197, 7354.154272258758, 7173.92826071743, 7280.890786638205, 7311.817204569928, 7319.743808966767, 7343.3390994810725, 7296.96351518239, 7346.52247603904, 7347.669354879044, 7356.485046046832, 7369.852602947911, 7120.323569260912, 7156.642167891689, 7165.820854478679, 7166.53417527859, 7178.353948144692, 6815.182178138655, 7056.682449289691, 7057.682404291717, 7066.258042905421, 7086.326798954091, 7338.889916651147, 7403.777886663409, 7404.629768511445, 7406.44451666138, 7408.555486670817, 4793.904121917472, 4820.903581928412, 4826.3243145958895, 4835.419749630067, 4836.250381190921, 6948.305169483011, 7130.465215108784, 7149.499535032498, 7182.712691492282, 7194.028806111108, 6968.7212511501, 6973.5118541701595, 6982.406495447944, 6992.195897471653, 6992.1958974718555, 6805.0, 6922.0, 6952.339527744856, 6968.303169682991, 6986.720531178696, 6756.256811750605, 6779.186497620317, 6811.9659401702675, 6813.2846051163915, 6815.284395138439, 6972.198197207386, 7013.438924886099, 7015.052967849275, 7026.0, 7047.7180912762915, 6702.865942681022, 6822.590644561342, 6837.62393068386, 6844.828879278058, 6853.828654283683], "unit": "ms", "name": "prototype.html", "value": 5150.61551044116}, {"lowerIsBetter": false, "replicates": [768.3200367674606, 781.6052893288888, 848.1857416879795, 865.3423398217353, 935.7941252924359, 14343.569692909216, 14987.025843320176, 14995.0, 15059.397624095023, 15075.77386339203, 13583.117097388687, 13719.725605487909, 13726.656833579165, 13741.450341986309, 13744.312784360767, 890.7461373508552, 899.8155378147496, 914.5381582300929, 923.2014307623924, 924.9075092490731, 858.2704701004159, 902.8916530016407, 909.3180114913814, 909.56340956341, 914.0402577293814, 951.7240000399876, 956.2350119904083, 956.6364781383064, 956.7368973532265, 958.8034452937131, 936.3024546712709, 945.1965829045291, 949.8385274503316, 951.7382719752054, 954.2127744610724, 704.2851505721696, 708.1572928215408, 709.9183593886718, 710.733474946895, 711.6228398948566, 15020.248987550578, 15061.322240499094, 15144.242787860672, 15151.621209469742, 15156.621084472867, 12930.0, 12998.675033124153, 13035.934820325932, 13252.597055754886, 13537.05240633156, 11369.147313951487, 11375.886241137565, 11549.076073914151, 11662.183647144704, 11877.287362758263, 3910.491636087319, 4016.4376987221813, 4019.5980401959864, 4083.040485485938, 4118.094019315746, 53652.73173634146, 54211.457885421034, 54721.0, 54723.0, 54748.726256368864, 10413.895861041292, 10498.317609355367, 10893.509792059376, 10908.563657453613, 11062.502187401586, 19510.60978780445, 19603.0, 19620.70568941467, 19629.31297404584, 19639.0, 7635.541867487968, 7732.922670773332, 7786.961065194638, 7788.805279868048, 7968.681252749941, 4262.509811371732, 4369.519352871245, 4456.17560751262, 4477.686561940698, 4559.0, 3354.463285874297, 3357.916052098717, 3372.983135084358, 3395.864165433404, 3399.6770306820813, 622.0793226025507, 626.7023163997156, 629.0501342972145, 641.5124505375948, 642.6915080761167, 701.4984286235264, 704.2886684448641, 704.5913370245246, 708.5996412027188, 719.9856002879914, 8039.422457006693, 8217.219364160395, 8248.587570621445, 8288.83422331562, 8316.750497485085, 718.3463048625725, 728.1226122522348, 756.6029222920306, 757.3675980556187, 773.439256539016, 3966.8413263469715, 4508.458984921765, 4513.593089121068, 4605.263157894721, 4647.465541462708, 57800.42199577951, 61289.69355153285, 62929.37070629235, 65610.67194663997, 66341.0, 54513.45486545084, 54664.0, 56007.0, 56335.71832140813, 56712.716436417555, 50187.74906125519, 50866.74566627143, 50979.49020509821, 51025.48974510356, 51096.0, 9467.431954082776, 9579.0, 9646.565904534173, 9659.71020869375, 9692.75768105803, 36705.816470917474, 37728.81135594304, 37881.24237515289, 37993.62006380012, 38949.22101558009, 49118.26322605092, 49271.0, 49883.0, 49995.250071248236, 50601.49398505968, 11745.588904388305, 11874.0, 11954.940225298818, 12407.875921241033, 12422.813657795321, 13295.20228786276, 13727.658097622569, 13956.651083722989, 14157.787633185304, 14337.56987290383, 12285.262884226975, 12604.495820167458, 12666.683332916382, 12728.427220774902, 12918.160319579198, 11680.591179308683, 11954.462049207981, 11998.880011199777, 12358.876411235773, 12455.93772031134, 12077.27536347822, 12221.144519883523, 12410.317432541297, 12451.626451206479, 12706.110572259853, 10295.12491438236, 10805.297655652357, 11033.668989930315, 11176.552937882394, 11624.186306958432, 10219.080282774587, 10299.639512617023, 10470.842937355794, 10783.568657253621, 10788.676339709822], "unit": "ms", "name": "yui.html", "value": 6904.493035604971}], "name": "dromaeo_css", "value": 7563.87958708115}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 106.0, 111.0, 110.0, 112.0, 121.0, 110.0, 111.0, 112.0, 110.0], "unit": "ms", "name": "ai-astar", "value": 111.3}, {"lowerIsBetter": true, "replicates": [150.0, 121.0, 147.0, 167.0, 126.0, 154.0, 157.0, 124.0, 157.0, 129.0], "unit": "ms", "name": "audio-beat-detection", "value": 143.2}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 161.0, 162.0, 162.0, 161.0, 161.0, 160.0, 165.0, 163.0], "unit": "ms", "name": "audio-dft", "value": 161.7}, {"lowerIsBetter": true, "replicates": [77.0, 74.0, 72.0, 156.0, 72.0, 71.0, 72.0, 71.0, 151.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 88.9}, {"lowerIsBetter": true, "replicates": [92.0, 92.0, 134.0, 91.0, 92.0, 93.0, 137.0, 93.0, 94.0, 138.0], "unit": "ms", "name": "audio-oscillator", "value": 105.6}, {"lowerIsBetter": true, "replicates": [110.0, 110.0, 110.0, 109.0, 110.0, 110.0, 110.0, 111.0, 109.0, 110.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.9}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 147.0, 146.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.4}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 95.0, 95.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [58.0, 60.0, 58.0, 60.0, 59.0, 58.0, 62.0, 60.0, 56.0, 56.0], "unit": "ms", "name": "json-parse-financial", "value": 58.7}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 65.0, 63.0, 66.0, 65.0, 63.0, 64.0, 64.0, 64.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 64.2}, {"lowerIsBetter": true, "replicates": [80.0, 84.0, 82.0, 91.0, 83.0, 82.0, 82.0, 82.0, 88.0, 84.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 83.8}, {"lowerIsBetter": true, "replicates": [127.0, 114.0, 115.0, 119.0, 117.0, 122.0, 117.0, 126.0, 115.0, 120.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 119.2}, {"lowerIsBetter": true, "replicates": [143.0, 143.0, 155.0, 144.0, 138.0, 138.0, 148.0, 146.0, 143.0, 150.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 144.8}, {"lowerIsBetter": true, "replicates": [67.0, 66.0, 67.0, 65.0, 64.0, 66.0, 67.0, 66.0, 66.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 66.2}], "name": "kraken", "value": 1499.8}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.6451880072884], "unit": "score", "name": "Richards", "value": 213.11817399999993}, {"lowerIsBetter": false, "replicates": [167.0564650851988], "unit": "score", "name": "DeltaBlue", "value": 395.7823480000001}, {"lowerIsBetter": false, "replicates": [278.08676307007784], "unit": "score", "name": "Encrypt", "value": 957.1868759999999}, {"lowerIsBetter": false, "replicates": [5256.544502617801], "unit": "score", "name": "Decrypt", "value": 50.6380189243028}, {"lowerIsBetter": false, "replicates": [918.2736455463728], "unit": "score", "name": "RayTrace", "value": 805.8480209999998}, {"lowerIsBetter": false, "replicates": [542.0054200542005], "unit": "score", "name": "Earley", "value": 1229.624235}, {"lowerIsBetter": false, "replicates": [11098.901098901099], "unit": "score", "name": "Boyer", "value": 60.04765643564352}, {"lowerIsBetter": false, "replicates": [23627.906976744187], "unit": "score", "name": "RegExp", "value": 38.55546751968505}, {"lowerIsBetter": false, "replicates": [531.9148936170212], "unit": "score", "name": "Splay", "value": 153.20307999999997}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 23236.338500988713}]} 01:43:15 INFO - RETURN: dromaeo_css: 7563.88 01:43:15 INFO - RETURN: kraken: 1499.80 01:43:15 INFO - RETURN: v8_7: 23236.34 01:43:15 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "23236.34"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1499.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7563.88"}}} 01:43:15 INFO - Return code: 0 01:43:15 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 01:43:15 INFO - # TBPL SUCCESS # 01:43:15 INFO - Running post-action listener: _resource_record_post_action 01:43:15 INFO - Running post-run listener: _resource_record_post_run 01:43:16 INFO - Total resource usage - Wall time: 1224s; CPU: 13.0%; Read bytes: 491520; Write bytes: 269496320; Read time: 216; Write time: 136228 01:43:16 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 4681728; Read time: 0; Write time: 444 01:43:16 INFO - run-tests - Wall time: 1209s; CPU: 13.0%; Read bytes: 491520; Write bytes: 263950336; Read time: 216; Write time: 135740 01:43:16 INFO - Running post-run listener: _upload_blobber_files 01:43:16 INFO - Blob upload gear active. 01:43:16 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 01:43:16 INFO - Copying logs to upload dir... 01:43:16 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1261.155942 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2015-12-15 01:43:16.676888) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-15 01:43:16.680809) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009947 build_url: 'https://queue.taskcluster.net/v1/task/Yh4oQSJqQ4O22DH_7VXT6Q/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-15 01:43:16.732628) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:43:16.732946) ========= 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=6ef107882637bc5fc02d78b7000001c2-1450170338.400726-1506764148 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004572 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-15 01:43:16.783297) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-15 01:43:16.783646) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-15 01:43:16.783946) ========= ========= Total master_lag: 0.31 =========