builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-046 starttime: 1451935274.45 results: success (0) buildid: 20160104085736 builduid: 8580e0d5a4704b8b8664b078977bb96f revision: 6f10c503b63f21523df03ddefa09c7f98221c371 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.451124) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.451675) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.452026) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006187 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.475093) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.475421) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.489983) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.490378) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004628 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.540434) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.540738) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.541108) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.541418) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-04 11:21:14-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.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% 222M=0s 2016-01-04 11:21:14 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.141665 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.695828) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.696182) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018574 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.746369) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:14.746745) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 6f10c503b63f21523df03ddefa09c7f98221c371 --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 6f10c503b63f21523df03ddefa09c7f98221c371 --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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-04 11:21:15,008 truncating revision to first 12 chars 2016-01-04 11:21:15,008 Setting DEBUG logging. 2016-01-04 11:21:15,008 attempt 1/10 2016-01-04 11:21:15,008 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/6f10c503b63f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-04 11:21:15,570 unpacking tar archive at: mozilla-aurora-6f10c503b63f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.851701 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:15.611468) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:15.611812) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:15.621855) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:15.622264) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-04 11:21:15.622771) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2016-01-04 11:21:15.623067) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:21:15 INFO - MultiFileLogger online at 20160104 11:21:15 in /builds/slave/test-pgo 11:21:15 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 11:21:15 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 11:21:15 INFO - {'append_to_log': False, 11:21:15 INFO - 'base_work_dir': '/builds/slave/test-pgo', 11:21:15 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 11:21:15 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 11:21:15 INFO - 'branch': 'Mozilla-Aurora', 11:21:15 INFO - 'buildbot_json_path': 'buildprops.json', 11:21:15 INFO - 'config_files': ('talos/linux_config.py',), 11:21:15 INFO - 'default_actions': ('clobber', 11:21:15 INFO - 'read-buildbot-config', 11:21:15 INFO - 'download-and-extract', 11:21:15 INFO - 'populate-webroot', 11:21:15 INFO - 'create-virtualenv', 11:21:15 INFO - 'install', 11:21:15 INFO - 'run-tests'), 11:21:15 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:21:15 INFO - 'download_minidump_stackwalk': True, 11:21:15 INFO - 'download_symbols': 'ondemand', 11:21:15 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:21:15 INFO - 'tooltool.py': '/tools/tooltool.py', 11:21:15 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:21:15 INFO - '/tools/misc-python/virtualenv.py')}, 11:21:15 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:21:15 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:21:15 INFO - 'installer_path': 'installer.exe', 11:21:15 INFO - 'log_level': 'info', 11:21:15 INFO - 'log_name': 'talos', 11:21:15 INFO - 'log_to_console': True, 11:21:15 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:21:15 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:21:15 INFO - 'opt_config_files': (), 11:21:15 INFO - 'pip_index': False, 11:21:15 INFO - 'sps_profile': False, 11:21:15 INFO - 'sps_profile_interval': 0, 11:21:15 INFO - 'suite': 'dromaeojs', 11:21:15 INFO - 'system_bits': '32', 11:21:15 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:21:15 INFO - 'title': 'talos-linux64-ix-046', 11:21:15 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:21:15 INFO - 'use_talos_json': True, 11:21:15 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 11:21:15 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:21:15 INFO - 'work_dir': 'build'} 11:21:15 INFO - ##### 11:21:15 INFO - ##### Running clobber step. 11:21:15 INFO - ##### 11:21:15 INFO - Running pre-action listener: _resource_record_pre_action 11:21:15 INFO - Running main action method: clobber 11:21:15 INFO - rmtree: /builds/slave/test-pgo/build 11:21:15 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 11:21:16 INFO - Running post-action listener: _resource_record_post_action 11:21:16 INFO - ##### 11:21:16 INFO - ##### Running read-buildbot-config step. 11:21:16 INFO - ##### 11:21:16 INFO - Running pre-action listener: _resource_record_pre_action 11:21:16 INFO - Running main action method: read_buildbot_config 11:21:16 INFO - Using buildbot properties: 11:21:16 INFO - { 11:21:16 INFO - "properties": { 11:21:16 INFO - "buildnumber": 63, 11:21:16 INFO - "product": "firefox", 11:21:16 INFO - "script_repo_revision": "production", 11:21:16 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 11:21:16 INFO - "repository": "", 11:21:16 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 11:21:16 INFO - "buildid": "20160104085736", 11:21:16 INFO - "slavename": "talos-linux64-ix-046", 11:21:16 INFO - "pgo_build": "True", 11:21:16 INFO - "basedir": "/builds/slave/test-pgo", 11:21:16 INFO - "project": "", 11:21:16 INFO - "platform": "ubuntu64_hw", 11:21:16 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 11:21:16 INFO - "slavebuilddir": "test", 11:21:16 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 11:21:16 INFO - "branch": "mozilla-aurora", 11:21:16 INFO - "repo_path": "releases/mozilla-aurora", 11:21:16 INFO - "stage_platform": "linux64-pgo", 11:21:16 INFO - "builduid": "8580e0d5a4704b8b8664b078977bb96f", 11:21:16 INFO - "revision": "6f10c503b63f21523df03ddefa09c7f98221c371" 11:21:16 INFO - }, 11:21:16 INFO - "sourcestamp": { 11:21:16 INFO - "repository": "", 11:21:16 INFO - "hasPatch": false, 11:21:16 INFO - "project": "", 11:21:16 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 11:21:16 INFO - "changes": [ 11:21:16 INFO - { 11:21:16 INFO - "category": null, 11:21:16 INFO - "files": [ 11:21:16 INFO - { 11:21:16 INFO - "url": null, 11:21:16 INFO - "name": "https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2" 11:21:16 INFO - } 11:21:16 INFO - ], 11:21:16 INFO - "repository": "", 11:21:16 INFO - "rev": "6f10c503b63f21523df03ddefa09c7f98221c371", 11:21:16 INFO - "who": "dholbert@mozilla.com", 11:21:16 INFO - "when": 1451934919, 11:21:16 INFO - "number": 7413301, 11:21:16 INFO - "comments": "Bug 1221919: Disable resizing of textarea in test_bug582181-1.html, since we don't use it and it causes intermittent orange due to inconsistent rendering. r=jfkthame a=testonly", 11:21:16 INFO - "project": "", 11:21:16 INFO - "at": "Mon 04 Jan 2016 11:15:19", 11:21:16 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 11:21:16 INFO - "revlink": "", 11:21:16 INFO - "properties": [ 11:21:16 INFO - [ 11:21:16 INFO - "buildid", 11:21:16 INFO - "20160104085736", 11:21:16 INFO - "Change" 11:21:16 INFO - ], 11:21:16 INFO - [ 11:21:16 INFO - "builduid", 11:21:16 INFO - "8580e0d5a4704b8b8664b078977bb96f", 11:21:16 INFO - "Change" 11:21:16 INFO - ], 11:21:16 INFO - [ 11:21:16 INFO - "pgo_build", 11:21:16 INFO - "True", 11:21:16 INFO - "Change" 11:21:16 INFO - ] 11:21:16 INFO - ], 11:21:16 INFO - "revision": "6f10c503b63f21523df03ddefa09c7f98221c371" 11:21:16 INFO - } 11:21:16 INFO - ], 11:21:16 INFO - "revision": "6f10c503b63f21523df03ddefa09c7f98221c371" 11:21:16 INFO - } 11:21:16 INFO - } 11:21:16 INFO - Found installer url https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2. 11:21:16 INFO - Running post-action listener: _resource_record_post_action 11:21:16 INFO - ##### 11:21:16 INFO - ##### Running download-and-extract step. 11:21:16 INFO - ##### 11:21:16 INFO - Running pre-action listener: _resource_record_pre_action 11:21:16 INFO - Running main action method: download_and_extract 11:21:16 INFO - mkdir: /builds/slave/test-pgo/build/tests 11:21: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')]} 11:21:16 INFO - https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 11:21:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/test_packages.json 11:21:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/test_packages.json 11:21:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 11:21:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 11:21:17 INFO - Downloaded 1302 bytes. 11:21:17 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 11:21:17 INFO - Using the following test package requirements: 11:21:17 INFO - {u'common': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 11:21:17 INFO - u'cppunittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 11:21:17 INFO - u'jittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'jsshell-linux-x86_64.zip'], 11:21:17 INFO - u'mochitest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 11:21:17 INFO - u'mozbase': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 11:21:17 INFO - u'reftest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.reftest.tests.zip'], 11:21:17 INFO - u'talos': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'], 11:21:17 INFO - u'web-platform': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 11:21:17 INFO - u'webapprt': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 11:21:17 INFO - u'xpcshell': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 11:21:17 INFO - u'firefox-45.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 11:21:17 INFO - Downloading packages: [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:21:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:17 INFO - https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:21:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:18 INFO - Downloaded 23023534 bytes. 11:21:18 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 11:21:18 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:18 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 11:21:19 INFO - Return code: 0 11:21:19 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 11:21:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:19 INFO - https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:21:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:20 INFO - Downloaded 23023534 bytes. 11:21:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 11:21:20 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 11:21:20 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 11:21:21 INFO - Return code: 0 11:21:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:21 INFO - https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:21:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 11:21:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 11:21:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:22 INFO - Downloaded 11132038 bytes. 11:21:22 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 11:21:22 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 11:21:22 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 11:21:22 INFO - Return code: 0 11:21:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:22 INFO - https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:21:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 11:21:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 11:21:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:21:24 INFO - Downloaded 58107110 bytes. 11:21:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 11:21:24 INFO - mkdir: /builds/slave/test-pgo/properties 11:21:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 11:21:24 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 11:21:24 INFO - Contents: 11:21:24 INFO - build_url:https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 11:21:24 INFO - Running post-action listener: _resource_record_post_action 11:21:24 INFO - Running post-action listener: set_extra_try_arguments 11:21:24 INFO - ##### 11:21:24 INFO - ##### Running populate-webroot step. 11:21:24 INFO - ##### 11:21:24 INFO - Running pre-action listener: _resource_record_pre_action 11:21:24 INFO - Running main action method: populate_webroot 11:21:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:21:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:21:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:21:24 INFO - '--tppagecycles', 11:21:24 INFO - '7'], 11:21:24 INFO - 'tests': ['tsvgm']}}, 11:21:24 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 11:21:24 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:21:24 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 11:21:24 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 11:21:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:21:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:21:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'tests': ['damp', 'tps']}, 11:21:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['damp', 'tps']}, 11:21:24 INFO - 'g3': {'tests': ['dromaeo_dom']}, 11:21:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:21:24 INFO - 'other': {'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'other-e10s': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'other_l64': {'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'other_nol64': {'tests': ['a11yr', 11:21:24 INFO - 'ts_paint', 11:21:24 INFO - 'tpaint', 11:21:24 INFO - 'sessionrestore', 11:21:24 INFO - 'sessionrestore_no_auto_restore']}, 11:21:24 INFO - 'svgr': {'tests': ['tsvgx', 11:21:24 INFO - 'tsvgr_opacity', 11:21:24 INFO - 'tart', 11:21:24 INFO - 'tscrollx', 11:21:24 INFO - 'cart']}, 11:21:24 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['tsvgx', 11:21:24 INFO - 'tsvgr_opacity', 11:21:24 INFO - 'tart', 11:21:24 INFO - 'tscrollx', 11:21:24 INFO - 'cart']}, 11:21:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'tests': ['tp5o']}, 11:21:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'talos_options': ['--e10s'], 11:21:24 INFO - 'tests': ['tp5o']}, 11:21:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'talos_options': ['--xperf_path', 11:21:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:21:24 INFO - 'tests': ['tp5n']}, 11:21:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:21:24 INFO - 'talos_options': ['--e10s', 11:21:24 INFO - '--xperf_path', 11:21:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:21:24 INFO - 'tests': ['tp5n']}}, 11:21:24 INFO - 'talos.zip': {'path': '', 11:21:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:21:24 INFO - Running post-action listener: _resource_record_post_action 11:21:24 INFO - ##### 11:21:24 INFO - ##### Running create-virtualenv step. 11:21:24 INFO - ##### 11:21:24 INFO - Running pre-action listener: _resource_record_pre_action 11:21:24 INFO - Running main action method: create_virtualenv 11:21:24 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 11:21:24 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 11:21:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 11:21:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:21:24 INFO - Using real prefix '/usr' 11:21:24 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 11:21:25 INFO - Installing distribute.............................................................................................................................................................................................done. 11:21:27 INFO - Installing pip.................done. 11:21:27 INFO - Return code: 0 11:21:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 11:21:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:27 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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:27 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 11:21:27 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 11:21:27 INFO - Using env: {'DISPLAY': ':0', 11:21:27 INFO - 'HOME': '/home/cltbld', 11:21:27 INFO - 'LANG': 'en_US.UTF-8', 11:21:27 INFO - 'LANGUAGE': 'en_US:en', 11:21:27 INFO - 'LOGNAME': 'cltbld', 11:21:27 INFO - 'MAIL': '/var/mail/cltbld', 11:21:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:27 INFO - 'MOZ_NO_REMOTE': '1', 11:21:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:27 INFO - 'NO_EM_RESTART': '1', 11:21:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:27 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:27 INFO - 'SHELL': '/bin/bash', 11:21:27 INFO - 'SHLVL': '1', 11:21:27 INFO - 'TERM': 'linux', 11:21:27 INFO - 'TMOUT': '86400', 11:21:27 INFO - 'USER': 'cltbld', 11:21:27 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:27 INFO - '_': '/tools/buildbot/bin/python'} 11:21:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:27 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 11:21:27 INFO - Cleaning up... 11:21:27 INFO - Return code: 0 11:21:27 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 11:21:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:27 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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:27 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 11:21:27 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 11:21:27 INFO - Using env: {'DISPLAY': ':0', 11:21:27 INFO - 'HOME': '/home/cltbld', 11:21:27 INFO - 'LANG': 'en_US.UTF-8', 11:21:27 INFO - 'LANGUAGE': 'en_US:en', 11:21:27 INFO - 'LOGNAME': 'cltbld', 11:21:27 INFO - 'MAIL': '/var/mail/cltbld', 11:21:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:27 INFO - 'MOZ_NO_REMOTE': '1', 11:21:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:27 INFO - 'NO_EM_RESTART': '1', 11:21:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:27 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:27 INFO - 'SHELL': '/bin/bash', 11:21:27 INFO - 'SHLVL': '1', 11:21:27 INFO - 'TERM': 'linux', 11:21:27 INFO - 'TMOUT': '86400', 11:21:27 INFO - 'USER': 'cltbld', 11:21:27 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:27 INFO - '_': '/tools/buildbot/bin/python'} 11:21:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:27 INFO - Downloading/unpacking psutil>=0.7.1 11:21: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 11:21: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 11:21: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 11:21: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 11:21: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 11:21: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 11:21:29 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 11:21:29 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 11:21:29 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 11:21:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:21:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:21:29 INFO - Installing collected packages: psutil 11:21:29 INFO - Running setup.py install for psutil 11:21:29 INFO - building 'psutil._psutil_linux' extension 11:21:29 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 11:21:29 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 11:21:29 INFO - building 'psutil._psutil_posix' extension 11:21:29 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 11:21:29 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 11:21:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:21:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:21:29 INFO - Successfully installed psutil 11:21:29 INFO - Cleaning up... 11:21:30 INFO - Return code: 0 11:21:30 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 11:21:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:30 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 11:21:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 11:21:30 INFO - Using env: {'DISPLAY': ':0', 11:21:30 INFO - 'HOME': '/home/cltbld', 11:21:30 INFO - 'LANG': 'en_US.UTF-8', 11:21:30 INFO - 'LANGUAGE': 'en_US:en', 11:21:30 INFO - 'LOGNAME': 'cltbld', 11:21:30 INFO - 'MAIL': '/var/mail/cltbld', 11:21:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:30 INFO - 'MOZ_NO_REMOTE': '1', 11:21:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:30 INFO - 'NO_EM_RESTART': '1', 11:21:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:30 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:30 INFO - 'SHELL': '/bin/bash', 11:21:30 INFO - 'SHLVL': '1', 11:21:30 INFO - 'TERM': 'linux', 11:21:30 INFO - 'TMOUT': '86400', 11:21:30 INFO - 'USER': 'cltbld', 11:21:30 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:30 INFO - '_': '/tools/buildbot/bin/python'} 11:21:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:30 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:21:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:31 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:21:31 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 11:21:31 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:21:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:21:32 INFO - Installing collected packages: mozsystemmonitor 11:21:32 INFO - Running setup.py install for mozsystemmonitor 11:21:32 INFO - Successfully installed mozsystemmonitor 11:21:32 INFO - Cleaning up... 11:21:32 INFO - Return code: 0 11:21:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 11:21:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:32 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 11:21:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:21:32 INFO - Using env: {'DISPLAY': ':0', 11:21:32 INFO - 'HOME': '/home/cltbld', 11:21:32 INFO - 'LANG': 'en_US.UTF-8', 11:21:32 INFO - 'LANGUAGE': 'en_US:en', 11:21:32 INFO - 'LOGNAME': 'cltbld', 11:21:32 INFO - 'MAIL': '/var/mail/cltbld', 11:21:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:32 INFO - 'MOZ_NO_REMOTE': '1', 11:21:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:32 INFO - 'NO_EM_RESTART': '1', 11:21:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:32 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:32 INFO - 'SHELL': '/bin/bash', 11:21:32 INFO - 'SHLVL': '1', 11:21:32 INFO - 'TERM': 'linux', 11:21:32 INFO - 'TMOUT': '86400', 11:21:32 INFO - 'USER': 'cltbld', 11:21:32 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:32 INFO - '_': '/tools/buildbot/bin/python'} 11:21:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:32 INFO - Downloading/unpacking blobuploader==1.2.4 11:21:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:34 INFO - Downloading blobuploader-1.2.4.tar.gz 11:21:34 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 11:21:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:21:34 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:21:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:34 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 11:21:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 11:21:34 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:21:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:34 INFO - Downloading docopt-0.6.1.tar.gz 11:21:34 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 11:21:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 11:21:34 INFO - Installing collected packages: blobuploader, requests, docopt 11:21:34 INFO - Running setup.py install for blobuploader 11:21:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:21:34 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 11:21:34 INFO - Running setup.py install for requests 11:21:35 INFO - Running setup.py install for docopt 11:21:35 INFO - Successfully installed blobuploader requests docopt 11:21:35 INFO - Cleaning up... 11:21:35 INFO - Return code: 0 11:21:35 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:21:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:35 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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:35 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 11:21:35 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 11:21:35 INFO - Using env: {'DISPLAY': ':0', 11:21:35 INFO - 'HOME': '/home/cltbld', 11:21:35 INFO - 'LANG': 'en_US.UTF-8', 11:21:35 INFO - 'LANGUAGE': 'en_US:en', 11:21:35 INFO - 'LOGNAME': 'cltbld', 11:21:35 INFO - 'MAIL': '/var/mail/cltbld', 11:21:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:35 INFO - 'MOZ_NO_REMOTE': '1', 11:21:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:35 INFO - 'NO_EM_RESTART': '1', 11:21:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:35 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:35 INFO - 'SHELL': '/bin/bash', 11:21:35 INFO - 'SHLVL': '1', 11:21:35 INFO - 'TERM': 'linux', 11:21:35 INFO - 'TMOUT': '86400', 11:21:35 INFO - 'USER': 'cltbld', 11:21:35 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:35 INFO - '_': '/tools/buildbot/bin/python'} 11:21:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:21:35 INFO - Running setup.py (path:/tmp/pip-dG9neE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:21:35 INFO - Running setup.py (path:/tmp/pip-JFu3o8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:21:35 INFO - Running setup.py (path:/tmp/pip-KBHZOq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:21:35 INFO - Running setup.py (path:/tmp/pip-QVlXDF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:21:35 INFO - Running setup.py (path:/tmp/pip-MLJGoo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:21:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:21:35 INFO - Running setup.py (path:/tmp/pip-LmzMHM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:21:36 INFO - Running setup.py (path:/tmp/pip-rSjeT0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:21:36 INFO - Running setup.py (path:/tmp/pip-xj77xV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:21:36 INFO - Running setup.py (path:/tmp/pip-0Pn22Z-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:21:36 INFO - Running setup.py (path:/tmp/pip-EXRKCZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:21:36 INFO - Running setup.py (path:/tmp/pip-lnJg4W-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:21:36 INFO - Running setup.py (path:/tmp/pip-u6yMtl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:21:36 INFO - Running setup.py (path:/tmp/pip-jWkgzZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:21:36 INFO - Running setup.py (path:/tmp/pip-1ub6WG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:21:36 INFO - Running setup.py (path:/tmp/pip-PfAiqC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:21:36 INFO - Running setup.py (path:/tmp/pip-yuiCFi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:21:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:21:36 INFO - Running setup.py (path:/tmp/pip-qGz7tE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:21:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:21:36 INFO - Running setup.py install for manifestparser 11:21:36 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 11:21:36 INFO - Running setup.py install for mozcrash 11:21:37 INFO - Running setup.py install for mozdebug 11:21:37 INFO - Running setup.py install for mozdevice 11:21:37 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for mozfile 11:21:37 INFO - Running setup.py install for mozhttpd 11:21:37 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for mozinfo 11:21:37 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for mozInstall 11:21:37 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for mozleak 11:21:37 INFO - Running setup.py install for mozlog 11:21:37 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for moznetwork 11:21:37 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 11:21:37 INFO - Running setup.py install for mozprocess 11:21:38 INFO - Running setup.py install for mozprofile 11:21:38 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 11:21:38 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 11:21:38 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 11:21:38 INFO - Running setup.py install for mozrunner 11:21:38 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 11:21:38 INFO - Running setup.py install for mozscreenshot 11:21:38 INFO - Running setup.py install for moztest 11:21:38 INFO - Running setup.py install for mozversion 11:21:38 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 11:21:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:21:38 INFO - Cleaning up... 11:21:38 INFO - Return code: 0 11:21:38 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:21:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:38 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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:38 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 11:21:38 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 11:21:38 INFO - Using env: {'DISPLAY': ':0', 11:21:38 INFO - 'HOME': '/home/cltbld', 11:21:38 INFO - 'LANG': 'en_US.UTF-8', 11:21:38 INFO - 'LANGUAGE': 'en_US:en', 11:21:38 INFO - 'LOGNAME': 'cltbld', 11:21:38 INFO - 'MAIL': '/var/mail/cltbld', 11:21:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:38 INFO - 'MOZ_NO_REMOTE': '1', 11:21:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:38 INFO - 'NO_EM_RESTART': '1', 11:21:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:38 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:38 INFO - 'SHELL': '/bin/bash', 11:21:38 INFO - 'SHLVL': '1', 11:21:38 INFO - 'TERM': 'linux', 11:21:38 INFO - 'TMOUT': '86400', 11:21:38 INFO - 'USER': 'cltbld', 11:21:38 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:38 INFO - '_': '/tools/buildbot/bin/python'} 11:21:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:21:38 INFO - Running setup.py (path:/tmp/pip-NJm4rf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:21:38 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 11:21:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:21:38 INFO - Running setup.py (path:/tmp/pip-5A4Ice-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:21:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:21:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:21:38 INFO - Running setup.py (path:/tmp/pip-jfh4C_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:21:39 INFO - Running setup.py (path:/tmp/pip-HFL2WV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:21:39 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)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:21:39 INFO - Running setup.py (path:/tmp/pip-sVdUBP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:21:39 INFO - Running setup.py (path:/tmp/pip-OHOY7N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:21:39 INFO - Running setup.py (path:/tmp/pip-3UM8h7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:21:39 INFO - Running setup.py (path:/tmp/pip-H5l5k6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:21:39 INFO - Running setup.py (path:/tmp/pip-PclC9P-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:21:39 INFO - Running setup.py (path:/tmp/pip-V2YWvt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:21:39 INFO - Running setup.py (path:/tmp/pip-hXLNsr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:21:39 INFO - Running setup.py (path:/tmp/pip-RD7v67-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:21:39 INFO - Running setup.py (path:/tmp/pip-OiSnfh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:21:39 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)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:21:39 INFO - Running setup.py (path:/tmp/pip-B7mQOU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:21:39 INFO - Running setup.py (path:/tmp/pip-OvudWW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:21:39 INFO - Running setup.py (path:/tmp/pip-Npll8i-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:21:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 11:21:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:21:39 INFO - Running setup.py (path:/tmp/pip-3aa_RF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:21:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 11:21:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:21:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:21:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:21:40 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)) 11:21:40 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)) 11:21:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:21:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:41 INFO - Downloading blessings-1.5.1.tar.gz 11:21:41 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 11:21:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 11:21:41 INFO - Installing collected packages: blessings 11:21:41 INFO - Running setup.py install for blessings 11:21:41 INFO - Successfully installed blessings 11:21:41 INFO - Cleaning up... 11:21:41 INFO - Return code: 0 11:21:41 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 11:21:41 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:21:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:21:42 INFO - Reading from file tmpfile_stdout 11:21:42 INFO - Current package versions: 11:21:42 INFO - argparse == 1.2.1 11:21:42 INFO - blessings == 1.5.1 11:21:42 INFO - blobuploader == 1.2.4 11:21:42 INFO - docopt == 0.6.1 11:21:42 INFO - manifestparser == 1.1 11:21:42 INFO - mozInstall == 1.12 11:21:42 INFO - mozcrash == 0.16 11:21:42 INFO - mozdebug == 0.1 11:21:42 INFO - mozdevice == 0.47 11:21:42 INFO - mozfile == 1.2 11:21:42 INFO - mozhttpd == 0.7 11:21:42 INFO - mozinfo == 0.9 11:21:42 INFO - mozleak == 0.1 11:21:42 INFO - mozlog == 3.1 11:21:42 INFO - moznetwork == 0.27 11:21:42 INFO - mozprocess == 0.22 11:21:42 INFO - mozprofile == 0.27 11:21:42 INFO - mozrunner == 6.11 11:21:42 INFO - mozscreenshot == 0.1 11:21:42 INFO - mozsystemmonitor == 0.0 11:21:42 INFO - moztest == 0.7 11:21:42 INFO - mozversion == 1.4 11:21:42 INFO - psutil == 3.1.1 11:21:42 INFO - requests == 1.2.3 11:21:42 INFO - wsgiref == 0.1.2 11:21:42 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 11:21:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:21:42 INFO - Using env: {'DISPLAY': ':0', 11:21:42 INFO - 'HOME': '/home/cltbld', 11:21:42 INFO - 'LANG': 'en_US.UTF-8', 11:21:42 INFO - 'LANGUAGE': 'en_US:en', 11:21:42 INFO - 'LOGNAME': 'cltbld', 11:21:42 INFO - 'MAIL': '/var/mail/cltbld', 11:21:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:42 INFO - 'MOZ_NO_REMOTE': '1', 11:21:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:42 INFO - 'NO_EM_RESTART': '1', 11:21:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:42 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:42 INFO - 'SHELL': '/bin/bash', 11:21:42 INFO - 'SHLVL': '1', 11:21:42 INFO - 'TERM': 'linux', 11:21:42 INFO - 'TMOUT': '86400', 11:21:42 INFO - 'USER': 'cltbld', 11:21:42 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:42 INFO - '_': '/tools/buildbot/bin/python'} 11:21:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 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)) 11:21:42 INFO - Cleaning up... 11:21:42 INFO - Return code: 0 11:21:42 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 11:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:42 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 11:21:42 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 11:21:42 INFO - Using env: {'DISPLAY': ':0', 11:21:42 INFO - 'HOME': '/home/cltbld', 11:21:42 INFO - 'LANG': 'en_US.UTF-8', 11:21:42 INFO - 'LANGUAGE': 'en_US:en', 11:21:42 INFO - 'LOGNAME': 'cltbld', 11:21:42 INFO - 'MAIL': '/var/mail/cltbld', 11:21:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:42 INFO - 'MOZ_NO_REMOTE': '1', 11:21:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:42 INFO - 'NO_EM_RESTART': '1', 11:21:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:42 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:42 INFO - 'SHELL': '/bin/bash', 11:21:42 INFO - 'SHLVL': '1', 11:21:42 INFO - 'TERM': 'linux', 11:21:42 INFO - 'TMOUT': '86400', 11:21:42 INFO - 'USER': 'cltbld', 11:21:42 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:42 INFO - '_': '/tools/buildbot/bin/python'} 11:21:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:42 INFO - Downloading/unpacking jsonschema 11:21:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:21:44 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 11:21:44 INFO - Downloading/unpacking functools32 (from jsonschema) 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - Downloading functools32-3.2.3-2.tar.gz 11:21:44 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 11:21:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 11:21:44 INFO - warning: no files found matching '*.txt' 11:21:44 INFO - no previously-included directories found matching 'build' 11:21:44 INFO - no previously-included directories found matching 'dist' 11:21:44 INFO - no previously-included directories found matching '.git*' 11:21:44 INFO - Installing collected packages: jsonschema, functools32 11:21:44 INFO - Running setup.py install for functools32 11:21:44 INFO - warning: no files found matching '*.txt' 11:21:44 INFO - no previously-included directories found matching 'build' 11:21:44 INFO - no previously-included directories found matching 'dist' 11:21:44 INFO - no previously-included directories found matching '.git*' 11:21:44 INFO - Successfully installed jsonschema functools32 11:21:44 INFO - Cleaning up... 11:21:44 INFO - Return code: 0 11:21:44 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 11:21:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:21:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:21:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:21:44 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 0x7fd563e06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11878a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1254600>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, '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-1451935273.975858-1492424210', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:21:44 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 11:21:44 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 11:21:44 INFO - Using env: {'DISPLAY': ':0', 11:21:44 INFO - 'HOME': '/home/cltbld', 11:21:44 INFO - 'LANG': 'en_US.UTF-8', 11:21:44 INFO - 'LANGUAGE': 'en_US:en', 11:21:44 INFO - 'LOGNAME': 'cltbld', 11:21:44 INFO - 'MAIL': '/var/mail/cltbld', 11:21:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:21:44 INFO - 'MOZ_NO_REMOTE': '1', 11:21:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:21:44 INFO - 'NO_EM_RESTART': '1', 11:21:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:21:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:21:44 INFO - 'PWD': '/builds/slave/test-pgo', 11:21:44 INFO - 'SHELL': '/bin/bash', 11:21:44 INFO - 'SHLVL': '1', 11:21:44 INFO - 'TERM': 'linux', 11:21:44 INFO - 'TMOUT': '86400', 11:21:44 INFO - 'USER': 'cltbld', 11:21:44 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:21:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:21:44 INFO - '_': '/tools/buildbot/bin/python'} 11:21:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:21:44 INFO - Downloading/unpacking flake8 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:46 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:21:46 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 11:21:46 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:21:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:46 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:21:46 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 11:21:46 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:21:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:47 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 11:21:47 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:21:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:21:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:21:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:21:47 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 11:21:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 11:21:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:21:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:21:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:21:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:21:47 INFO - no previously-included directories found matching 'docs/_build' 11:21:47 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:21:47 INFO - Running setup.py install for pep8 11:21:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:21:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:21:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:21:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:21:47 INFO - no previously-included directories found matching 'docs/_build' 11:21:47 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 11:21:47 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:21:47 INFO - Cleaning up... 11:21:47 INFO - Return code: 0 11:21:47 INFO - Running post-action listener: _resource_record_post_action 11:21:47 INFO - Running post-action listener: _start_resource_monitoring 11:21:47 INFO - Starting resource monitoring. 11:21:47 INFO - ##### 11:21:47 INFO - ##### Running install step. 11:21:47 INFO - ##### 11:21:47 INFO - Running pre-action listener: _resource_record_pre_action 11:21:47 INFO - Running main action method: install 11:21:47 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:21:47 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:21:47 INFO - Reading from file tmpfile_stdout 11:21:47 INFO - Detecting whether we're running mozinstall >=1.0... 11:21:47 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 11:21:47 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 11:21:47 INFO - Reading from file tmpfile_stdout 11:21:47 INFO - Output received: 11:21:47 INFO - Usage: mozinstall [options] installer 11:21:47 INFO - Options: 11:21:47 INFO - -h, --help show this help message and exit 11:21:47 INFO - -d DEST, --destination=DEST 11:21:47 INFO - Directory to install application into. [default: 11:21:47 INFO - "/builds/slave/test-pgo"] 11:21:47 INFO - --app=APP Application being installed. [default: firefox] 11:21:47 INFO - mkdir: /builds/slave/test-pgo/build/application 11:21:47 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'] 11:21:47 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 11:22:02 INFO - Reading from file tmpfile_stdout 11:22:02 INFO - Output received: 11:22:02 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 11:22:02 INFO - Running post-action listener: _resource_record_post_action 11:22:02 INFO - ##### 11:22:02 INFO - ##### Running run-tests step. 11:22:02 INFO - ##### 11:22:02 INFO - Running pre-action listener: _resource_record_pre_action 11:22:02 INFO - Running main action method: run_tests 11:22:02 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 11:22:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 11:22:02 INFO - Python 2.7.3 11:22:02 INFO - Return code: 0 11:22:02 INFO - grabbing minidump binary from tooltool 11:22: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')]} 11:22:02 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 0x12e3350>, '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 0x12e4250>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12e46e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 11:22:02 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 11:22:02 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 11:22:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:22:02 INFO - Return code: 0 11:22:02 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 11:22:02 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 11:22:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 11:22:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 11:22:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 11:22:02 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 11:22:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 11:22:03 INFO - Return code: 0 11:22:03 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:22:03 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 --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-046 --webServer localhost 11:22:03 INFO - Using env: {'DISPLAY': ':0', 11:22:03 INFO - 'HOME': '/home/cltbld', 11:22:03 INFO - 'LANG': 'en_US.UTF-8', 11:22:03 INFO - 'LANGUAGE': 'en_US:en', 11:22:03 INFO - 'LOGNAME': 'cltbld', 11:22:03 INFO - 'MAIL': '/var/mail/cltbld', 11:22:03 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:22:03 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 11:22:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:22:03 INFO - 'MOZ_NO_REMOTE': '1', 11:22:03 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:22:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:22:03 INFO - 'NO_EM_RESTART': '1', 11:22:03 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:22:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:22:03 INFO - 'PWD': '/builds/slave/test-pgo', 11:22:03 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 11:22:03 INFO - 'SHELL': '/bin/bash', 11:22:03 INFO - 'SHLVL': '1', 11:22:03 INFO - 'TERM': 'linux', 11:22:03 INFO - 'TMOUT': '86400', 11:22:03 INFO - 'USER': 'cltbld', 11:22:03 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1451935273.975858-1492424210', 11:22:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:22:03 INFO - '_': '/tools/buildbot/bin/python'} 11:22:03 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', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/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 11:22:03 INFO - mozversion INFO | application_buildid: 20160104085736 11:22:03 INFO - mozversion INFO | application_changeset: 6f10c503b63f21523df03ddefa09c7f98221c371 11:22:03 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 11:22:03 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:22:03 INFO - mozversion INFO | application_name: Firefox 11:22:03 INFO - mozversion INFO | application_remotingname: firefox-dev 11:22:03 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 11:22:03 INFO - mozversion INFO | application_vendor: Mozilla 11:22:03 INFO - mozversion INFO | application_version: 45.0a2 11:22:03 INFO - mozversion INFO | platform_buildid: 20160104085736 11:22:03 INFO - mozversion INFO | platform_changeset: 6f10c503b63f21523df03ddefa09c7f98221c371 11:22:03 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 11:22:03 INFO - mozversion INFO | platform_version: 45.0a2 11:22:03 INFO - 2016-01-04 11:22:03,623 DEBUG : using testdate: 1451935323 11:22:03 INFO - 2016-01-04 11:22:03,623 DEBUG : actual date: 1451935323 11:22:03 INFO - 2016-01-04 11:22:03,631 INFO : starting webserver on 'localhost:41308' 11:22:03 INFO - 2016-01-04 11:22:03,631 INFO : Starting test suite talos-linux64-ix-046 11:22:03 INFO - 2016-01-04 11:22:03,632 INFO : Starting test dromaeo_css 11:22:03 INFO - 2016-01-04 11:22:03,632 DEBUG : operating with platform_type : linux_ 11:22:03 INFO - 2016-01-04 11:22:03,633 INFO : Initialising browser for dromaeo_css test... 11:22:03 INFO - 2016-01-04 11:22:03,647 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOrhiT5/profile http://localhost:41308/getInfo.html 11:22:07 INFO - 2016-01-04 11:22:07,788 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:22:07 INFO - 2016-01-04 11:22:07,788 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:22:07 INFO - 2016-01-04 11:22:07,788 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:22:07 INFO - 2016-01-04 11:22:07,789 DEBUG : BROWSER_OUTPUT: __metrics 11:22:07 INFO - 2016-01-04 11:22:07,950 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:22:08 INFO - 2016-01-04 11:22:08,766 INFO : Browser initialized. 11:22:08 INFO - 2016-01-04 11:22:08,766 INFO : Running cycle 1/1 for dromaeo_css test... 11:22:08 INFO - 2016-01-04 11:22:08,766 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOrhiT5/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:22:20 INFO - 2016-01-04 11:22:20,587 DEBUG : BROWSER_OUTPUT: RSS: Main: 137768960 11:22:20 INFO - 2016-01-04 11:22:20,587 DEBUG : BROWSER_OUTPUT: 11:23:11 INFO - 2016-01-04 11:23:11,577 DEBUG : BROWSER_OUTPUT: 1451935391575 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 11:25:20 INFO - 2016-01-04 11:25:20,120 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41308/tests/dromaeo/cssquery-ext.html) 11:25:21 INFO - 2016-01-04 11:25:21,133 DEBUG : BROWSER_OUTPUT: RSS: Main: 240857088 11:25:21 INFO - 2016-01-04 11:25:21,133 DEBUG : BROWSER_OUTPUT: 11:28:23 INFO - 2016-01-04 11:28:23,248 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-ext.html (next: http://localhost:41308/tests/dromaeo/cssquery-jquery.html) 11:28:23 INFO - 2016-01-04 11:28:23,815 DEBUG : BROWSER_OUTPUT: RSS: Main: 225218560 11:28:23 INFO - 2016-01-04 11:28:23,815 DEBUG : BROWSER_OUTPUT: 11:31:25 INFO - 2016-01-04 11:31:25,609 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41308/tests/dromaeo/cssquery-mootools.html) 11:31:26 INFO - 2016-01-04 11:31:26,171 DEBUG : BROWSER_OUTPUT: RSS: Main: 217829376 11:31:26 INFO - 2016-01-04 11:31:26,171 DEBUG : BROWSER_OUTPUT: 11:34:27 INFO - 2016-01-04 11:34:27,923 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41308/tests/dromaeo/cssquery-prototype.html) 11:34:28 INFO - 2016-01-04 11:34:28,490 DEBUG : BROWSER_OUTPUT: RSS: Main: 201142272 11:34:28 INFO - 2016-01-04 11:34:28,490 DEBUG : BROWSER_OUTPUT: 11:37:30 INFO - 2016-01-04 11:37:30,858 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41308/tests/dromaeo/cssquery-yui.html) 11:37:31 INFO - 2016-01-04 11:37:31,444 DEBUG : BROWSER_OUTPUT: RSS: Main: 203792384 11:37:31 INFO - 2016-01-04 11:37:31,444 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,674 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/dromaeo/cssquery-yui.html (next: http://localhost:41308/tests/dromaeo/cssquery-dojo.html) 11:40:33 INFO - 2016-01-04 11:40:33,924 DEBUG : BROWSER_OUTPUT: RSS: Main: 246005760 11:40:33 INFO - 2016-01-04 11:40:33,924 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,926 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:40:33 INFO - 2016-01-04 11:40:33,926 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:40:33 INFO - 2016-01-04 11:40:33,926 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:40:33 INFO - 2016-01-04 11:40:33,926 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:40:33 INFO - 2016-01-04 11:40:33,930 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3327.8003319800814;3373.257883265681;3406.0633325835392;3408.659134086593;3422.6748458896395;5531.612787104899;5552.139418390156;5556.833295001146;5561.777528898844;5581.2186293918885;5554.888902221964;5579.832605021846;5581;5587.664740115596;5588.776448942048;4973.378327709036;5062.190049592066;5085.364329458817;5112.795488180487;5176.767045482962;4996.100701873679;5098.719570423626;5165.431802501722;5168.043911876315;5176.171812509999;5061.848144555669;5110.821121260757;5148.124818780816;5152.330197074375;5173.5085166909275;5135.537801597856;5208.114620514521;5211.895762084756;5213;5242.370915490127;4878.707277563358;4887.169181239198;4955.826546070906;5087.084324821531;5090.98180363925;5328.6802791832615;5418.783248670048;5424.511793938565;5426.972865135649;5430.0768869292315;6033.818985430444;6044.576879618428;6066.393360663898;6084.452399284041;6092.66490343031;5861.0915308127305;5948.7620495180145;5966.254218222723;6097.542684298695;6107.328193898712;5620.578456615729;5693.316801983747;5697.344805347397;5699.886002279973;5700.515456186271;6155.2921414037955;6175.3515880832765;6177.598456100429;6179.5056395488255;6182.381761823872;5731.083026715705;5773.711314434261;5861.794837180678;5872.588918775645;5905.025670764362;5994.310654274815;6050.757969681164;6056.031035034373;6057.909131363033;6062.211912451353;5798.6810725410505;5975.163477113208;6008.188894499274;6018.067199584071;6019.277686677539;5857.384974577608;5881.41185881417;5937.079752638261;5937.821865344046;5968.641881487038;4562.452505699337;4617.1227466781875;4651.97656515566;4653.604443622262;4688.226442636927;4044.029432936074;4127.2570937230985;4186.958130418718;4197.286461301586;4198.6641068714425;5652.604317697804;5686.459786320293;5777.480026797609;5784.21913041734;5821.7380217890295;6118.847028824315;6127.264728232641;6130.080487926846;6133.478654314434;6133.6319820810895;5492.890142197213;5592.608517403743;5751.051076572402;5772.047612144033;5773.624714393551;5184.818531351385;5253.264542963988;5275.498827611371;5280.656757310762;5315.681059136464;6230.190075290183;6243.282022567372;6249.78125765596;6254.812355629248;6256.092866534418;5634.1548767683535;5765.279340082489;5977.073553599199;6047.879042419215;6093.390660933871;6210.378962103934;6228.501719862309;6233.501319894307;6234.625922444668;6235.033569796688;5946.554008449297;5996.370381110095;6001.159837622649;6003.129546215861;6036.245469316335;5945.762169513344;5948.643081415129;6085.786997455068;6099.451049405575;6113.969430152821;5929.318128415115;5962.731677074456;5977.701114944322;5977.850553736192;5977.983742763828;5954.583179177416;5965.105234214729;5968.641881487125;5969.52243820502;5975.880482390241;5658.886822263614;5723.942760572341;5772.191893135048;5826.475617194304;5845.357010728731;5877.324107727666;5909.113632954919;5915.171875937458;5930.881382372242;5987.700614969147;5682.0340542107115;5830.038043722739;5835.241418615553;5835.503982161394;5839.562032847638 11:40:33 INFO - 2016-01-04 11:40:33,930 DEBUG : BROWSER_OUTPUT: |1;ext.html;605.9939400605996;645.370763505582;649.0912722188937;680.9080774095496;700.6776882633991;31683.366332673362;32300.19249518763;32374.35251294973;32418.67581324189;39497.21005579887;46121.538784612145;47100.76449617756;47135.76432117834;47154.29268560974;47384.52615473844;9119.179273865368;9214.493202873839;9254.2133918617;9284.350095493319;9290.25677945766;8394.202550757669;8576.957115214414;9100.63597456101;10804.18968577356;10884.510197041152;10743.40911249881;10823.080038196724;10843.349399036044;10889.346639201634;10945;8436.620352084172;10886.564537418493;10921.071708904752;10952.726181845517;11015.228933974626;8234.588270586446;11022.834657480144;11363;11368.715782105432;11374.260673056226;43466.34800477995;44129.55870441319;44143.55856441459;44178;44232.778836105936;3453.326601312745;3463.0822831949554;3479.356319080978;3507.877224297137;3606.2607165531003;32826.17934551631;33156.50265246023;33160.50259246113;33187;33223.83388083044;4154.065335299533;4214.36784482327;4224.746515209097;4261.190373828963;4326.9567304326865;300362;302623;302705;303464;303962;57793;60157.39842601606;65926.67036664882;66908.6654566724;72390.63804681048;65681;65807;65814.40577550865;65867.34132658708;65940;17871.106444677975;17923;17964.820351796578;18039.909800450914;18071.186796594186;13027.413766380347;13043.739125217633;13058.673533161747;13100.475980960655;13135;21186.78813211879;21530.461738456663;21534.892325538272;21569.56860862774;21639.35081947544;7543.358814500719;7606.125295590967;7680.270374314431;7691.384689224848;7787.766367008999;964.2334344196381;1040.7814358984547;1096.6874440784497;1121.4000509727257;1225.3934302520308;26500.60249096265;26760.732392676215;27140;27255.454890902467;27288.863555682492;1090.3981635399357;1135.0805847263578;1180.7992641251008;1222.2116734706242;1274.9298788566718;14036.298185090705;14926.10443373401;15265.923670381577;15563.688726225411;16352.836471635132;281881;282542;284958;285326;285437;50089.24866127011;51457;53162;53375;53517.46482535203;1436.5762100180473;1481.0965311160185;1483.7329280729357;1486.5614643679924;1486.8215814102161;29412.705872941;30520;30553.694463055086;30742.231444214074;31022.91419800296;47829.28256076092;48356.274655880894;49829.75085124551;54176.18735718889;56064.15903761528;216749;218255;219326;219735;219931;33070.83464582662;33478.33043339168;33529.83235083809;33572;33578;42848.78575607102;43409;44064.983277092884;44301;48064;39647.80176099101;40702;40870.59129408668;41451;41516.58483415127;39218.411723824735;39425.2114957705;40505.797471012454;40512.1897562053;41069.794651026554;36170;36519.81740091283;38572.2285554293;38711;38807.61192388153;33281;34320.31359372848;34405.82797085999;34833.47749783806;34944.30111397809;26330.73669263283;26645.733542664326;26743.465130697667;26745.598816017387;26746.331341716614 11:40:33 INFO - 2016-01-04 11:40:33,931 DEBUG : BROWSER_OUTPUT: |2;jquery.html;378.2265267527905;381.87398158607664;382.00678236584884;386.9922601547969;390.9061825161961;15389.923050384732;15948.362065517395;16958;18414.723779143307;18440.07799610019;18463.615228857823;18555.350562730306;18858.24567017321;18888.5277868053;18957.62084758304;6195.7831475898465;6355.459785918202;6355.872882542347;6358.364163583651;6359.777407790728;4524.253498172798;4648.372469716579;6175.135481032659;6958.304169583052;7204.423646108325;6944.270851560589;7084.43324534036;7100.289971002884;7155.89266161008;7167.247439018906;6934.618595977219;6959.965200174018;6980.581165130108;6982.965085174593;6991.98616200648;6593.20881494219;6690.565113267622;6782.966085169592;6783.6269005204695;6792.320767923217;24105.758942410528;24236.636450453258;24285.878570607212;24555.263342099766;24709.5058098837;2483.7019557653016;2496.450780828215;2542;2549.961750573724;2556.5653838847256;14743.631409214748;14768.704625907421;14935.25323733809;15085.622859428493;15385.46150884725;1995.3614843250166;2003.5291706448972;2011.3764732932837;2017.8183963443214;2024.4736368544138;72840.63579682121;76242.61878690572;77340;77558.22441775567;78580;15973.920130399274;15997;16114.677706445806;16237.51287461378;16276.674466510603;25267.873660631947;25269.747302527107;25410.110646127298;25478.490430191294;25551.744482554936;9310.906890931004;9551.474668893277;9580.041995800364;9651.855222171673;9683.322167448352;8194.877076843852;8227.300679442315;8236.176382361717;8300.460470069547;8315.667373305;7222.74720384784;8022.318102961197;8025.31784798287;8103.797405064921;8114.63484143215;1918.47242008446;1941.1555973151724;1945.4649971258018;1956.4424139120283;2351.1888398502488;990.935589186715;991.3209451525728;1006.9093781559695;1065.5418170186895;1134.3364131982883;14549.34527946245;16353.83646163547;17521.64956700859;18014.5496362592;18072.63854722898;951.2532661860406;955.8948515663271;995.5569771451635;999.0958182844537;1000.5497526113278;9474.526273686288;9679.70960871161;9732;9746.220302375792;9914.206863450907;626818;640204;643508;666511;666771;84149.57925210334;85807.57096214479;86346.56826715826;86948;88575.55712221397;1223.443333283354;1230.2003697596633;1231.2858542045592;1235.734317121823;1248.219862585884;15844.287007084478;15872.76190857115;15924;16161.838381616033;16253.268602912662;35382.8230858844;36241;36420;36642.900712978655;37131.443028355134;51379.486205138965;51662.74168629133;52390.47609524008;53343.73328133334;53402.46597534131;9971;10196.38821670702;10404.063634272952;10404.635837745642;10406.323588966692;12124.757504849676;13296.401661925043;18010.18954147093;18446.446606601825;18492.81507184911;15025.774613380589;15231.162286074372;15281.235938202823;15463.690726185188;15659.138747369005;14658.853411465749;14927.179005154821;15185.6203594911;15217;15226.46707365237;12703.301318427575;14781.778273326125;15290.464833730766;15759;15944;10038;10186.286959912735;10223.079922806983;10339.586416543254;10358.533865975898;10696.946515267375;11689.415529223335;14319.355628996513;14503;15358.616034599225 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1532.387045181927;1588.475802985015;1630.5108467459775;1763.4533294678652;1876.127600665691;7198.244184360646;7649.847003059936;7963.3231175350165;7969.362451003927;7976.6809327626825;7804.18056104108;7959;7963.482373645709;7969.123396426388;7970.641321140548;1979.6832506798914;2033.806788355104;2313.5719891820027;2338.053088499152;2369.0760603364615;2374.323317854412;2380.500094980048;2384.463495713468;2385.3678775124604;2387.271882075966;2278.977210227901;2311.0178174275948;2326.6975293211945;2327.837051406402;2332.47519308156;2311.9422014449606;2314.375118717937;2318.6058370077126;2322.129201549419;2330.1727886600265;2347.5657003454244;2354.2466410748566;2389.9641505377435;2392.425817803732;2392.461696118377;7917.524948503051;7983.680652773882;7986.440949133563;7992.320652744524;7992.800179995488;4788.928166077511;4844.103840789465;4855.223164293731;4888.608911287089;4889.193283108283;3070.416620842055;3092.304231547906;3100.147459448647;3128.749700023993;3137.7176054155234;938.8216238914653;956.5360800011989;973.8587904753842;984.178211193647;1014.6195176808696;10816.405097719622;10823.404712740796;10829.83755243672;10854.348739075602;10910.399928003957;4349.478062632441;4368.27923392643;4432.556744325606;4451.866444006685;4453.55464453552;9391.671291504765;9403.341766076446;9413.90586094144;9424.246060315158;9451.858222126673;4860.659753817199;4866.975665121652;4884.7069175849565;4900.4854490278;4905.1416002200185;4416.53626369233;4417.3815665806815;4423.933640995388;4428.490723566767;4432.180046691373;3503.597086335053;3516.4197907345;3543.6102028776813;3565.679088881961;3680.3191409589313;1197.736497970445;1219.439058033297;1232.976629397598;1237.9257244565356;1249.1256120715354;1138.8633363996373;1152.3489228585822;1152.4813833774836;1365.590322903125;1430.5207755401848;7571.772846814604;7602.315791578784;7682.615869206629;7691;7734.4585878989055;1188.2157775867886;1191.386435985468;1192.1714408486018;1195.5337418406828;1209.7701436726993;5854.795082172103;5963.761449542057;5967.075103358986;5969;5970.34326224115;9084.227840633488;9444.811103777885;9451.527423628791;9455.05449455049;9457.43255404678;9442.48066356357;9479.905200947902;9484.288678349152;9490.383125096847;9505.619775209052;7329;7488.513246638951;7564.697412103565;7571.242875712494;7582.62086895653;7220.74727384539;7270.563766174047;7292.781216563511;7294.307040831325;7295.963520182578;8460.873086903579;8495.490270583785;8500.489970601784;8506.617202226038;8655.48067115975;8659.653613855375;8744.825103497767;8889.111088891317;8900.154485323885;8900.198982091384;6456.709448074754;7193.676284567312;7249.130104387507;7251.456140789567;7254.492185546961;7144.928550714634;7170.318819712119;7339.74310899116;7348.52234604749;7350.411967042517;7191.280871912767;7297.562146271241;7321.450891183076;7379.225181356095;7402.925970740223;7304;7316.743913962986;7333.266673332624;7387.704491820482;7395.075615548057;7270.345668889825;7302.160251571137;7403.259674032553;7407.111146662435;7427.740029098955;6715;6717.026031225542;6755.1556055493065;6773.390394864486;6776.08522849409;6710.228323742832;6750.86498270022;6772.55978361405;6787.321267873173;6804 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: |4;prototype.html;360.27944111776446;363.0524331494799;364.9014766013175;367.0493422036924;368.4822823932374;6180.351063138373;6226.408491193335;6241.719122639481;6253.37466253375;6266.84332891678;6126.172966649501;6149.538784591151;6154.446099851012;6162.9383706163035;6163.322034576193;4599.609033232179;4736.976315118437;4742.027884283713;4759.595434388081;4779.235322348425;4735.337052812609;4750.287456881478;4785.377900872899;4789.2097803862325;4789.3294938708605;4462.665300102489;4518.8418405355815;4739.52604739525;4746.833860814872;4750.97624511877;4615.584597386234;4696.671233013691;4707.952920470802;4714.481407045222;4739.597134243593;4145.440365550642;4151.190517849021;4152.9202407374;4153.584641535853;4160.895977600554;5672.773089076432;5745;5790.797322093748;5838.737256823453;5867.031939729939;5470.56235501159;5471.2887324647545;5498.725063746797;5516.14499752535;5523.6685798852195;6502.934970650327;6549.5742776719835;6572.507061970324;6575.309592492815;6588.374104460068;4517.277235642281;4573.291139873325;4592.081583683277;4609.838655647036;4614.146382919171;6695.531312808105;6780.93219067808;6785.457163426963;6785.694643741043;6791.558548694368;4708.858734237979;4710.8351207707565;4713.599344055794;4718.05638872227;4722.362481065081;4765.761711914391;4771.498992605726;4773.427188737373;4778.784954677048;4779.02030083832;5375.623706340597;5498.725063746797;5503.091989821714;5505.256790333254;5516.062269414209;6540.836479087966;6598.868022639616;6600.8349791255605;6608.86782264352;6615.6030638161865;1670.0981470006304;1692.6953148433154;1693.1534232883557;1694.466243133409;1696.5928177237622;1128.9717757055976;1129.3562669278597;1131.9603813866474;1150.6893138852463;1159.9594014209463;6405.19935008124;6426.196725409324;6433.195850518685;6436.066770318278;6441.066045423388;6833.214180369222;6838.794836154923;6846.8972965405555;6847.452203823782;6855.965720171367;6328.050792381179;6385.393387628168;6423.229212494531;6429.967850160813;6438.25960014595;3662.853485860589;3668.614795446493;3676.9264614707554;3679.6136405677553;3679.668829805277;6779.559328643622;6933.722651094001;6963.373296403348;6987.196472405739;6989.091418115612;6910.7581234656545;7008.159020917523;7030.191527974348;7042.92957070433;7089.432845372357;7063.328983746638;7063.964680176567;7064.894026589605;7067.646617669096;7067.752628658075;6712.295209002984;6878.896816547855;6881.965590172017;6891.965540172468;6937.271586483346;6817.3182681733415;6818.556793808387;6823.1812182538415;6825.795226143224;6826.692798824164;7094.751683691046;7096.219415864354;7106.857862842611;7106.928930710626;7109.608971506616;4534.2065138599955;4609.815607375667;4612.215923292981;4614.330922016222;4616.561426664462;6884.586924784529;6906.654667266516;6910.654467276516;6913.10129683138;6913.688884000333;6721.193456785217;6723.731050757915;6725.596464212163;6727.596344219362;6728.360805723449;6571.934280657132;6705.698243579148;6713.227978782307;6713.899291510534;6718.93281067183;6566.4418524425955;6570.671466426564;6570.901436478361;6582.243042050034;6609.702563384755;6741.797746067429;6743.52795304324;6746.123004009447;6749.966250168718;6750.088738020305;6387.712552935036;6562;6576.309487503743;6577.112089867998;6589.835254118685 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: |5;yui.html;774.6862520679119;845.5307304446033;853.8889944307239;927.6614035876903;954.0364232125553;13653.180809151445;13985.51050713224;14892.329845156966;14934.402623895045;14979;13447.529336473226;13466.797998030013;13474.797878031814;13550.728985420286;13554.796678049812;728.158976382278;745.2659130756201;914.1224424552438;930.1024511346549;930.7393929699662;906.1844340093902;913.3332667152982;921.0329154387899;922.1470140120396;922.3128769067055;780.5667854340838;793.4802704228739;943.3915124744535;946.3517490518982;946.9763255918589;940.9858852117223;956.2015716876416;957.2772556719632;959.4051687953479;962.0187408843011;701.113091938698;703.2721133626723;704.2288693880193;705.6048612776862;707.6567864585672;14220.217888016155;14393.064450810663;14397.712045759132;14401.279936003159;14405.567832965027;11939.40302984856;12099.213551119148;12117.636470905887;12237.143399962006;12471.563495277713;10368.274220804471;10577.206709496819;10721.78556428867;10726.517306721138;10990;3790.469334293201;3880.8059597020037;3890.474785903895;3893.961060389388;3896.688264938798;46335;47272;47286.76356618229;47985;48595;10386.532606032746;10670.57317707283;10746.140308775279;10760.461976901124;10961.6163434281;18120.728189077174;18183.090845457675;18186.272549098154;18196.81803181951;18200.544986375447;7612.429067819936;7707.344875685518;7712.884306735404;7717.614119294125;7928.801779955547;4864.318995340655;4867.075255701406;4879.536444037811;4943.975280123576;4977.303177555145;3176.09481297829;3191.6648751880716;3199.024297589211;3206.3747569224242;3213.79110357826;574.9338826035059;598.8143675460622;602.3584882100549;609.6250805754429;619.8791235709084;624.4005754475663;674.1775034457953;692.5221597097986;705.763569204312;725.4160400877239;8162.102168761431;8435.409521333448;8447.281981031558;8478.533680647624;8511.74464766058;711.7651175112304;712.4407340237889;714.4391652552825;715.0295036445638;727.8216836874999;4083.1017176221185;4428.31361139024;4476.462824461086;4537.2059889519205;4593.793279302439;58359.416405836244;58787;58974;59069.704651476466;59330;54650;54904;55203.72398137984;55554.722226389415;55823;47152.7642361786;48132.27801582979;48633.5136648629;50894.74552627287;50907.49092509028;8616.0522342541;9217.400868943498;9423.952880235554;9754.0733630305;9790.06994335537;36887;37332.2533549322;37628;37892.62107378891;38185;45217.54782452133;45804.31293530666;48523.75738121287;48795.75602122109;49046.26430603615;11541.249818761753;11569.826452603049;11700.88299117032;11924.344161070878;11945.522179112739;12003;12015.399230038638;12175.939120304341;12314.692132696755;12385.62843114708;10860.565577376816;11780.234284771463;11881.465334059814;12001.519939202333;13077.869221308045;11845.23006004607;11849.81258757853;12144.271343719405;12153.939230303791;12572.811407828707;9917.887140601499;11058.22592418523;11077.778444431227;11268.436578170895;12151.75696486083;9965.35225210359;10285.074343309137;10370.585176593153;10418.114460270961;10804.135669146606;9604.95197524008;9745.220382369534;9982.251331150337;10007.499625018865;10069.496525173565 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: __start_cc_report 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,777 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: __end_cc_report 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: __startTimestamp1451936433925__endTimestamp 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,935 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:40:33 INFO - 2016-01-04 11:40:33,936 DEBUG : BROWSER_OUTPUT: Number of tests: 6 11:40:33 INFO - 2016-01-04 11:40:33,936 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,936 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5592.44 Median:5798.68 stddev:621.14 (10.7%) stddev-sans-first:597.10 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: Values: 3327.8 3373.3 3406.1 3408.7 3422.7 5531.6 5552.1 5556.8 5561.8 5581.2 5554.9 5579.8 5581.0 5587.7 5588.8 4973.4 5062.2 5085.4 5112.8 5176.8 4996.1 5098.7 5165.4 5168.0 5176.2 5061.8 5110.8 5148.1 5152.3 5173.5 5135.5 5208.1 5211.9 5213.0 5242.4 4878.7 4887.2 4955.8 5087.1 5091.0 5328.7 5418.8 5424.5 5427.0 5430.1 6033.8 6044.6 6066.4 6084.5 6092.7 5861.1 5948.8 5966.3 6097.5 6107.3 5620.6 5693.3 5697.3 5699.9 5700.5 6155.3 6175.4 6177.6 6179.5 6182.4 5731.1 5773.7 5861.8 5872.6 5905.0 5994.3 6050.8 6056.0 6057.9 6062.2 5798.7 5975.2 6008.2 6018.1 6019.3 5857.4 5881.4 5937.1 5937.8 5968.6 4562.5 4617.1 4652.0 4653.6 4688.2 4044.0 4127.3 4187.0 4197.3 4198.7 5652.6 5686.5 5777.5 5784.2 5821.7 6118.8 6127.3 6130.1 6133.5 6133.6 5492.9 5592.6 5751.1 5772.0 5773.6 5184.8 5253.3 5275.5 5280.7 5315.7 6230.2 6243.3 6249.8 6254.8 6256.1 5634.2 5765.3 5977.1 6047.9 6093.4 6210.4 6228.5 6233.5 6234.6 6235.0 5946.6 5996.4 6001.2 6003.1 6036.2 5945.8 5948.6 6085.8 6099.5 6114.0 5929.3 5962.7 5977.7 5977.9 5978.0 5954.6 5965.1 5968.6 5969.5 5975.9 5658.9 5723.9 5772.2 5826.5 5845.4 5877.3 5909.1 5915.2 5930.9 5987.7 5682.0 5830.0 5835.2 5835.5 5839.6 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:45853.76 Median:33504.08 stddev:70492.90 (210.4%) stddev-sans-first:70608.78 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: Values: 606.0 645.4 649.1 680.9 700.7 31683.4 32300.2 32374.4 32418.7 39497.2 46121.5 47100.8 47135.8 47154.3 47384.5 9119.2 9214.5 9254.2 9284.4 9290.3 8394.2 8577.0 9100.6 10804.2 10884.5 10743.4 10823.1 10843.3 10889.3 10945.0 8436.6 10886.6 10921.1 10952.7 11015.2 8234.6 11022.8 11363.0 11368.7 11374.3 43466.3 44129.6 44143.6 44178.0 44232.8 3453.3 3463.1 3479.4 3507.9 3606.3 32826.2 33156.5 33160.5 33187.0 33223.8 4154.1 4214.4 4224.7 4261.2 4327.0 300362.0 302623.0 302705.0 303464.0 303962.0 57793.0 60157.4 65926.7 66908.7 72390.6 65681.0 65807.0 65814.4 65867.3 65940.0 17871.1 17923.0 17964.8 18039.9 18071.2 13027.4 13043.7 13058.7 13100.5 13135.0 21186.8 21530.5 21534.9 21569.6 21639.4 7543.4 7606.1 7680.3 7691.4 7787.8 964.2 1040.8 1096.7 1121.4 1225.4 26500.6 26760.7 27140.0 27255.5 27288.9 1090.4 1135.1 1180.8 1222.2 1274.9 14036.3 14926.1 15265.9 15563.7 16352.8 281881.0 282542.0 284958.0 285326.0 285437.0 50089.2 51457.0 53162.0 53375.0 53517.5 1436.6 1481.1 1483.7 1486.6 1486.8 29412.7 30520.0 30553.7 30742.2 31022.9 47829.3 48356.3 49829.8 54176.2 56064.2 216749.0 218255.0 219326.0 219735.0 219931.0 33070.8 33478.3 33529.8 33572.0 33578.0 42848.8 43409.0 44065.0 44301.0 48064.0 39647.8 40702.0 40870.6 41451.0 41516.6 39218.4 39425.2 40505.8 40512.2 41069.8 36170.0 36519.8 38572.2 38711.0 38807.6 33281.0 34320.3 34405.8 34833.5 34944.3 26330.7 26645.7 26743.5 26745.6 26746.3 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,937 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:33994.41 Median:25268.81 stddev:105932.09 (419.2%) stddev-sans-first:106199.18 11:40:33 INFO - 2016-01-04 11:40:33,938 DEBUG : BROWSER_OUTPUT: Values: 378.2 381.9 382.0 387.0 390.9 15389.9 15948.4 16958.0 18414.7 18440.1 18463.6 18555.4 18858.2 18888.5 18957.6 6195.8 6355.5 6355.9 6358.4 6359.8 4524.3 4648.4 6175.1 6958.3 7204.4 6944.3 7084.4 7100.3 7155.9 7167.2 6934.6 6960.0 6980.6 6983.0 6992.0 6593.2 6690.6 6783.0 6783.6 6792.3 24105.8 24236.6 24285.9 24555.3 24709.5 2483.7 2496.5 2542.0 2550.0 2556.6 14743.6 14768.7 14935.3 15085.6 15385.5 1995.4 2003.5 2011.4 2017.8 2024.5 72840.6 76242.6 77340.0 77558.2 78580.0 15973.9 15997.0 16114.7 16237.5 16276.7 25267.9 25269.7 25410.1 25478.5 25551.7 9310.9 9551.5 9580.0 9651.9 9683.3 8194.9 8227.3 8236.2 8300.5 8315.7 7222.7 8022.3 8025.3 8103.8 8114.6 1918.5 1941.2 1945.5 1956.4 2351.2 990.9 991.3 1006.9 1065.5 1134.3 14549.3 16353.8 17521.6 18014.5 18072.6 951.3 955.9 995.6 999.1 1000.5 9474.5 9679.7 9732.0 9746.2 9914.2 626818.0 640204.0 643508.0 666511.0 666771.0 84149.6 85807.6 86346.6 86948.0 88575.6 1223.4 1230.2 1231.3 1235.7 1248.2 15844.3 15872.8 15924.0 16161.8 16253.3 35382.8 36241.0 36420.0 36642.9 37131.4 51379.5 51662.7 52390.5 53343.7 53402.5 9971.0 10196.4 10404.1 10404.6 10406.3 12124.8 13296.4 18010.2 18446.4 18492.8 15025.8 15231.2 15281.2 15463.7 15659.1 14658.9 14927.2 15185.6 15217.0 15226.5 12703.3 14781.8 15290.5 15759.0 15944.0 10038.0 10186.3 10223.1 10339.6 10358.5 10696.9 11689.4 14319.4 14503.0 15358.6 11:40:33 INFO - 2016-01-04 11:40:33,938 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,938 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5598.95 Median:6753.01 stddev:2876.69 (42.6%) stddev-sans-first:2868.52 11:40:33 INFO - 2016-01-04 11:40:33,939 DEBUG : BROWSER_OUTPUT: Values: 1532.4 1588.5 1630.5 1763.5 1876.1 7198.2 7649.8 7963.3 7969.4 7976.7 7804.2 7959.0 7963.5 7969.1 7970.6 1979.7 2033.8 2313.6 2338.1 2369.1 2374.3 2380.5 2384.5 2385.4 2387.3 2279.0 2311.0 2326.7 2327.8 2332.5 2311.9 2314.4 2318.6 2322.1 2330.2 2347.6 2354.2 2390.0 2392.4 2392.5 7917.5 7983.7 7986.4 7992.3 7992.8 4788.9 4844.1 4855.2 4888.6 4889.2 3070.4 3092.3 3100.1 3128.7 3137.7 938.8 956.5 973.9 984.2 1014.6 10816.4 10823.4 10829.8 10854.3 10910.4 4349.5 4368.3 4432.6 4451.9 4453.6 9391.7 9403.3 9413.9 9424.2 9451.9 4860.7 4867.0 4884.7 4900.5 4905.1 4416.5 4417.4 4423.9 4428.5 4432.2 3503.6 3516.4 3543.6 3565.7 3680.3 1197.7 1219.4 1233.0 1237.9 1249.1 1138.9 1152.3 1152.5 1365.6 1430.5 7571.8 7602.3 7682.6 7691.0 7734.5 1188.2 1191.4 1192.2 1195.5 1209.8 5854.8 5963.8 5967.1 5969.0 5970.3 9084.2 9444.8 9451.5 9455.1 9457.4 9442.5 9479.9 9484.3 9490.4 9505.6 7329.0 7488.5 7564.7 7571.2 7582.6 7220.7 7270.6 7292.8 7294.3 7296.0 8460.9 8495.5 8500.5 8506.6 8655.5 8659.7 8744.8 8889.1 8900.2 8900.2 6456.7 7193.7 7249.1 7251.5 7254.5 7144.9 7170.3 7339.7 7348.5 7350.4 7191.3 7297.6 7321.5 7379.2 7402.9 7304.0 7316.7 7333.3 7387.7 7395.1 7270.3 7302.2 7403.3 7407.1 7427.7 6715.0 6717.0 6755.2 6773.4 6776.1 6710.2 6750.9 6772.6 6787.3 6804.0 11:40:33 INFO - 2016-01-04 11:40:33,939 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,939 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5534.30 Median:6356.72 stddev:1675.33 (26.4%) stddev-sans-first:1634.40 11:40:33 INFO - 2016-01-04 11:40:33,939 DEBUG : BROWSER_OUTPUT: Values: 360.3 363.1 364.9 367.0 368.5 6180.4 6226.4 6241.7 6253.4 6266.8 6126.2 6149.5 6154.4 6162.9 6163.3 4599.6 4737.0 4742.0 4759.6 4779.2 4735.3 4750.3 4785.4 4789.2 4789.3 4462.7 4518.8 4739.5 4746.8 4751.0 4615.6 4696.7 4708.0 4714.5 4739.6 4145.4 4151.2 4152.9 4153.6 4160.9 5672.8 5745.0 5790.8 5838.7 5867.0 5470.6 5471.3 5498.7 5516.1 5523.7 6502.9 6549.6 6572.5 6575.3 6588.4 4517.3 4573.3 4592.1 4609.8 4614.1 6695.5 6780.9 6785.5 6785.7 6791.6 4708.9 4710.8 4713.6 4718.1 4722.4 4765.8 4771.5 4773.4 4778.8 4779.0 5375.6 5498.7 5503.1 5505.3 5516.1 6540.8 6598.9 6600.8 6608.9 6615.6 1670.1 1692.7 1693.2 1694.5 1696.6 1129.0 1129.4 1132.0 1150.7 1160.0 6405.2 6426.2 6433.2 6436.1 6441.1 6833.2 6838.8 6846.9 6847.5 6856.0 6328.1 6385.4 6423.2 6430.0 6438.3 3662.9 3668.6 3676.9 3679.6 3679.7 6779.6 6933.7 6963.4 6987.2 6989.1 6910.8 7008.2 7030.2 7042.9 7089.4 7063.3 7064.0 7064.9 7067.6 7067.8 6712.3 6878.9 6882.0 6892.0 6937.3 6817.3 6818.6 6823.2 6825.8 6826.7 7094.8 7096.2 7106.9 7106.9 7109.6 4534.2 4609.8 4612.2 4614.3 4616.6 6884.6 6906.7 6910.7 6913.1 6913.7 6721.2 6723.7 6725.6 6727.6 6728.4 6571.9 6705.7 6713.2 6713.9 6718.9 6566.4 6570.7 6570.9 6582.2 6609.7 6741.8 6743.5 6746.1 6750.0 6750.1 6387.7 6562.0 6576.3 6577.1 6589.8 11:40:33 INFO - 2016-01-04 11:40:33,939 DEBUG : BROWSER_OUTPUT: 11:40:33 INFO - 2016-01-04 11:40:33,940 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:14397.03 Median:47635.88 stddev:16633.61 (34.9%) stddev-sans-first:16648.81 11:40:33 INFO - 2016-01-04 11:40:33,940 DEBUG : BROWSER_OUTPUT: Values: 774.7 845.5 853.9 927.7 954.0 13653.2 13985.5 14892.3 14934.4 14979.0 13447.5 13466.8 13474.8 13550.7 13554.8 728.2 745.3 914.1 930.1 930.7 906.2 913.3 921.0 922.1 922.3 780.6 793.5 943.4 946.4 947.0 941.0 956.2 957.3 959.4 962.0 701.1 703.3 704.2 705.6 707.7 14220.2 14393.1 14397.7 14401.3 14405.6 11939.4 12099.2 12117.6 12237.1 12471.6 10368.3 10577.2 10721.8 10726.5 10990.0 3790.5 3880.8 3890.5 3894.0 3896.7 46335.0 47272.0 47286.8 47985.0 48595.0 10386.5 10670.6 10746.1 10760.5 10961.6 18120.7 18183.1 18186.3 18196.8 18200.5 7612.4 7707.3 7712.9 7717.6 7928.8 4864.3 4867.1 4879.5 4944.0 4977.3 3176.1 3191.7 3199.0 3206.4 3213.8 574.9 598.8 602.4 609.6 619.9 624.4 674.2 692.5 705.8 725.4 8162.1 8435.4 8447.3 8478.5 8511.7 711.8 712.4 714.4 715.0 727.8 4083.1 4428.3 4476.5 4537.2 4593.8 58359.4 58787.0 58974.0 59069.7 59330.0 54650.0 54904.0 55203.7 55554.7 55823.0 47152.8 48132.3 48633.5 50894.7 50907.5 8616.1 9217.4 9424.0 9754.1 9790.1 36887.0 37332.3 37628.0 37892.6 38185.0 45217.5 45804.3 48523.8 48795.8 49046.3 11541.2 11569.8 11700.9 11924.3 11945.5 12003.0 12015.4 12175.9 12314.7 12385.6 10860.6 11780.2 11881.5 12001.5 13077.9 11845.2 11849.8 12144.3 12153.9 12572.8 9917.9 11058.2 11077.8 11268.4 12151.8 9965.4 10285.1 10370.6 10418.1 10804.1 9605.0 9745.2 9982.3 10007.5 10069.5 11:40:33 INFO - 2016-01-04 11:40:33,940 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:40:33 INFO - 2016-01-04 11:40:33,940 DEBUG : BROWSER_OUTPUT: 11:40:34 INFO - 2016-01-04 11:40:34,602 INFO : Browser exited with error code: 0 11:40:34 INFO - 2016-01-04 11:40:34,623 INFO : Completed test dromaeo_css (00:18:30) 11:40:34 INFO - 2016-01-04 11:40:34,623 INFO : Starting test kraken 11:40:34 INFO - 2016-01-04 11:40:34,623 DEBUG : operating with platform_type : linux_ 11:40:34 INFO - 2016-01-04 11:40:34,623 INFO : Initialising browser for kraken test... 11:40:34 INFO - 2016-01-04 11:40:34,629 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpF198ne/profile http://localhost:41308/getInfo.html 11:40:38 INFO - 2016-01-04 11:40:38,391 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:40:38 INFO - 2016-01-04 11:40:38,392 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:40:38 INFO - 2016-01-04 11:40:38,392 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:40:38 INFO - 2016-01-04 11:40:38,392 DEBUG : BROWSER_OUTPUT: __metrics 11:40:38 INFO - 2016-01-04 11:40:38,528 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:40:39 INFO - 2016-01-04 11:40:39,599 INFO : Browser initialized. 11:40:39 INFO - 2016-01-04 11:40:39,600 INFO : Running cycle 1/1 for kraken test... 11:40:39 INFO - 2016-01-04 11:40:39,600 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpF198ne/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:40:51 INFO - 2016-01-04 11:40:51,436 DEBUG : BROWSER_OUTPUT: RSS: Main: 136097792 11:40:51 INFO - 2016-01-04 11:40:51,436 DEBUG : BROWSER_OUTPUT: 11:40:53 INFO - 2016-01-04 11:40:53,877 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41308/tests/kraken/driver.html?testName=audio-beat-detection) 11:40:54 INFO - 2016-01-04 11:40:54,459 DEBUG : BROWSER_OUTPUT: RSS: Main: 167493632 11:40:54 INFO - 2016-01-04 11:40:54,459 DEBUG : BROWSER_OUTPUT: 11:40:57 INFO - 2016-01-04 11:40:57,041 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41308/tests/kraken/driver.html?testName=audio-dft) 11:40:57 INFO - 2016-01-04 11:40:57,607 DEBUG : BROWSER_OUTPUT: RSS: Main: 167092224 11:40:57 INFO - 2016-01-04 11:40:57,607 DEBUG : BROWSER_OUTPUT: 11:41:00 INFO - 2016-01-04 11:41:00,427 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41308/tests/kraken/driver.html?testName=audio-fft) 11:41:00 INFO - 2016-01-04 11:41:00,989 DEBUG : BROWSER_OUTPUT: RSS: Main: 162873344 11:41:00 INFO - 2016-01-04 11:41:00,989 DEBUG : BROWSER_OUTPUT: 11:41:02 INFO - 2016-01-04 11:41:02,968 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41308/tests/kraken/driver.html?testName=audio-oscillator) 11:41:03 INFO - 2016-01-04 11:41:03,533 DEBUG : BROWSER_OUTPUT: RSS: Main: 161730560 11:41:03 INFO - 2016-01-04 11:41:03,534 DEBUG : BROWSER_OUTPUT: 11:41:05 INFO - 2016-01-04 11:41:05,686 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41308/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:41:06 INFO - 2016-01-04 11:41:06,247 DEBUG : BROWSER_OUTPUT: RSS: Main: 162455552 11:41:06 INFO - 2016-01-04 11:41:06,248 DEBUG : BROWSER_OUTPUT: 11:41:09 INFO - 2016-01-04 11:41:09,079 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41308/tests/kraken/driver.html?testName=imaging-darkroom) 11:41:09 INFO - 2016-01-04 11:41:09,660 DEBUG : BROWSER_OUTPUT: RSS: Main: 162476032 11:41:09 INFO - 2016-01-04 11:41:09,660 DEBUG : BROWSER_OUTPUT: 11:41:12 INFO - 2016-01-04 11:41:12,994 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41308/tests/kraken/driver.html?testName=imaging-desaturate) 11:41:13 INFO - 2016-01-04 11:41:13,577 DEBUG : BROWSER_OUTPUT: RSS: Main: 162291712 11:41:13 INFO - 2016-01-04 11:41:13,577 DEBUG : BROWSER_OUTPUT: 11:41:16 INFO - 2016-01-04 11:41:16,276 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41308/tests/kraken/driver.html?testName=json-parse-financial) 11:41:16 INFO - 2016-01-04 11:41:16,843 DEBUG : BROWSER_OUTPUT: RSS: Main: 163463168 11:41:16 INFO - 2016-01-04 11:41:16,843 DEBUG : BROWSER_OUTPUT: 11:41:18 INFO - 2016-01-04 11:41:18,377 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41308/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:41:18 INFO - 2016-01-04 11:41:18,939 DEBUG : BROWSER_OUTPUT: RSS: Main: 168370176 11:41:18 INFO - 2016-01-04 11:41:18,939 DEBUG : BROWSER_OUTPUT: 11:41:20 INFO - 2016-01-04 11:41:20,694 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:41:21 INFO - 2016-01-04 11:41:21,288 DEBUG : BROWSER_OUTPUT: RSS: Main: 167018496 11:41:21 INFO - 2016-01-04 11:41:21,288 DEBUG : BROWSER_OUTPUT: 11:41:23 INFO - 2016-01-04 11:41:23,281 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:41:23 INFO - 2016-01-04 11:41:23,847 DEBUG : BROWSER_OUTPUT: RSS: Main: 176123904 11:41:23 INFO - 2016-01-04 11:41:23,847 DEBUG : BROWSER_OUTPUT: 11:41:26 INFO - 2016-01-04 11:41:26,214 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:41:26 INFO - 2016-01-04 11:41:26,800 DEBUG : BROWSER_OUTPUT: RSS: Main: 182972416 11:41:26 INFO - 2016-01-04 11:41:26,800 DEBUG : BROWSER_OUTPUT: 11:41:29 INFO - 2016-01-04 11:41:29,315 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:41:29 INFO - 2016-01-04 11:41:29,885 DEBUG : BROWSER_OUTPUT: RSS: Main: 182210560 11:41:29 INFO - 2016-01-04 11:41:29,885 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,527 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41308/tests/kraken/driver.html?testName=ai-astar) 11:41:31 INFO - 2016-01-04 11:41:31,784 DEBUG : BROWSER_OUTPUT: RSS: Main: 240295936 11:41:31 INFO - 2016-01-04 11:41:31,784 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |0;ai-astar;108;109;105;110;110;110;99;109;110;110 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;153;120;151;166;127;146;139;121;160;127 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;160;161;161;168;160;159;162;160;161 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |3;audio-fft;74;73;71;151;72;70;70;71;148;71 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;92;135;91;93;93;138;92;92;135 11:41:31 INFO - 2016-01-04 11:41:31,785 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;109;109;108;109;108;109;109;109 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;145;147;145;146;145;145;145;145;146;145 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;95;95;95;95;95;96;95;95 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;56;56;56;55;57;56;58;56;53;54 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;63;63;63;63;64;66;64;64;64;65 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;78;79;79;81;82;80;81;79;80;86 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;109;116;117;115;107;116;119;126;118;110 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;153;143;143;145;146;134;134;143;150;132 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;65;69;64;64;64;64;65;65;65;63 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: __start_cc_report 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,917 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: __end_cc_report 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: __startTimestamp1451936491780__endTimestamp 11:41:31 INFO - 2016-01-04 11:41:31,786 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,787 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:41:31 INFO - 2016-01-04 11:41:31,787 DEBUG : BROWSER_OUTPUT: Number of tests: 14 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:108.00 Median:110.00 stddev:3.53 (3.2%) stddev-sans-first:3.74 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: Values: 108.0 109.0 105.0 110.0 110.0 110.0 99.0 109.0 110.0 110.0 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:141.00 Median:148.50 stddev:16.64 (11.2%) stddev-sans-first:17.07 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: Values: 153.0 120.0 151.0 166.0 127.0 146.0 139.0 121.0 160.0 127.0 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,788 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.30 Median:161.00 stddev:2.50 (1.6%) stddev-sans-first:2.65 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: Values: 161.0 160.0 161.0 161.0 168.0 160.0 159.0 162.0 160.0 161.0 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:87.10 Median:71.00 stddev:32.92 (46.4%) stddev-sans-first:34.57 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: Values: 74.0 73.0 71.0 151.0 72.0 70.0 70.0 71.0 148.0 71.0 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.30 Median:92.00 stddev:21.21 (23.1%) stddev-sans-first:21.94 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: Values: 92.0 92.0 135.0 91.0 93.0 93.0 138.0 92.0 92.0 135.0 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:108.80 Median:109.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 109.0 109.0 108.0 109.0 108.0 109.0 109.0 109.0 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,789 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:145.40 Median:145.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 145.0 147.0 145.0 146.0 145.0 145.0 145.0 145.0 146.0 145.0 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:55.70 Median:56.00 stddev:1.42 (2.5%) stddev-sans-first:1.50 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 56.0 56.0 56.0 55.0 57.0 56.0 58.0 56.0 53.0 54.0 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:63.90 Median:64.00 stddev:0.99 (1.6%) stddev-sans-first:1.00 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 63.0 63.0 63.0 63.0 64.0 66.0 64.0 64.0 64.0 65.0 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:80.50 Median:80.50 stddev:2.27 (2.8%) stddev-sans-first:2.22 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 78.0 79.0 79.0 81.0 82.0 80.0 81.0 79.0 80.0 86.0 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:115.30 Median:116.50 stddev:5.54 (4.8%) stddev-sans-first:5.39 11:41:31 INFO - 2016-01-04 11:41:31,790 DEBUG : BROWSER_OUTPUT: Values: 109.0 116.0 117.0 115.0 107.0 116.0 119.0 126.0 118.0 110.0 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.30 Median:144.00 stddev:6.99 (4.9%) stddev-sans-first:6.25 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: Values: 153.0 143.0 143.0 145.0 146.0 134.0 134.0 143.0 150.0 132.0 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.80 Median:65.00 stddev:1.62 (2.5%) stddev-sans-first:1.72 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: Values: 65.0 69.0 64.0 64.0 64.0 64.0 65.0 65.0 65.0 63.0 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:41:31 INFO - 2016-01-04 11:41:31,791 DEBUG : BROWSER_OUTPUT: 11:41:32 INFO - 2016-01-04 11:41:32,546 INFO : Browser exited with error code: 0 11:41:32 INFO - 2016-01-04 11:41:32,593 INFO : Completed test kraken (00:00:57) 11:41:32 INFO - 2016-01-04 11:41:32,594 INFO : Starting test v8_7 11:41:32 INFO - 2016-01-04 11:41:32,594 DEBUG : operating with platform_type : linux_ 11:41:32 INFO - 2016-01-04 11:41:32,594 INFO : Initialising browser for v8_7 test... 11:41:32 INFO - 2016-01-04 11:41:32,600 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFENvxE/profile http://localhost:41308/getInfo.html 11:41:36 INFO - 2016-01-04 11:41:36,416 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:41:36 INFO - 2016-01-04 11:41:36,417 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:41:36 INFO - 2016-01-04 11:41:36,417 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:41:36 INFO - 2016-01-04 11:41:36,417 DEBUG : BROWSER_OUTPUT: __metrics 11:41:36 INFO - 2016-01-04 11:41:36,614 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:41:37 INFO - 2016-01-04 11:41:37,571 INFO : Browser initialized. 11:41:37 INFO - 2016-01-04 11:41:37,571 INFO : Running cycle 1/1 for v8_7 test... 11:41:37 INFO - 2016-01-04 11:41:37,572 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFENvxE/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:41:49 INFO - 2016-01-04 11:41:49,390 DEBUG : BROWSER_OUTPUT: RSS: Main: 137687040 11:41:49 INFO - 2016-01-04 11:41:49,390 DEBUG : BROWSER_OUTPUT: 11:42:10 INFO - 2016-01-04 11:42:10,749 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:41308/tests/v8_7/run.html (next: http://localhost:41308/tests/v8_7/run.html) 11:42:11 INFO - 2016-01-04 11:42:11,007 DEBUG : BROWSER_OUTPUT: RSS: Main: 423161856 11:42:11 INFO - 2016-01-04 11:42:11,007 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,007 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:42:11 INFO - 2016-01-04 11:42:11,007 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:42:11 INFO - 2016-01-04 11:42:11,007 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |0;Richards;165.80998176090202 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;168.0672268907563 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.9400278940028 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5191.709844559586 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |4;RayTrace;972.7626459143969 11:42:11 INFO - 2016-01-04 11:42:11,008 DEBUG : BROWSER_OUTPUT: |5;Earley;557.4136008918617 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: |6;Boyer;11177.777777777777 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: |7;RegExp;24285.714285714286 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: |8;Splay;543.1830526887561 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4826.923076923077 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: __startTimestamp1451936531000__endTimestamp 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,009 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: Number of tests: 10 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.81 Median:165.81 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: Values: 165.8 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:168.07 Median:168.07 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,010 DEBUG : BROWSER_OUTPUT: Values: 168.1 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.94 Median:278.94 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: Values: 278.9 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5191.71 Median:5191.71 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: Values: 5191.7 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,011 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:972.76 Median:972.76 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: Values: 972.8 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:557.41 Median:557.41 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: Values: 557.4 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11177.78 Median:11177.78 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,012 DEBUG : BROWSER_OUTPUT: Values: 11177.8 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:24285.71 Median:24285.71 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: Values: 24285.7 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:543.18 Median:543.18 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: Values: 543.2 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: Values: 4826.9 11:42:11 INFO - 2016-01-04 11:42:11,013 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:42:11 INFO - 2016-01-04 11:42:11,014 DEBUG : BROWSER_OUTPUT: 11:42:11 INFO - 2016-01-04 11:42:11,790 INFO : Browser exited with error code: 0 11:42:11 INFO - 2016-01-04 11:42:11,806 INFO : Completed test v8_7 (00:00:39) 11:42:12 INFO - 2016-01-04 11:42:12,057 INFO : Completed test suite (00:20:08) 11:42:12 INFO - 2016-01-04 11:42:12,057 DEBUG : Working with test: dromaeo_css 11:42:12 INFO - 2016-01-04 11:42:12,057 DEBUG : Generating results file: dromaeo_css 11:42:12 INFO - 2016-01-04 11:42:12,059 DEBUG : Working with test: kraken 11:42:12 INFO - 2016-01-04 11:42:12,059 DEBUG : Generating results file: kraken 11:42:12 INFO - 2016-01-04 11:42:12,059 INFO : javascript benchmark 11:42:12 INFO - 2016-01-04 11:42:12,059 DEBUG : Working with test: v8_7 11:42:12 INFO - 2016-01-04 11:42:12,059 DEBUG : Generating results file: v8_7 11:42:12 INFO - 2016-01-04 11:42:12,060 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:42:12 INFO - 2016-01-04 11:42:12,116 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,35]] 11:42:12 INFO - 2016-01-04 11:42:12,117 DEBUG : process_Request line: dromaeo_css 7466.06 graph.html#tests=[[72,52,35]] 11:42:12 INFO - 2016-01-04 11:42:12,117 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:42:12 INFO - 2016-01-04 11:42:12,148 DEBUG : process_Request line: kraken 1474.50 graph.html#tests=[[232,52,35]] 11:42:12 INFO - 2016-01-04 11:42:12,148 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:42:12 INFO - 2016-01-04 11:42:12,181 DEBUG : process_Request line: v8_7 22918.36 graph.html#tests=[[230,52,35]] 11:42:12 INFO - 2016-01-04 11:42:12,182 INFO : javascript benchmark 11:42:12 INFO - 2016-01-04 11:42:12,186 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3327.8003319800814, 3373.257883265681, 3406.0633325835392, 3408.659134086593, 3422.6748458896395, 5531.612787104899, 5552.139418390156, 5556.833295001146, 5561.777528898844, 5581.2186293918885, 5554.888902221964, 5579.832605021846, 5581.0, 5587.664740115596, 5588.776448942048, 4973.378327709036, 5062.190049592066, 5085.364329458817, 5112.795488180487, 5176.767045482962, 4996.100701873679, 5098.719570423626, 5165.431802501722, 5168.043911876315, 5176.171812509999, 5061.848144555669, 5110.821121260757, 5148.124818780816, 5152.330197074375, 5173.5085166909275, 5135.537801597856, 5208.114620514521, 5211.895762084756, 5213.0, 5242.370915490127, 4878.707277563358, 4887.169181239198, 4955.826546070906, 5087.084324821531, 5090.98180363925, 5328.6802791832615, 5418.783248670048, 5424.511793938565, 5426.972865135649, 5430.0768869292315, 6033.818985430444, 6044.576879618428, 6066.393360663898, 6084.452399284041, 6092.66490343031, 5861.0915308127305, 5948.7620495180145, 5966.254218222723, 6097.542684298695, 6107.328193898712, 5620.578456615729, 5693.316801983747, 5697.344805347397, 5699.886002279973, 5700.515456186271, 6155.2921414037955, 6175.3515880832765, 6177.598456100429, 6179.5056395488255, 6182.381761823872, 5731.083026715705, 5773.711314434261, 5861.794837180678, 5872.588918775645, 5905.025670764362, 5994.310654274815, 6050.757969681164, 6056.031035034373, 6057.909131363033, 6062.211912451353, 5798.6810725410505, 5975.163477113208, 6008.188894499274, 6018.067199584071, 6019.277686677539, 5857.384974577608, 5881.41185881417, 5937.079752638261, 5937.821865344046, 5968.641881487038, 4562.452505699337, 4617.1227466781875, 4651.97656515566, 4653.604443622262, 4688.226442636927, 4044.029432936074, 4127.2570937230985, 4186.958130418718, 4197.286461301586, 4198.6641068714425, 5652.604317697804, 5686.459786320293, 5777.480026797609, 5784.21913041734, 5821.7380217890295, 6118.847028824315, 6127.264728232641, 6130.080487926846, 6133.478654314434, 6133.6319820810895, 5492.890142197213, 5592.608517403743, 5751.051076572402, 5772.047612144033, 5773.624714393551, 5184.818531351385, 5253.264542963988, 5275.498827611371, 5280.656757310762, 5315.681059136464, 6230.190075290183, 6243.282022567372, 6249.78125765596, 6254.812355629248, 6256.092866534418, 5634.1548767683535, 5765.279340082489, 5977.073553599199, 6047.879042419215, 6093.390660933871, 6210.378962103934, 6228.501719862309, 6233.501319894307, 6234.625922444668, 6235.033569796688, 5946.554008449297, 5996.370381110095, 6001.159837622649, 6003.129546215861, 6036.245469316335, 5945.762169513344, 5948.643081415129, 6085.786997455068, 6099.451049405575, 6113.969430152821, 5929.318128415115, 5962.731677074456, 5977.701114944322, 5977.850553736192, 5977.983742763828, 5954.583179177416, 5965.105234214729, 5968.641881487125, 5969.52243820502, 5975.880482390241, 5658.886822263614, 5723.942760572341, 5772.191893135048, 5826.475617194304, 5845.357010728731, 5877.324107727666, 5909.113632954919, 5915.171875937458, 5930.881382372242, 5987.700614969147, 5682.0340542107115, 5830.038043722739, 5835.241418615553, 5835.503982161394, 5839.562032847638], "unit": "ms", "name": "dojo.html", "value": 5552.382988981384}, {"lowerIsBetter": false, "replicates": [605.9939400605996, 645.370763505582, 649.0912722188937, 680.9080774095496, 700.6776882633991, 31683.366332673362, 32300.19249518763, 32374.35251294973, 32418.67581324189, 39497.21005579887, 46121.538784612145, 47100.76449617756, 47135.76432117834, 47154.29268560974, 47384.52615473844, 9119.179273865368, 9214.493202873839, 9254.2133918617, 9284.350095493319, 9290.25677945766, 8394.202550757669, 8576.957115214414, 9100.63597456101, 10804.18968577356, 10884.510197041152, 10743.40911249881, 10823.080038196724, 10843.349399036044, 10889.346639201634, 10945.0, 8436.620352084172, 10886.564537418493, 10921.071708904752, 10952.726181845517, 11015.228933974626, 8234.588270586446, 11022.834657480144, 11363.0, 11368.715782105432, 11374.260673056226, 43466.34800477995, 44129.55870441319, 44143.55856441459, 44178.0, 44232.778836105936, 3453.326601312745, 3463.0822831949554, 3479.356319080978, 3507.877224297137, 3606.2607165531003, 32826.17934551631, 33156.50265246023, 33160.50259246113, 33187.0, 33223.83388083044, 4154.065335299533, 4214.36784482327, 4224.746515209097, 4261.190373828963, 4326.9567304326865, 300362.0, 302623.0, 302705.0, 303464.0, 303962.0, 57793.0, 60157.39842601606, 65926.67036664882, 66908.6654566724, 72390.63804681048, 65681.0, 65807.0, 65814.40577550865, 65867.34132658708, 65940.0, 17871.106444677975, 17923.0, 17964.820351796578, 18039.909800450914, 18071.186796594186, 13027.413766380347, 13043.739125217633, 13058.673533161747, 13100.475980960655, 13135.0, 21186.78813211879, 21530.461738456663, 21534.892325538272, 21569.56860862774, 21639.35081947544, 7543.358814500719, 7606.125295590967, 7680.270374314431, 7691.384689224848, 7787.766367008999, 964.2334344196381, 1040.7814358984547, 1096.6874440784497, 1121.4000509727257, 1225.3934302520308, 26500.60249096265, 26760.732392676215, 27140.0, 27255.454890902467, 27288.863555682492, 1090.3981635399357, 1135.0805847263578, 1180.7992641251008, 1222.2116734706242, 1274.9298788566718, 14036.298185090705, 14926.10443373401, 15265.923670381577, 15563.688726225411, 16352.836471635132, 281881.0, 282542.0, 284958.0, 285326.0, 285437.0, 50089.24866127011, 51457.0, 53162.0, 53375.0, 53517.46482535203, 1436.5762100180473, 1481.0965311160185, 1483.7329280729357, 1486.5614643679924, 1486.8215814102161, 29412.705872941, 30520.0, 30553.694463055086, 30742.231444214074, 31022.91419800296, 47829.28256076092, 48356.274655880894, 49829.75085124551, 54176.18735718889, 56064.15903761528, 216749.0, 218255.0, 219326.0, 219735.0, 219931.0, 33070.83464582662, 33478.33043339168, 33529.83235083809, 33572.0, 33578.0, 42848.78575607102, 43409.0, 44064.983277092884, 44301.0, 48064.0, 39647.80176099101, 40702.0, 40870.59129408668, 41451.0, 41516.58483415127, 39218.411723824735, 39425.2114957705, 40505.797471012454, 40512.1897562053, 41069.794651026554, 36170.0, 36519.81740091283, 38572.2285554293, 38711.0, 38807.61192388153, 33281.0, 34320.31359372848, 34405.82797085999, 34833.47749783806, 34944.30111397809, 26330.73669263283, 26645.733542664326, 26743.465130697667, 26745.598816017387, 26746.331341716614], "unit": "ms", "name": "ext.html", "value": 19701.43568047954}, {"lowerIsBetter": false, "replicates": [378.2265267527905, 381.87398158607664, 382.00678236584884, 386.9922601547969, 390.9061825161961, 15389.923050384732, 15948.362065517395, 16958.0, 18414.723779143307, 18440.07799610019, 18463.615228857823, 18555.350562730306, 18858.24567017321, 18888.5277868053, 18957.62084758304, 6195.7831475898465, 6355.459785918202, 6355.872882542347, 6358.364163583651, 6359.777407790728, 4524.253498172798, 4648.372469716579, 6175.135481032659, 6958.304169583052, 7204.423646108325, 6944.270851560589, 7084.43324534036, 7100.289971002884, 7155.89266161008, 7167.247439018906, 6934.618595977219, 6959.965200174018, 6980.581165130108, 6982.965085174593, 6991.98616200648, 6593.20881494219, 6690.565113267622, 6782.966085169592, 6783.6269005204695, 6792.320767923217, 24105.758942410528, 24236.636450453258, 24285.878570607212, 24555.263342099766, 24709.5058098837, 2483.7019557653016, 2496.450780828215, 2542.0, 2549.961750573724, 2556.5653838847256, 14743.631409214748, 14768.704625907421, 14935.25323733809, 15085.622859428493, 15385.46150884725, 1995.3614843250166, 2003.5291706448972, 2011.3764732932837, 2017.8183963443214, 2024.4736368544138, 72840.63579682121, 76242.61878690572, 77340.0, 77558.22441775567, 78580.0, 15973.920130399274, 15997.0, 16114.677706445806, 16237.51287461378, 16276.674466510603, 25267.873660631947, 25269.747302527107, 25410.110646127298, 25478.490430191294, 25551.744482554936, 9310.906890931004, 9551.474668893277, 9580.041995800364, 9651.855222171673, 9683.322167448352, 8194.877076843852, 8227.300679442315, 8236.176382361717, 8300.460470069547, 8315.667373305, 7222.74720384784, 8022.318102961197, 8025.31784798287, 8103.797405064921, 8114.63484143215, 1918.47242008446, 1941.1555973151724, 1945.4649971258018, 1956.4424139120283, 2351.1888398502488, 990.935589186715, 991.3209451525728, 1006.9093781559695, 1065.5418170186895, 1134.3364131982883, 14549.34527946245, 16353.83646163547, 17521.64956700859, 18014.5496362592, 18072.63854722898, 951.2532661860406, 955.8948515663271, 995.5569771451635, 999.0958182844537, 1000.5497526113278, 9474.526273686288, 9679.70960871161, 9732.0, 9746.220302375792, 9914.206863450907, 626818.0, 640204.0, 643508.0, 666511.0, 666771.0, 84149.57925210334, 85807.57096214479, 86346.56826715826, 86948.0, 88575.55712221397, 1223.443333283354, 1230.2003697596633, 1231.2858542045592, 1235.734317121823, 1248.219862585884, 15844.287007084478, 15872.76190857115, 15924.0, 16161.838381616033, 16253.268602912662, 35382.8230858844, 36241.0, 36420.0, 36642.900712978655, 37131.443028355134, 51379.486205138965, 51662.74168629133, 52390.47609524008, 53343.73328133334, 53402.46597534131, 9971.0, 10196.38821670702, 10404.063634272952, 10404.635837745642, 10406.323588966692, 12124.757504849676, 13296.401661925043, 18010.18954147093, 18446.446606601825, 18492.81507184911, 15025.774613380589, 15231.162286074372, 15281.235938202823, 15463.690726185188, 15659.138747369005, 14658.853411465749, 14927.179005154821, 15185.6203594911, 15217.0, 15226.46707365237, 12703.301318427575, 14781.778273326125, 15290.464833730766, 15759.0, 15944.0, 10038.0, 10186.286959912735, 10223.079922806983, 10339.586416543254, 10358.533865975898, 10696.946515267375, 11689.415529223335, 14319.355628996513, 14503.0, 15358.616034599225], "unit": "ms", "name": "jquery.html", "value": 10314.71355348588}, {"lowerIsBetter": false, "replicates": [1532.387045181927, 1588.475802985015, 1630.5108467459775, 1763.4533294678652, 1876.127600665691, 7198.244184360646, 7649.847003059936, 7963.3231175350165, 7969.362451003927, 7976.6809327626825, 7804.18056104108, 7959.0, 7963.482373645709, 7969.123396426388, 7970.641321140548, 1979.6832506798914, 2033.806788355104, 2313.5719891820027, 2338.053088499152, 2369.0760603364615, 2374.323317854412, 2380.500094980048, 2384.463495713468, 2385.3678775124604, 2387.271882075966, 2278.977210227901, 2311.0178174275948, 2326.6975293211945, 2327.837051406402, 2332.47519308156, 2311.9422014449606, 2314.375118717937, 2318.6058370077126, 2322.129201549419, 2330.1727886600265, 2347.5657003454244, 2354.2466410748566, 2389.9641505377435, 2392.425817803732, 2392.461696118377, 7917.524948503051, 7983.680652773882, 7986.440949133563, 7992.320652744524, 7992.800179995488, 4788.928166077511, 4844.103840789465, 4855.223164293731, 4888.608911287089, 4889.193283108283, 3070.416620842055, 3092.304231547906, 3100.147459448647, 3128.749700023993, 3137.7176054155234, 938.8216238914653, 956.5360800011989, 973.8587904753842, 984.178211193647, 1014.6195176808696, 10816.405097719622, 10823.404712740796, 10829.83755243672, 10854.348739075602, 10910.399928003957, 4349.478062632441, 4368.27923392643, 4432.556744325606, 4451.866444006685, 4453.55464453552, 9391.671291504765, 9403.341766076446, 9413.90586094144, 9424.246060315158, 9451.858222126673, 4860.659753817199, 4866.975665121652, 4884.7069175849565, 4900.4854490278, 4905.1416002200185, 4416.53626369233, 4417.3815665806815, 4423.933640995388, 4428.490723566767, 4432.180046691373, 3503.597086335053, 3516.4197907345, 3543.6102028776813, 3565.679088881961, 3680.3191409589313, 1197.736497970445, 1219.439058033297, 1232.976629397598, 1237.9257244565356, 1249.1256120715354, 1138.8633363996373, 1152.3489228585822, 1152.4813833774836, 1365.590322903125, 1430.5207755401848, 7571.772846814604, 7602.315791578784, 7682.615869206629, 7691.0, 7734.4585878989055, 1188.2157775867886, 1191.386435985468, 1192.1714408486018, 1195.5337418406828, 1209.7701436726993, 5854.795082172103, 5963.761449542057, 5967.075103358986, 5969.0, 5970.34326224115, 9084.227840633488, 9444.811103777885, 9451.527423628791, 9455.05449455049, 9457.43255404678, 9442.48066356357, 9479.905200947902, 9484.288678349152, 9490.383125096847, 9505.619775209052, 7329.0, 7488.513246638951, 7564.697412103565, 7571.242875712494, 7582.62086895653, 7220.74727384539, 7270.563766174047, 7292.781216563511, 7294.307040831325, 7295.963520182578, 8460.873086903579, 8495.490270583785, 8500.489970601784, 8506.617202226038, 8655.48067115975, 8659.653613855375, 8744.825103497767, 8889.111088891317, 8900.154485323885, 8900.198982091384, 6456.709448074754, 7193.676284567312, 7249.130104387507, 7251.456140789567, 7254.492185546961, 7144.928550714634, 7170.318819712119, 7339.74310899116, 7348.52234604749, 7350.411967042517, 7191.280871912767, 7297.562146271241, 7321.450891183076, 7379.225181356095, 7402.925970740223, 7304.0, 7316.743913962986, 7333.266673332624, 7387.704491820482, 7395.075615548057, 7270.345668889825, 7302.160251571137, 7403.259674032553, 7407.111146662435, 7427.740029098955, 6715.0, 6717.026031225542, 6755.1556055493065, 6773.390394864486, 6776.08522849409, 6710.228323742832, 6750.86498270022, 6772.55978361405, 6787.321267873173, 6804.0], "unit": "ms", "name": "mootools.html", "value": 4612.408801960181}, {"lowerIsBetter": false, "replicates": [360.27944111776446, 363.0524331494799, 364.9014766013175, 367.0493422036924, 368.4822823932374, 6180.351063138373, 6226.408491193335, 6241.719122639481, 6253.37466253375, 6266.84332891678, 6126.172966649501, 6149.538784591151, 6154.446099851012, 6162.9383706163035, 6163.322034576193, 4599.609033232179, 4736.976315118437, 4742.027884283713, 4759.595434388081, 4779.235322348425, 4735.337052812609, 4750.287456881478, 4785.377900872899, 4789.2097803862325, 4789.3294938708605, 4462.665300102489, 4518.8418405355815, 4739.52604739525, 4746.833860814872, 4750.97624511877, 4615.584597386234, 4696.671233013691, 4707.952920470802, 4714.481407045222, 4739.597134243593, 4145.440365550642, 4151.190517849021, 4152.9202407374, 4153.584641535853, 4160.895977600554, 5672.773089076432, 5745.0, 5790.797322093748, 5838.737256823453, 5867.031939729939, 5470.56235501159, 5471.2887324647545, 5498.725063746797, 5516.14499752535, 5523.6685798852195, 6502.934970650327, 6549.5742776719835, 6572.507061970324, 6575.309592492815, 6588.374104460068, 4517.277235642281, 4573.291139873325, 4592.081583683277, 4609.838655647036, 4614.146382919171, 6695.531312808105, 6780.93219067808, 6785.457163426963, 6785.694643741043, 6791.558548694368, 4708.858734237979, 4710.8351207707565, 4713.599344055794, 4718.05638872227, 4722.362481065081, 4765.761711914391, 4771.498992605726, 4773.427188737373, 4778.784954677048, 4779.02030083832, 5375.623706340597, 5498.725063746797, 5503.091989821714, 5505.256790333254, 5516.062269414209, 6540.836479087966, 6598.868022639616, 6600.8349791255605, 6608.86782264352, 6615.6030638161865, 1670.0981470006304, 1692.6953148433154, 1693.1534232883557, 1694.466243133409, 1696.5928177237622, 1128.9717757055976, 1129.3562669278597, 1131.9603813866474, 1150.6893138852463, 1159.9594014209463, 6405.19935008124, 6426.196725409324, 6433.195850518685, 6436.066770318278, 6441.066045423388, 6833.214180369222, 6838.794836154923, 6846.8972965405555, 6847.452203823782, 6855.965720171367, 6328.050792381179, 6385.393387628168, 6423.229212494531, 6429.967850160813, 6438.25960014595, 3662.853485860589, 3668.614795446493, 3676.9264614707554, 3679.6136405677553, 3679.668829805277, 6779.559328643622, 6933.722651094001, 6963.373296403348, 6987.196472405739, 6989.091418115612, 6910.7581234656545, 7008.159020917523, 7030.191527974348, 7042.92957070433, 7089.432845372357, 7063.328983746638, 7063.964680176567, 7064.894026589605, 7067.646617669096, 7067.752628658075, 6712.295209002984, 6878.896816547855, 6881.965590172017, 6891.965540172468, 6937.271586483346, 6817.3182681733415, 6818.556793808387, 6823.1812182538415, 6825.795226143224, 6826.692798824164, 7094.751683691046, 7096.219415864354, 7106.857862842611, 7106.928930710626, 7109.608971506616, 4534.2065138599955, 4609.815607375667, 4612.215923292981, 4614.330922016222, 4616.561426664462, 6884.586924784529, 6906.654667266516, 6910.654467276516, 6913.10129683138, 6913.688884000333, 6721.193456785217, 6723.731050757915, 6725.596464212163, 6727.596344219362, 6728.360805723449, 6571.934280657132, 6705.698243579148, 6713.227978782307, 6713.899291510534, 6718.93281067183, 6566.4418524425955, 6570.671466426564, 6570.901436478361, 6582.243042050034, 6609.702563384755, 6741.797746067429, 6743.52795304324, 6746.123004009447, 6749.966250168718, 6750.088738020305, 6387.712552935036, 6562.0, 6576.309487503743, 6577.112089867998, 6589.835254118685], "unit": "ms", "name": "prototype.html", "value": 4996.374538139925}, {"lowerIsBetter": false, "replicates": [774.6862520679119, 845.5307304446033, 853.8889944307239, 927.6614035876903, 954.0364232125553, 13653.180809151445, 13985.51050713224, 14892.329845156966, 14934.402623895045, 14979.0, 13447.529336473226, 13466.797998030013, 13474.797878031814, 13550.728985420286, 13554.796678049812, 728.158976382278, 745.2659130756201, 914.1224424552438, 930.1024511346549, 930.7393929699662, 906.1844340093902, 913.3332667152982, 921.0329154387899, 922.1470140120396, 922.3128769067055, 780.5667854340838, 793.4802704228739, 943.3915124744535, 946.3517490518982, 946.9763255918589, 940.9858852117223, 956.2015716876416, 957.2772556719632, 959.4051687953479, 962.0187408843011, 701.113091938698, 703.2721133626723, 704.2288693880193, 705.6048612776862, 707.6567864585672, 14220.217888016155, 14393.064450810663, 14397.712045759132, 14401.279936003159, 14405.567832965027, 11939.40302984856, 12099.213551119148, 12117.636470905887, 12237.143399962006, 12471.563495277713, 10368.274220804471, 10577.206709496819, 10721.78556428867, 10726.517306721138, 10990.0, 3790.469334293201, 3880.8059597020037, 3890.474785903895, 3893.961060389388, 3896.688264938798, 46335.0, 47272.0, 47286.76356618229, 47985.0, 48595.0, 10386.532606032746, 10670.57317707283, 10746.140308775279, 10760.461976901124, 10961.6163434281, 18120.728189077174, 18183.090845457675, 18186.272549098154, 18196.81803181951, 18200.544986375447, 7612.429067819936, 7707.344875685518, 7712.884306735404, 7717.614119294125, 7928.801779955547, 4864.318995340655, 4867.075255701406, 4879.536444037811, 4943.975280123576, 4977.303177555145, 3176.09481297829, 3191.6648751880716, 3199.024297589211, 3206.3747569224242, 3213.79110357826, 574.9338826035059, 598.8143675460622, 602.3584882100549, 609.6250805754429, 619.8791235709084, 624.4005754475663, 674.1775034457953, 692.5221597097986, 705.763569204312, 725.4160400877239, 8162.102168761431, 8435.409521333448, 8447.281981031558, 8478.533680647624, 8511.74464766058, 711.7651175112304, 712.4407340237889, 714.4391652552825, 715.0295036445638, 727.8216836874999, 4083.1017176221185, 4428.31361139024, 4476.462824461086, 4537.2059889519205, 4593.793279302439, 58359.416405836244, 58787.0, 58974.0, 59069.704651476466, 59330.0, 54650.0, 54904.0, 55203.72398137984, 55554.722226389415, 55823.0, 47152.7642361786, 48132.27801582979, 48633.5136648629, 50894.74552627287, 50907.49092509028, 8616.0522342541, 9217.400868943498, 9423.952880235554, 9754.0733630305, 9790.06994335537, 36887.0, 37332.2533549322, 37628.0, 37892.62107378891, 38185.0, 45217.54782452133, 45804.31293530666, 48523.75738121287, 48795.75602122109, 49046.26430603615, 11541.249818761753, 11569.826452603049, 11700.88299117032, 11924.344161070878, 11945.522179112739, 12003.0, 12015.399230038638, 12175.939120304341, 12314.692132696755, 12385.62843114708, 10860.565577376816, 11780.234284771463, 11881.465334059814, 12001.519939202333, 13077.869221308045, 11845.23006004607, 11849.81258757853, 12144.271343719405, 12153.939230303791, 12572.811407828707, 9917.887140601499, 11058.22592418523, 11077.778444431227, 11268.436578170895, 12151.75696486083, 9965.35225210359, 10285.074343309137, 10370.585176593153, 10418.114460270961, 10804.135669146606, 9604.95197524008, 9745.220382369534, 9982.251331150337, 10007.499625018865, 10069.496525173565], "unit": "ms", "name": "yui.html", "value": 6660.296346433257}], "name": "dromaeo_css", "value": 7466.0644890268395}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [108.0, 109.0, 105.0, 110.0, 110.0, 110.0, 99.0, 109.0, 110.0, 110.0], "unit": "ms", "name": "ai-astar", "value": 108.0}, {"lowerIsBetter": true, "replicates": [153.0, 120.0, 151.0, 166.0, 127.0, 146.0, 139.0, 121.0, 160.0, 127.0], "unit": "ms", "name": "audio-beat-detection", "value": 141.0}, {"lowerIsBetter": true, "replicates": [161.0, 160.0, 161.0, 161.0, 168.0, 160.0, 159.0, 162.0, 160.0, 161.0], "unit": "ms", "name": "audio-dft", "value": 161.3}, {"lowerIsBetter": true, "replicates": [74.0, 73.0, 71.0, 151.0, 72.0, 70.0, 70.0, 71.0, 148.0, 71.0], "unit": "ms", "name": "audio-fft", "value": 87.1}, {"lowerIsBetter": true, "replicates": [92.0, 92.0, 135.0, 91.0, 93.0, 93.0, 138.0, 92.0, 92.0, 135.0], "unit": "ms", "name": "audio-oscillator", "value": 105.3}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 109.0, 108.0, 109.0, 108.0, 109.0, 109.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 108.8}, {"lowerIsBetter": true, "replicates": [145.0, 147.0, 145.0, 146.0, 145.0, 145.0, 145.0, 145.0, 146.0, 145.0], "unit": "ms", "name": "imaging-darkroom", "value": 145.4}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.1}, {"lowerIsBetter": true, "replicates": [56.0, 56.0, 56.0, 55.0, 57.0, 56.0, 58.0, 56.0, 53.0, 54.0], "unit": "ms", "name": "json-parse-financial", "value": 55.7}, {"lowerIsBetter": true, "replicates": [63.0, 63.0, 63.0, 63.0, 64.0, 66.0, 64.0, 64.0, 64.0, 65.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 63.9}, {"lowerIsBetter": true, "replicates": [78.0, 79.0, 79.0, 81.0, 82.0, 80.0, 81.0, 79.0, 80.0, 86.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 80.5}, {"lowerIsBetter": true, "replicates": [109.0, 116.0, 117.0, 115.0, 107.0, 116.0, 119.0, 126.0, 118.0, 110.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 115.3}, {"lowerIsBetter": true, "replicates": [153.0, 143.0, 143.0, 145.0, 146.0, 134.0, 134.0, 143.0, 150.0, 132.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 142.3}, {"lowerIsBetter": true, "replicates": [65.0, 69.0, 64.0, 64.0, 64.0, 64.0, 65.0, 65.0, 65.0, 63.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 64.8}], "name": "kraken", "value": 1474.4999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.80998176090202], "unit": "score", "name": "Richards", "value": 212.90636200000006}, {"lowerIsBetter": false, "replicates": [168.0672268907563], "unit": "score", "name": "DeltaBlue", "value": 393.40209999999996}, {"lowerIsBetter": false, "replicates": [278.9400278940028], "unit": "score", "name": "Encrypt", "value": 954.2588850000001}, {"lowerIsBetter": false, "replicates": [5191.709844559586], "unit": "score", "name": "Decrypt", "value": 51.270392215568904}, {"lowerIsBetter": false, "replicates": [972.7626459143969], "unit": "score", "name": "RayTrace", "value": 760.7086919999998}, {"lowerIsBetter": false, "replicates": [557.4136008918617], "unit": "score", "name": "Earley", "value": 1195.6346220000003}, {"lowerIsBetter": false, "replicates": [11177.777777777777], "unit": "score", "name": "Boyer", "value": 59.6239264413519}, {"lowerIsBetter": false, "replicates": [24285.714285714286], "unit": "score", "name": "RegExp", "value": 37.511147058823504}, {"lowerIsBetter": false, "replicates": [543.1830526887561], "unit": "score", "name": "Splay", "value": 150.024931}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 22918.357124379036}]} 11:42:12 INFO - RETURN: dromaeo_css: 7466.06 11:42:12 INFO - RETURN: kraken: 1474.50 11:42:12 INFO - RETURN: v8_7: 22918.36 11:42:12 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,35]]", "result": "22918.36"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,35]]", "result": "1474.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,35]]", "result": "7466.06"}}} 11:42:12 INFO - Return code: 0 11:42:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 11:42:12 INFO - # TBPL SUCCESS # 11:42:12 INFO - Running post-action listener: _resource_record_post_action 11:42:12 INFO - Running post-run listener: _resource_record_post_run 11:42:13 INFO - Total resource usage - Wall time: 1224s; CPU: 13.0%; Read bytes: 262144; Write bytes: 501608448; Read time: 16; Write time: 356000 11:42:13 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 236281856; Read time: 0; Write time: 215020 11:42:13 INFO - run-tests - Wall time: 1210s; CPU: 13.0%; Read bytes: 262144; Write bytes: 264953856; Read time: 16; Write time: 140952 11:42:13 INFO - Running post-run listener: _upload_blobber_files 11:42:13 INFO - Blob upload gear active. 11:42:13 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 11:42:13 INFO - Copying logs to upload dir... 11:42:13 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1257.597305 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2016-01-04 11:42:13.246400) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2016-01-04 11:42:13.249807) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010047 build_url: 'https://queue.taskcluster.net/v1/task/sSv41SbdT7mrMDGg57H81A/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2016-01-04 11:42:13.300427) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:42:13.300783) ========= 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-1451935273.975858-1492424210 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004623 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-04 11:42:13.350518) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-04 11:42:13.350860) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-04 11:42:13.351202) ========= ========= Total master_lag: 0.23 =========