builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-046 starttime: 1452488793.85 results: success (0) buildid: 20160110185232 builduid: b82c7a7462d1415b9375f4f59f1bf065 revision: 35d941a0a9be39902070b6cd896c38a3090dfdb7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.850214) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.850986) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.851358) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006269 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.877774) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.878168) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.939867) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.940273) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004661 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.993745) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.994060) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.994467) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:33.994813) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-10 21:06:34-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 37.1M=0s 2016-01-10 21:06:34 (37.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.153565 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:34.161932) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:34.162262) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014595 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:34.220015) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-01-10 21:06:34.220379) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 35d941a0a9be39902070b6cd896c38a3090dfdb7 --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 35d941a0a9be39902070b6cd896c38a3090dfdb7 --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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-10 21:06:34,418 truncating revision to first 12 chars 2016-01-10 21:06:34,418 Setting DEBUG logging. 2016-01-10 21:06:34,418 attempt 1/10 2016-01-10 21:06:34,418 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/35d941a0a9be?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-10 21:06:35,583 unpacking tar archive at: mozilla-aurora-35d941a0a9be/testing/mozharness/ program finished with exit code 0 elapsedTime=1.483729 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-01-10 21:06:35.720591) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:35.720951) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:35.731734) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:35.732026) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-10 21:06:35.732501) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2016-01-10 21:06:35.732842) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 21:06:36 INFO - MultiFileLogger online at 20160110 21:06:36 in /builds/slave/test-pgo 21:06:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 21:06:36 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 21:06:36 INFO - {'append_to_log': False, 21:06:36 INFO - 'base_work_dir': '/builds/slave/test-pgo', 21:06:36 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 21:06:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 21:06:36 INFO - 'branch': 'Mozilla-Aurora', 21:06:36 INFO - 'buildbot_json_path': 'buildprops.json', 21:06:36 INFO - 'config_files': ('talos/linux_config.py',), 21:06:36 INFO - 'default_actions': ('clobber', 21:06:36 INFO - 'read-buildbot-config', 21:06:36 INFO - 'download-and-extract', 21:06:36 INFO - 'populate-webroot', 21:06:36 INFO - 'create-virtualenv', 21:06:36 INFO - 'install', 21:06:36 INFO - 'run-tests'), 21:06:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 21:06:36 INFO - 'download_minidump_stackwalk': True, 21:06:36 INFO - 'download_symbols': 'ondemand', 21:06:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 21:06:36 INFO - 'tooltool.py': '/tools/tooltool.py', 21:06:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 21:06:36 INFO - '/tools/misc-python/virtualenv.py')}, 21:06:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 21:06:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 21:06:36 INFO - 'installer_path': 'installer.exe', 21:06:36 INFO - 'log_level': 'info', 21:06:36 INFO - 'log_name': 'talos', 21:06:36 INFO - 'log_to_console': True, 21:06:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 21:06:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 21:06:36 INFO - 'opt_config_files': (), 21:06:36 INFO - 'pip_index': False, 21:06:36 INFO - 'sps_profile': False, 21:06:36 INFO - 'sps_profile_interval': 0, 21:06:36 INFO - 'suite': 'dromaeojs-e10s', 21:06:36 INFO - 'system_bits': '32', 21:06:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 21:06:36 INFO - 'title': 'talos-linux64-ix-046', 21:06:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 21:06:36 INFO - 'use_talos_json': True, 21:06:36 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 21:06:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 21:06:36 INFO - 'work_dir': 'build'} 21:06:36 INFO - ##### 21:06:36 INFO - ##### Running clobber step. 21:06:36 INFO - ##### 21:06:36 INFO - Running pre-action listener: _resource_record_pre_action 21:06:36 INFO - Running main action method: clobber 21:06:36 INFO - rmtree: /builds/slave/test-pgo/build 21:06:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 21:06:36 INFO - Running post-action listener: _resource_record_post_action 21:06:36 INFO - ##### 21:06:36 INFO - ##### Running read-buildbot-config step. 21:06:36 INFO - ##### 21:06:36 INFO - Running pre-action listener: _resource_record_pre_action 21:06:36 INFO - Running main action method: read_buildbot_config 21:06:36 INFO - Using buildbot properties: 21:06:36 INFO - { 21:06:36 INFO - "properties": { 21:06:36 INFO - "buildnumber": 46, 21:06:36 INFO - "product": "firefox", 21:06:36 INFO - "script_repo_revision": "production", 21:06:36 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 21:06:36 INFO - "repository": "", 21:06:36 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 21:06:36 INFO - "buildid": "20160110185232", 21:06:36 INFO - "slavename": "talos-linux64-ix-046", 21:06:36 INFO - "pgo_build": "True", 21:06:36 INFO - "basedir": "/builds/slave/test-pgo", 21:06:36 INFO - "project": "", 21:06:36 INFO - "platform": "ubuntu64_hw", 21:06:36 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 21:06:36 INFO - "slavebuilddir": "test", 21:06:36 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 21:06:36 INFO - "branch": "mozilla-aurora", 21:06:36 INFO - "repo_path": "releases/mozilla-aurora", 21:06:36 INFO - "stage_platform": "linux64-pgo", 21:06:36 INFO - "builduid": "b82c7a7462d1415b9375f4f59f1bf065", 21:06:36 INFO - "revision": "35d941a0a9be39902070b6cd896c38a3090dfdb7" 21:06:36 INFO - }, 21:06:36 INFO - "sourcestamp": { 21:06:36 INFO - "repository": "", 21:06:36 INFO - "hasPatch": false, 21:06:36 INFO - "project": "", 21:06:36 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 21:06:36 INFO - "changes": [ 21:06:36 INFO - { 21:06:36 INFO - "category": null, 21:06:36 INFO - "files": [ 21:06:36 INFO - { 21:06:36 INFO - "url": null, 21:06:36 INFO - "name": "https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2" 21:06:36 INFO - } 21:06:36 INFO - ], 21:06:36 INFO - "repository": "", 21:06:36 INFO - "rev": "35d941a0a9be39902070b6cd896c38a3090dfdb7", 21:06:36 INFO - "who": "philringnalda@gmail.com", 21:06:36 INFO - "when": 1452488675, 21:06:36 INFO - "number": 7441380, 21:06:36 INFO - "comments": "Bug 1205145 - skip test_videocontrols_video_direction.html on Windows, a=testonly", 21:06:36 INFO - "project": "", 21:06:36 INFO - "at": "Sun 10 Jan 2016 21:04:35", 21:06:36 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 21:06:36 INFO - "revlink": "", 21:06:36 INFO - "properties": [ 21:06:36 INFO - [ 21:06:36 INFO - "buildid", 21:06:36 INFO - "20160110185232", 21:06:36 INFO - "Change" 21:06:36 INFO - ], 21:06:36 INFO - [ 21:06:36 INFO - "builduid", 21:06:36 INFO - "b82c7a7462d1415b9375f4f59f1bf065", 21:06:36 INFO - "Change" 21:06:36 INFO - ], 21:06:36 INFO - [ 21:06:36 INFO - "pgo_build", 21:06:36 INFO - "True", 21:06:36 INFO - "Change" 21:06:36 INFO - ] 21:06:36 INFO - ], 21:06:36 INFO - "revision": "35d941a0a9be39902070b6cd896c38a3090dfdb7" 21:06:36 INFO - } 21:06:36 INFO - ], 21:06:36 INFO - "revision": "35d941a0a9be39902070b6cd896c38a3090dfdb7" 21:06:36 INFO - } 21:06:36 INFO - } 21:06:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2. 21:06:36 INFO - Running post-action listener: _resource_record_post_action 21:06:36 INFO - ##### 21:06:36 INFO - ##### Running download-and-extract step. 21:06:36 INFO - ##### 21:06:36 INFO - Running pre-action listener: _resource_record_pre_action 21:06:36 INFO - Running main action method: download_and_extract 21:06:36 INFO - mkdir: /builds/slave/test-pgo/build/tests 21:06:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:06:36 INFO - https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 21:06:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/test_packages.json 21:06:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/test_packages.json 21:06:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 21:06:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 21:06:42 INFO - Downloaded 1302 bytes. 21:06:42 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 21:06:42 INFO - Using the following test package requirements: 21:06:42 INFO - {u'common': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 21:06:42 INFO - u'cppunittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 21:06:42 INFO - u'jittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'jsshell-linux-x86_64.zip'], 21:06:42 INFO - u'mochitest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 21:06:42 INFO - u'mozbase': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 21:06:42 INFO - u'reftest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.reftest.tests.zip'], 21:06:42 INFO - u'talos': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'], 21:06:42 INFO - u'web-platform': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 21:06:42 INFO - u'webapprt': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 21:06:42 INFO - u'xpcshell': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 21:06:42 INFO - u'firefox-45.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 21:06:42 INFO - Downloading packages: [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 21:06: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')]} 21:06:42 INFO - https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 21:06:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:06:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:06:51 INFO - Downloaded 23024338 bytes. 21:06:51 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 21:06:51 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:51 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 21:06:52 INFO - Return code: 0 21:06:52 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 21:06:52 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')]} 21:06:52 INFO - https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 21:06:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:06:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:06:54 INFO - Downloaded 23024338 bytes. 21:06:54 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 21:06:54 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 21:06:54 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 21:06:56 INFO - Return code: 0 21:06:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:06:56 INFO - https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 21:06:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 21:06:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 21:06:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:06:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:07:02 INFO - Downloaded 11132038 bytes. 21:07:02 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 21:07:02 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 21:07:02 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 21:07:02 INFO - Return code: 0 21:07:02 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')]} 21:07:02 INFO - https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 21:07:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 21:07:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 21:07:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:07:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CBgmkUalTyOv0MIcZ-PWhA/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 21:07:05 INFO - Downloaded 58126638 bytes. 21:07:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 21:07:05 INFO - mkdir: /builds/slave/test-pgo/properties 21:07:05 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 21:07:05 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 21:07:05 INFO - Contents: 21:07:05 INFO - build_url:https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 21:07:05 INFO - Running post-action listener: _resource_record_post_action 21:07:05 INFO - Running post-action listener: set_extra_try_arguments 21:07:05 INFO - ##### 21:07:05 INFO - ##### Running populate-webroot step. 21:07:05 INFO - ##### 21:07:05 INFO - Running pre-action listener: _resource_record_pre_action 21:07:05 INFO - Running main action method: populate_webroot 21:07:05 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 21:07:05 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 21:07:05 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 21:07:05 INFO - '--tppagecycles', 21:07:05 INFO - '7'], 21:07:05 INFO - 'tests': ['tsvgm']}}, 21:07:05 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 21:07:05 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['tresize', 'tcanvasmark']}, 21:07:05 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 21:07:05 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 21:07:05 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:07:05 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:07:05 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'tests': ['damp', 'tps']}, 21:07:05 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['damp', 'tps']}, 21:07:05 INFO - 'g3': {'tests': ['dromaeo_dom']}, 21:07:05 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 21:07:05 INFO - 'other': {'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'other-e10s': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'other_l64': {'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'other_nol64': {'tests': ['a11yr', 21:07:05 INFO - 'ts_paint', 21:07:05 INFO - 'tpaint', 21:07:05 INFO - 'sessionrestore', 21:07:05 INFO - 'sessionrestore_no_auto_restore']}, 21:07:05 INFO - 'svgr': {'tests': ['tsvgx', 21:07:05 INFO - 'tsvgr_opacity', 21:07:05 INFO - 'tart', 21:07:05 INFO - 'tscrollx', 21:07:05 INFO - 'cart']}, 21:07:05 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['tsvgx', 21:07:05 INFO - 'tsvgr_opacity', 21:07:05 INFO - 'tart', 21:07:05 INFO - 'tscrollx', 21:07:05 INFO - 'cart']}, 21:07:05 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'tests': ['tp5o']}, 21:07:05 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'talos_options': ['--e10s'], 21:07:05 INFO - 'tests': ['tp5o']}, 21:07:05 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'talos_options': ['--xperf_path', 21:07:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 21:07:05 INFO - 'tests': ['tp5n']}, 21:07:05 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 21:07:05 INFO - 'talos_options': ['--e10s', 21:07:05 INFO - '--xperf_path', 21:07:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 21:07:05 INFO - 'tests': ['tp5n']}}, 21:07:05 INFO - 'talos.zip': {'path': '', 21:07:05 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 21:07:05 INFO - Running post-action listener: _resource_record_post_action 21:07:05 INFO - ##### 21:07:05 INFO - ##### Running create-virtualenv step. 21:07:05 INFO - ##### 21:07:05 INFO - Running pre-action listener: _resource_record_pre_action 21:07:05 INFO - Running main action method: create_virtualenv 21:07:05 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 21:07:05 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 21:07:05 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 21:07:05 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 21:07:05 INFO - Using real prefix '/usr' 21:07:05 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 21:07:05 INFO - Installing distribute.............................................................................................................................................................................................done. 21:07:07 INFO - Installing pip.................done. 21:07:07 INFO - Return code: 0 21:07:07 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 21:07:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:07 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:07 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 21:07:07 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 21:07:07 INFO - Using env: {'DISPLAY': ':0', 21:07:07 INFO - 'HOME': '/home/cltbld', 21:07:07 INFO - 'LANG': 'en_US.UTF-8', 21:07:07 INFO - 'LANGUAGE': 'en_US:en', 21:07:07 INFO - 'LOGNAME': 'cltbld', 21:07:07 INFO - 'MAIL': '/var/mail/cltbld', 21:07:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:07 INFO - 'MOZ_NO_REMOTE': '1', 21:07:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:07 INFO - 'NO_EM_RESTART': '1', 21:07:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:07 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:07 INFO - 'SHELL': '/bin/bash', 21:07:07 INFO - 'SHLVL': '1', 21:07:07 INFO - 'TERM': 'linux', 21:07:07 INFO - 'TMOUT': '86400', 21:07:07 INFO - 'USER': 'cltbld', 21:07:07 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:07 INFO - '_': '/tools/buildbot/bin/python'} 21:07:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:08 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 21:07:08 INFO - Cleaning up... 21:07:08 INFO - Return code: 0 21:07:08 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 21:07:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:08 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:08 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 21:07:08 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 21:07:08 INFO - Using env: {'DISPLAY': ':0', 21:07:08 INFO - 'HOME': '/home/cltbld', 21:07:08 INFO - 'LANG': 'en_US.UTF-8', 21:07:08 INFO - 'LANGUAGE': 'en_US:en', 21:07:08 INFO - 'LOGNAME': 'cltbld', 21:07:08 INFO - 'MAIL': '/var/mail/cltbld', 21:07:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:08 INFO - 'MOZ_NO_REMOTE': '1', 21:07:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:08 INFO - 'NO_EM_RESTART': '1', 21:07:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:08 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:08 INFO - 'SHELL': '/bin/bash', 21:07:08 INFO - 'SHLVL': '1', 21:07:08 INFO - 'TERM': 'linux', 21:07:08 INFO - 'TMOUT': '86400', 21:07:08 INFO - 'USER': 'cltbld', 21:07:08 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:08 INFO - '_': '/tools/buildbot/bin/python'} 21:07:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:08 INFO - Downloading/unpacking psutil>=0.7.1 21:07:08 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 21:07:08 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 21:07:08 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 21:07:08 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 21:07:08 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 21:07:08 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 21:07:10 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 21:07:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 21:07:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 21:07:10 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:07:10 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:07:10 INFO - Installing collected packages: psutil 21:07:10 INFO - Running setup.py install for psutil 21:07:10 INFO - building 'psutil._psutil_linux' extension 21:07:10 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 21:07:10 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 21:07:10 INFO - building 'psutil._psutil_posix' extension 21:07:10 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 21:07:10 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 21:07:10 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:07:10 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:07:10 INFO - Successfully installed psutil 21:07:10 INFO - Cleaning up... 21:07:10 INFO - Return code: 0 21:07:10 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 21:07:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:10 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:10 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 21:07:10 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 21:07:10 INFO - Using env: {'DISPLAY': ':0', 21:07:10 INFO - 'HOME': '/home/cltbld', 21:07:10 INFO - 'LANG': 'en_US.UTF-8', 21:07:10 INFO - 'LANGUAGE': 'en_US:en', 21:07:10 INFO - 'LOGNAME': 'cltbld', 21:07:10 INFO - 'MAIL': '/var/mail/cltbld', 21:07:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:10 INFO - 'MOZ_NO_REMOTE': '1', 21:07:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:10 INFO - 'NO_EM_RESTART': '1', 21:07:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:10 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:10 INFO - 'SHELL': '/bin/bash', 21:07:10 INFO - 'SHLVL': '1', 21:07:10 INFO - 'TERM': 'linux', 21:07:10 INFO - 'TMOUT': '86400', 21:07:10 INFO - 'USER': 'cltbld', 21:07:10 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:10 INFO - '_': '/tools/buildbot/bin/python'} 21:07:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:10 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 21:07:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:12 INFO - Downloading mozsystemmonitor-0.0.tar.gz 21:07:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 21:07:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 21:07:12 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 21:07:12 INFO - Installing collected packages: mozsystemmonitor 21:07:12 INFO - Running setup.py install for mozsystemmonitor 21:07:12 INFO - Successfully installed mozsystemmonitor 21:07:12 INFO - Cleaning up... 21:07:12 INFO - Return code: 0 21:07:12 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 21:07:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:12 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:12 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 21:07:12 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 21:07:12 INFO - Using env: {'DISPLAY': ':0', 21:07:12 INFO - 'HOME': '/home/cltbld', 21:07:12 INFO - 'LANG': 'en_US.UTF-8', 21:07:12 INFO - 'LANGUAGE': 'en_US:en', 21:07:12 INFO - 'LOGNAME': 'cltbld', 21:07:12 INFO - 'MAIL': '/var/mail/cltbld', 21:07:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:12 INFO - 'MOZ_NO_REMOTE': '1', 21:07:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:12 INFO - 'NO_EM_RESTART': '1', 21:07:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:12 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:12 INFO - 'SHELL': '/bin/bash', 21:07:12 INFO - 'SHLVL': '1', 21:07:12 INFO - 'TERM': 'linux', 21:07:12 INFO - 'TMOUT': '86400', 21:07:12 INFO - 'USER': 'cltbld', 21:07:12 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:12 INFO - '_': '/tools/buildbot/bin/python'} 21:07:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:13 INFO - Downloading/unpacking blobuploader==1.2.4 21:07:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:14 INFO - Downloading blobuploader-1.2.4.tar.gz 21:07:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 21:07:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 21:07:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 21:07:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:15 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 21:07:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 21:07:15 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 21:07:15 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 21:07:15 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 21:07:15 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 21:07:15 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 21:07:15 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 21:07:15 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 21:07:15 INFO - Downloading docopt-0.6.1.tar.gz 21:07:15 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 21:07:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 21:07:15 INFO - Installing collected packages: blobuploader, requests, docopt 21:07:15 INFO - Running setup.py install for blobuploader 21:07:15 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 21:07:15 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 21:07:15 INFO - Running setup.py install for requests 21:07:15 INFO - Running setup.py install for docopt 21:07:16 INFO - Successfully installed blobuploader requests docopt 21:07:16 INFO - Cleaning up... 21:07:16 INFO - Return code: 0 21:07:16 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 21:07: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')]} 21:07:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07: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')]} 21:07:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:16 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:16 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 21:07:16 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 21:07:16 INFO - Using env: {'DISPLAY': ':0', 21:07:16 INFO - 'HOME': '/home/cltbld', 21:07:16 INFO - 'LANG': 'en_US.UTF-8', 21:07:16 INFO - 'LANGUAGE': 'en_US:en', 21:07:16 INFO - 'LOGNAME': 'cltbld', 21:07:16 INFO - 'MAIL': '/var/mail/cltbld', 21:07:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:16 INFO - 'MOZ_NO_REMOTE': '1', 21:07:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:16 INFO - 'NO_EM_RESTART': '1', 21:07:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:16 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:16 INFO - 'SHELL': '/bin/bash', 21:07:16 INFO - 'SHLVL': '1', 21:07:16 INFO - 'TERM': 'linux', 21:07:16 INFO - 'TMOUT': '86400', 21:07:16 INFO - 'USER': 'cltbld', 21:07:16 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:16 INFO - '_': '/tools/buildbot/bin/python'} 21:07:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 21:07:16 INFO - Running setup.py (path:/tmp/pip-jGuNqo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 21:07:16 INFO - Running setup.py (path:/tmp/pip-HVuYW5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 21:07:16 INFO - Running setup.py (path:/tmp/pip-wQPRKh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 21:07:16 INFO - Running setup.py (path:/tmp/pip-Tzcxsl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 21:07:16 INFO - Running setup.py (path:/tmp/pip-jd46IP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 21:07:16 INFO - Running setup.py (path:/tmp/pip-tyzqxZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 21:07:16 INFO - Running setup.py (path:/tmp/pip-kXZNLu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 21:07:16 INFO - Running setup.py (path:/tmp/pip-bI0CQj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 21:07:16 INFO - Running setup.py (path:/tmp/pip-mC3eRp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 21:07:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 21:07:16 INFO - Running setup.py (path:/tmp/pip-og7K2R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 21:07:17 INFO - Running setup.py (path:/tmp/pip-3GqJoG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 21:07:17 INFO - Running setup.py (path:/tmp/pip-7stD3v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 21:07:17 INFO - Running setup.py (path:/tmp/pip-r8upfo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 21:07:17 INFO - Running setup.py (path:/tmp/pip-JoPlVI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 21:07:17 INFO - Running setup.py (path:/tmp/pip-qeJpIX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 21:07:17 INFO - Running setup.py (path:/tmp/pip-UCqxp1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 21:07:17 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 21:07:17 INFO - Running setup.py (path:/tmp/pip-YdZ4Ts-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 21:07:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 21:07:17 INFO - Running setup.py install for manifestparser 21:07:17 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 21:07:17 INFO - Running setup.py install for mozcrash 21:07:17 INFO - Running setup.py install for mozdebug 21:07:17 INFO - Running setup.py install for mozdevice 21:07:17 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 21:07:17 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 21:07:17 INFO - Running setup.py install for mozfile 21:07:18 INFO - Running setup.py install for mozhttpd 21:07:18 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozinfo 21:07:18 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozInstall 21:07:18 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozleak 21:07:18 INFO - Running setup.py install for mozlog 21:07:18 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for moznetwork 21:07:18 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozprocess 21:07:18 INFO - Running setup.py install for mozprofile 21:07:18 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozrunner 21:07:18 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 21:07:18 INFO - Running setup.py install for mozscreenshot 21:07:19 INFO - Running setup.py install for moztest 21:07:19 INFO - Running setup.py install for mozversion 21:07:19 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 21:07:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 21:07:19 INFO - Cleaning up... 21:07:19 INFO - Return code: 0 21:07:19 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 21:07:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:19 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:19 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 21:07:19 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 21:07:19 INFO - Using env: {'DISPLAY': ':0', 21:07:19 INFO - 'HOME': '/home/cltbld', 21:07:19 INFO - 'LANG': 'en_US.UTF-8', 21:07:19 INFO - 'LANGUAGE': 'en_US:en', 21:07:19 INFO - 'LOGNAME': 'cltbld', 21:07:19 INFO - 'MAIL': '/var/mail/cltbld', 21:07:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:19 INFO - 'MOZ_NO_REMOTE': '1', 21:07:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:19 INFO - 'NO_EM_RESTART': '1', 21:07:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:19 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:19 INFO - 'SHELL': '/bin/bash', 21:07:19 INFO - 'SHLVL': '1', 21:07:19 INFO - 'TERM': 'linux', 21:07:19 INFO - 'TMOUT': '86400', 21:07:19 INFO - 'USER': 'cltbld', 21:07:19 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:19 INFO - '_': '/tools/buildbot/bin/python'} 21:07:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 21:07:19 INFO - Running setup.py (path:/tmp/pip-FwJW9e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 21:07:19 INFO - Running setup.py (path:/tmp/pip-bq5_oR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 21:07:19 INFO - Running setup.py (path:/tmp/pip-acEja3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 21:07:19 INFO - Running setup.py (path:/tmp/pip-gbw1QF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 21:07:19 INFO - Running setup.py (path:/tmp/pip-cvYSJA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 21:07:19 INFO - Running setup.py (path:/tmp/pip-JS7vJ6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 21:07:19 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)) 21:07:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 21:07:19 INFO - Running setup.py (path:/tmp/pip-gP6VYa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 21:07:20 INFO - Running setup.py (path:/tmp/pip-oHIHjV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 21:07:20 INFO - Running setup.py (path:/tmp/pip-CMk9VW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 21:07:20 INFO - Running setup.py (path:/tmp/pip-eWX6HZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 21:07:20 INFO - Running setup.py (path:/tmp/pip-Y4ifcx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 21:07:20 INFO - Running setup.py (path:/tmp/pip-jNjva6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 21:07:20 INFO - Running setup.py (path:/tmp/pip-fn3hS6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 21:07:20 INFO - Running setup.py (path:/tmp/pip-0cWx41-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 21:07:20 INFO - Running setup.py (path:/tmp/pip-IbQUK8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 21:07:20 INFO - Running setup.py (path:/tmp/pip-EOGnw3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 21:07:20 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)) 21:07:20 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 21:07:20 INFO - Running setup.py (path:/tmp/pip-dKEvtd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 21:07:20 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)) 21:07:20 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)) 21:07:20 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)) 21:07:20 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)) 21:07:20 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)) 21:07:20 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)) 21:07:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 21:07:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 21:07:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:07:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:07:22 INFO - Downloading blessings-1.5.1.tar.gz 21:07:22 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 21:07:22 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 21:07:22 INFO - Installing collected packages: blessings 21:07:22 INFO - Running setup.py install for blessings 21:07:22 INFO - Successfully installed blessings 21:07:22 INFO - Cleaning up... 21:07:22 INFO - Return code: 0 21:07:22 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 21:07:22 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 21:07:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 21:07:22 INFO - Reading from file tmpfile_stdout 21:07:22 INFO - Current package versions: 21:07:22 INFO - argparse == 1.2.1 21:07:22 INFO - blessings == 1.5.1 21:07:22 INFO - blobuploader == 1.2.4 21:07:22 INFO - docopt == 0.6.1 21:07:22 INFO - manifestparser == 1.1 21:07:22 INFO - mozInstall == 1.12 21:07:22 INFO - mozcrash == 0.16 21:07:22 INFO - mozdebug == 0.1 21:07:22 INFO - mozdevice == 0.47 21:07:22 INFO - mozfile == 1.2 21:07:22 INFO - mozhttpd == 0.7 21:07:22 INFO - mozinfo == 0.9 21:07:22 INFO - mozleak == 0.1 21:07:22 INFO - mozlog == 3.1 21:07:22 INFO - moznetwork == 0.27 21:07:22 INFO - mozprocess == 0.22 21:07:22 INFO - mozprofile == 0.27 21:07:22 INFO - mozrunner == 6.11 21:07:22 INFO - mozscreenshot == 0.1 21:07:22 INFO - mozsystemmonitor == 0.0 21:07:22 INFO - moztest == 0.7 21:07:22 INFO - mozversion == 1.4 21:07:22 INFO - psutil == 3.1.1 21:07:22 INFO - requests == 1.2.3 21:07:22 INFO - wsgiref == 0.1.2 21:07:22 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 21:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:22 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:22 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 21:07:22 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 21:07:22 INFO - Using env: {'DISPLAY': ':0', 21:07:22 INFO - 'HOME': '/home/cltbld', 21:07:22 INFO - 'LANG': 'en_US.UTF-8', 21:07:22 INFO - 'LANGUAGE': 'en_US:en', 21:07:22 INFO - 'LOGNAME': 'cltbld', 21:07:22 INFO - 'MAIL': '/var/mail/cltbld', 21:07:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:22 INFO - 'MOZ_NO_REMOTE': '1', 21:07:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:22 INFO - 'NO_EM_RESTART': '1', 21:07:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:22 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:22 INFO - 'SHELL': '/bin/bash', 21:07:22 INFO - 'SHLVL': '1', 21:07:22 INFO - 'TERM': 'linux', 21:07:22 INFO - 'TMOUT': '86400', 21:07:22 INFO - 'USER': 'cltbld', 21:07:22 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:22 INFO - '_': '/tools/buildbot/bin/python'} 21:07:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 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)) 21:07:23 INFO - Cleaning up... 21:07:23 INFO - Return code: 0 21:07:23 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 21:07:23 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')]} 21:07:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:23 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')]} 21:07:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:23 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:23 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 21:07:23 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 21:07:23 INFO - Using env: {'DISPLAY': ':0', 21:07:23 INFO - 'HOME': '/home/cltbld', 21:07:23 INFO - 'LANG': 'en_US.UTF-8', 21:07:23 INFO - 'LANGUAGE': 'en_US:en', 21:07:23 INFO - 'LOGNAME': 'cltbld', 21:07:23 INFO - 'MAIL': '/var/mail/cltbld', 21:07:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:23 INFO - 'MOZ_NO_REMOTE': '1', 21:07:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:23 INFO - 'NO_EM_RESTART': '1', 21:07:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:23 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:23 INFO - 'SHELL': '/bin/bash', 21:07:23 INFO - 'SHLVL': '1', 21:07:23 INFO - 'TERM': 'linux', 21:07:23 INFO - 'TMOUT': '86400', 21:07:23 INFO - 'USER': 'cltbld', 21:07:23 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:23 INFO - '_': '/tools/buildbot/bin/python'} 21:07:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:23 INFO - Downloading/unpacking jsonschema 21:07:23 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 21:07:23 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 21:07:23 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 21:07:23 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 21:07:23 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 21:07:23 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 21:07:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 21:07:25 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 21:07:25 INFO - Downloading/unpacking functools32 (from jsonschema) 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 INFO - Downloading functools32-3.2.3-2.tar.gz 21:07:25 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 21:07:25 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 21:07:25 INFO - warning: no files found matching '*.txt' 21:07:25 INFO - no previously-included directories found matching 'build' 21:07:25 INFO - no previously-included directories found matching 'dist' 21:07:25 INFO - no previously-included directories found matching '.git*' 21:07:25 INFO - Installing collected packages: jsonschema, functools32 21:07:25 INFO - Running setup.py install for functools32 21:07:25 INFO - warning: no files found matching '*.txt' 21:07:25 INFO - no previously-included directories found matching 'build' 21:07:25 INFO - no previously-included directories found matching 'dist' 21:07:25 INFO - no previously-included directories found matching '.git*' 21:07:25 INFO - Successfully installed jsonschema functools32 21:07:25 INFO - Cleaning up... 21:07:25 INFO - Return code: 0 21:07:25 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 21:07: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')]} 21:07:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:07:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07: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')]} 21:07:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:07:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 21:07:25 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 0x7fe64310df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdef8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xebd450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, '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': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', '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 21:07:25 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 21:07:25 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 21:07:25 INFO - Using env: {'DISPLAY': ':0', 21:07:25 INFO - 'HOME': '/home/cltbld', 21:07:25 INFO - 'LANG': 'en_US.UTF-8', 21:07:25 INFO - 'LANGUAGE': 'en_US:en', 21:07:25 INFO - 'LOGNAME': 'cltbld', 21:07:25 INFO - 'MAIL': '/var/mail/cltbld', 21:07:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:25 INFO - 'MOZ_NO_REMOTE': '1', 21:07:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:25 INFO - 'NO_EM_RESTART': '1', 21:07:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:25 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:25 INFO - 'SHELL': '/bin/bash', 21:07:25 INFO - 'SHLVL': '1', 21:07:25 INFO - 'TERM': 'linux', 21:07:25 INFO - 'TMOUT': '86400', 21:07:25 INFO - 'USER': 'cltbld', 21:07:25 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:25 INFO - '_': '/tools/buildbot/bin/python'} 21:07:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:07:25 INFO - Downloading/unpacking flake8 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:25 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 21:07:27 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 21:07:27 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 21:07:27 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 21:07:27 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 21:07:27 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:27 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 21:07:28 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 21:07:28 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 21:07:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 21:07:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 21:07:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 21:07:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 21:07:28 INFO - no previously-included directories found matching 'docs/_build' 21:07:28 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 21:07:28 INFO - Running setup.py install for pep8 21:07:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 21:07:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 21:07:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 21:07:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 21:07:28 INFO - no previously-included directories found matching 'docs/_build' 21:07:28 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 21:07:28 INFO - Successfully installed flake8 mccabe pyflakes pep8 21:07:28 INFO - Cleaning up... 21:07:28 INFO - Return code: 0 21:07:28 INFO - Running post-action listener: _resource_record_post_action 21:07:28 INFO - Running post-action listener: _start_resource_monitoring 21:07:28 INFO - Starting resource monitoring. 21:07:28 INFO - ##### 21:07:28 INFO - ##### Running install step. 21:07:28 INFO - ##### 21:07:28 INFO - Running pre-action listener: _resource_record_pre_action 21:07:28 INFO - Running main action method: install 21:07:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 21:07:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 21:07:28 INFO - Reading from file tmpfile_stdout 21:07:28 INFO - Detecting whether we're running mozinstall >=1.0... 21:07:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 21:07:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 21:07:28 INFO - Reading from file tmpfile_stdout 21:07:28 INFO - Output received: 21:07:28 INFO - Usage: mozinstall [options] installer 21:07:28 INFO - Options: 21:07:28 INFO - -h, --help show this help message and exit 21:07:28 INFO - -d DEST, --destination=DEST 21:07:28 INFO - Directory to install application into. [default: 21:07:28 INFO - "/builds/slave/test-pgo"] 21:07:28 INFO - --app=APP Application being installed. [default: firefox] 21:07:28 INFO - mkdir: /builds/slave/test-pgo/build/application 21:07:28 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'] 21:07:28 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 21:07:43 INFO - Reading from file tmpfile_stdout 21:07:43 INFO - Output received: 21:07:43 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 21:07:43 INFO - Running post-action listener: _resource_record_post_action 21:07:43 INFO - ##### 21:07:43 INFO - ##### Running run-tests step. 21:07:43 INFO - ##### 21:07:43 INFO - Running pre-action listener: _resource_record_pre_action 21:07:43 INFO - Running main action method: run_tests 21:07:43 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 21:07:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 21:07:43 INFO - Python 2.7.3 21:07:43 INFO - Return code: 0 21:07:43 INFO - grabbing minidump binary from tooltool 21:07:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 21:07:43 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 0xf4fa50>, '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 0xebb550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xebb9e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 21:07:43 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 21:07:43 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 21:07:43 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 21:07:43 INFO - Return code: 0 21:07:43 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 21:07:43 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 21:07:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 21:07:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 21:07:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 21:07:43 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 21:07:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 21:07:44 INFO - Return code: 0 21:07:44 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/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 21:07:44 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/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-046 --webServer localhost 21:07:44 INFO - Using env: {'DISPLAY': ':0', 21:07:44 INFO - 'HOME': '/home/cltbld', 21:07:44 INFO - 'LANG': 'en_US.UTF-8', 21:07:44 INFO - 'LANGUAGE': 'en_US:en', 21:07:44 INFO - 'LOGNAME': 'cltbld', 21:07:44 INFO - 'MAIL': '/var/mail/cltbld', 21:07:44 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 21:07:44 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 21:07:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:07:44 INFO - 'MOZ_NO_REMOTE': '1', 21:07:44 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 21:07:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:07:44 INFO - 'NO_EM_RESTART': '1', 21:07:44 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:07:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 21:07:44 INFO - 'PWD': '/builds/slave/test-pgo', 21:07:44 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 21:07:44 INFO - 'SHELL': '/bin/bash', 21:07:44 INFO - 'SHLVL': '1', 21:07:44 INFO - 'TERM': 'linux', 21:07:44 INFO - 'TMOUT': '86400', 21:07:44 INFO - 'USER': 'cltbld', 21:07:44 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249', 21:07:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:07:44 INFO - '_': '/tools/buildbot/bin/python'} 21:07:44 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/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost'] with output_timeout 3600 21:07:44 INFO - mozversion INFO | application_buildid: 20160110185232 21:07:44 INFO - mozversion INFO | application_changeset: 35d941a0a9be39902070b6cd896c38a3090dfdb7 21:07:44 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 21:07:44 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 21:07:44 INFO - mozversion INFO | application_name: Firefox 21:07:44 INFO - mozversion INFO | application_remotingname: firefox-dev 21:07:44 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 21:07:44 INFO - mozversion INFO | application_vendor: Mozilla 21:07:44 INFO - mozversion INFO | application_version: 45.0a2 21:07:44 INFO - mozversion INFO | platform_buildid: 20160110185232 21:07:44 INFO - mozversion INFO | platform_changeset: 35d941a0a9be39902070b6cd896c38a3090dfdb7 21:07:44 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 21:07:44 INFO - mozversion INFO | platform_version: 45.0a2 21:07:44 INFO - 2016-01-10 21:07:44,510 DEBUG : using testdate: 1452488864 21:07:44 INFO - 2016-01-10 21:07:44,510 DEBUG : actual date: 1452488864 21:07:44 INFO - 2016-01-10 21:07:44,590 INFO : starting webserver on 'localhost:45274' 21:07:44 INFO - 2016-01-10 21:07:44,591 INFO : Starting test suite talos-linux64-ix-046.e 21:07:44 INFO - 2016-01-10 21:07:44,591 INFO : Starting test dromaeo_css 21:07:44 INFO - 2016-01-10 21:07:44,591 DEBUG : operating with platform_type : linux_ 21:07:44 INFO - 2016-01-10 21:07:44,592 INFO : Initialising browser for dromaeo_css test... 21:07:44 INFO - 2016-01-10 21:07:44,608 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpks1j7C/profile http://localhost:45274/getInfo.html 21:07:48 INFO - 2016-01-10 21:07:48,913 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 21:07:48 INFO - 2016-01-10 21:07:48,914 DEBUG : BROWSER_OUTPUT: colorDepth:24 21:07:48 INFO - 2016-01-10 21:07:48,914 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 21:07:48 INFO - 2016-01-10 21:07:48,914 DEBUG : BROWSER_OUTPUT: __metrics 21:07:49 INFO - 2016-01-10 21:07:49,849 INFO : Browser initialized. 21:07:49 INFO - 2016-01-10 21:07:49,850 INFO : Running cycle 1/1 for dromaeo_css test... 21:07:49 INFO - 2016-01-10 21:07:49,850 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpks1j7C/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 21:08:01 INFO - 2016-01-10 21:08:01,614 DEBUG : BROWSER_OUTPUT: RSS: Main: 136953856 21:08:01 INFO - 2016-01-10 21:08:01,615 DEBUG : BROWSER_OUTPUT: 21:08:51 INFO - 2016-01-10 21:08:51,212 DEBUG : BROWSER_OUTPUT: 1452488931204 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] 21:10:59 INFO - 2016-01-10 21:10:59,123 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45274/tests/dromaeo/cssquery-ext.html) 21:11:00 INFO - 2016-01-10 21:11:00,241 DEBUG : BROWSER_OUTPUT: RSS: Main: 141938688 21:11:00 INFO - 2016-01-10 21:11:00,242 DEBUG : BROWSER_OUTPUT: 21:14:02 INFO - 2016-01-10 21:14:02,025 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-ext.html (next: http://localhost:45274/tests/dromaeo/cssquery-jquery.html) 21:14:02 INFO - 2016-01-10 21:14:02,613 DEBUG : BROWSER_OUTPUT: RSS: Main: 140210176 21:14:02 INFO - 2016-01-10 21:14:02,613 DEBUG : BROWSER_OUTPUT: 21:17:04 INFO - 2016-01-10 21:17:04,251 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45274/tests/dromaeo/cssquery-mootools.html) 21:17:04 INFO - 2016-01-10 21:17:04,832 DEBUG : BROWSER_OUTPUT: RSS: Main: 139497472 21:17:04 INFO - 2016-01-10 21:17:04,833 DEBUG : BROWSER_OUTPUT: 21:20:06 INFO - 2016-01-10 21:20:06,424 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45274/tests/dromaeo/cssquery-prototype.html) 21:20:07 INFO - 2016-01-10 21:20:07,018 DEBUG : BROWSER_OUTPUT: RSS: Main: 139661312 21:20:07 INFO - 2016-01-10 21:20:07,018 DEBUG : BROWSER_OUTPUT: 21:23:09 INFO - 2016-01-10 21:23:09,234 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45274/tests/dromaeo/cssquery-yui.html) 21:23:09 INFO - 2016-01-10 21:23:09,823 DEBUG : BROWSER_OUTPUT: RSS: Main: 139079680 21:23:09 INFO - 2016-01-10 21:23:09,823 DEBUG : BROWSER_OUTPUT: 21:26:11 INFO - 2016-01-10 21:26:11,841 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/dromaeo/cssquery-yui.html (next: http://localhost:45274/tests/dromaeo/cssquery-dojo.html) 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: RSS: Main: 141455360 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: __start_tp_report 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 21:26:12 INFO - 2016-01-10 21:26:12,099 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3327.5175099610556;3424.760266781325;3440.2087519870447;3457.4986626939094;3463.6363181865904;5524.861878453041;5559.11054231323;5562.388137304898;5567.192757050226;5603.1315146152365;5583.6928968906695;5616.354119276284;5657.377688454267;5657.632253903494;5709.77160913563;5144.61415393846;5176.378834539842;5214.165733482643;5228.398734145565;5230.816921407752;5032.169692000815;5056.342675452186;5117.641765076446;5137;5211.348581427322;5102.209157580581;5173.974130129344;5185.455527169649;5190.636655434121;5210.609204309692;5194.142966410556;5228.895422091575;5229.764660590283;5237.921431178497;5271.262023316739;4930.309756634074;4967.577755890754;5006.199008158677;5109.974450127763;5130.640855140105;5351.839444816662;5423.969445805324;5437.34751829783;5497.615166938316;5502.0371434999115;6080.027195648675;6099.115628233882;6151.261848578154;6152.446279834791;6159.353267906895;5950.375210602911;6026.728797204137;6072.423119803611;6119.541034422392;6162.198914141178;5590.602349412647;5633.718314084321;5659.783146623496;5688.175214593861;5750.7987220447085;6136.815895523141;6164.198654175018;6192.164057852222;6193.721282542297;6201.069839524017;5766.481016708432;5962.642241465526;5963.7912673056235;5967.910481342783;5981.401859814071;5856.209411729362;5918.201042859245;5961.135635332939;6025.638461692312;6031;6021.698915054318;6068.605540639845;6083.300420451616;6087.634741915499;6098.298695650057;5680.943190568124;6071.241094863142;6082.878342433127;6091.177691011745;6112.541559383064;4571.611413029863;4577.22187228172;4601.562851529099;4604;4676.836310729108;4167.562405947392;4169.3120635094865;4183.686223533247;4193.475815523059;4208.116295577902;5880.088586269135;5892.322382925932;5896.262967129109;5898.970505147533;5901.0558310670085;5926.259217597801;6039.607425517327;6074.088886667036;6121.123721227671;6164.722587483484;5800.8259752207505;5829.300483941869;5829.88340233193;5834.708264586754;5846.473817356373;5093.541581257705;5232.529072383504;5310.840674779763;5314.7608357624;5329.307190065267;6100.267967843887;6169.691515424301;6281.7173227204885;6293.527985401021;6302.212223472066;6019.067044608093;6029.336772954972;6056.394360563909;6066.939330606638;6070.18052562916;5981.730822112929;6138.877222455437;6180.72890664004;6181.690915454119;6210.968945155245;5896;5981.222441082631;5981.222441082806;6021.367756385692;6047.0627052806885;6088.908666369919;6158.661273629993;6199.039148931923;6214.5028397728975;6235.657038862906;5790.363060063305;5880.94119058804;5919.200907877382;6060.787872424444;6074.210352654127;6013.188219590299;6018.3680713524445;6043.667598281961;6048.032314829607;6049.485793707584;5824.708764561839;5902.1146827976145;5920.437558431942;5926.111083337534;5928.673922934107;5748.396418376177;5768.278965129359;5902.763889444374;6035.6076855004285;6060.727267273071;5764.337101233412;5780.161876527964;5812.505936995233;5851.64890106595;5887.7056147193325 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |1;ext.html;609.6342194683187;647.6502688548185;656.6782276684426;674.787441955784;676.0265218085959;40329.19341613166;41100.794496027476;41382.58617413825;41643.37534936978;41656;45925.77037114818;46370.76814615931;46371.30443043357;46402.76798616002;46411;9026.954865225665;9216.216621587173;9243.676471323504;9246.67636632718;9247.58385872634;8999.550022498881;9033.277337812959;9050.456972581633;9070.682526111588;9080.727578172633;8968.282537397024;9013.504257265848;9018.86471702925;9049.411788233776;9053.230475409599;9021.278297736199;9065.773355666095;9069.909300907006;9086.727398178;9093.363464557484;8962.193402593733;9119.270458363315;9135.36052476327;9148.4968326742;9155.13026262504;42024;42257.577424225674;42322.57677423248;42339.36490952638;42577.57422425767;3629.981850090759;3763.7929913854728;3793.848246070154;3944.1322908959983;4242.427272318259;31685.20786980344;31836.20409489758;31861.840690796398;32487.512687309474;33414.16464588381;4235.470566179228;4382.145481631083;4398.296272596369;4424.446944131983;4433.9801845575375;266422;272479;366072;366903;368828.15585922165;66703.33296666971;67075.32924670789;67432.3256767426;67506;67520.3247967524;72030.63984680148;72276.63861680658;72809;72887.63556182185;72966.27033729595;17931.820681793015;17971.101444927703;18078.09609519519;18087.18607662658;18198.5450363742;13980.091294065853;14008.089474184146;14013.5095271665;14075.577732668036;14105.506307279196;21846.781532184792;22289;22291.777082229295;22313.442163945707;22315.442113946956;8221.876671849926;8491.490510569385;8545.615447304763;8614.698485552975;8740.562971851383;1059.9453543724044;1096.13405409727;1102.73534351755;1112.1158678850334;1114.8439218509416;28796;28929.566056509168;29113;29551.113466596038;29827.85086074556;1130.5760339872547;1146.9655910322704;1151.5508951508918;1157.2188772578645;1223.2721530689225;15235.847641523664;15294.388224471119;15394.0819476079;15526.223688815515;15574.454894078879;354484;573295;574973.2502675003;578645;578794;60028.39971600316;60909.695451523345;61057;61135.38864611386;61371.079433808525;1483.9629009274854;1499.3702644889172;1509.5697726148214;1510.9546713598609;1518.7494063479623;31228.687713123487;31752.841235793672;31802.840985794923;31888.202794930312;32121.35757284888;49101;49664.503354965986;49671.25493117679;49756.75121624369;49844.25233621426;321355;326581;328123;328492;328818;35124.29751404907;35203;35292.823535882155;35617.93146205618;49847.50152498428;45411.318830216915;45428.77285613551;45658.31512527381;45983.31025034694;46434.53565464302;39177;39365.80317098396;39823.60176398315;39968;40317.79841100776;38498.6150138495;39096;39135.80432097821;39145.41281880831;39314.80342598269;43870.34194487021;44377.55622443734;44909.775451122536;45695.77152114218;45868.77065614651;33797;33828.83085584556;33888.322233555686;34184.48723269203;34518.30963380769;26653.365588448323;26931;27196.864015680585;27220.31949201286;27411.45177096407 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |2;jquery.html;386.97678139311626;394.6172212953436;397.06689280191546;399.75015615240477;400.85969910531315;16180.27188776505;17205.053722045282;17690.823091769096;19359.516012099706;19429.12568934398;11466.48400821963;12191.634250972464;13936.79094813576;18255.087245637696;18549.53626159347;4298.161858437606;5064.3669541307245;5147.330846989886;5602.271704678386;5641.52047075997;5590.2732644756325;5630.127330263796;5647.519960803336;5658.292713410824;5662.207290979266;5495.395506494302;5567.109262517998;5604.187392828037;5625.156226566007;5636.15457681347;5478.972605136989;5502.8349149525575;5503.559715222773;5509.118541033436;5509.917351239735;4923.138450771101;4986.5013498650205;5066.518680725325;5069.214271787879;5080.923786143211;14022.92988535061;14040.087394319336;14107.083039602392;20183.89908050465;22094.779052209433;2334.0663734506165;2355.3522781235297;2360.9173678921156;2380.845871295151;2449.9020039198413;10149;10343.948280258626;10388;10514.684559463229;10527.210459215514;1922.80771922808;1942.7377304063912;1977.0114942528735;1977.7824439311664;2023.6660950943076;64503;67532.3246767531;67771.66114169447;70095;70234.99999999949;11303.773924521463;11571.884281157249;11583.942080289713;11602.361870097056;11623.244489108181;14897.18065506386;14917.104973701613;14961;14973;14977.400903963937;8746.125387461203;8760.948686157702;8813.338999575057;8819.162179592928;8832.51421171829;8755.0807165248;8785;8794.076621954602;8809.251213646912;8841.071687472851;4787.688800227974;4891.119598472309;4927.310176575283;4927.90144197114;4944.752762361867;1941.3205378117827;1951.1219951022097;1959.2652755216793;2023.3019608235136;2026.979730202679;986.6842610364614;1026.5175367577226;1107.9002889739802;1121.383239218443;1156.6067537037447;16926.74609880853;17579.296828126986;17746.20142093609;18113;18321.81678183201;1010.5842253184337;1028.92797504174;1033.3076838518061;1043.2384359417667;1045.2630895219004;10083.092521672937;10197.592096316064;10206.540705668263;10313.329633573794;10324;571899;587823;591413;601222;627155;80876;84338;85362;85540.57229713812;86752.56623716842;1163.9825402618967;1202.500962100736;1202.6650418035972;1203.6268756685456;1205.433446280247;15978.440754573534;16254.918725406298;16310.102944338176;16313.10277934725;16574.917125414297;37891.62108378991;38055.80972095122;38255.23489530249;38799;39421.60578394294;47121.76439117782;47492;47784.761076194394;48550.75724621354;50057;10152.187824973837;10217.795644087226;10595.258331916692;10686.625968091079;10705.304155230197;17563.912180439016;18158.728888978174;18248.36130735418;18257.908710456362;18303.633927321112;15172.544823655307;15455.381784728484;15503.689926201638;15857.762133568236;15898.60253493672;14930.552083437515;14947.551573452814;15277.541673749805;15423.074615522655;15638.765418518959;15821.446249381217;15951.760723588923;15952;16043.759343610089;16149.515514534583;9824.45965471906;10157.441340726331;10225.897741022494;10238.744031398977;10860.945695271474;15754.041719054792;15802.68394632078;16019.279132439302;16186;16470.75293870617 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1573.6459296658254;1586.880983926205;1815.8547316214704;1859;1864.4033909149068;7504.774856754299;7882.60586970652;7932.841343173133;7969.561674107922;8039.276465118138;7809.843803123934;7864.724734634289;7900.486468379566;7936.365090792737;7957.72147974821;2274.8521346112448;2300.804431623314;2304.700388949434;2314.780095890896;2315.641075633271;2293.6444851048113;2316.872572008539;2336.7663233676667;2337.100216416675;2344.648302754592;2225.121077174515;2238.3956331790405;2270.398344438725;2276;2280.304507125326;2250.549890021994;2255.954880902389;2302.458922153284;2311.8150547956207;2313.49103197298;2308.6421604651305;2327.627579587275;2331.7668233176546;2339.63735620979;2343.2267351774044;7913.446058775888;8006.479578827358;8017.318527925133;8025.638846251933;8030.678772849079;4726.810927562893;4815.951840481621;4818.710877347336;4819.277108433728;4824.927626085611;2914.3588410549646;2919.5474701421103;2953.114065780279;2979.4488019716205;2996.805207661495;913.8126684029825;919.3840127114782;923.8983711791698;928.4614923344444;945.7351941456403;11087.168462365275;11159.27464714791;11190.44047797615;11197.832032519518;11241.044511216556;4190.057237121623;4236.279832428495;4239.618434340924;4267.935980960288;4334.111507141029;8922.776930576787;8955.776105597412;8959.73120806377;8975;8976.730698079067;4860.8298709545;4866.805327786919;4888.633352498577;4906.1414252505665;4908.828191013297;4389.40742999691;4435.911281774346;4476.798544065525;4501.897035226325;4515.164694531522;3491.354099491602;3500.984714432837;3544.822758862098;3558.146044949245;3563.465480177942;1001.839705647093;1023.4831410137833;1029.8455231715302;1031.3605564550028;1037.8131936251395;1101.680512651322;1104.2380757277613;1148.6496618531262;1258.9118761686593;1319.0436933223336;7360.889586656204;7362.9631851840395;7461.067366579177;7464.813379665552;7466.178720340758;1189.5598628507507;1198.7722332756748;1200.6758175292623;1210.606552870303;1210.7820592293297;5913.113033045078;5942.8811423771285;5964.701764911737;5966.343702192756;5973.731182096816;9337.533123343941;9730.075642813921;9762.560684769202;9853.408795472295;9904.653337133166;9560.904390956;9618.51907404627;9647.517624118906;9663.661771837951;9689.41863488193;7478.775636730907;7629.122650895107;7631.084269887649;7646.694132234759;7708.152103268636;7274.636268186464;7297.452691048086;7319.377852882564;7329.486935914435;7435.256474352522;8532.91467085346;8576.27101696338;8678.82642347137;8697.608607612547;8734.388592798443;8471.745847624581;8805.295576354005;8872.645094196418;8875.644974201217;8936.329775266751;7175.605341706257;7181.245969173162;7235.927640723736;7241.348278654947;7258.745943891939;7621.961890190513;7637.88543171864;7704;7706.884396733942;7747.806304842198;7151.177614574391;7215.098112735908;7256.963715181601;7287.744928927462;7315.524490908074;7100.396466300215;7134.286571342825;7167.104111986002;7210.71157153708;7241.710331586678;7306.4520160989205;7309.488335816442;7342.669579869025;7358.742444014434;7362.447816413897;6377.426031657174;6378.9362106380195;6417.133686952202;6429.8714025720155;6452.193475815523;6361.936380636134;6447.967760161169;6473.708683109177;6475.805725828232;6490.058941453557 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |4;prototype.html;369.09755647442;370.2890450335357;372.06611405372524;372.9981350093249;376.9321522126018;6281.492441813966;6393.0410438434255;6410.102585638003;6437.839054023651;6446.355364463551;6134.907976380347;6277.560570760049;6296.150019747344;6310.779122730705;6359.141515895364;4923.704577725348;4933.531314525123;4936.7037977721275;4938.506149385069;4944.505549445063;4942.209246520558;4946.332245146913;4948.554630083292;4949.628777841658;4963.478834722357;4687.390639216897;4811.254255590372;4822.324874517571;4856.781444834991;4863.294822250771;4849.660523763338;4849.757512124415;4854.393200849894;4855;4868.732219727914;4235.089455766994;4245.872623821259;4252.659787217046;4254.08537164508;4254.255505286563;6024.126501657279;6068.939310606882;6085.786997455112;6142.84642883927;6158.322584515699;5631.577631677641;5634.887302253932;5650.124230744241;5657.745401456944;5700.572457065695;6704.5306828522025;6748.291429399891;6759.425448836855;6780.8304792380095;6800.387965083117;4738.526147385269;4760.761961901926;4769.4515130760055;4772.856814295542;4777.187878060703;6909.1018167637885;6960.129983752031;7002.684879180449;7037.261087585781;7061.50569460138;4851.684640498356;4860.1008813369635;4864.367632207861;4864.708117512961;4866.48901865299;4924.556789888928;4925.852224433273;4929.309896614477;4933.136701077297;4939.357883475197;5564.360098588714;5691.743871525791;5698.7435565399655;5704.11586204139;5709.115087161496;6844.657767111625;6871.587704737732;6871.725130994704;6877.105976223159;6883.070785443901;1687.2744719770371;1734.5923707928628;1735.8003829559761;1737.6350966297218;1738.608813017061;1139.9601013964636;1152.262551966742;1163.313644949467;1166.6791632301185;1183.1303991566192;6514.934850651528;6572.86854262912;6586.407223349922;6601.8349541260895;6605.70274337656;6991.300869912968;7021.859562808715;7047.647617619098;7057.188423331382;7060.894086588705;6403.199600049994;6583.407493325623;6589.967050164814;6601.372869577479;6614.0740296358545;3796.4495148203355;3815.751976121543;3832;3835.1562656216147;3841.193349396602;7186.568805871664;7232.132144142736;7233.638318084075;7238.565686058748;7243.5653860768525;7140.143182818095;7186.712531498786;7197.856042879218;7208.315210055036;7392;7316.780496585111;7321.158066822277;7325.560466372035;7327.010853534811;7340.449466289942;7166.605836679033;7170.175429825428;7171.748988785576;7199.316064973819;7199.3520583147765;6912.135983002125;7069.469789765685;7073.080499535027;7079.646017699198;7082.4688148390105;7367.963160184165;7383.07711536058;7389.150247721581;7391.260873912565;7407.333339999426;4830.082284365959;4874.878128046827;4883.8290659826735;4887.780049897834;4889.657723959289;6995.895061573979;7054.717811287696;7184.066071410683;7192.244814294424;7197.388222001188;6887.242403335729;6960.8955865663065;6989.580625162506;6991.755288564876;6992.61540615271;6832.692528836114;6898.724051038103;6955.756548520778;6968.268331825288;6978.302169782981;6652.168478940132;6788.389044985975;6809.250982392032;6841.076454678555;6862.759803406857;6965.129358830146;6985.825354366181;6994.720211191699;6999.580025198301;7003.089598352181;6716.227633822173;6721.831954201184;6745.5952642841585;6750.831229219309;6768.661566921536 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: |5;yui.html;706.660802814649;830.5473516933273;851.6593362654941;881.268547105902;937.2595649436945;14383.712325753491;14528.854711452883;14602.269886505685;14636.34136463859;14670.706585868276;16221.513354599352;16456.09491477971;16491.09298988555;16495.422660206896;16511.504654860375;904.891413030434;913.5021413329752;923.9168474837263;924.6486335192651;925.509479975614;922.446532080753;929.3680297397767;930.1767935377206;930.9674161404353;932.4172392254841;973.5521660036392;976.3604838830578;977.6089564174316;978.9265805064613;982.3074732313737;969.2100937735722;970.8980557041515;971.0677749360588;971.4122955611859;979.485769970764;726.2737262737263;730.03635201534;730.2332550821616;733.0982891043992;734.5886303669909;14960.251987400696;15165.924170379189;15192.696146077127;15224.847751522453;15280.159591222478;12406.565770198;12925.482980680761;12961.287129207889;12977.545785897542;13032.283224422654;11134.443277836075;11565.479553420117;11570.363630000347;11614.245074070159;11628.94185529067;3852.2295540891655;3853.6339047790416;3860.227954409101;3868.497095377583;3931.960680393188;45617.31574026392;45799.77100114478;45816.77091614554;45858;50591.747041264556;9801.264905132144;10377.688669339932;10505.264631475724;10676;10708;18008.36970706045;18017.369392071476;18070.18684159216;18108.9094554529;18114.63770724578;8039.638216280281;8059.83880322402;8157.592120393957;8364.749057528285;8430.873536896952;4514.81940722374;4527.320901864747;4580.541945805459;4588.632909367243;4663;3222.4360736870954;3258.299465614904;3264.722498587599;3423.9486407703903;3494.807785571767;627.8555932135635;645.403002222942;646.0341789025343;648.1671052697355;655.5083687234574;605.0984033789622;636.1253276744476;713.8578521888472;727.4580437574041;734.2840730288033;9103.863442048374;9471.952640236892;9524.619015239312;10011.549480273405;10225.079742823182;731.9487635865438;742.354151887861;749.720216695889;778.696308439709;787.393706845737;4076.3681629347498;4121.196366708523;4750.691205071659;4752.28715692642;4835.3714017178245;52155.21767173496;52283;52597;57413.42586574164;57641.423585764445;51198.74400627973;52649.473505264454;53191.46808531942;53254.73372633112;53992.190117148275;45496.54503454923;45580.772096139306;45805.54194458079;46119.538804612195;46438.76780616075;8622.741317760478;8628.352873534384;8702.390832641655;8806.515641639771;8855.690050848189;34190.31619367649;35086.64913350834;35454;35631.46552801658;35721.64278357287;40334.39498407585;40573.79713101416;44021.77989110034;44313.77843110764;44891.55108448874;11011.28426652265;11705.765884682429;11733.706657333634;11908.821367679666;12229.449674764835;13547.458101675822;13548.525801596898;13574.117682350616;13718.65703357424;13865;11736.941315293368;11934.164608477324;11947.581834635746;12016.098792590416;12344.814827777771;11229.382383968634;11459;11621.360825154698;11711.707207319885;12040.819387709367;11834.585789497327;12031.699207519881;12198.57304994321;12339.50641974311;12813.423395947018;10436.63471778484;10537.315074520131;10787.730306742395;11156.49795759209;11284;9807.9019209807;9945.154661853534;9961.601535938482;10210.387376757419;10250.743731406774 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: __end_tp_report 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: __start_cc_report 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,303 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: __end_cc_report 21:26:12 INFO - 2016-01-10 21:26:12,100 DEBUG : BROWSER_OUTPUT: __startTimestamp1452489972092__endTimestamp 21:26:12 INFO - 2016-01-10 21:26:12,101 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,101 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 21:26:12 INFO - 2016-01-10 21:26:12,101 DEBUG : BROWSER_OUTPUT: Number of tests: 6 21:26:12 INFO - 2016-01-10 21:26:12,101 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,101 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5631.47 Median:5880.94 stddev:623.51 (10.6%) stddev-sans-first:598.65 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: Values: 3327.5 3424.8 3440.2 3457.5 3463.6 5524.9 5559.1 5562.4 5567.2 5603.1 5583.7 5616.4 5657.4 5657.6 5709.8 5144.6 5176.4 5214.2 5228.4 5230.8 5032.2 5056.3 5117.6 5137.0 5211.3 5102.2 5174.0 5185.5 5190.6 5210.6 5194.1 5228.9 5229.8 5237.9 5271.3 4930.3 4967.6 5006.2 5110.0 5130.6 5351.8 5424.0 5437.3 5497.6 5502.0 6080.0 6099.1 6151.3 6152.4 6159.4 5950.4 6026.7 6072.4 6119.5 6162.2 5590.6 5633.7 5659.8 5688.2 5750.8 6136.8 6164.2 6192.2 6193.7 6201.1 5766.5 5962.6 5963.8 5967.9 5981.4 5856.2 5918.2 5961.1 6025.6 6031.0 6021.7 6068.6 6083.3 6087.6 6098.3 5680.9 6071.2 6082.9 6091.2 6112.5 4571.6 4577.2 4601.6 4604.0 4676.8 4167.6 4169.3 4183.7 4193.5 4208.1 5880.1 5892.3 5896.3 5899.0 5901.1 5926.3 6039.6 6074.1 6121.1 6164.7 5800.8 5829.3 5829.9 5834.7 5846.5 5093.5 5232.5 5310.8 5314.8 5329.3 6100.3 6169.7 6281.7 6293.5 6302.2 6019.1 6029.3 6056.4 6066.9 6070.2 5981.7 6138.9 6180.7 6181.7 6211.0 5896.0 5981.2 5981.2 6021.4 6047.1 6088.9 6158.7 6199.0 6214.5 6235.7 5790.4 5880.9 5919.2 6060.8 6074.2 6013.2 6018.4 6043.7 6048.0 6049.5 5824.7 5902.1 5920.4 5926.1 5928.7 5748.4 5768.3 5902.8 6035.6 6060.7 5764.3 5780.2 5812.5 5851.6 5887.7 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:57373.73 Median:41241.69 stddev:109088.86 (264.5%) stddev-sans-first:109311.63 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: Values: 609.6 647.7 656.7 674.8 676.0 40329.2 41100.8 41382.6 41643.4 41656.0 45925.8 46370.8 46371.3 46402.8 46411.0 9027.0 9216.2 9243.7 9246.7 9247.6 8999.6 9033.3 9050.5 9070.7 9080.7 8968.3 9013.5 9018.9 9049.4 9053.2 9021.3 9065.8 9069.9 9086.7 9093.4 8962.2 9119.3 9135.4 9148.5 9155.1 42024.0 42257.6 42322.6 42339.4 42577.6 3630.0 3763.8 3793.8 3944.1 4242.4 31685.2 31836.2 31861.8 32487.5 33414.2 4235.5 4382.1 4398.3 4424.4 4434.0 266422.0 272479.0 366072.0 366903.0 368828.2 66703.3 67075.3 67432.3 67506.0 67520.3 72030.6 72276.6 72809.0 72887.6 72966.3 17931.8 17971.1 18078.1 18087.2 18198.5 13980.1 14008.1 14013.5 14075.6 14105.5 21846.8 22289.0 22291.8 22313.4 22315.4 8221.9 8491.5 8545.6 8614.7 8740.6 1059.9 1096.1 1102.7 1112.1 1114.8 28796.0 28929.6 29113.0 29551.1 29827.9 1130.6 1147.0 1151.6 1157.2 1223.3 15235.8 15294.4 15394.1 15526.2 15574.5 354484.0 573295.0 574973.3 578645.0 578794.0 60028.4 60909.7 61057.0 61135.4 61371.1 1484.0 1499.4 1509.6 1511.0 1518.7 31228.7 31752.8 31802.8 31888.2 32121.4 49101.0 49664.5 49671.3 49756.8 49844.3 321355.0 326581.0 328123.0 328492.0 328818.0 35124.3 35203.0 35292.8 35617.9 49847.5 45411.3 45428.8 45658.3 45983.3 46434.5 39177.0 39365.8 39823.6 39968.0 40317.8 38498.6 39096.0 39135.8 39145.4 39314.8 43870.3 44377.6 44909.8 45695.8 45868.8 33797.0 33828.8 33888.3 34184.5 34518.3 26653.4 26931.0 27196.9 27220.3 27411.5 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,102 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:31309.85 Median:10650.42 stddev:97397.81 (914.5%) stddev-sans-first:97643.36 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: Values: 387.0 394.6 397.1 399.8 400.9 16180.3 17205.1 17690.8 19359.5 19429.1 11466.5 12191.6 13936.8 18255.1 18549.5 4298.2 5064.4 5147.3 5602.3 5641.5 5590.3 5630.1 5647.5 5658.3 5662.2 5495.4 5567.1 5604.2 5625.2 5636.2 5479.0 5502.8 5503.6 5509.1 5509.9 4923.1 4986.5 5066.5 5069.2 5080.9 14022.9 14040.1 14107.1 20183.9 22094.8 2334.1 2355.4 2360.9 2380.8 2449.9 10149.0 10343.9 10388.0 10514.7 10527.2 1922.8 1942.7 1977.0 1977.8 2023.7 64503.0 67532.3 67771.7 70095.0 70235.0 11303.8 11571.9 11583.9 11602.4 11623.2 14897.2 14917.1 14961.0 14973.0 14977.4 8746.1 8760.9 8813.3 8819.2 8832.5 8755.1 8785.0 8794.1 8809.3 8841.1 4787.7 4891.1 4927.3 4927.9 4944.8 1941.3 1951.1 1959.3 2023.3 2027.0 986.7 1026.5 1107.9 1121.4 1156.6 16926.7 17579.3 17746.2 18113.0 18321.8 1010.6 1028.9 1033.3 1043.2 1045.3 10083.1 10197.6 10206.5 10313.3 10324.0 571899.0 587823.0 591413.0 601222.0 627155.0 80876.0 84338.0 85362.0 85540.6 86752.6 1164.0 1202.5 1202.7 1203.6 1205.4 15978.4 16254.9 16310.1 16313.1 16574.9 37891.6 38055.8 38255.2 38799.0 39421.6 47121.8 47492.0 47784.8 48550.8 50057.0 10152.2 10217.8 10595.3 10686.6 10705.3 17563.9 18158.7 18248.4 18257.9 18303.6 15172.5 15455.4 15503.7 15857.8 15898.6 14930.6 14947.6 15277.5 15423.1 15638.8 15821.4 15951.8 15952.0 16043.8 16149.5 9824.5 10157.4 10225.9 10238.7 10860.9 15754.0 15802.7 16019.3 16186.0 16470.8 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5583.17 Median:6450.08 stddev:2918.32 (45.2%) stddev-sans-first:2910.95 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: Values: 1573.6 1586.9 1815.9 1859.0 1864.4 7504.8 7882.6 7932.8 7969.6 8039.3 7809.8 7864.7 7900.5 7936.4 7957.7 2274.9 2300.8 2304.7 2314.8 2315.6 2293.6 2316.9 2336.8 2337.1 2344.6 2225.1 2238.4 2270.4 2276.0 2280.3 2250.5 2256.0 2302.5 2311.8 2313.5 2308.6 2327.6 2331.8 2339.6 2343.2 7913.4 8006.5 8017.3 8025.6 8030.7 4726.8 4816.0 4818.7 4819.3 4824.9 2914.4 2919.5 2953.1 2979.4 2996.8 913.8 919.4 923.9 928.5 945.7 11087.2 11159.3 11190.4 11197.8 11241.0 4190.1 4236.3 4239.6 4267.9 4334.1 8922.8 8955.8 8959.7 8975.0 8976.7 4860.8 4866.8 4888.6 4906.1 4908.8 4389.4 4435.9 4476.8 4501.9 4515.2 3491.4 3501.0 3544.8 3558.1 3563.5 1001.8 1023.5 1029.8 1031.4 1037.8 1101.7 1104.2 1148.6 1258.9 1319.0 7360.9 7363.0 7461.1 7464.8 7466.2 1189.6 1198.8 1200.7 1210.6 1210.8 5913.1 5942.9 5964.7 5966.3 5973.7 9337.5 9730.1 9762.6 9853.4 9904.7 9560.9 9618.5 9647.5 9663.7 9689.4 7478.8 7629.1 7631.1 7646.7 7708.2 7274.6 7297.5 7319.4 7329.5 7435.3 8532.9 8576.3 8678.8 8697.6 8734.4 8471.7 8805.3 8872.6 8875.6 8936.3 7175.6 7181.2 7235.9 7241.3 7258.7 7622.0 7637.9 7704.0 7706.9 7747.8 7151.2 7215.1 7257.0 7287.7 7315.5 7100.4 7134.3 7167.1 7210.7 7241.7 7306.5 7309.5 7342.7 7358.7 7362.4 6377.4 6378.9 6417.1 6429.9 6452.2 6361.9 6448.0 6473.7 6475.8 6490.1 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,104 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5725.71 Median:6480.65 stddev:1733.61 (26.8%) stddev-sans-first:1691.21 21:26:12 INFO - 2016-01-10 21:26:12,105 DEBUG : BROWSER_OUTPUT: Values: 369.1 370.3 372.1 373.0 376.9 6281.5 6393.0 6410.1 6437.8 6446.4 6134.9 6277.6 6296.2 6310.8 6359.1 4923.7 4933.5 4936.7 4938.5 4944.5 4942.2 4946.3 4948.6 4949.6 4963.5 4687.4 4811.3 4822.3 4856.8 4863.3 4849.7 4849.8 4854.4 4855.0 4868.7 4235.1 4245.9 4252.7 4254.1 4254.3 6024.1 6068.9 6085.8 6142.8 6158.3 5631.6 5634.9 5650.1 5657.7 5700.6 6704.5 6748.3 6759.4 6780.8 6800.4 4738.5 4760.8 4769.5 4772.9 4777.2 6909.1 6960.1 7002.7 7037.3 7061.5 4851.7 4860.1 4864.4 4864.7 4866.5 4924.6 4925.9 4929.3 4933.1 4939.4 5564.4 5691.7 5698.7 5704.1 5709.1 6844.7 6871.6 6871.7 6877.1 6883.1 1687.3 1734.6 1735.8 1737.6 1738.6 1140.0 1152.3 1163.3 1166.7 1183.1 6514.9 6572.9 6586.4 6601.8 6605.7 6991.3 7021.9 7047.6 7057.2 7060.9 6403.2 6583.4 6590.0 6601.4 6614.1 3796.4 3815.8 3832.0 3835.2 3841.2 7186.6 7232.1 7233.6 7238.6 7243.6 7140.1 7186.7 7197.9 7208.3 7392.0 7316.8 7321.2 7325.6 7327.0 7340.4 7166.6 7170.2 7171.7 7199.3 7199.4 6912.1 7069.5 7073.1 7079.6 7082.5 7368.0 7383.1 7389.2 7391.3 7407.3 4830.1 4874.9 4883.8 4887.8 4889.7 6995.9 7054.7 7184.1 7192.2 7197.4 6887.2 6960.9 6989.6 6991.8 6992.6 6832.7 6898.7 6955.8 6968.3 6978.3 6652.2 6788.4 6809.3 6841.1 6862.8 6965.1 6985.8 6994.7 6999.6 7003.1 6716.2 6721.8 6745.6 6750.8 6768.7 21:26:12 INFO - 2016-01-10 21:26:12,105 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,105 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:14149.74 Median:4521.07 stddev:15547.86 (343.9%) stddev-sans-first:15558.70 21:26:12 INFO - 2016-01-10 21:26:12,106 DEBUG : BROWSER_OUTPUT: Values: 706.7 830.5 851.7 881.3 937.3 14383.7 14528.9 14602.3 14636.3 14670.7 16221.5 16456.1 16491.1 16495.4 16511.5 904.9 913.5 923.9 924.6 925.5 922.4 929.4 930.2 931.0 932.4 973.6 976.4 977.6 978.9 982.3 969.2 970.9 971.1 971.4 979.5 726.3 730.0 730.2 733.1 734.6 14960.3 15165.9 15192.7 15224.8 15280.2 12406.6 12925.5 12961.3 12977.5 13032.3 11134.4 11565.5 11570.4 11614.2 11628.9 3852.2 3853.6 3860.2 3868.5 3932.0 45617.3 45799.8 45816.8 45858.0 50591.7 9801.3 10377.7 10505.3 10676.0 10708.0 18008.4 18017.4 18070.2 18108.9 18114.6 8039.6 8059.8 8157.6 8364.7 8430.9 4514.8 4527.3 4580.5 4588.6 4663.0 3222.4 3258.3 3264.7 3423.9 3494.8 627.9 645.4 646.0 648.2 655.5 605.1 636.1 713.9 727.5 734.3 9103.9 9472.0 9524.6 10011.5 10225.1 731.9 742.4 749.7 778.7 787.4 4076.4 4121.2 4750.7 4752.3 4835.4 52155.2 52283.0 52597.0 57413.4 57641.4 51198.7 52649.5 53191.5 53254.7 53992.2 45496.5 45580.8 45805.5 46119.5 46438.8 8622.7 8628.4 8702.4 8806.5 8855.7 34190.3 35086.6 35454.0 35631.5 35721.6 40334.4 40573.8 44021.8 44313.8 44891.6 11011.3 11705.8 11733.7 11908.8 12229.4 13547.5 13548.5 13574.1 13718.7 13865.0 11736.9 11934.2 11947.6 12016.1 12344.8 11229.4 11459.0 11621.4 11711.7 12040.8 11834.6 12031.7 12198.6 12339.5 12813.4 10436.6 10537.3 10787.7 11156.5 11284.0 9807.9 9945.2 9961.6 10210.4 10250.7 21:26:12 INFO - 2016-01-10 21:26:12,106 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 21:26:12 INFO - 2016-01-10 21:26:12,106 DEBUG : BROWSER_OUTPUT: 21:26:12 INFO - 2016-01-10 21:26:12,737 INFO : Browser exited with error code: 0 21:26:12 INFO - 2016-01-10 21:26:12,761 INFO : Completed test dromaeo_css (00:18:28) 21:26:12 INFO - 2016-01-10 21:26:12,761 INFO : Starting test kraken 21:26:12 INFO - 2016-01-10 21:26:12,761 DEBUG : operating with platform_type : linux_ 21:26:12 INFO - 2016-01-10 21:26:12,761 INFO : Initialising browser for kraken test... 21:26:12 INFO - 2016-01-10 21:26:12,767 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpcTYEia/profile http://localhost:45274/getInfo.html 21:26:17 INFO - 2016-01-10 21:26:17,010 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 21:26:17 INFO - 2016-01-10 21:26:17,010 DEBUG : BROWSER_OUTPUT: colorDepth:24 21:26:17 INFO - 2016-01-10 21:26:17,010 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 21:26:17 INFO - 2016-01-10 21:26:17,010 DEBUG : BROWSER_OUTPUT: __metrics 21:26:17 INFO - 2016-01-10 21:26:17,929 INFO : Browser initialized. 21:26:17 INFO - 2016-01-10 21:26:17,929 INFO : Running cycle 1/1 for kraken test... 21:26:17 INFO - 2016-01-10 21:26:17,930 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpcTYEia/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 21:26:29 INFO - 2016-01-10 21:26:29,781 DEBUG : BROWSER_OUTPUT: RSS: Main: 136941568 21:26:29 INFO - 2016-01-10 21:26:29,782 DEBUG : BROWSER_OUTPUT: 21:26:32 INFO - 2016-01-10 21:26:32,233 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45274/tests/kraken/driver.html?testName=audio-beat-detection) 21:26:32 INFO - 2016-01-10 21:26:32,834 DEBUG : BROWSER_OUTPUT: RSS: Main: 139350016 21:26:32 INFO - 2016-01-10 21:26:32,834 DEBUG : BROWSER_OUTPUT: 21:26:35 INFO - 2016-01-10 21:26:35,410 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45274/tests/kraken/driver.html?testName=audio-dft) 21:26:36 INFO - 2016-01-10 21:26:36,017 DEBUG : BROWSER_OUTPUT: RSS: Main: 137973760 21:26:36 INFO - 2016-01-10 21:26:36,017 DEBUG : BROWSER_OUTPUT: 21:26:38 INFO - 2016-01-10 21:26:38,857 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45274/tests/kraken/driver.html?testName=audio-fft) 21:26:39 INFO - 2016-01-10 21:26:39,443 DEBUG : BROWSER_OUTPUT: RSS: Main: 138747904 21:26:39 INFO - 2016-01-10 21:26:39,444 DEBUG : BROWSER_OUTPUT: 21:26:41 INFO - 2016-01-10 21:26:41,449 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45274/tests/kraken/driver.html?testName=audio-oscillator) 21:26:42 INFO - 2016-01-10 21:26:42,035 DEBUG : BROWSER_OUTPUT: RSS: Main: 138485760 21:26:42 INFO - 2016-01-10 21:26:42,035 DEBUG : BROWSER_OUTPUT: 21:26:44 INFO - 2016-01-10 21:26:44,230 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 21:26:44 INFO - 2016-01-10 21:26:44,812 DEBUG : BROWSER_OUTPUT: RSS: Main: 138371072 21:26:44 INFO - 2016-01-10 21:26:44,812 DEBUG : BROWSER_OUTPUT: 21:26:47 INFO - 2016-01-10 21:26:47,792 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45274/tests/kraken/driver.html?testName=imaging-darkroom) 21:26:48 INFO - 2016-01-10 21:26:48,373 DEBUG : BROWSER_OUTPUT: RSS: Main: 138575872 21:26:48 INFO - 2016-01-10 21:26:48,374 DEBUG : BROWSER_OUTPUT: 21:26:51 INFO - 2016-01-10 21:26:51,789 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45274/tests/kraken/driver.html?testName=imaging-desaturate) 21:26:52 INFO - 2016-01-10 21:26:52,375 DEBUG : BROWSER_OUTPUT: RSS: Main: 138895360 21:26:52 INFO - 2016-01-10 21:26:52,375 DEBUG : BROWSER_OUTPUT: 21:26:55 INFO - 2016-01-10 21:26:55,160 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45274/tests/kraken/driver.html?testName=json-parse-financial) 21:26:55 INFO - 2016-01-10 21:26:55,747 DEBUG : BROWSER_OUTPUT: RSS: Main: 139055104 21:26:55 INFO - 2016-01-10 21:26:55,748 DEBUG : BROWSER_OUTPUT: 21:26:57 INFO - 2016-01-10 21:26:57,369 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 21:26:57 INFO - 2016-01-10 21:26:57,942 DEBUG : BROWSER_OUTPUT: RSS: Main: 139575296 21:26:57 INFO - 2016-01-10 21:26:57,943 DEBUG : BROWSER_OUTPUT: 21:26:59 INFO - 2016-01-10 21:26:59,745 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-aes) 21:27:00 INFO - 2016-01-10 21:27:00,367 DEBUG : BROWSER_OUTPUT: RSS: Main: 138706944 21:27:00 INFO - 2016-01-10 21:27:00,367 DEBUG : BROWSER_OUTPUT: 21:27:02 INFO - 2016-01-10 21:27:02,425 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 21:27:03 INFO - 2016-01-10 21:27:03,018 DEBUG : BROWSER_OUTPUT: RSS: Main: 139071488 21:27:03 INFO - 2016-01-10 21:27:03,018 DEBUG : BROWSER_OUTPUT: 21:27:05 INFO - 2016-01-10 21:27:05,435 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 21:27:06 INFO - 2016-01-10 21:27:06,028 DEBUG : BROWSER_OUTPUT: RSS: Main: 139673600 21:27:06 INFO - 2016-01-10 21:27:06,029 DEBUG : BROWSER_OUTPUT: 21:27:08 INFO - 2016-01-10 21:27:08,570 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 21:27:09 INFO - 2016-01-10 21:27:09,158 DEBUG : BROWSER_OUTPUT: RSS: Main: 139194368 21:27:09 INFO - 2016-01-10 21:27:09,158 DEBUG : BROWSER_OUTPUT: 21:27:10 INFO - 2016-01-10 21:27:10,812 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45274/tests/kraken/driver.html?testName=ai-astar) 21:27:11 INFO - 2016-01-10 21:27:11,062 DEBUG : BROWSER_OUTPUT: RSS: Main: 139698176 21:27:11 INFO - 2016-01-10 21:27:11,062 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,064 DEBUG : BROWSER_OUTPUT: __start_tp_report 21:27:11 INFO - 2016-01-10 21:27:11,064 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 21:27:11 INFO - 2016-01-10 21:27:11,064 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 21:27:11 INFO - 2016-01-10 21:27:11,064 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 21:27:11 INFO - 2016-01-10 21:27:11,065 DEBUG : BROWSER_OUTPUT: |0;ai-astar;109;104;113;113;111;119;109;109;108;110 21:27:11 INFO - 2016-01-10 21:27:11,065 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;156;124;151;169;125;152;149;123;159;123 21:27:11 INFO - 2016-01-10 21:27:11,065 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;162;161;162;163;161;161;162;164;160 21:27:11 INFO - 2016-01-10 21:27:11,065 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;72;74;152;72;74;74;75;153;72 21:27:11 INFO - 2016-01-10 21:27:11,065 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;93;92;138;94;93;92;139;93;93;131 21:27:11 INFO - 2016-01-10 21:27:11,066 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;110;110;110;109;111;110;110;109 21:27:11 INFO - 2016-01-10 21:27:11,066 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;145;146;148;146;145;146;146;147;147 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;95;97;96;96;96;96;96;96 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;60;68;63;63;62;62;63;61;61;72 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;68;67;66;68;67;66;69;68;67 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;88;82;90;83;82;89;82;88;88;81 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;116;120;120;116;119;113;112;124;120;128 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;150;152;151;152;144;143;149;143;145;147 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;65;65;71;66;69;67;65;64;64;64 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: __end_tp_report 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: __start_cc_report 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,702 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: __end_cc_report 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: __startTimestamp1452490031063__endTimestamp 21:27:11 INFO - 2016-01-10 21:27:11,067 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: Number of tests: 14 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.50 Median:110.50 stddev:3.95 (3.6%) stddev-sans-first:4.15 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: Values: 109.0 104.0 113.0 113.0 111.0 119.0 109.0 109.0 108.0 110.0 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:143.10 Median:151.50 stddev:17.53 (11.6%) stddev-sans-first:17.97 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: Values: 156.0 124.0 151.0 169.0 125.0 152.0 149.0 123.0 159.0 123.0 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.60 Median:162.00 stddev:1.26 (0.8%) stddev-sans-first:1.20 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: Values: 160.0 162.0 161.0 162.0 163.0 161.0 161.0 162.0 164.0 160.0 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:89.10 Median:73.50 stddev:33.43 (45.5%) stddev-sans-first:34.95 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: Values: 73.0 72.0 74.0 152.0 72.0 74.0 74.0 75.0 153.0 72.0 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,069 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.80 Median:93.00 stddev:20.95 (22.5%) stddev-sans-first:21.70 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: Values: 93.0 92.0 138.0 94.0 93.0 92.0 139.0 93.0 93.0 131.0 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.80 Median:110.00 stddev:0.63 (0.6%) stddev-sans-first:0.67 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 110.0 110.0 110.0 109.0 111.0 110.0 110.0 109.0 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.50 stddev:0.95 (0.6%) stddev-sans-first:0.97 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: Values: 147.0 145.0 146.0 148.0 146.0 145.0 146.0 146.0 147.0 147.0 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:0.47 (0.5%) stddev-sans-first:0.50 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 95.0 97.0 96.0 96.0 96.0 96.0 96.0 96.0 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,070 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:63.50 Median:63.00 stddev:3.69 (5.9%) stddev-sans-first:3.69 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: Values: 60.0 68.0 63.0 63.0 62.0 62.0 63.0 61.0 61.0 72.0 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.20 Median:67.50 stddev:1.03 (1.5%) stddev-sans-first:1.00 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: Values: 66.0 68.0 67.0 66.0 68.0 67.0 66.0 69.0 68.0 67.0 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.30 Median:88.00 stddev:3.56 (4.0%) stddev-sans-first:3.64 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: Values: 88.0 82.0 90.0 83.0 82.0 89.0 82.0 88.0 88.0 81.0 21:27:11 INFO - 2016-01-10 21:27:11,071 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:118.80 Median:120.00 stddev:4.85 (4.0%) stddev-sans-first:5.04 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: Values: 116.0 120.0 120.0 116.0 119.0 113.0 112.0 124.0 120.0 128.0 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.60 Median:149.50 stddev:3.66 (2.4%) stddev-sans-first:3.77 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: Values: 150.0 152.0 151.0 152.0 144.0 143.0 149.0 143.0 145.0 147.0 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.00 Median:65.50 stddev:2.36 (3.6%) stddev-sans-first:2.47 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: Values: 65.0 65.0 71.0 66.0 69.0 67.0 65.0 64.0 64.0 64.0 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 21:27:11 INFO - 2016-01-10 21:27:11,072 DEBUG : BROWSER_OUTPUT: 21:27:11 INFO - 2016-01-10 21:27:11,893 INFO : Browser exited with error code: 0 21:27:11 INFO - 2016-01-10 21:27:11,996 INFO : Completed test kraken (00:00:59) 21:27:11 INFO - 2016-01-10 21:27:11,996 INFO : Starting test v8_7 21:27:11 INFO - 2016-01-10 21:27:11,996 DEBUG : operating with platform_type : linux_ 21:27:11 INFO - 2016-01-10 21:27:11,997 INFO : Initialising browser for v8_7 test... 21:27:12 INFO - 2016-01-10 21:27:12,007 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpSthQC9/profile http://localhost:45274/getInfo.html 21:27:16 INFO - 2016-01-10 21:27:16,258 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 21:27:16 INFO - 2016-01-10 21:27:16,258 DEBUG : BROWSER_OUTPUT: colorDepth:24 21:27:16 INFO - 2016-01-10 21:27:16,258 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 21:27:16 INFO - 2016-01-10 21:27:16,258 DEBUG : BROWSER_OUTPUT: __metrics 21:27:17 INFO - 2016-01-10 21:27:17,193 INFO : Browser initialized. 21:27:17 INFO - 2016-01-10 21:27:17,194 INFO : Running cycle 1/1 for v8_7 test... 21:27:17 INFO - 2016-01-10 21:27:17,194 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpSthQC9/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 21:27:29 INFO - 2016-01-10 21:27:29,049 DEBUG : BROWSER_OUTPUT: RSS: Main: 135987200 21:27:29 INFO - 2016-01-10 21:27:29,049 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,434 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45274/tests/v8_7/run.html (next: http://localhost:45274/tests/v8_7/run.html) 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: RSS: Main: 136273920 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: __start_tp_report 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 21:27:50 INFO - 2016-01-10 21:27:50,692 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |0;Richards;166.05778811026238 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;167.25204883759827 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |2;Encrypt;280.19052956010086 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5191.709844559586 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |4;RayTrace;894.4543828264758 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |5;Earley;550.6607929515418 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |6;Boyer;10923.91304347826 21:27:50 INFO - 2016-01-10 21:27:50,693 DEBUG : BROWSER_OUTPUT: |7;RegExp;24095.238095238095 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: |8;Splay;525.4860746190226 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4826.923076923077 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: __end_tp_report 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: __startTimestamp1452490070685__endTimestamp 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 21:27:50 INFO - 2016-01-10 21:27:50,694 DEBUG : BROWSER_OUTPUT: Number of tests: 10 21:27:50 INFO - 2016-01-10 21:27:50,695 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,695 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.06 Median:166.06 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,695 DEBUG : BROWSER_OUTPUT: Values: 166.1 21:27:50 INFO - 2016-01-10 21:27:50,695 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,695 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:167.25 Median:167.25 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,696 DEBUG : BROWSER_OUTPUT: Values: 167.3 21:27:50 INFO - 2016-01-10 21:27:50,696 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,696 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:280.19 Median:280.19 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,696 DEBUG : BROWSER_OUTPUT: Values: 280.2 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5191.71 Median:5191.71 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: Values: 5191.7 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:894.45 Median:894.45 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: Values: 894.5 21:27:50 INFO - 2016-01-10 21:27:50,697 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:550.66 Median:550.66 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: Values: 550.7 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:10923.91 Median:10923.91 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: Values: 10923.9 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,698 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:24095.24 Median:24095.24 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: Values: 24095.2 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:525.49 Median:525.49 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: Values: 525.5 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 21:27:50 INFO - 2016-01-10 21:27:50,699 DEBUG : BROWSER_OUTPUT: Values: 4826.9 21:27:50 INFO - 2016-01-10 21:27:50,700 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 21:27:50 INFO - 2016-01-10 21:27:50,700 DEBUG : BROWSER_OUTPUT: 21:27:51 INFO - 2016-01-10 21:27:51,553 INFO : Browser exited with error code: 0 21:27:51 INFO - 2016-01-10 21:27:51,568 INFO : Completed test v8_7 (00:00:39) 21:27:51 INFO - 2016-01-10 21:27:51,724 INFO : Completed test suite (00:20:07) 21:27:51 INFO - 2016-01-10 21:27:51,724 DEBUG : Working with test: dromaeo_css 21:27:51 INFO - 2016-01-10 21:27:51,724 DEBUG : Generating results file: dromaeo_css 21:27:51 INFO - 2016-01-10 21:27:51,725 DEBUG : Working with test: kraken 21:27:51 INFO - 2016-01-10 21:27:51,725 DEBUG : Generating results file: kraken 21:27:51 INFO - 2016-01-10 21:27:51,726 INFO : javascript benchmark 21:27:51 INFO - 2016-01-10 21:27:51,726 DEBUG : Working with test: v8_7 21:27:51 INFO - 2016-01-10 21:27:51,726 DEBUG : Generating results file: v8_7 21:27:51 INFO - 2016-01-10 21:27:51,726 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 21:27:51 INFO - 2016-01-10 21:27:51,771 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 21:27:51 INFO - 2016-01-10 21:27:51,771 DEBUG : process_Request line: dromaeo_css 7481.17 graph.html#tests=[[72,52,43]] 21:27:51 INFO - 2016-01-10 21:27:51,771 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 21:27:51 INFO - 2016-01-10 21:27:51,807 DEBUG : process_Request line: kraken 1510.60 graph.html#tests=[[232,52,43]] 21:27:51 INFO - 2016-01-10 21:27:51,807 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 21:27:51 INFO - 2016-01-10 21:27:51,853 DEBUG : process_Request line: v8_7 23285.10 graph.html#tests=[[230,52,43]] 21:27:51 INFO - 2016-01-10 21:27:51,854 INFO : javascript benchmark 21:27:51 INFO - 2016-01-10 21:27:51,858 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3327.5175099610556, 3424.760266781325, 3440.2087519870447, 3457.4986626939094, 3463.6363181865904, 5524.861878453041, 5559.11054231323, 5562.388137304898, 5567.192757050226, 5603.1315146152365, 5583.6928968906695, 5616.354119276284, 5657.377688454267, 5657.632253903494, 5709.77160913563, 5144.61415393846, 5176.378834539842, 5214.165733482643, 5228.398734145565, 5230.816921407752, 5032.169692000815, 5056.342675452186, 5117.641765076446, 5137.0, 5211.348581427322, 5102.209157580581, 5173.974130129344, 5185.455527169649, 5190.636655434121, 5210.609204309692, 5194.142966410556, 5228.895422091575, 5229.764660590283, 5237.921431178497, 5271.262023316739, 4930.309756634074, 4967.577755890754, 5006.199008158677, 5109.974450127763, 5130.640855140105, 5351.839444816662, 5423.969445805324, 5437.34751829783, 5497.615166938316, 5502.0371434999115, 6080.027195648675, 6099.115628233882, 6151.261848578154, 6152.446279834791, 6159.353267906895, 5950.375210602911, 6026.728797204137, 6072.423119803611, 6119.541034422392, 6162.198914141178, 5590.602349412647, 5633.718314084321, 5659.783146623496, 5688.175214593861, 5750.7987220447085, 6136.815895523141, 6164.198654175018, 6192.164057852222, 6193.721282542297, 6201.069839524017, 5766.481016708432, 5962.642241465526, 5963.7912673056235, 5967.910481342783, 5981.401859814071, 5856.209411729362, 5918.201042859245, 5961.135635332939, 6025.638461692312, 6031.0, 6021.698915054318, 6068.605540639845, 6083.300420451616, 6087.634741915499, 6098.298695650057, 5680.943190568124, 6071.241094863142, 6082.878342433127, 6091.177691011745, 6112.541559383064, 4571.611413029863, 4577.22187228172, 4601.562851529099, 4604.0, 4676.836310729108, 4167.562405947392, 4169.3120635094865, 4183.686223533247, 4193.475815523059, 4208.116295577902, 5880.088586269135, 5892.322382925932, 5896.262967129109, 5898.970505147533, 5901.0558310670085, 5926.259217597801, 6039.607425517327, 6074.088886667036, 6121.123721227671, 6164.722587483484, 5800.8259752207505, 5829.300483941869, 5829.88340233193, 5834.708264586754, 5846.473817356373, 5093.541581257705, 5232.529072383504, 5310.840674779763, 5314.7608357624, 5329.307190065267, 6100.267967843887, 6169.691515424301, 6281.7173227204885, 6293.527985401021, 6302.212223472066, 6019.067044608093, 6029.336772954972, 6056.394360563909, 6066.939330606638, 6070.18052562916, 5981.730822112929, 6138.877222455437, 6180.72890664004, 6181.690915454119, 6210.968945155245, 5896.0, 5981.222441082631, 5981.222441082806, 6021.367756385692, 6047.0627052806885, 6088.908666369919, 6158.661273629993, 6199.039148931923, 6214.5028397728975, 6235.657038862906, 5790.363060063305, 5880.94119058804, 5919.200907877382, 6060.787872424444, 6074.210352654127, 6013.188219590299, 6018.3680713524445, 6043.667598281961, 6048.032314829607, 6049.485793707584, 5824.708764561839, 5902.1146827976145, 5920.437558431942, 5926.111083337534, 5928.673922934107, 5748.396418376177, 5768.278965129359, 5902.763889444374, 6035.6076855004285, 6060.727267273071, 5764.337101233412, 5780.161876527964, 5812.505936995233, 5851.64890106595, 5887.7056147193325], "unit": "ms", "name": "dojo.html", "value": 5591.38100569598}, {"lowerIsBetter": false, "replicates": [609.6342194683187, 647.6502688548185, 656.6782276684426, 674.787441955784, 676.0265218085959, 40329.19341613166, 41100.794496027476, 41382.58617413825, 41643.37534936978, 41656.0, 45925.77037114818, 46370.76814615931, 46371.30443043357, 46402.76798616002, 46411.0, 9026.954865225665, 9216.216621587173, 9243.676471323504, 9246.67636632718, 9247.58385872634, 8999.550022498881, 9033.277337812959, 9050.456972581633, 9070.682526111588, 9080.727578172633, 8968.282537397024, 9013.504257265848, 9018.86471702925, 9049.411788233776, 9053.230475409599, 9021.278297736199, 9065.773355666095, 9069.909300907006, 9086.727398178, 9093.363464557484, 8962.193402593733, 9119.270458363315, 9135.36052476327, 9148.4968326742, 9155.13026262504, 42024.0, 42257.577424225674, 42322.57677423248, 42339.36490952638, 42577.57422425767, 3629.981850090759, 3763.7929913854728, 3793.848246070154, 3944.1322908959983, 4242.427272318259, 31685.20786980344, 31836.20409489758, 31861.840690796398, 32487.512687309474, 33414.16464588381, 4235.470566179228, 4382.145481631083, 4398.296272596369, 4424.446944131983, 4433.9801845575375, 266422.0, 272479.0, 366072.0, 366903.0, 368828.15585922165, 66703.33296666971, 67075.32924670789, 67432.3256767426, 67506.0, 67520.3247967524, 72030.63984680148, 72276.63861680658, 72809.0, 72887.63556182185, 72966.27033729595, 17931.820681793015, 17971.101444927703, 18078.09609519519, 18087.18607662658, 18198.5450363742, 13980.091294065853, 14008.089474184146, 14013.5095271665, 14075.577732668036, 14105.506307279196, 21846.781532184792, 22289.0, 22291.777082229295, 22313.442163945707, 22315.442113946956, 8221.876671849926, 8491.490510569385, 8545.615447304763, 8614.698485552975, 8740.562971851383, 1059.9453543724044, 1096.13405409727, 1102.73534351755, 1112.1158678850334, 1114.8439218509416, 28796.0, 28929.566056509168, 29113.0, 29551.113466596038, 29827.85086074556, 1130.5760339872547, 1146.9655910322704, 1151.5508951508918, 1157.2188772578645, 1223.2721530689225, 15235.847641523664, 15294.388224471119, 15394.0819476079, 15526.223688815515, 15574.454894078879, 354484.0, 573295.0, 574973.2502675003, 578645.0, 578794.0, 60028.39971600316, 60909.695451523345, 61057.0, 61135.38864611386, 61371.079433808525, 1483.9629009274854, 1499.3702644889172, 1509.5697726148214, 1510.9546713598609, 1518.7494063479623, 31228.687713123487, 31752.841235793672, 31802.840985794923, 31888.202794930312, 32121.35757284888, 49101.0, 49664.503354965986, 49671.25493117679, 49756.75121624369, 49844.25233621426, 321355.0, 326581.0, 328123.0, 328492.0, 328818.0, 35124.29751404907, 35203.0, 35292.823535882155, 35617.93146205618, 49847.50152498428, 45411.318830216915, 45428.77285613551, 45658.31512527381, 45983.31025034694, 46434.53565464302, 39177.0, 39365.80317098396, 39823.60176398315, 39968.0, 40317.79841100776, 38498.6150138495, 39096.0, 39135.80432097821, 39145.41281880831, 39314.80342598269, 43870.34194487021, 44377.55622443734, 44909.775451122536, 45695.77152114218, 45868.77065614651, 33797.0, 33828.83085584556, 33888.322233555686, 34184.48723269203, 34518.30963380769, 26653.365588448323, 26931.0, 27196.864015680585, 27220.31949201286, 27411.45177096407], "unit": "ms", "name": "ext.html", "value": 20665.46176829426}, {"lowerIsBetter": false, "replicates": [386.97678139311626, 394.6172212953436, 397.06689280191546, 399.75015615240477, 400.85969910531315, 16180.27188776505, 17205.053722045282, 17690.823091769096, 19359.516012099706, 19429.12568934398, 11466.48400821963, 12191.634250972464, 13936.79094813576, 18255.087245637696, 18549.53626159347, 4298.161858437606, 5064.3669541307245, 5147.330846989886, 5602.271704678386, 5641.52047075997, 5590.2732644756325, 5630.127330263796, 5647.519960803336, 5658.292713410824, 5662.207290979266, 5495.395506494302, 5567.109262517998, 5604.187392828037, 5625.156226566007, 5636.15457681347, 5478.972605136989, 5502.8349149525575, 5503.559715222773, 5509.118541033436, 5509.917351239735, 4923.138450771101, 4986.5013498650205, 5066.518680725325, 5069.214271787879, 5080.923786143211, 14022.92988535061, 14040.087394319336, 14107.083039602392, 20183.89908050465, 22094.779052209433, 2334.0663734506165, 2355.3522781235297, 2360.9173678921156, 2380.845871295151, 2449.9020039198413, 10149.0, 10343.948280258626, 10388.0, 10514.684559463229, 10527.210459215514, 1922.80771922808, 1942.7377304063912, 1977.0114942528735, 1977.7824439311664, 2023.6660950943076, 64503.0, 67532.3246767531, 67771.66114169447, 70095.0, 70234.99999999949, 11303.773924521463, 11571.884281157249, 11583.942080289713, 11602.361870097056, 11623.244489108181, 14897.18065506386, 14917.104973701613, 14961.0, 14973.0, 14977.400903963937, 8746.125387461203, 8760.948686157702, 8813.338999575057, 8819.162179592928, 8832.51421171829, 8755.0807165248, 8785.0, 8794.076621954602, 8809.251213646912, 8841.071687472851, 4787.688800227974, 4891.119598472309, 4927.310176575283, 4927.90144197114, 4944.752762361867, 1941.3205378117827, 1951.1219951022097, 1959.2652755216793, 2023.3019608235136, 2026.979730202679, 986.6842610364614, 1026.5175367577226, 1107.9002889739802, 1121.383239218443, 1156.6067537037447, 16926.74609880853, 17579.296828126986, 17746.20142093609, 18113.0, 18321.81678183201, 1010.5842253184337, 1028.92797504174, 1033.3076838518061, 1043.2384359417667, 1045.2630895219004, 10083.092521672937, 10197.592096316064, 10206.540705668263, 10313.329633573794, 10324.0, 571899.0, 587823.0, 591413.0, 601222.0, 627155.0, 80876.0, 84338.0, 85362.0, 85540.57229713812, 86752.56623716842, 1163.9825402618967, 1202.500962100736, 1202.6650418035972, 1203.6268756685456, 1205.433446280247, 15978.440754573534, 16254.918725406298, 16310.102944338176, 16313.10277934725, 16574.917125414297, 37891.62108378991, 38055.80972095122, 38255.23489530249, 38799.0, 39421.60578394294, 47121.76439117782, 47492.0, 47784.761076194394, 48550.75724621354, 50057.0, 10152.187824973837, 10217.795644087226, 10595.258331916692, 10686.625968091079, 10705.304155230197, 17563.912180439016, 18158.728888978174, 18248.36130735418, 18257.908710456362, 18303.633927321112, 15172.544823655307, 15455.381784728484, 15503.689926201638, 15857.762133568236, 15898.60253493672, 14930.552083437515, 14947.551573452814, 15277.541673749805, 15423.074615522655, 15638.765418518959, 15821.446249381217, 15951.760723588923, 15952.0, 16043.759343610089, 16149.515514534583, 9824.45965471906, 10157.441340726331, 10225.897741022494, 10238.744031398977, 10860.945695271474, 15754.041719054792, 15802.68394632078, 16019.279132439302, 16186.0, 16470.75293870617], "unit": "ms", "name": "jquery.html", "value": 9487.10847528262}, {"lowerIsBetter": false, "replicates": [1573.6459296658254, 1586.880983926205, 1815.8547316214704, 1859.0, 1864.4033909149068, 7504.774856754299, 7882.60586970652, 7932.841343173133, 7969.561674107922, 8039.276465118138, 7809.843803123934, 7864.724734634289, 7900.486468379566, 7936.365090792737, 7957.72147974821, 2274.8521346112448, 2300.804431623314, 2304.700388949434, 2314.780095890896, 2315.641075633271, 2293.6444851048113, 2316.872572008539, 2336.7663233676667, 2337.100216416675, 2344.648302754592, 2225.121077174515, 2238.3956331790405, 2270.398344438725, 2276.0, 2280.304507125326, 2250.549890021994, 2255.954880902389, 2302.458922153284, 2311.8150547956207, 2313.49103197298, 2308.6421604651305, 2327.627579587275, 2331.7668233176546, 2339.63735620979, 2343.2267351774044, 7913.446058775888, 8006.479578827358, 8017.318527925133, 8025.638846251933, 8030.678772849079, 4726.810927562893, 4815.951840481621, 4818.710877347336, 4819.277108433728, 4824.927626085611, 2914.3588410549646, 2919.5474701421103, 2953.114065780279, 2979.4488019716205, 2996.805207661495, 913.8126684029825, 919.3840127114782, 923.8983711791698, 928.4614923344444, 945.7351941456403, 11087.168462365275, 11159.27464714791, 11190.44047797615, 11197.832032519518, 11241.044511216556, 4190.057237121623, 4236.279832428495, 4239.618434340924, 4267.935980960288, 4334.111507141029, 8922.776930576787, 8955.776105597412, 8959.73120806377, 8975.0, 8976.730698079067, 4860.8298709545, 4866.805327786919, 4888.633352498577, 4906.1414252505665, 4908.828191013297, 4389.40742999691, 4435.911281774346, 4476.798544065525, 4501.897035226325, 4515.164694531522, 3491.354099491602, 3500.984714432837, 3544.822758862098, 3558.146044949245, 3563.465480177942, 1001.839705647093, 1023.4831410137833, 1029.8455231715302, 1031.3605564550028, 1037.8131936251395, 1101.680512651322, 1104.2380757277613, 1148.6496618531262, 1258.9118761686593, 1319.0436933223336, 7360.889586656204, 7362.9631851840395, 7461.067366579177, 7464.813379665552, 7466.178720340758, 1189.5598628507507, 1198.7722332756748, 1200.6758175292623, 1210.606552870303, 1210.7820592293297, 5913.113033045078, 5942.8811423771285, 5964.701764911737, 5966.343702192756, 5973.731182096816, 9337.533123343941, 9730.075642813921, 9762.560684769202, 9853.408795472295, 9904.653337133166, 9560.904390956, 9618.51907404627, 9647.517624118906, 9663.661771837951, 9689.41863488193, 7478.775636730907, 7629.122650895107, 7631.084269887649, 7646.694132234759, 7708.152103268636, 7274.636268186464, 7297.452691048086, 7319.377852882564, 7329.486935914435, 7435.256474352522, 8532.91467085346, 8576.27101696338, 8678.82642347137, 8697.608607612547, 8734.388592798443, 8471.745847624581, 8805.295576354005, 8872.645094196418, 8875.644974201217, 8936.329775266751, 7175.605341706257, 7181.245969173162, 7235.927640723736, 7241.348278654947, 7258.745943891939, 7621.961890190513, 7637.88543171864, 7704.0, 7706.884396733942, 7747.806304842198, 7151.177614574391, 7215.098112735908, 7256.963715181601, 7287.744928927462, 7315.524490908074, 7100.396466300215, 7134.286571342825, 7167.104111986002, 7210.71157153708, 7241.710331586678, 7306.4520160989205, 7309.488335816442, 7342.669579869025, 7358.742444014434, 7362.447816413897, 6377.426031657174, 6378.9362106380195, 6417.133686952202, 6429.8714025720155, 6452.193475815523, 6361.936380636134, 6447.967760161169, 6473.708683109177, 6475.805725828232, 6490.058941453557], "unit": "ms", "name": "mootools.html", "value": 4562.721973662155}, {"lowerIsBetter": false, "replicates": [369.09755647442, 370.2890450335357, 372.06611405372524, 372.9981350093249, 376.9321522126018, 6281.492441813966, 6393.0410438434255, 6410.102585638003, 6437.839054023651, 6446.355364463551, 6134.907976380347, 6277.560570760049, 6296.150019747344, 6310.779122730705, 6359.141515895364, 4923.704577725348, 4933.531314525123, 4936.7037977721275, 4938.506149385069, 4944.505549445063, 4942.209246520558, 4946.332245146913, 4948.554630083292, 4949.628777841658, 4963.478834722357, 4687.390639216897, 4811.254255590372, 4822.324874517571, 4856.781444834991, 4863.294822250771, 4849.660523763338, 4849.757512124415, 4854.393200849894, 4855.0, 4868.732219727914, 4235.089455766994, 4245.872623821259, 4252.659787217046, 4254.08537164508, 4254.255505286563, 6024.126501657279, 6068.939310606882, 6085.786997455112, 6142.84642883927, 6158.322584515699, 5631.577631677641, 5634.887302253932, 5650.124230744241, 5657.745401456944, 5700.572457065695, 6704.5306828522025, 6748.291429399891, 6759.425448836855, 6780.8304792380095, 6800.387965083117, 4738.526147385269, 4760.761961901926, 4769.4515130760055, 4772.856814295542, 4777.187878060703, 6909.1018167637885, 6960.129983752031, 7002.684879180449, 7037.261087585781, 7061.50569460138, 4851.684640498356, 4860.1008813369635, 4864.367632207861, 4864.708117512961, 4866.48901865299, 4924.556789888928, 4925.852224433273, 4929.309896614477, 4933.136701077297, 4939.357883475197, 5564.360098588714, 5691.743871525791, 5698.7435565399655, 5704.11586204139, 5709.115087161496, 6844.657767111625, 6871.587704737732, 6871.725130994704, 6877.105976223159, 6883.070785443901, 1687.2744719770371, 1734.5923707928628, 1735.8003829559761, 1737.6350966297218, 1738.608813017061, 1139.9601013964636, 1152.262551966742, 1163.313644949467, 1166.6791632301185, 1183.1303991566192, 6514.934850651528, 6572.86854262912, 6586.407223349922, 6601.8349541260895, 6605.70274337656, 6991.300869912968, 7021.859562808715, 7047.647617619098, 7057.188423331382, 7060.894086588705, 6403.199600049994, 6583.407493325623, 6589.967050164814, 6601.372869577479, 6614.0740296358545, 3796.4495148203355, 3815.751976121543, 3832.0, 3835.1562656216147, 3841.193349396602, 7186.568805871664, 7232.132144142736, 7233.638318084075, 7238.565686058748, 7243.5653860768525, 7140.143182818095, 7186.712531498786, 7197.856042879218, 7208.315210055036, 7392.0, 7316.780496585111, 7321.158066822277, 7325.560466372035, 7327.010853534811, 7340.449466289942, 7166.605836679033, 7170.175429825428, 7171.748988785576, 7199.316064973819, 7199.3520583147765, 6912.135983002125, 7069.469789765685, 7073.080499535027, 7079.646017699198, 7082.4688148390105, 7367.963160184165, 7383.07711536058, 7389.150247721581, 7391.260873912565, 7407.333339999426, 4830.082284365959, 4874.878128046827, 4883.8290659826735, 4887.780049897834, 4889.657723959289, 6995.895061573979, 7054.717811287696, 7184.066071410683, 7192.244814294424, 7197.388222001188, 6887.242403335729, 6960.8955865663065, 6989.580625162506, 6991.755288564876, 6992.61540615271, 6832.692528836114, 6898.724051038103, 6955.756548520778, 6968.268331825288, 6978.302169782981, 6652.168478940132, 6788.389044985975, 6809.250982392032, 6841.076454678555, 6862.759803406857, 6965.129358830146, 6985.825354366181, 6994.720211191699, 6999.580025198301, 7003.089598352181, 6716.227633822173, 6721.831954201184, 6745.5952642841585, 6750.831229219309, 6768.661566921536], "unit": "ms", "name": "prototype.html", "value": 5165.246713025604}, {"lowerIsBetter": false, "replicates": [706.660802814649, 830.5473516933273, 851.6593362654941, 881.268547105902, 937.2595649436945, 14383.712325753491, 14528.854711452883, 14602.269886505685, 14636.34136463859, 14670.706585868276, 16221.513354599352, 16456.09491477971, 16491.09298988555, 16495.422660206896, 16511.504654860375, 904.891413030434, 913.5021413329752, 923.9168474837263, 924.6486335192651, 925.509479975614, 922.446532080753, 929.3680297397767, 930.1767935377206, 930.9674161404353, 932.4172392254841, 973.5521660036392, 976.3604838830578, 977.6089564174316, 978.9265805064613, 982.3074732313737, 969.2100937735722, 970.8980557041515, 971.0677749360588, 971.4122955611859, 979.485769970764, 726.2737262737263, 730.03635201534, 730.2332550821616, 733.0982891043992, 734.5886303669909, 14960.251987400696, 15165.924170379189, 15192.696146077127, 15224.847751522453, 15280.159591222478, 12406.565770198, 12925.482980680761, 12961.287129207889, 12977.545785897542, 13032.283224422654, 11134.443277836075, 11565.479553420117, 11570.363630000347, 11614.245074070159, 11628.94185529067, 3852.2295540891655, 3853.6339047790416, 3860.227954409101, 3868.497095377583, 3931.960680393188, 45617.31574026392, 45799.77100114478, 45816.77091614554, 45858.0, 50591.747041264556, 9801.264905132144, 10377.688669339932, 10505.264631475724, 10676.0, 10708.0, 18008.36970706045, 18017.369392071476, 18070.18684159216, 18108.9094554529, 18114.63770724578, 8039.638216280281, 8059.83880322402, 8157.592120393957, 8364.749057528285, 8430.873536896952, 4514.81940722374, 4527.320901864747, 4580.541945805459, 4588.632909367243, 4663.0, 3222.4360736870954, 3258.299465614904, 3264.722498587599, 3423.9486407703903, 3494.807785571767, 627.8555932135635, 645.403002222942, 646.0341789025343, 648.1671052697355, 655.5083687234574, 605.0984033789622, 636.1253276744476, 713.8578521888472, 727.4580437574041, 734.2840730288033, 9103.863442048374, 9471.952640236892, 9524.619015239312, 10011.549480273405, 10225.079742823182, 731.9487635865438, 742.354151887861, 749.720216695889, 778.696308439709, 787.393706845737, 4076.3681629347498, 4121.196366708523, 4750.691205071659, 4752.28715692642, 4835.3714017178245, 52155.21767173496, 52283.0, 52597.0, 57413.42586574164, 57641.423585764445, 51198.74400627973, 52649.473505264454, 53191.46808531942, 53254.73372633112, 53992.190117148275, 45496.54503454923, 45580.772096139306, 45805.54194458079, 46119.538804612195, 46438.76780616075, 8622.741317760478, 8628.352873534384, 8702.390832641655, 8806.515641639771, 8855.690050848189, 34190.31619367649, 35086.64913350834, 35454.0, 35631.46552801658, 35721.64278357287, 40334.39498407585, 40573.79713101416, 44021.77989110034, 44313.77843110764, 44891.55108448874, 11011.28426652265, 11705.765884682429, 11733.706657333634, 11908.821367679666, 12229.449674764835, 13547.458101675822, 13548.525801596898, 13574.117682350616, 13718.65703357424, 13865.0, 11736.941315293368, 11934.164608477324, 11947.581834635746, 12016.098792590416, 12344.814827777771, 11229.382383968634, 11459.0, 11621.360825154698, 11711.707207319885, 12040.819387709367, 11834.585789497327, 12031.699207519881, 12198.57304994321, 12339.50641974311, 12813.423395947018, 10436.63471778484, 10537.315074520131, 10787.730306742395, 11156.49795759209, 11284.0, 9807.9019209807, 9945.154661853534, 9961.601535938482, 10210.387376757419, 10250.743731406774], "unit": "ms", "name": "yui.html", "value": 6785.246356479361}], "name": "dromaeo_css", "value": 7481.172974528337}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 104.0, 113.0, 113.0, 111.0, 119.0, 109.0, 109.0, 108.0, 110.0], "unit": "ms", "name": "ai-astar", "value": 110.5}, {"lowerIsBetter": true, "replicates": [156.0, 124.0, 151.0, 169.0, 125.0, 152.0, 149.0, 123.0, 159.0, 123.0], "unit": "ms", "name": "audio-beat-detection", "value": 143.1}, {"lowerIsBetter": true, "replicates": [160.0, 162.0, 161.0, 162.0, 163.0, 161.0, 161.0, 162.0, 164.0, 160.0], "unit": "ms", "name": "audio-dft", "value": 161.6}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 74.0, 152.0, 72.0, 74.0, 74.0, 75.0, 153.0, 72.0], "unit": "ms", "name": "audio-fft", "value": 89.1}, {"lowerIsBetter": true, "replicates": [93.0, 92.0, 138.0, 94.0, 93.0, 92.0, 139.0, 93.0, 93.0, 131.0], "unit": "ms", "name": "audio-oscillator", "value": 105.8}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 110.0, 110.0, 110.0, 109.0, 111.0, 110.0, 110.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.8}, {"lowerIsBetter": true, "replicates": [147.0, 145.0, 146.0, 148.0, 146.0, 145.0, 146.0, 146.0, 147.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.3}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 95.0, 97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0], "unit": "ms", "name": "imaging-desaturate", "value": 96.0}, {"lowerIsBetter": true, "replicates": [60.0, 68.0, 63.0, 63.0, 62.0, 62.0, 63.0, 61.0, 61.0, 72.0], "unit": "ms", "name": "json-parse-financial", "value": 63.5}, {"lowerIsBetter": true, "replicates": [66.0, 68.0, 67.0, 66.0, 68.0, 67.0, 66.0, 69.0, 68.0, 67.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 67.2}, {"lowerIsBetter": true, "replicates": [88.0, 82.0, 90.0, 83.0, 82.0, 89.0, 82.0, 88.0, 88.0, 81.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 85.3}, {"lowerIsBetter": true, "replicates": [116.0, 120.0, 120.0, 116.0, 119.0, 113.0, 112.0, 124.0, 120.0, 128.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 118.8}, {"lowerIsBetter": true, "replicates": [150.0, 152.0, 151.0, 152.0, 144.0, 143.0, 149.0, 143.0, 145.0, 147.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 147.6}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 71.0, 66.0, 69.0, 67.0, 65.0, 64.0, 64.0, 64.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 66.0}], "name": "kraken", "value": 1510.5999999999997}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.05778811026238], "unit": "score", "name": "Richards", "value": 212.58864400000002}, {"lowerIsBetter": false, "replicates": [167.25204883759827], "unit": "score", "name": "DeltaBlue", "value": 395.31952199999984}, {"lowerIsBetter": false, "replicates": [280.19052956010086], "unit": "score", "name": "Encrypt", "value": 949.9999890000003}, {"lowerIsBetter": false, "replicates": [5191.709844559586], "unit": "score", "name": "Decrypt", "value": 51.270392215568904}, {"lowerIsBetter": false, "replicates": [894.4543828264758], "unit": "score", "name": "RayTrace", "value": 827.3077020000004}, {"lowerIsBetter": false, "replicates": [550.6607929515418], "unit": "score", "name": "Earley", "value": 1210.2968080000003}, {"lowerIsBetter": false, "replicates": [10923.91304347826], "unit": "score", "name": "Boyer", "value": 61.0095482587065}, {"lowerIsBetter": false, "replicates": [24095.238095238095], "unit": "score", "name": "RegExp", "value": 37.80767786561265}, {"lowerIsBetter": false, "replicates": [525.4860746190226], "unit": "score", "name": "Splay", "value": 155.077373}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 23285.099246266218}]} 21:27:51 INFO - RETURN: dromaeo_css: 7481.17 21:27:51 INFO - RETURN: kraken: 1510.60 21:27:51 INFO - RETURN: v8_7: 23285.10 21:27:51 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "23285.10"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1510.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7481.17"}}} 21:27:51 INFO - Return code: 0 21:27:52 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 21:27:52 INFO - # TBPL SUCCESS # 21:27:52 INFO - Running post-action listener: _resource_record_post_action 21:27:52 INFO - Running post-run listener: _resource_record_post_run 21:27:53 INFO - Total resource usage - Wall time: 1223s; CPU: 13.0%; Read bytes: 266240; Write bytes: 514416640; Read time: 72; Write time: 387640 21:27:53 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 191934464; Read time: 0; Write time: 180608 21:27:53 INFO - run-tests - Wall time: 1209s; CPU: 13.0%; Read bytes: 262144; Write bytes: 277929984; Read time: 12; Write time: 186004 21:27:53 INFO - Running post-run listener: _upload_blobber_files 21:27:53 INFO - Blob upload gear active. 21:27:53 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 21:27:53 INFO - Copying logs to upload dir... 21:27:53 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1277.242604 ========= master_lag: 7.15 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 24 secs) (at 2016-01-10 21:28:00.124685) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2016-01-10 21:28:00.129955) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009930 build_url: 'https://queue.taskcluster.net/v1/task/CBgmkUalTyOv0MIcZ-PWhA/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.32 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2016-01-10 21:28:00.457915) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:28:00.458286) ========= 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=652eb03db935cfc1c15ebda0000001ad-1452486312.220517-1586834249 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004531 ========= master_lag: 0.01 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-10 21:28:00.477619) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-10 21:28:00.477928) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-10 21:28:00.478224) ========= ========= Total master_lag: 7.62 =========