builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-002 starttime: 1451139988.48 results: success (0) buildid: 20151226040448 builduid: b1953ab9490a44b4b0804fd6df18f911 revision: 866e6a5e2847194516ab65d71d19fd422842b22e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.476966) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.477405) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.477694) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006380 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.06 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.544232) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.544523) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.643129) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:28.643414) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004619 ========= master_lag: 0.83 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.473316) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.473766) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.474382) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.474817) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-26 06:26:30-- 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% 42.9M=0s 2015-12-26 06:26:30 (42.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.087730 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.606021) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.606303) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014639 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.655798) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:29.656163) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 866e6a5e2847194516ab65d71d19fd422842b22e --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 866e6a5e2847194516ab65d71d19fd422842b22e --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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-26 06:26:30,345 truncating revision to first 12 chars 2015-12-26 06:26:30,346 Setting DEBUG logging. 2015-12-26 06:26:30,346 attempt 1/10 2015-12-26 06:26:30,346 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/866e6a5e2847?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-26 06:26:30,598 unpacking tar archive at: mozilla-aurora-866e6a5e2847/testing/mozharness/ program finished with exit code 0 elapsedTime=0.536728 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:30.205131) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:30.205393) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:30.213771) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:30.214059) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-26 06:26:30.214422) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2015-12-26 06:26:30.214699) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:26:30 INFO - MultiFileLogger online at 20151226 06:26:30 in /builds/slave/test-pgo 06:26:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 06:26:30 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 06:26:30 INFO - {'append_to_log': False, 06:26:30 INFO - 'base_work_dir': '/builds/slave/test-pgo', 06:26:30 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:26:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 06:26:30 INFO - 'branch': 'Mozilla-Aurora', 06:26:30 INFO - 'buildbot_json_path': 'buildprops.json', 06:26:30 INFO - 'config_files': ('talos/linux_config.py',), 06:26:30 INFO - 'default_actions': ('clobber', 06:26:30 INFO - 'read-buildbot-config', 06:26:30 INFO - 'download-and-extract', 06:26:30 INFO - 'populate-webroot', 06:26:30 INFO - 'create-virtualenv', 06:26:30 INFO - 'install', 06:26:30 INFO - 'run-tests'), 06:26:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:26:30 INFO - 'download_minidump_stackwalk': True, 06:26:30 INFO - 'download_symbols': 'ondemand', 06:26:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:26:30 INFO - 'tooltool.py': '/tools/tooltool.py', 06:26:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:26:30 INFO - '/tools/misc-python/virtualenv.py')}, 06:26:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:26:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:26:30 INFO - 'installer_path': 'installer.exe', 06:26:30 INFO - 'log_level': 'info', 06:26:30 INFO - 'log_name': 'talos', 06:26:30 INFO - 'log_to_console': True, 06:26:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:26:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:26:30 INFO - 'opt_config_files': (), 06:26:30 INFO - 'pip_index': False, 06:26:30 INFO - 'sps_profile': False, 06:26:30 INFO - 'sps_profile_interval': 0, 06:26:30 INFO - 'suite': 'dromaeojs-e10s', 06:26:30 INFO - 'system_bits': '64', 06:26:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:26:30 INFO - 'title': 'talos-linux64-ix-002', 06:26:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:26:30 INFO - 'use_talos_json': True, 06:26:30 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 06:26:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:26:30 INFO - 'work_dir': 'build'} 06:26:30 INFO - ##### 06:26:30 INFO - ##### Running clobber step. 06:26:30 INFO - ##### 06:26:30 INFO - Running pre-action listener: _resource_record_pre_action 06:26:30 INFO - Running main action method: clobber 06:26:30 INFO - rmtree: /builds/slave/test-pgo/build 06:26:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 06:26:31 INFO - Running post-action listener: _resource_record_post_action 06:26:31 INFO - ##### 06:26:31 INFO - ##### Running read-buildbot-config step. 06:26:31 INFO - ##### 06:26:31 INFO - Running pre-action listener: _resource_record_pre_action 06:26:31 INFO - Running main action method: read_buildbot_config 06:26:31 INFO - Using buildbot properties: 06:26:31 INFO - { 06:26:31 INFO - "properties": { 06:26:31 INFO - "buildnumber": 52, 06:26:31 INFO - "product": "firefox", 06:26:31 INFO - "script_repo_revision": "production", 06:26:31 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 06:26:31 INFO - "repository": "", 06:26:31 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 06:26:31 INFO - "buildid": "20151226040448", 06:26:31 INFO - "slavename": "talos-linux64-ix-002", 06:26:31 INFO - "pgo_build": "True", 06:26:31 INFO - "basedir": "/builds/slave/test-pgo", 06:26:31 INFO - "project": "", 06:26:31 INFO - "platform": "ubuntu64_hw", 06:26:31 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 06:26:31 INFO - "slavebuilddir": "test", 06:26:31 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 06:26:31 INFO - "branch": "mozilla-aurora", 06:26:31 INFO - "repo_path": "releases/mozilla-aurora", 06:26:31 INFO - "stage_platform": "linux64-pgo", 06:26:31 INFO - "builduid": "b1953ab9490a44b4b0804fd6df18f911", 06:26:31 INFO - "revision": "866e6a5e2847194516ab65d71d19fd422842b22e" 06:26:31 INFO - }, 06:26:31 INFO - "sourcestamp": { 06:26:31 INFO - "repository": "", 06:26:31 INFO - "hasPatch": false, 06:26:31 INFO - "project": "", 06:26:31 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 06:26:31 INFO - "changes": [ 06:26:31 INFO - { 06:26:31 INFO - "category": null, 06:26:31 INFO - "files": [ 06:26:31 INFO - { 06:26:31 INFO - "url": null, 06:26:31 INFO - "name": "https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2" 06:26:31 INFO - } 06:26:31 INFO - ], 06:26:31 INFO - "repository": "", 06:26:31 INFO - "rev": "866e6a5e2847194516ab65d71d19fd422842b22e", 06:26:31 INFO - "who": "ffxbld", 06:26:31 INFO - "when": 1451139937, 06:26:31 INFO - "number": 7395266, 06:26:31 INFO - "comments": "No bug, Automated blocklist update from host bld-linux64-spot-308 - a=blocklist-update", 06:26:31 INFO - "project": "", 06:26:31 INFO - "at": "Sat 26 Dec 2015 06:25:37", 06:26:31 INFO - "branch": "mozilla-aurora-linux64-pgo-talos", 06:26:31 INFO - "revlink": "", 06:26:31 INFO - "properties": [ 06:26:31 INFO - [ 06:26:31 INFO - "buildid", 06:26:31 INFO - "20151226040448", 06:26:31 INFO - "Change" 06:26:31 INFO - ], 06:26:31 INFO - [ 06:26:31 INFO - "builduid", 06:26:31 INFO - "b1953ab9490a44b4b0804fd6df18f911", 06:26:31 INFO - "Change" 06:26:31 INFO - ], 06:26:31 INFO - [ 06:26:31 INFO - "pgo_build", 06:26:31 INFO - "True", 06:26:31 INFO - "Change" 06:26:31 INFO - ] 06:26:31 INFO - ], 06:26:31 INFO - "revision": "866e6a5e2847194516ab65d71d19fd422842b22e" 06:26:31 INFO - } 06:26:31 INFO - ], 06:26:31 INFO - "revision": "866e6a5e2847194516ab65d71d19fd422842b22e" 06:26:31 INFO - } 06:26:31 INFO - } 06:26:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2. 06:26:31 INFO - Running post-action listener: _resource_record_post_action 06:26:31 INFO - ##### 06:26:31 INFO - ##### Running download-and-extract step. 06:26:31 INFO - ##### 06:26:31 INFO - Running pre-action listener: _resource_record_pre_action 06:26:31 INFO - Running main action method: download_and_extract 06:26:31 INFO - mkdir: /builds/slave/test-pgo/build/tests 06:26:31 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')]} 06:26:31 INFO - https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 06:26:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/test_packages.json 06:26:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/test_packages.json 06:26:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 06:26:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 06:26:36 INFO - Downloaded 1302 bytes. 06:26:36 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 06:26:36 INFO - Using the following test package requirements: 06:26:36 INFO - {u'common': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 06:26:36 INFO - u'cppunittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 06:26:36 INFO - u'jittest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'jsshell-linux-x86_64.zip'], 06:26:36 INFO - u'mochitest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 06:26:36 INFO - u'mozbase': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 06:26:36 INFO - u'reftest': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.reftest.tests.zip'], 06:26:36 INFO - u'talos': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip'], 06:26:36 INFO - u'web-platform': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 06:26:36 INFO - u'webapprt': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'], 06:26:36 INFO - u'xpcshell': [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip', 06:26:36 INFO - u'firefox-45.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 06:26:36 INFO - Downloading packages: [u'firefox-45.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:26:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:36 INFO - https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:26:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:38 INFO - Downloaded 23022833 bytes. 06:26:38 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 06:26:38 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:38 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 06:26:39 INFO - Return code: 0 06:26:39 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 06:26:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:39 INFO - https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:26:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:49 INFO - Downloaded 23022833 bytes. 06:26:49 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 06:26:49 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.common.tests.zip 06:26:49 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 06:26:50 INFO - Return code: 0 06:26:50 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')]} 06:26:50 INFO - https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:26:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 06:26:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 06:26:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:51 INFO - Downloaded 11132038 bytes. 06:26:51 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 06:26:51 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a2.en-US.linux-x86_64.talos.tests.zip 06:26:51 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 06:26:51 INFO - Return code: 0 06:26:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:51 INFO - https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:26:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 06:26:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 06:26:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NMb6CQBfSyiGbV08CnN5oQ/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 06:26:53 INFO - Downloaded 58087444 bytes. 06:26:53 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 06:26:53 INFO - mkdir: /builds/slave/test-pgo/properties 06:26:53 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 06:26:53 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 06:26:53 INFO - Contents: 06:26:53 INFO - build_url:https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 06:26:53 INFO - Running post-action listener: _resource_record_post_action 06:26:53 INFO - Running post-action listener: set_extra_try_arguments 06:26:53 INFO - ##### 06:26:53 INFO - ##### Running populate-webroot step. 06:26:53 INFO - ##### 06:26:53 INFO - Running pre-action listener: _resource_record_pre_action 06:26:53 INFO - Running main action method: populate_webroot 06:26:53 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:26:53 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:26:53 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:26:53 INFO - '--tppagecycles', 06:26:53 INFO - '7'], 06:26:53 INFO - 'tests': ['tsvgm']}}, 06:26:53 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:26:53 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:26:53 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:26:53 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:26:53 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:26:53 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:26:53 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'tests': ['damp', 'tps']}, 06:26:53 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['damp', 'tps']}, 06:26:53 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:26:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:26:53 INFO - 'other': {'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'other_l64': {'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'other_nol64': {'tests': ['a11yr', 06:26:53 INFO - 'ts_paint', 06:26:53 INFO - 'tpaint', 06:26:53 INFO - 'sessionrestore', 06:26:53 INFO - 'sessionrestore_no_auto_restore']}, 06:26:53 INFO - 'svgr': {'tests': ['tsvgx', 06:26:53 INFO - 'tsvgr_opacity', 06:26:53 INFO - 'tart', 06:26:53 INFO - 'tscrollx', 06:26:53 INFO - 'cart']}, 06:26:53 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['tsvgx', 06:26:53 INFO - 'tsvgr_opacity', 06:26:53 INFO - 'tart', 06:26:53 INFO - 'tscrollx', 06:26:53 INFO - 'cart']}, 06:26:53 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'tests': ['tp5o']}, 06:26:53 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'talos_options': ['--e10s'], 06:26:53 INFO - 'tests': ['tp5o']}, 06:26:53 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'talos_options': ['--xperf_path', 06:26:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:26:53 INFO - 'tests': ['tp5n']}, 06:26:53 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:26:53 INFO - 'talos_options': ['--e10s', 06:26:53 INFO - '--xperf_path', 06:26:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:26:53 INFO - 'tests': ['tp5n']}}, 06:26:53 INFO - 'talos.zip': {'path': '', 06:26:53 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:26:53 INFO - Running post-action listener: _resource_record_post_action 06:26:53 INFO - ##### 06:26:53 INFO - ##### Running create-virtualenv step. 06:26:53 INFO - ##### 06:26:53 INFO - Running pre-action listener: _resource_record_pre_action 06:26:53 INFO - Running main action method: create_virtualenv 06:26:53 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 06:26:53 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 06:26:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 06:26:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:26:53 INFO - Using real prefix '/usr' 06:26:53 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 06:26:54 INFO - Installing distribute.............................................................................................................................................................................................done. 06:26:56 INFO - Installing pip.................done. 06:26:56 INFO - Return code: 0 06:26:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 06:26:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:26:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:26:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:56 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:26:56 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 06:26:56 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 06:26:56 INFO - Using env: {'DISPLAY': ':0', 06:26:56 INFO - 'HOME': '/home/cltbld', 06:26:56 INFO - 'LANG': 'en_US.UTF-8', 06:26:56 INFO - 'LANGUAGE': 'en_US:en', 06:26:56 INFO - 'LOGNAME': 'cltbld', 06:26:56 INFO - 'MAIL': '/var/mail/cltbld', 06:26:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:26:56 INFO - 'MOZ_NO_REMOTE': '1', 06:26:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:26:56 INFO - 'NO_EM_RESTART': '1', 06:26:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:26:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:26:56 INFO - 'PWD': '/builds/slave/test-pgo', 06:26:56 INFO - 'SHELL': '/bin/bash', 06:26:56 INFO - 'SHLVL': '1', 06:26:56 INFO - 'TERM': 'linux', 06:26:56 INFO - 'TMOUT': '86400', 06:26:56 INFO - 'USER': 'cltbld', 06:26:56 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:26:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:26:56 INFO - '_': '/tools/buildbot/bin/python'} 06:26:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:26:56 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 06:26:56 INFO - Cleaning up... 06:26:56 INFO - Return code: 0 06:26:56 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 06:26:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:26:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:26:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:56 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:26:56 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 06:26:56 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 06:26:56 INFO - Using env: {'DISPLAY': ':0', 06:26:56 INFO - 'HOME': '/home/cltbld', 06:26:56 INFO - 'LANG': 'en_US.UTF-8', 06:26:56 INFO - 'LANGUAGE': 'en_US:en', 06:26:56 INFO - 'LOGNAME': 'cltbld', 06:26:56 INFO - 'MAIL': '/var/mail/cltbld', 06:26:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:26:56 INFO - 'MOZ_NO_REMOTE': '1', 06:26:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:26:56 INFO - 'NO_EM_RESTART': '1', 06:26:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:26:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:26:56 INFO - 'PWD': '/builds/slave/test-pgo', 06:26:56 INFO - 'SHELL': '/bin/bash', 06:26:56 INFO - 'SHLVL': '1', 06:26:56 INFO - 'TERM': 'linux', 06:26:56 INFO - 'TMOUT': '86400', 06:26:56 INFO - 'USER': 'cltbld', 06:26:56 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:26:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:26:56 INFO - '_': '/tools/buildbot/bin/python'} 06:26:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:26:56 INFO - Downloading/unpacking psutil>=0.7.1 06:26:56 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 06:26:56 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 06:26:56 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 06:26:56 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 06:26:56 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 06:26:56 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 06:26:58 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 06:26:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 06:26:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 06:26:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:26:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:26:58 INFO - Installing collected packages: psutil 06:26:58 INFO - Running setup.py install for psutil 06:26:58 INFO - building 'psutil._psutil_linux' extension 06:26:58 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 06:26:58 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 06:26:58 INFO - building 'psutil._psutil_posix' extension 06:26:58 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 06:26:58 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 06:26:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:26:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:26:58 INFO - Successfully installed psutil 06:26:58 INFO - Cleaning up... 06:26:58 INFO - Return code: 0 06:26:58 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 06:26:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:26:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:26:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:26:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:26:58 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:26:58 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 06:26:58 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 06:26:58 INFO - Using env: {'DISPLAY': ':0', 06:26:58 INFO - 'HOME': '/home/cltbld', 06:26:58 INFO - 'LANG': 'en_US.UTF-8', 06:26:58 INFO - 'LANGUAGE': 'en_US:en', 06:26:58 INFO - 'LOGNAME': 'cltbld', 06:26:58 INFO - 'MAIL': '/var/mail/cltbld', 06:26:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:26:58 INFO - 'MOZ_NO_REMOTE': '1', 06:26:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:26:58 INFO - 'NO_EM_RESTART': '1', 06:26:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:26:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:26:58 INFO - 'PWD': '/builds/slave/test-pgo', 06:26:58 INFO - 'SHELL': '/bin/bash', 06:26:58 INFO - 'SHLVL': '1', 06:26:58 INFO - 'TERM': 'linux', 06:26:58 INFO - 'TMOUT': '86400', 06:26:58 INFO - 'USER': 'cltbld', 06:26:58 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:26:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:26:58 INFO - '_': '/tools/buildbot/bin/python'} 06:26:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:26:59 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:26:59 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 06:26:59 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 06:26:59 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 06:26:59 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 06:26:59 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 06:26:59 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 06:27:00 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:27:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 06:27:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:27:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:27:00 INFO - Installing collected packages: mozsystemmonitor 06:27:00 INFO - Running setup.py install for mozsystemmonitor 06:27:00 INFO - Successfully installed mozsystemmonitor 06:27:00 INFO - Cleaning up... 06:27:00 INFO - Return code: 0 06:27:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 06:27:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:00 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:00 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 06:27:00 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 06:27:00 INFO - Using env: {'DISPLAY': ':0', 06:27:00 INFO - 'HOME': '/home/cltbld', 06:27:00 INFO - 'LANG': 'en_US.UTF-8', 06:27:00 INFO - 'LANGUAGE': 'en_US:en', 06:27:00 INFO - 'LOGNAME': 'cltbld', 06:27:00 INFO - 'MAIL': '/var/mail/cltbld', 06:27:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:00 INFO - 'MOZ_NO_REMOTE': '1', 06:27:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:00 INFO - 'NO_EM_RESTART': '1', 06:27:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:00 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:00 INFO - 'SHELL': '/bin/bash', 06:27:00 INFO - 'SHLVL': '1', 06:27:00 INFO - 'TERM': 'linux', 06:27:00 INFO - 'TMOUT': '86400', 06:27:00 INFO - 'USER': 'cltbld', 06:27:00 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:00 INFO - '_': '/tools/buildbot/bin/python'} 06:27:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:01 INFO - Downloading/unpacking blobuploader==1.2.4 06:27:01 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 06:27:01 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 06:27:01 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 06:27:01 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 06:27:01 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 06:27:01 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 06:27:02 INFO - Downloading blobuploader-1.2.4.tar.gz 06:27:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 06:27:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:27:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:27:02 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 06:27:02 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 06:27:02 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 06:27:02 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 06:27:02 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 06:27:02 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 06:27:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 06:27:03 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 06:27:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:27:03 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 06:27:03 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 06:27:03 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 06:27:03 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 06:27:03 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 06:27:03 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 06:27:03 INFO - Downloading docopt-0.6.1.tar.gz 06:27:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 06:27:03 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 06:27:03 INFO - Installing collected packages: blobuploader, requests, docopt 06:27:03 INFO - Running setup.py install for blobuploader 06:27:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:27:03 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 06:27:03 INFO - Running setup.py install for requests 06:27:03 INFO - Running setup.py install for docopt 06:27:04 INFO - Successfully installed blobuploader requests docopt 06:27:04 INFO - Cleaning up... 06:27:04 INFO - Return code: 0 06:27:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 06:27:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:04 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:04 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 06:27:04 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 06:27:04 INFO - Using env: {'DISPLAY': ':0', 06:27:04 INFO - 'HOME': '/home/cltbld', 06:27:04 INFO - 'LANG': 'en_US.UTF-8', 06:27:04 INFO - 'LANGUAGE': 'en_US:en', 06:27:04 INFO - 'LOGNAME': 'cltbld', 06:27:04 INFO - 'MAIL': '/var/mail/cltbld', 06:27:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:04 INFO - 'MOZ_NO_REMOTE': '1', 06:27:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:04 INFO - 'NO_EM_RESTART': '1', 06:27:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:04 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:04 INFO - 'SHELL': '/bin/bash', 06:27:04 INFO - 'SHLVL': '1', 06:27:04 INFO - 'TERM': 'linux', 06:27:04 INFO - 'TMOUT': '86400', 06:27:04 INFO - 'USER': 'cltbld', 06:27:04 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:04 INFO - '_': '/tools/buildbot/bin/python'} 06:27:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 06:27:04 INFO - Running setup.py (path:/tmp/pip-RJcu5m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 06:27:04 INFO - Running setup.py (path:/tmp/pip-YuUOvr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 06:27:04 INFO - Running setup.py (path:/tmp/pip-vFIytg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 06:27:04 INFO - Running setup.py (path:/tmp/pip-VmmEft-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 06:27:04 INFO - Running setup.py (path:/tmp/pip-KBYQIx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 06:27:04 INFO - Running setup.py (path:/tmp/pip-RhMame-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 06:27:04 INFO - Running setup.py (path:/tmp/pip-GvBh08-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 06:27:04 INFO - Running setup.py (path:/tmp/pip-eNlomY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 06:27:04 INFO - Running setup.py (path:/tmp/pip-yMgb3d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 06:27:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 06:27:04 INFO - Running setup.py (path:/tmp/pip-wDSVi6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 06:27:05 INFO - Running setup.py (path:/tmp/pip-FFIYkY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 06:27:05 INFO - Running setup.py (path:/tmp/pip-e8zMoi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 06:27:05 INFO - Running setup.py (path:/tmp/pip-CdNAcm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 06:27:05 INFO - Running setup.py (path:/tmp/pip-f_czwd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 06:27:05 INFO - Running setup.py (path:/tmp/pip-bUdmyf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 06:27:05 INFO - Running setup.py (path:/tmp/pip-mep50L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 06:27:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 06:27:05 INFO - Running setup.py (path:/tmp/pip-nsXVCX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 06:27:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:27:05 INFO - Running setup.py install for manifestparser 06:27:05 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 06:27:05 INFO - Running setup.py install for mozcrash 06:27:05 INFO - Running setup.py install for mozdebug 06:27:05 INFO - Running setup.py install for mozdevice 06:27:05 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 06:27:05 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 06:27:05 INFO - Running setup.py install for mozfile 06:27:06 INFO - Running setup.py install for mozhttpd 06:27:06 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozinfo 06:27:06 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozInstall 06:27:06 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozleak 06:27:06 INFO - Running setup.py install for mozlog 06:27:06 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for moznetwork 06:27:06 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozprocess 06:27:06 INFO - Running setup.py install for mozprofile 06:27:06 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozrunner 06:27:06 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 06:27:06 INFO - Running setup.py install for mozscreenshot 06:27:07 INFO - Running setup.py install for moztest 06:27:07 INFO - Running setup.py install for mozversion 06:27:07 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 06:27:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:27:07 INFO - Cleaning up... 06:27:07 INFO - Return code: 0 06:27:07 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 06:27:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:07 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:07 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 06:27:07 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 06:27:07 INFO - Using env: {'DISPLAY': ':0', 06:27:07 INFO - 'HOME': '/home/cltbld', 06:27:07 INFO - 'LANG': 'en_US.UTF-8', 06:27:07 INFO - 'LANGUAGE': 'en_US:en', 06:27:07 INFO - 'LOGNAME': 'cltbld', 06:27:07 INFO - 'MAIL': '/var/mail/cltbld', 06:27:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:07 INFO - 'MOZ_NO_REMOTE': '1', 06:27:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:07 INFO - 'NO_EM_RESTART': '1', 06:27:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:07 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:07 INFO - 'SHELL': '/bin/bash', 06:27:07 INFO - 'SHLVL': '1', 06:27:07 INFO - 'TERM': 'linux', 06:27:07 INFO - 'TMOUT': '86400', 06:27:07 INFO - 'USER': 'cltbld', 06:27:07 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:07 INFO - '_': '/tools/buildbot/bin/python'} 06:27:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 06:27:07 INFO - Running setup.py (path:/tmp/pip-stGKm1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 06:27:07 INFO - Running setup.py (path:/tmp/pip-Ffi2Dz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 06:27:07 INFO - Running setup.py (path:/tmp/pip-waJhtc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 06:27:07 INFO - Running setup.py (path:/tmp/pip-qbiiJT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 06:27:07 INFO - Running setup.py (path:/tmp/pip-uQumY6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 06:27:07 INFO - Running setup.py (path:/tmp/pip-0ymxPC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 06:27:07 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)) 06:27:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 06:27:07 INFO - Running setup.py (path:/tmp/pip-VqJrM4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 06:27:08 INFO - Running setup.py (path:/tmp/pip-EY36br-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 06:27:08 INFO - Running setup.py (path:/tmp/pip-hPgOQP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 06:27:08 INFO - Running setup.py (path:/tmp/pip-OleeT4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 06:27:08 INFO - Running setup.py (path:/tmp/pip-KfsAuw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 06:27:08 INFO - Running setup.py (path:/tmp/pip-fhZ8wi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 06:27:08 INFO - Running setup.py (path:/tmp/pip-LmsTWt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 06:27:08 INFO - Running setup.py (path:/tmp/pip-ivqfIW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 06:27:08 INFO - Running setup.py (path:/tmp/pip-Sa3z4n-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 06:27:08 INFO - Running setup.py (path:/tmp/pip-FN4GH9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 06:27:08 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)) 06:27:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 06:27:08 INFO - Running setup.py (path:/tmp/pip-bVTR1d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 06:27:08 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)) 06:27:08 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)) 06:27:08 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)) 06:27:08 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)) 06:27:08 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)) 06:27:08 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)) 06:27:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 06:27:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:10 INFO - Downloading blessings-1.5.1.tar.gz 06:27:10 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 06:27:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 06:27:10 INFO - Installing collected packages: blessings 06:27:10 INFO - Running setup.py install for blessings 06:27:10 INFO - Successfully installed blessings 06:27:10 INFO - Cleaning up... 06:27:10 INFO - Return code: 0 06:27:10 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 06:27:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 06:27:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 06:27:10 INFO - Reading from file tmpfile_stdout 06:27:10 INFO - Current package versions: 06:27:10 INFO - argparse == 1.2.1 06:27:10 INFO - blessings == 1.5.1 06:27:10 INFO - blobuploader == 1.2.4 06:27:10 INFO - docopt == 0.6.1 06:27:10 INFO - manifestparser == 1.1 06:27:10 INFO - mozInstall == 1.12 06:27:10 INFO - mozcrash == 0.16 06:27:10 INFO - mozdebug == 0.1 06:27:10 INFO - mozdevice == 0.47 06:27:10 INFO - mozfile == 1.2 06:27:10 INFO - mozhttpd == 0.7 06:27:10 INFO - mozinfo == 0.9 06:27:10 INFO - mozleak == 0.1 06:27:10 INFO - mozlog == 3.1 06:27:10 INFO - moznetwork == 0.27 06:27:10 INFO - mozprocess == 0.22 06:27:10 INFO - mozprofile == 0.27 06:27:10 INFO - mozrunner == 6.11 06:27:10 INFO - mozscreenshot == 0.1 06:27:10 INFO - mozsystemmonitor == 0.0 06:27:10 INFO - moztest == 0.7 06:27:10 INFO - mozversion == 1.4 06:27:10 INFO - psutil == 3.1.1 06:27:10 INFO - requests == 1.2.3 06:27:10 INFO - wsgiref == 0.1.2 06:27:10 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 06:27:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:10 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:10 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 06:27:10 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 06:27:10 INFO - Using env: {'DISPLAY': ':0', 06:27:10 INFO - 'HOME': '/home/cltbld', 06:27:10 INFO - 'LANG': 'en_US.UTF-8', 06:27:10 INFO - 'LANGUAGE': 'en_US:en', 06:27:10 INFO - 'LOGNAME': 'cltbld', 06:27:10 INFO - 'MAIL': '/var/mail/cltbld', 06:27:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:10 INFO - 'MOZ_NO_REMOTE': '1', 06:27:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:10 INFO - 'NO_EM_RESTART': '1', 06:27:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:10 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:10 INFO - 'SHELL': '/bin/bash', 06:27:10 INFO - 'SHLVL': '1', 06:27:10 INFO - 'TERM': 'linux', 06:27:10 INFO - 'TMOUT': '86400', 06:27:10 INFO - 'USER': 'cltbld', 06:27:10 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:10 INFO - '_': '/tools/buildbot/bin/python'} 06:27:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 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)) 06:27:11 INFO - Cleaning up... 06:27:11 INFO - Return code: 0 06:27:11 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 06:27:11 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')]} 06:27:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:11 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')]} 06:27:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:11 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:11 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 06:27:11 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 06:27:11 INFO - Using env: {'DISPLAY': ':0', 06:27:11 INFO - 'HOME': '/home/cltbld', 06:27:11 INFO - 'LANG': 'en_US.UTF-8', 06:27:11 INFO - 'LANGUAGE': 'en_US:en', 06:27:11 INFO - 'LOGNAME': 'cltbld', 06:27:11 INFO - 'MAIL': '/var/mail/cltbld', 06:27:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:11 INFO - 'MOZ_NO_REMOTE': '1', 06:27:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:11 INFO - 'NO_EM_RESTART': '1', 06:27:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:11 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:11 INFO - 'SHELL': '/bin/bash', 06:27:11 INFO - 'SHLVL': '1', 06:27:11 INFO - 'TERM': 'linux', 06:27:11 INFO - 'TMOUT': '86400', 06:27:11 INFO - 'USER': 'cltbld', 06:27:11 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:11 INFO - '_': '/tools/buildbot/bin/python'} 06:27:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:11 INFO - Downloading/unpacking jsonschema 06:27:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:27:13 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 06:27:13 INFO - Downloading/unpacking functools32 (from jsonschema) 06:27:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:13 INFO - Downloading functools32-3.2.3-2.tar.gz 06:27:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 06:27:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 06:27:13 INFO - warning: no files found matching '*.txt' 06:27:13 INFO - no previously-included directories found matching 'build' 06:27:13 INFO - no previously-included directories found matching 'dist' 06:27:13 INFO - no previously-included directories found matching '.git*' 06:27:13 INFO - Installing collected packages: jsonschema, functools32 06:27:13 INFO - Running setup.py install for functools32 06:27:13 INFO - warning: no files found matching '*.txt' 06:27:13 INFO - no previously-included directories found matching 'build' 06:27:13 INFO - no previously-included directories found matching 'dist' 06:27:13 INFO - no previously-included directories found matching '.git*' 06:27:13 INFO - Successfully installed jsonschema functools32 06:27:13 INFO - Cleaning up... 06:27:13 INFO - Return code: 0 06:27:13 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 06:27:13 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')]} 06:27:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:13 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')]} 06:27:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:13 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 0x7f713a64ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27a98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2877450>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, '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': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', '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 06:27:13 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 06:27:13 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 06:27:13 INFO - Using env: {'DISPLAY': ':0', 06:27:13 INFO - 'HOME': '/home/cltbld', 06:27:13 INFO - 'LANG': 'en_US.UTF-8', 06:27:13 INFO - 'LANGUAGE': 'en_US:en', 06:27:13 INFO - 'LOGNAME': 'cltbld', 06:27:13 INFO - 'MAIL': '/var/mail/cltbld', 06:27:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:13 INFO - 'MOZ_NO_REMOTE': '1', 06:27:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:13 INFO - 'NO_EM_RESTART': '1', 06:27:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:13 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:13 INFO - 'SHELL': '/bin/bash', 06:27:13 INFO - 'SHLVL': '1', 06:27:13 INFO - 'TERM': 'linux', 06:27:13 INFO - 'TMOUT': '86400', 06:27:13 INFO - 'USER': 'cltbld', 06:27:13 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:13 INFO - '_': '/tools/buildbot/bin/python'} 06:27:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:13 INFO - Downloading/unpacking flake8 06:27:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:27:15 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 06:27:15 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:27:15 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 06:27:15 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 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 06:27:15 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:15 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 06:27:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 06:27:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:27:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:27:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:27:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:27:16 INFO - no previously-included directories found matching 'docs/_build' 06:27:16 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:27:16 INFO - Running setup.py install for pep8 06:27:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:27:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:27:16 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:27:16 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:27:16 INFO - no previously-included directories found matching 'docs/_build' 06:27:16 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 06:27:16 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:27:16 INFO - Cleaning up... 06:27:16 INFO - Return code: 0 06:27:16 INFO - Running post-action listener: _resource_record_post_action 06:27:16 INFO - Running post-action listener: _start_resource_monitoring 06:27:16 INFO - Starting resource monitoring. 06:27:16 INFO - ##### 06:27:16 INFO - ##### Running install step. 06:27:16 INFO - ##### 06:27:16 INFO - Running pre-action listener: _resource_record_pre_action 06:27:16 INFO - Running main action method: install 06:27:16 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 06:27:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 06:27:16 INFO - Reading from file tmpfile_stdout 06:27:16 INFO - Detecting whether we're running mozinstall >=1.0... 06:27:16 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 06:27:16 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 06:27:16 INFO - Reading from file tmpfile_stdout 06:27:16 INFO - Output received: 06:27:16 INFO - Usage: mozinstall [options] installer 06:27:16 INFO - Options: 06:27:16 INFO - -h, --help show this help message and exit 06:27:16 INFO - -d DEST, --destination=DEST 06:27:16 INFO - Directory to install application into. [default: 06:27:16 INFO - "/builds/slave/test-pgo"] 06:27:16 INFO - --app=APP Application being installed. [default: firefox] 06:27:16 INFO - mkdir: /builds/slave/test-pgo/build/application 06:27:16 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'] 06:27:16 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 06:27:31 INFO - Reading from file tmpfile_stdout 06:27:31 INFO - Output received: 06:27:31 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 06:27:31 INFO - Running post-action listener: _resource_record_post_action 06:27:31 INFO - ##### 06:27:31 INFO - ##### Running run-tests step. 06:27:31 INFO - ##### 06:27:31 INFO - Running pre-action listener: _resource_record_pre_action 06:27:31 INFO - Running main action method: run_tests 06:27:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 06:27:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 06:27:31 INFO - Python 2.7.3 06:27:31 INFO - Return code: 0 06:27:31 INFO - grabbing minidump binary from tooltool 06:27:31 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')]} 06:27:31 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 0x2909a50>, '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 0x2875550>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28759e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 06:27:31 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 06:27:31 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 06:27:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:27:31 INFO - Return code: 0 06:27:31 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 06:27:31 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 06:27:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 06:27:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 06:27:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 06:27:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 06:27:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 06:27:32 INFO - Return code: 0 06:27:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 06:27:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --webServer localhost 06:27:32 INFO - Using env: {'DISPLAY': ':0', 06:27:32 INFO - 'HOME': '/home/cltbld', 06:27:32 INFO - 'LANG': 'en_US.UTF-8', 06:27:32 INFO - 'LANGUAGE': 'en_US:en', 06:27:32 INFO - 'LOGNAME': 'cltbld', 06:27:32 INFO - 'MAIL': '/var/mail/cltbld', 06:27:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 06:27:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 06:27:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:32 INFO - 'MOZ_NO_REMOTE': '1', 06:27:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 06:27:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:32 INFO - 'NO_EM_RESTART': '1', 06:27:32 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:27:32 INFO - 'PWD': '/builds/slave/test-pgo', 06:27:32 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 06:27:32 INFO - 'SHELL': '/bin/bash', 06:27:32 INFO - 'SHLVL': '1', 06:27:32 INFO - 'TERM': 'linux', 06:27:32 INFO - 'TMOUT': '86400', 06:27:32 INFO - 'USER': 'cltbld', 06:27:32 INFO - 'XDG_SESSION_COOKIE': 'dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158', 06:27:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:32 INFO - '_': '/tools/buildbot/bin/python'} 06:27:32 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost'] with output_timeout 3600 06:27:32 INFO - mozversion INFO | application_buildid: 20151226040448 06:27:32 INFO - mozversion INFO | application_changeset: 866e6a5e2847194516ab65d71d19fd422842b22e 06:27:32 INFO - mozversion INFO | application_display_name: FirefoxDeveloperEdition 06:27:32 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:27:32 INFO - mozversion INFO | application_name: Firefox 06:27:32 INFO - mozversion INFO | application_remotingname: firefox-dev 06:27:32 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:27:32 INFO - mozversion INFO | application_vendor: Mozilla 06:27:32 INFO - mozversion INFO | application_version: 45.0a2 06:27:32 INFO - mozversion INFO | platform_buildid: 20151226040448 06:27:32 INFO - mozversion INFO | platform_changeset: 866e6a5e2847194516ab65d71d19fd422842b22e 06:27:32 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:27:32 INFO - mozversion INFO | platform_version: 45.0a2 06:27:32 INFO - 2015-12-26 06:27:32,360 DEBUG : using testdate: 1451140052 06:27:32 INFO - 2015-12-26 06:27:32,361 DEBUG : actual date: 1451140052 06:27:32 INFO - 2015-12-26 06:27:32,375 INFO : starting webserver on 'localhost:58158' 06:27:32 INFO - 2015-12-26 06:27:32,376 INFO : Starting test suite talos-linux64-ix-002.e 06:27:32 INFO - 2015-12-26 06:27:32,376 INFO : Starting test dromaeo_css 06:27:32 INFO - 2015-12-26 06:27:32,376 DEBUG : operating with platform_type : linux_ 06:27:32 INFO - 2015-12-26 06:27:32,377 INFO : Initialising browser for dromaeo_css test... 06:27:32 INFO - 2015-12-26 06:27:32,390 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRN02dl/profile http://localhost:58158/getInfo.html 06:27:36 INFO - 2015-12-26 06:27:36,734 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:27:36 INFO - 2015-12-26 06:27:36,734 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:27:36 INFO - 2015-12-26 06:27:36,734 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 06:27:36 INFO - 2015-12-26 06:27:36,734 DEBUG : BROWSER_OUTPUT: __metrics 06:27:37 INFO - 2015-12-26 06:27:37,692 INFO : Browser initialized. 06:27:37 INFO - 2015-12-26 06:27:37,692 INFO : Running cycle 1/1 for dromaeo_css test... 06:27:37 INFO - 2015-12-26 06:27:37,693 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRN02dl/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:27:49 INFO - 2015-12-26 06:27:49,406 DEBUG : BROWSER_OUTPUT: RSS: Main: 138473472 06:27:49 INFO - 2015-12-26 06:27:49,406 DEBUG : BROWSER_OUTPUT: 06:28:39 INFO - 2015-12-26 06:28:39,034 DEBUG : BROWSER_OUTPUT: 1451140119030 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] 06:30:46 INFO - 2015-12-26 06:30:46,852 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58158/tests/dromaeo/cssquery-ext.html) 06:30:47 INFO - 2015-12-26 06:30:47,917 DEBUG : BROWSER_OUTPUT: RSS: Main: 141750272 06:30:47 INFO - 2015-12-26 06:30:47,917 DEBUG : BROWSER_OUTPUT: 06:33:49 INFO - 2015-12-26 06:33:49,782 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-ext.html (next: http://localhost:58158/tests/dromaeo/cssquery-jquery.html) 06:33:50 INFO - 2015-12-26 06:33:50,368 DEBUG : BROWSER_OUTPUT: RSS: Main: 140001280 06:33:50 INFO - 2015-12-26 06:33:50,368 DEBUG : BROWSER_OUTPUT: 06:36:51 INFO - 2015-12-26 06:36:51,999 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58158/tests/dromaeo/cssquery-mootools.html) 06:36:52 INFO - 2015-12-26 06:36:52,593 DEBUG : BROWSER_OUTPUT: RSS: Main: 140001280 06:36:52 INFO - 2015-12-26 06:36:52,593 DEBUG : BROWSER_OUTPUT: 06:39:54 INFO - 2015-12-26 06:39:54,160 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58158/tests/dromaeo/cssquery-prototype.html) 06:39:54 INFO - 2015-12-26 06:39:54,747 DEBUG : BROWSER_OUTPUT: RSS: Main: 139808768 06:39:54 INFO - 2015-12-26 06:39:54,747 DEBUG : BROWSER_OUTPUT: 06:42:56 INFO - 2015-12-26 06:42:56,930 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58158/tests/dromaeo/cssquery-yui.html) 06:42:57 INFO - 2015-12-26 06:42:57,512 DEBUG : BROWSER_OUTPUT: RSS: Main: 139489280 06:42:57 INFO - 2015-12-26 06:42:57,512 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,495 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/dromaeo/cssquery-yui.html (next: http://localhost:58158/tests/dromaeo/cssquery-dojo.html) 06:45:59 INFO - 2015-12-26 06:45:59,753 DEBUG : BROWSER_OUTPUT: RSS: Main: 142540800 06:45:59 INFO - 2015-12-26 06:45:59,754 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,754 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:45:59 INFO - 2015-12-26 06:45:59,754 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:45:59 INFO - 2015-12-26 06:45:59,754 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:45:59 INFO - 2015-12-26 06:45:59,754 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:45:59 INFO - 2015-12-26 06:45:59,755 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3306.4544350182223;3335.7831740936836;3344.7156991655706;3344.732421406288;3373.190434295769;5415.9458405416035;5424.566034717223;5447.400785913546;5459.235707001018;5459.563234941205;5460.34475862896;5480.808171713991;5493.533049690781;5509.228707980876;5546.278983732109;4944.851654450372;5030.547250747432;5070.315507406508;5095.668781529189;5106.412762532319;4856.611471082322;4993.076280888029;5000.949990500085;5003.224500202475;5067.771950262247;4969.552740253376;5018.673786203904;5019.949800502003;5033.496650334955;5083.415407228179;5071.492850714936;5149.0474262261605;5156;5167.276581278624;5170.6122040847085;4861.368022157132;4950.4307004694565;4964.925526117111;5051.646384753069;5058.671186372874;5294.311739473844;5312.60155488336;5321.148616221386;5341.332333458317;5354.892902141974;5919.763209471616;5936.5250779937505;5955.404459554054;5957.910631340534;5968;5796.391378905197;5893.351731309553;5914.645121292736;5939.554533409968;6017.458428741391;5583.720813959327;5588.6646801191655;5595.272614560122;5596.27248457702;5602.663840169603;6022.518198544193;6025.78909738157;6028.517718582503;6045.3652366501765;6045.879082418327;5657.858553536194;5749.885002300014;5766.163906233573;5815.389384114692;5838.299404071538;5926.911096333559;5928.318243401977;5962;5980.162777211194;5982.4316689914385;5697.230873832063;5891.617044892068;5931.1992880960515;5939.554533409925;5944.227250457413;5744.51171650406;5800.767969281182;5817.7382017809305;5818.912716309259;5863.501602363847;4466.9553304466535;4484.955150448519;4487.349334346502;4505.61702255312;4514.390557274726;3998.220347032359;4092.263392589303;4103.117829666636;4106.958930410718;4112.383142528584;5624.3250809903075;5656.745446454919;5688.914666280009;5703.914441283384;5741.598088133791;5995.970020149872;6008;6025.789097381658;6043.063325184604;6056.818295451144;5407.756650950717;5575.749091290902;5618.073017952074;5698.17376480408;5716.314042314949;5137.717425541631;5139.6145289102715;5140.742962851842;5142.1772516397195;5189.7405129743365;6059.182010428536;6060.939390606126;6080;6080.726367313481;6088.8782224356155;5859.062549991981;5950.642961422415;5962.5528085394635;5990.951583472787;6061.818145455643;6107.786227482017;6127.14220009208;6128.325884152829;6134.6625935573975;6143.96928015357;5786.132080188006;5863.384344643751;5868.38381969887;5885.323187833454;5890.587658863838;5830.125481177857;5866.266716660418;5870.706464676664;5932.466078052996;5973.671448070398;5825.213596164633;5828.912566311594;5871.6183448075735;5871.853203669943;5873.500752436091;5625.774969001194;5851.765929362949;5852.648841069549;5855.063189889597;5856.677882716492;5580.581456390706;5672.432756724294;5673.262475878109;5695.231143795535;5709.628874123168;5804.1293805929445;5829.912551311649;5837.5329973601165;5848.678322692293;5862.208601838697;5532.695701736282;5630.774769009357;5728.026235540052;5752.511036561939;5760.193572899713 06:45:59 INFO - 2015-12-26 06:45:59,755 DEBUG : BROWSER_OUTPUT: |1;ext.html;590.3093380744529;631.1353445779282;633.9651319177447;638.0716058135414;656.9375909288616;38553.61446385535;38556.03609909754;38603;38693.806530967304;38919.416208756855;44604;45145.548544514626;45293.094138117216;45321.32018019733;45329.7733511332;9072.954635226815;9267.72196834096;9277.118673725985;9296.488693121875;9301.581428835718;8951.955240223822;8989.235914947238;9028.548572571379;9038.18656320931;9051.728448146567;9024.729258122234;9147.085291470867;9150.725478235663;9157.862632060524;9162.541872906362;9109.498977556232;9178.311626627996;9183.357164998453;9206.17144457002;9234.492102934337;9014.098590140999;9137.086291370877;9143.177114059767;9151.588178531916;9169.495677737721;42973.14053718939;43141.13717725628;43354;43493.56506434927;43626.12747745059;3684.2263124743836;4172.123853990665;4260.68044896634;4301.591348821857;4340.435743353375;32516.6748332516;32600.184995375304;32852.835735821405;32917.50623740646;33584.16039599005;4048.7570745755347;4073.5315438724333;4096.242195193869;4097.282975479279;4127.200601261254;275568;277638;277764;277772;277810;59977;60988.39011609827;72962.63518682373;74496.27518624047;74548.25451745522;64394.678026610505;64970.67514662491;65016.67491662606;65067.34932650708;65081.67459162674;16194.433194838124;16568.83431165697;16626.334946602;16661.916690416714;16723.247453864606;11790.351530665725;11928.986036187021;11935.880641193651;12033.699157521132;12035.759284814254;21759.564808704054;22074.889625552092;22104.115835366407;22121.66817497739;22130.225442109448;7694.384449244159;7859.6463159157975;7919.643616037292;7997.920020799834;8037.557934313669;1081.8802539371713;1115.1747706696985;1127.1208457403238;1180.5454899863614;1229.2931564350356;30000.69999299979;30194.24514387158;30467.542986855216;30562.388752225277;30697.38605227883;1132.445101900063;1165.2367699157066;1200.3518100225954;1222.3155033181447;1235.3452670084869;15652.452164174427;16142.919285403497;16228.918855405884;16365.181740912907;16389.180540972902;349102;365844;367657;368196;380264;47685.523144768806;47866.760666196446;48010.75994620074;48065.75967120142;48281.75859120752;1449.3188201545468;1457.8979471436899;1459.2411945788342;1464.934077966494;1478.0392744715805;26441.471170576096;29742.553861692526;29893;30165.09504714862;30278.69721302847;53753.19370209372;55018.449815501335;55164;55282.447175527726;55397.44602554084;206946;207496;208120;209323;209700;31669.841650791597;31808.363832722753;31810.840945795124;31921.68078319187;32361.676383235867;41973.79013104915;42608.14783704247;42785.786071069444;43528.129437411706;47023.76488117674;39782.2043559133;40107.398389023605;40649.78050658485;40716.59283407128;41121.58878411177;40098;40252.597474024886;40292.270375001;40497.1900561993;40675.79662101671;38986.4152037714;39137.80431097826;39265.607343926196;39485;39652.40521392239;34636.82681586576;35091.12272193216;43224;46607;47757.283640746115;32362;32473;32523.349533008735;32645.34709305848;34593.308133836676 06:45:59 INFO - 2015-12-26 06:45:59,755 DEBUG : BROWSER_OUTPUT: |2;jquery.html;373.64130434782606;378.647857492532;381.3345711733026;386.24874618866284;387.31831975722736;15998.76001859973;17042.318307267695;18051.368202112895;19120.521986950316;19167.712484312728;11117.166212534072;11176.776464470706;11319;11328.660140195787;11409.429528523562;5067.873303167432;5161.200013997836;5177.042247184283;5180.352455943007;5183.222516622499;5129.307543481638;5196.506331898464;5395.406505284415;5395.757190926418;5418.4039755626845;5355.946440535603;5365.543928766059;5389.6496727712765;6127.724252408652;6134.662593557353;6098.2682078150465;6105.145279660851;6105.65675551378;6105.786297479567;6114.0828875668785;5344.91982620261;5412.296401467784;5438.891222175574;5456.0997435423105;5519.061759500894;13343.532976345781;13549.322533873266;13786.793198102036;21346.25288114924;21476.892615536977;2344.8827558622;2364.5861974154454;2440.97559024411;2459.446624509489;2463.1132792194794;10102.949485252526;10233.9488302558;10472.895271047268;11974.640760777103;13950.651233719136;1949.0741897598668;1954.5602239496143;2010.7762566114654;2013.2953466286683;2094.790520947908;70780.2921970784;71324.28675713229;71360.6431967842;71667.2833271671;72925;16273.267702953159;16904.40834570784;17280.654386912443;17437.65124697499;17555.473335799947;25857.482850343265;25916.8704156478;25990.6101408479;26071;26309.868450657625;9094;9221.170094691375;9246.982831888487;9251.07489251083;9303.53482325881;7746.0704715433385;7758.7672369829;7801.219878012267;7818;7840.9215907841335;4585.72485650862;4674.761188285107;8441.915580844114;8453.746387608382;8490.745277641681;1881.3979526551645;1908.3034692337474;1938.2925232290113;1955.5795503966715;1957.2855907593625;929.3958926697566;934.45334479329;993.2997236947934;1000.9849852252222;1070.0904231403401;16920.746188807178;17381.739273910902;17469.65060698804;17742.20160092799;17861;479.38399157082983;480.4042986696471;488.3773189183819;492.88663607370506;1086.3481910853425;6126.264848218153;6185.350538193515;6214.720337584819;6348.111264422984;10298.073173414428;438720;450238;453306;453642;465208;77530;78834;84348;91581.54209229044;92863;507.47476361965187;513.9229115632685;513.9845804625793;518.7769259218496;519.5999080707834;10873.78252434931;11075.889241107487;11102.333859968428;11148;11389.715257118638;35478.64521354857;36338.81830590936;36925.44611830771;37498.8125059373;39045.6095439042;46559.76720116378;49035;49219.753901230266;51684.22473662973;52493.47506524886;10076.647317343857;10255.282130250811;10256.38461692301;10345.172386208935;10370.170386368922;17475.56311092233;17798.559861364123;18193.545161371072;18212.36256731008;18875.716864247323;14916.701665966402;15149.697006059596;15430.5370838875;15522.689546209238;16092.678146436772;14938.327775249922;15048.548543543711;15405.691886162438;15464.381424743335;15536.223188840288;16124.758128627846;16407.097609631586;16485.91757041207;16680.999140051637;16771.32914683399;10144.695659129942;10318.896811032095;10347.793044139225;10720.303180293256;10737;10939;12593.496260149857;15586.14276214819;15614.84385156134;16164.515064548083 06:45:59 INFO - 2015-12-26 06:45:59,755 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1467.310364128859;1492.6343045953743;1669.1487341455854;1788.6601545706314;1821.945341639751;7421.740239091633;7576.280253375928;7589.279018493235;7607.885881711772;7812.062552493709;7736.65185066672;7775.30022297993;7790;7792.766217013499;7839.647215875285;2292.896819643116;2318.4435735423463;2325.023490134148;2325.2094287942095;2333.393317737392;2312.2947501012186;2324.2213858357472;2365.8580485170946;2366.5503554324623;2367.822413318999;2245.2702871566726;2268.3081660093667;2274.3972847195505;2300.5168914527967;2303.9193628223015;2239.2050821958296;2242.5963326601204;2258.762829902853;2259.378670865517;2259.6949411829437;2272.8409011369213;2276.5333106713083;2293.6674182243646;2295.047555264563;2302.8503147295373;7672.539647621161;7706.190849960785;7728.497647652885;7737.226277372218;7760.456768026241;4500.144972455256;4578.839740609096;4591.816327346902;4598.885027874297;4610.354550362952;3069.6469905960653;3082.1215953453384;3153.8107713537033;3168.5564021036844;3171.6511183769767;1026.9794604107876;1047.2459828923163;1049.2340591368343;1071.0681706914957;1082;10191.337563058378;10266.538005789758;10271.48642567876;10276.588936442533;10291.845622315597;3935.8622448214173;3974.642282194616;3978.522577290744;3983.661388781986;4025.8590949316635;8475.32197424217;8537.274331681876;8581.914180858237;8603.655853765778;8618.353623478139;4535.206338890681;4563;4594.816207351669;4607.562281583244;4644.024754801462;4177.039280965395;4228.830846766156;4246.193223287565;4259.680523960716;4290.978545107255;3511.613722490524;3520.2255503789124;3542.875999340011;3549.112721819545;3578.516900218437;1006.0995409108807;1011.7824667696333;1019.8419245017034;1028.475477506477;1028.8919663435381;1102.090775110537;1115.1580556679655;1116.7487315354142;1167.229628445222;1208.6796998795326;7285.890711639329;7295.051643286339;7307.963460182665;7308.451866110063;7342.70629174827;1190.839236703034;1206.9517219311306;1209.4255228766442;1214.4777745569313;1221.9024772202424;5922.3485416604135;5923.111533270044;5951.642901425928;5953.553483488756;5993.4905533029305;8774.429662072072;9150.08499150093;9177.495237761854;9243.861342079874;9276.860847087299;8916.420432671985;8999.415038022507;9010.098990100938;9028;9118.908810911806;7132.572045677276;7196.532225405436;7209.423246140296;7240.674169662378;7280;7272.309130632581;7278.272172782679;7331.41348692114;7358.300961408658;7398.778036658909;8150.144234855492;8212.384071194803;8322.916770832457;8348.415610907177;8420.5789710513;8385.1195624461;8430.283425908867;8434.704785332484;8466.449680770731;8572.3999320047;6036.939630603638;6158.599691020069;6470.676466176767;6882.277360877236;6969.54697944632;7291.927080729125;7318.377937875341;7360.77917662471;7381.188069312264;7402.888956665546;6838.93161068383;7018.192907815666;7020.22777494465;7120.750773723102;7146.678399471933;6925.757598484029;6947.5831450113155;7007.719691212498;7036.331548502884;7077.433805295667;6858.862822743617;6869.896951545631;6906.965465172843;7106.964465177641;7152.9284707152265;6510.869782604226;6515.12045873801;6525.804225873231;6561.606303621798;6564.540482166202;6394.776182833579;6489.967550162219;6495.610263384212;6504.869902601827;6533.803985880431 06:45:59 INFO - 2015-12-26 06:45:59,759 DEBUG : BROWSER_OUTPUT: |4;prototype.html;345.7631522407151;349.9755017148799;352.6720150260257;356.0990693545331;358.97128229741617;6457.870842583157;6465.9353406465925;6489.05908643247;6521.250056243533;6572.07990881277;6388.584741991767;6404.519661025419;6416.967915160418;6444.871102577946;6484.6433446160445;4914.287428322882;4922.606191504689;4925.729084900329;4927.6550641455115;4934.777934992916;4925.82759603414;4926.950730492685;4938.234573641092;4944.8516544503545;4946.554810067111;4466.12910482456;4803.831865884695;4804.351412559295;4815.374001379833;4815.398075240595;4846.61227101831;4848.151573474663;4852.344933433977;4854.732989685566;4859.902801943959;4206.432131662217;4207.558206388347;4211.936820947688;4215.789210539491;4221.957780422187;5959.076343166773;6112.877742445171;6126.846828829271;6140.6929653517145;6144.600600960924;5653.406392328788;5694.829155125353;5713.14302854571;5718.885622287531;5722.027255366597;6845.623490708009;6853.17761868574;6866.107406037183;6880.862382752317;6881.690323935435;4710.5289471052965;4710.5524975127655;4714;4718.8584342469785;4726.480087190406;6875.621840798754;7050.6827192776445;7057.929420705778;7057.964710176468;7059.470539709491;4783.736894470838;4794.9280760787915;4803.567678908845;4810.63920205979;4812.326274321597;4821.300911367832;4866.29438731389;4867.148249056472;4870.050340183701;4882;5545.833624991256;5653.406392328829;5655.915161272585;5656.688882111441;5685.971570142123;6850.280720524373;6850.897236541456;6852.5203235773015;6868.828279292958;6894.758683446055;1676.9077700726334;1704.377902065737;1706.6245426006258;1711.2812618700175;1716.4678949525687;1132.2017977325966;1132.473399869065;1138.1009002887793;1153.106342584487;1170.4966864248454;6524.934750652527;6533.673316334164;6541.672916354163;6556.114924485133;6573.835654108686;6925.203601585781;6971.268016858258;6984.196817365966;6984.546004509691;6990.790276291719;6454.515911306671;6478.805635830932;6522.249941256721;6531.510136739764;6544.051112588743;3771.962280377216;3806.5051543299196;3810.333191691443;3814.065553939303;3818.961810381916;7190.06529151207;7201.243869393743;7254.056972593529;7255.818604534928;7266.63666816657;6985.93014069863;7133.643317834088;7190.532615380088;7192.352688257977;7205.063341765642;7191.208967013625;7210.170830354471;7211.891821622575;7217.24218957002;7262.382697470668;6952.443804495527;6957.199922009034;6981.79054628362;6985.336393042653;6994.61529615876;6775.119234499483;6909.378155965987;6916.55042422241;6929.965350173217;6936.618485983319;7182.6408679564765;7233.638318083969;7240;7254.854902901807;7282.490225684363;4825.30033145199;4829.27560865873;4831.227003679394;4831.468538460696;4841.709497430165;6872.10662613857;6978.755743548952;7004.089468369079;7009.439244860501;7157.57054576727;6939.548929319578;6974.128233970754;6990.895136573057;6999.965000175171;7008;6917.757878474229;6948.687309071205;6976.895346569704;6983.196932352845;6990.09128813251;6690.665466726741;6807.965960170168;6810.523263371517;6818.795436136726;6825.1127353443735;6918.515703900679;6947.166340039228;6985.755498557526;6985.79042628722;6990.056342393712;6747.325267473213;6829.658517074027;6840.486963477859;6849.691763870737;6852.314768523108 06:45:59 INFO - 2015-12-26 06:45:59,760 DEBUG : BROWSER_OUTPUT: |5;yui.html;739.1352118021914;826.4834478450969;829.2453866981049;881.8544940084886;914.1726737302739;16998.150092495373;17422.12889355532;17435.5641108972;17480.737788933176;17498.82501174988;15959.202039898017;16041.598960026005;16108.677826443463;16175.110368929703;16230.269637866295;738.3428748413916;743.1528058013869;874.873143394209;875.8423483772918;877.1360210192987;885.2386947225381;885.3050355470957;887.9822403551957;890.461270931087;891;935.8128374325128;936.7143021378511;939.746268507506;940.3981451870808;942.5993952570165;926.6339795780628;930.3766476460754;931.753085432361;932.5803388475146;935.4106912645024;690.6995456976181;691.3466773898667;693.0470602920983;693.7883945396702;696.2341424433133;14469.78295325571;14659.34032968519;14661.193634350106;14695.63260918475;14733.852661473355;12811.359432028361;12869.742605147845;12956.09307348486;13125;13135.540256090992;10936.289141205796;11434.199606027581;11597.76804463906;11652.126090543159;11804.70488237801;3754.3805272130066;3840.116773142165;3842.269968705965;3852.903677408059;3931.76409415436;45525.54474455246;45776.77111614454;45786.54213457889;45808;45913.31130033085;10303.433311167808;10737.51681174349;10749.57173021002;10803.459827008775;10874.72813179661;18686.532836678918;18759.531011724543;18779.530511737317;18810.81189188118;18815.153318100718;7532.322091011725;7582.507137036075;7714.382849372037;7719.729809456642;7811.882821757678;4264.744115353089;4268.317069268965;4301.784910754513;4307.913841723148;4376.14665140301;3191.920201994969;3226.080567038383;3227.5481432598986;3227.8547465364113;3228.3704677587643;591.3879135095156;602.9909551356733;605.1074664869283;613.4969325153331;613.9508839292846;649.9220093588799;650.0541711809401;658.3021996683435;667.5160508631203;702.1433850702135;7706.653200605986;7957.482763620462;8183.263506284463;8231.259186673227;8238.423310368216;613.6285402126244;662.2781168526329;695.1831597872581;698.7240040184099;708.7554793596202;3758.267137908136;4035.3139966205817;4221.514525829508;4299.849505267301;4324.372965919924;57164.42835571591;61482.385176148564;61614;62390.68804655947;62595.6870215646;52857;53385.46614533805;54048;54169.1874621881;55280.51237694314;48738.512614874104;48857.511424886005;48867.5113248863;48877.02245955061;49553.50446495561;8516.872246916177;8756.4308319959;8953.194212520904;9104.271658267455;9261.398009129385;35440.29119417649;35454.290914182086;36045.91862244137;36468.63531364759;36725.63274367329;43159.9210019752;48973.26540101973;49170.75414622904;50060;50439.49560504495;11537.192396532499;11608;11613;11740.58907938218;11819.645410637695;11809.881901180877;11977.940110299392;12171.939140304596;12278.693032673897;12809.61571152867;11051;11079;11590.652280431601;11667.241629294069;12086.637400877988;10748.946255268673;10773.569057237622;10833.67498975032;11080.445977701243;11129.944350278196;10794.56821727122;10831.295965762516;10972.725681858017;11041.503132358903;11346.489407976826;9570.760730981781;9931.851022234816;10316.638917637847;10473.162147028068;10648.574057037631;9856.162226210852;9867.506624668882;9955.054269844353;9964.252681049094;10013.19894408431 06:45:59 INFO - 2015-12-26 06:45:59,760 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: __start_cc_report 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,301 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: __end_cc_report 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: __startTimestamp1451141159747__endTimestamp 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: Number of tests: 6 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5499.58 Median:5709.63 stddev:608.47 (10.7%) stddev-sans-first:585.51 06:45:59 INFO - 2015-12-26 06:45:59,761 DEBUG : BROWSER_OUTPUT: Values: 3306.5 3335.8 3344.7 3344.7 3373.2 5415.9 5424.6 5447.4 5459.2 5459.6 5460.3 5480.8 5493.5 5509.2 5546.3 4944.9 5030.5 5070.3 5095.7 5106.4 4856.6 4993.1 5000.9 5003.2 5067.8 4969.6 5018.7 5019.9 5033.5 5083.4 5071.5 5149.0 5156.0 5167.3 5170.6 4861.4 4950.4 4964.9 5051.6 5058.7 5294.3 5312.6 5321.1 5341.3 5354.9 5919.8 5936.5 5955.4 5957.9 5968.0 5796.4 5893.4 5914.6 5939.6 6017.5 5583.7 5588.7 5595.3 5596.3 5602.7 6022.5 6025.8 6028.5 6045.4 6045.9 5657.9 5749.9 5766.2 5815.4 5838.3 5926.9 5928.3 5962.0 5980.2 5982.4 5697.2 5891.6 5931.2 5939.6 5944.2 5744.5 5800.8 5817.7 5818.9 5863.5 4467.0 4485.0 4487.3 4505.6 4514.4 3998.2 4092.3 4103.1 4107.0 4112.4 5624.3 5656.7 5688.9 5703.9 5741.6 5996.0 6008.0 6025.8 6043.1 6056.8 5407.8 5575.7 5618.1 5698.2 5716.3 5137.7 5139.6 5140.7 5142.2 5189.7 6059.2 6060.9 6080.0 6080.7 6088.9 5859.1 5950.6 5962.6 5991.0 6061.8 6107.8 6127.1 6128.3 6134.7 6144.0 5786.1 5863.4 5868.4 5885.3 5890.6 5830.1 5866.3 5870.7 5932.5 5973.7 5825.2 5828.9 5871.6 5871.9 5873.5 5625.8 5851.8 5852.6 5855.1 5856.7 5580.6 5672.4 5673.3 5695.2 5709.6 5804.1 5829.9 5837.5 5848.7 5862.2 5532.7 5630.8 5728.0 5752.5 5760.2 06:45:59 INFO - 2015-12-26 06:45:59,762 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,762 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:47525.85 Median:40180.00 stddev:76224.66 (189.7%) stddev-sans-first:76357.03 06:45:59 INFO - 2015-12-26 06:45:59,762 DEBUG : BROWSER_OUTPUT: Values: 590.3 631.1 634.0 638.1 656.9 38553.6 38556.0 38603.0 38693.8 38919.4 44604.0 45145.5 45293.1 45321.3 45329.8 9073.0 9267.7 9277.1 9296.5 9301.6 8952.0 8989.2 9028.5 9038.2 9051.7 9024.7 9147.1 9150.7 9157.9 9162.5 9109.5 9178.3 9183.4 9206.2 9234.5 9014.1 9137.1 9143.2 9151.6 9169.5 42973.1 43141.1 43354.0 43493.6 43626.1 3684.2 4172.1 4260.7 4301.6 4340.4 32516.7 32600.2 32852.8 32917.5 33584.2 4048.8 4073.5 4096.2 4097.3 4127.2 275568.0 277638.0 277764.0 277772.0 277810.0 59977.0 60988.4 72962.6 74496.3 74548.3 64394.7 64970.7 65016.7 65067.3 65081.7 16194.4 16568.8 16626.3 16661.9 16723.2 11790.4 11929.0 11935.9 12033.7 12035.8 21759.6 22074.9 22104.1 22121.7 22130.2 7694.4 7859.6 7919.6 7997.9 8037.6 1081.9 1115.2 1127.1 1180.5 1229.3 30000.7 30194.2 30467.5 30562.4 30697.4 1132.4 1165.2 1200.4 1222.3 1235.3 15652.5 16142.9 16228.9 16365.2 16389.2 349102.0 365844.0 367657.0 368196.0 380264.0 47685.5 47866.8 48010.8 48065.8 48281.8 1449.3 1457.9 1459.2 1464.9 1478.0 26441.5 29742.6 29893.0 30165.1 30278.7 53753.2 55018.4 55164.0 55282.4 55397.4 206946.0 207496.0 208120.0 209323.0 209700.0 31669.8 31808.4 31810.8 31921.7 32361.7 41973.8 42608.1 42785.8 43528.1 47023.8 39782.2 40107.4 40649.8 40716.6 41121.6 40098.0 40252.6 40292.3 40497.2 40675.8 38986.4 39137.8 39265.6 39485.0 39652.4 34636.8 35091.1 43224.0 46607.0 47757.3 32362.0 32473.0 32523.3 32645.3 34593.3 06:45:59 INFO - 2015-12-26 06:45:59,762 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,762 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27564.41 Median:25953.74 stddev:74305.82 (286.3%) stddev-sans-first:74486.22 06:45:59 INFO - 2015-12-26 06:45:59,763 DEBUG : BROWSER_OUTPUT: Values: 373.6 378.6 381.3 386.2 387.3 15998.8 17042.3 18051.4 19120.5 19167.7 11117.2 11176.8 11319.0 11328.7 11409.4 5067.9 5161.2 5177.0 5180.4 5183.2 5129.3 5196.5 5395.4 5395.8 5418.4 5355.9 5365.5 5389.6 6127.7 6134.7 6098.3 6105.1 6105.7 6105.8 6114.1 5344.9 5412.3 5438.9 5456.1 5519.1 13343.5 13549.3 13786.8 21346.3 21476.9 2344.9 2364.6 2441.0 2459.4 2463.1 10102.9 10233.9 10472.9 11974.6 13950.7 1949.1 1954.6 2010.8 2013.3 2094.8 70780.3 71324.3 71360.6 71667.3 72925.0 16273.3 16904.4 17280.7 17437.7 17555.5 25857.5 25916.9 25990.6 26071.0 26309.9 9094.0 9221.2 9247.0 9251.1 9303.5 7746.1 7758.8 7801.2 7818.0 7840.9 4585.7 4674.8 8441.9 8453.7 8490.7 1881.4 1908.3 1938.3 1955.6 1957.3 929.4 934.5 993.3 1001.0 1070.1 16920.7 17381.7 17469.7 17742.2 17861.0 479.4 480.4 488.4 492.9 1086.3 6126.3 6185.4 6214.7 6348.1 10298.1 438720.0 450238.0 453306.0 453642.0 465208.0 77530.0 78834.0 84348.0 91581.5 92863.0 507.5 513.9 514.0 518.8 519.6 10873.8 11075.9 11102.3 11148.0 11389.7 35478.6 36338.8 36925.4 37498.8 39045.6 46559.8 49035.0 49219.8 51684.2 52493.5 10076.6 10255.3 10256.4 10345.2 10370.2 17475.6 17798.6 18193.5 18212.4 18875.7 14916.7 15149.7 15430.5 15522.7 16092.7 14938.3 15048.5 15405.7 15464.4 15536.2 16124.8 16407.1 16485.9 16681.0 16771.3 10144.7 10318.9 10347.8 10720.3 10737.0 10939.0 12593.5 15586.1 15614.8 16164.5 06:45:59 INFO - 2015-12-26 06:45:59,763 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,764 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5391.95 Median:6097.77 stddev:2745.84 (45.0%) stddev-sans-first:2737.70 06:45:59 INFO - 2015-12-26 06:45:59,765 DEBUG : BROWSER_OUTPUT: Values: 1467.3 1492.6 1669.1 1788.7 1821.9 7421.7 7576.3 7589.3 7607.9 7812.1 7736.7 7775.3 7790.0 7792.8 7839.6 2292.9 2318.4 2325.0 2325.2 2333.4 2312.3 2324.2 2365.9 2366.6 2367.8 2245.3 2268.3 2274.4 2300.5 2303.9 2239.2 2242.6 2258.8 2259.4 2259.7 2272.8 2276.5 2293.7 2295.0 2302.9 7672.5 7706.2 7728.5 7737.2 7760.5 4500.1 4578.8 4591.8 4598.9 4610.4 3069.6 3082.1 3153.8 3168.6 3171.7 1027.0 1047.2 1049.2 1071.1 1082.0 10191.3 10266.5 10271.5 10276.6 10291.8 3935.9 3974.6 3978.5 3983.7 4025.9 8475.3 8537.3 8581.9 8603.7 8618.4 4535.2 4563.0 4594.8 4607.6 4644.0 4177.0 4228.8 4246.2 4259.7 4291.0 3511.6 3520.2 3542.9 3549.1 3578.5 1006.1 1011.8 1019.8 1028.5 1028.9 1102.1 1115.2 1116.7 1167.2 1208.7 7285.9 7295.1 7308.0 7308.5 7342.7 1190.8 1207.0 1209.4 1214.5 1221.9 5922.3 5923.1 5951.6 5953.6 5993.5 8774.4 9150.1 9177.5 9243.9 9276.9 8916.4 8999.4 9010.1 9028.0 9118.9 7132.6 7196.5 7209.4 7240.7 7280.0 7272.3 7278.3 7331.4 7358.3 7398.8 8150.1 8212.4 8322.9 8348.4 8420.6 8385.1 8430.3 8434.7 8466.4 8572.4 6036.9 6158.6 6470.7 6882.3 6969.5 7291.9 7318.4 7360.8 7381.2 7402.9 6838.9 7018.2 7020.2 7120.8 7146.7 6925.8 6947.6 7007.7 7036.3 7077.4 6858.9 6869.9 6907.0 7107.0 7152.9 6510.9 6515.1 6525.8 6561.6 6564.5 6394.8 6490.0 6495.6 6504.9 6533.8 06:45:59 INFO - 2015-12-26 06:45:59,765 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,765 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5701.46 Median:6521.75 stddev:1730.11 (26.5%) stddev-sans-first:1687.61 06:45:59 INFO - 2015-12-26 06:45:59,767 DEBUG : BROWSER_OUTPUT: Values: 345.8 350.0 352.7 356.1 359.0 6457.9 6465.9 6489.1 6521.3 6572.1 6388.6 6404.5 6417.0 6444.9 6484.6 4914.3 4922.6 4925.7 4927.7 4934.8 4925.8 4927.0 4938.2 4944.9 4946.6 4466.1 4803.8 4804.4 4815.4 4815.4 4846.6 4848.2 4852.3 4854.7 4859.9 4206.4 4207.6 4211.9 4215.8 4222.0 5959.1 6112.9 6126.8 6140.7 6144.6 5653.4 5694.8 5713.1 5718.9 5722.0 6845.6 6853.2 6866.1 6880.9 6881.7 4710.5 4710.6 4714.0 4718.9 4726.5 6875.6 7050.7 7057.9 7058.0 7059.5 4783.7 4794.9 4803.6 4810.6 4812.3 4821.3 4866.3 4867.1 4870.1 4882.0 5545.8 5653.4 5655.9 5656.7 5686.0 6850.3 6850.9 6852.5 6868.8 6894.8 1676.9 1704.4 1706.6 1711.3 1716.5 1132.2 1132.5 1138.1 1153.1 1170.5 6524.9 6533.7 6541.7 6556.1 6573.8 6925.2 6971.3 6984.2 6984.5 6990.8 6454.5 6478.8 6522.2 6531.5 6544.1 3772.0 3806.5 3810.3 3814.1 3819.0 7190.1 7201.2 7254.1 7255.8 7266.6 6985.9 7133.6 7190.5 7192.4 7205.1 7191.2 7210.2 7211.9 7217.2 7262.4 6952.4 6957.2 6981.8 6985.3 6994.6 6775.1 6909.4 6916.6 6930.0 6936.6 7182.6 7233.6 7240.0 7254.9 7282.5 4825.3 4829.3 4831.2 4831.5 4841.7 6872.1 6978.8 7004.1 7009.4 7157.6 6939.5 6974.1 6990.9 7000.0 7008.0 6917.8 6948.7 6976.9 6983.2 6990.1 6690.7 6808.0 6810.5 6818.8 6825.1 6918.5 6947.2 6985.8 6985.8 6990.1 6747.3 6829.7 6840.5 6849.7 6852.3 06:45:59 INFO - 2015-12-26 06:45:59,767 DEBUG : BROWSER_OUTPUT: 06:45:59 INFO - 2015-12-26 06:45:59,767 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:14465.98 Median:45651.16 stddev:16644.95 (36.5%) stddev-sans-first:16659.73 06:45:59 INFO - 2015-12-26 06:45:59,767 DEBUG : BROWSER_OUTPUT: Values: 739.1 826.5 829.2 881.9 914.2 16998.2 17422.1 17435.6 17480.7 17498.8 15959.2 16041.6 16108.7 16175.1 16230.3 738.3 743.2 874.9 875.8 877.1 885.2 885.3 888.0 890.5 891.0 935.8 936.7 939.7 940.4 942.6 926.6 930.4 931.8 932.6 935.4 690.7 691.3 693.0 693.8 696.2 14469.8 14659.3 14661.2 14695.6 14733.9 12811.4 12869.7 12956.1 13125.0 13135.5 10936.3 11434.2 11597.8 11652.1 11804.7 3754.4 3840.1 3842.3 3852.9 3931.8 45525.5 45776.8 45786.5 45808.0 45913.3 10303.4 10737.5 10749.6 10803.5 10874.7 18686.5 18759.5 18779.5 18810.8 18815.2 7532.3 7582.5 7714.4 7719.7 7811.9 4264.7 4268.3 4301.8 4307.9 4376.1 3191.9 3226.1 3227.5 3227.9 3228.4 591.4 603.0 605.1 613.5 614.0 649.9 650.1 658.3 667.5 702.1 7706.7 7957.5 8183.3 8231.3 8238.4 613.6 662.3 695.2 698.7 708.8 3758.3 4035.3 4221.5 4299.8 4324.4 57164.4 61482.4 61614.0 62390.7 62595.7 52857.0 53385.5 54048.0 54169.2 55280.5 48738.5 48857.5 48867.5 48877.0 49553.5 8516.9 8756.4 8953.2 9104.3 9261.4 35440.3 35454.3 36045.9 36468.6 36725.6 43159.9 48973.3 49170.8 50060.0 50439.5 11537.2 11608.0 11613.0 11740.6 11819.6 11809.9 11977.9 12171.9 12278.7 12809.6 11051.0 11079.0 11590.7 11667.2 12086.6 10748.9 10773.6 10833.7 11080.4 11129.9 10794.6 10831.3 10972.7 11041.5 11346.5 9570.8 9931.9 10316.6 10473.2 10648.6 9856.2 9867.5 9955.1 9964.3 10013.2 06:45:59 INFO - 2015-12-26 06:45:59,768 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:45:59 INFO - 2015-12-26 06:45:59,768 DEBUG : BROWSER_OUTPUT: 06:46:00 INFO - 2015-12-26 06:46:00,408 INFO : Browser exited with error code: 0 06:46:00 INFO - 2015-12-26 06:46:00,429 INFO : Completed test dromaeo_css (00:18:28) 06:46:00 INFO - 2015-12-26 06:46:00,429 INFO : Starting test kraken 06:46:00 INFO - 2015-12-26 06:46:00,429 DEBUG : operating with platform_type : linux_ 06:46:00 INFO - 2015-12-26 06:46:00,429 INFO : Initialising browser for kraken test... 06:46:00 INFO - 2015-12-26 06:46:00,436 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzrYTzs/profile http://localhost:58158/getInfo.html 06:46:04 INFO - 2015-12-26 06:46:04,742 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:46:04 INFO - 2015-12-26 06:46:04,743 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:46:04 INFO - 2015-12-26 06:46:04,743 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 06:46:04 INFO - 2015-12-26 06:46:04,743 DEBUG : BROWSER_OUTPUT: __metrics 06:46:05 INFO - 2015-12-26 06:46:05,788 INFO : Browser initialized. 06:46:05 INFO - 2015-12-26 06:46:05,788 INFO : Running cycle 1/1 for kraken test... 06:46:05 INFO - 2015-12-26 06:46:05,789 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzrYTzs/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:46:17 INFO - 2015-12-26 06:46:17,618 DEBUG : BROWSER_OUTPUT: RSS: Main: 138694656 06:46:17 INFO - 2015-12-26 06:46:17,619 DEBUG : BROWSER_OUTPUT: 06:46:20 INFO - 2015-12-26 06:46:20,080 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58158/tests/kraken/driver.html?testName=audio-beat-detection) 06:46:20 INFO - 2015-12-26 06:46:20,682 DEBUG : BROWSER_OUTPUT: RSS: Main: 139137024 06:46:20 INFO - 2015-12-26 06:46:20,683 DEBUG : BROWSER_OUTPUT: 06:46:23 INFO - 2015-12-26 06:46:23,251 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58158/tests/kraken/driver.html?testName=audio-dft) 06:46:23 INFO - 2015-12-26 06:46:23,845 DEBUG : BROWSER_OUTPUT: RSS: Main: 139071488 06:46:23 INFO - 2015-12-26 06:46:23,845 DEBUG : BROWSER_OUTPUT: 06:46:26 INFO - 2015-12-26 06:46:26,648 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58158/tests/kraken/driver.html?testName=audio-fft) 06:46:27 INFO - 2015-12-26 06:46:27,230 DEBUG : BROWSER_OUTPUT: RSS: Main: 139259904 06:46:27 INFO - 2015-12-26 06:46:27,230 DEBUG : BROWSER_OUTPUT: 06:46:29 INFO - 2015-12-26 06:46:29,243 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58158/tests/kraken/driver.html?testName=audio-oscillator) 06:46:29 INFO - 2015-12-26 06:46:29,826 DEBUG : BROWSER_OUTPUT: RSS: Main: 139333632 06:46:29 INFO - 2015-12-26 06:46:29,826 DEBUG : BROWSER_OUTPUT: 06:46:32 INFO - 2015-12-26 06:46:32,004 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58158/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:46:32 INFO - 2015-12-26 06:46:32,590 DEBUG : BROWSER_OUTPUT: RSS: Main: 139177984 06:46:32 INFO - 2015-12-26 06:46:32,591 DEBUG : BROWSER_OUTPUT: 06:46:35 INFO - 2015-12-26 06:46:35,538 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58158/tests/kraken/driver.html?testName=imaging-darkroom) 06:46:36 INFO - 2015-12-26 06:46:36,132 DEBUG : BROWSER_OUTPUT: RSS: Main: 139763712 06:46:36 INFO - 2015-12-26 06:46:36,132 DEBUG : BROWSER_OUTPUT: 06:46:39 INFO - 2015-12-26 06:46:39,442 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58158/tests/kraken/driver.html?testName=imaging-desaturate) 06:46:40 INFO - 2015-12-26 06:46:40,031 DEBUG : BROWSER_OUTPUT: RSS: Main: 139677696 06:46:40 INFO - 2015-12-26 06:46:40,031 DEBUG : BROWSER_OUTPUT: 06:46:42 INFO - 2015-12-26 06:46:42,851 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58158/tests/kraken/driver.html?testName=json-parse-financial) 06:46:43 INFO - 2015-12-26 06:46:43,438 DEBUG : BROWSER_OUTPUT: RSS: Main: 139554816 06:46:43 INFO - 2015-12-26 06:46:43,439 DEBUG : BROWSER_OUTPUT: 06:46:45 INFO - 2015-12-26 06:46:45,016 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58158/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:46:45 INFO - 2015-12-26 06:46:45,598 DEBUG : BROWSER_OUTPUT: RSS: Main: 139640832 06:46:45 INFO - 2015-12-26 06:46:45,598 DEBUG : BROWSER_OUTPUT: 06:46:47 INFO - 2015-12-26 06:46:47,348 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:46:47 INFO - 2015-12-26 06:46:47,970 DEBUG : BROWSER_OUTPUT: RSS: Main: 138313728 06:46:47 INFO - 2015-12-26 06:46:47,970 DEBUG : BROWSER_OUTPUT: 06:46:49 INFO - 2015-12-26 06:46:49,967 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:46:50 INFO - 2015-12-26 06:46:50,553 DEBUG : BROWSER_OUTPUT: RSS: Main: 138690560 06:46:50 INFO - 2015-12-26 06:46:50,554 DEBUG : BROWSER_OUTPUT: 06:46:52 INFO - 2015-12-26 06:46:52,972 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:46:53 INFO - 2015-12-26 06:46:53,561 DEBUG : BROWSER_OUTPUT: RSS: Main: 140210176 06:46:53 INFO - 2015-12-26 06:46:53,561 DEBUG : BROWSER_OUTPUT: 06:46:56 INFO - 2015-12-26 06:46:56,083 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:46:56 INFO - 2015-12-26 06:46:56,670 DEBUG : BROWSER_OUTPUT: RSS: Main: 140849152 06:46:56 INFO - 2015-12-26 06:46:56,670 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,323 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58158/tests/kraken/driver.html?testName=ai-astar) 06:46:58 INFO - 2015-12-26 06:46:58,573 DEBUG : BROWSER_OUTPUT: RSS: Main: 140005376 06:46:58 INFO - 2015-12-26 06:46:58,574 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,575 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:46:58 INFO - 2015-12-26 06:46:58,575 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:46:58 INFO - 2015-12-26 06:46:58,575 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:46:58 INFO - 2015-12-26 06:46:58,576 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:46:58 INFO - 2015-12-26 06:46:58,576 DEBUG : BROWSER_OUTPUT: |0;ai-astar;112;106;110;111;112;123;111;111;110;112 06:46:58 INFO - 2015-12-26 06:46:58,576 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;152;120;148;151;122;147;148;127;165;126 06:46:58 INFO - 2015-12-26 06:46:58,576 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;161;161;162;162;162;161;160;164;161 06:46:58 INFO - 2015-12-26 06:46:58,576 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;72;153;73;70;73;72;161;73 06:46:58 INFO - 2015-12-26 06:46:58,577 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;93;134;92;92;94;140;92;94;134 06:46:58 INFO - 2015-12-26 06:46:58,577 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;110;110;110;109;109;109;109;109;109 06:46:58 INFO - 2015-12-26 06:46:58,577 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;146;146;153;147;147;146;146;146;147 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;97;95;95;96;96;95;95;95;96;96 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;60;61;59;59;59;62;62;59;61;57 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;64;65;66;63;64;63;64;65;64;64 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;79;80;80;88;81;88;80;82;82;80 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;125;122;123;124;113;121;113;119;112;111 06:46:58 INFO - 2015-12-26 06:46:58,578 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;136;160;143;147;144;144;141;138;143;144 06:46:58 INFO - 2015-12-26 06:46:58,579 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;64;64;65;65;65;67;64;63;64;72 06:46:58 INFO - 2015-12-26 06:46:58,579 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:46:58 INFO - 2015-12-26 06:46:58,579 DEBUG : BROWSER_OUTPUT: __start_cc_report 06:46:58 INFO - 2015-12-26 06:46:58,579 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,705 06:46:58 INFO - 2015-12-26 06:46:58,579 DEBUG : BROWSER_OUTPUT: __end_cc_report 06:46:58 INFO - 2015-12-26 06:46:58,580 DEBUG : BROWSER_OUTPUT: __startTimestamp1451141218575__endTimestamp 06:46:58 INFO - 2015-12-26 06:46:58,580 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,583 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:46:58 INFO - 2015-12-26 06:46:58,583 DEBUG : BROWSER_OUTPUT: Number of tests: 14 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:111.80 Median:111.50 stddev:4.32 (3.9%) stddev-sans-first:4.58 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: Values: 112.0 106.0 110.0 111.0 112.0 123.0 111.0 111.0 110.0 112.0 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:140.60 Median:148.00 stddev:15.46 (10.4%) stddev-sans-first:15.84 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: Values: 152.0 120.0 148.0 151.0 122.0 147.0 148.0 127.0 165.0 126.0 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:1.17 (0.7%) stddev-sans-first:1.13 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: Values: 160.0 161.0 161.0 162.0 162.0 162.0 161.0 160.0 164.0 161.0 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,584 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:89.00 Median:72.00 stddev:35.90 (49.9%) stddev-sans-first:37.55 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 72.0 153.0 73.0 70.0 73.0 72.0 161.0 73.0 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.60 Median:92.00 stddev:21.06 (22.9%) stddev-sans-first:21.67 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: Values: 91.0 93.0 134.0 92.0 92.0 94.0 140.0 92.0 94.0 134.0 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.30 Median:109.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: Values: 109.0 110.0 110.0 110.0 109.0 109.0 109.0 109.0 109.0 109.0 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.00 Median:146.50 stddev:2.16 (1.5%) stddev-sans-first:2.26 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: Values: 146.0 146.0 146.0 153.0 147.0 147.0 146.0 146.0 146.0 147.0 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,585 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.53 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: Values: 97.0 95.0 95.0 96.0 96.0 95.0 95.0 95.0 96.0 96.0 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.90 Median:60.50 stddev:1.60 (2.6%) stddev-sans-first:1.69 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: Values: 60.0 61.0 59.0 59.0 59.0 62.0 62.0 59.0 61.0 57.0 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:64.20 Median:64.00 stddev:0.92 (1.4%) stddev-sans-first:0.97 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: Values: 64.0 65.0 66.0 63.0 64.0 63.0 64.0 65.0 64.0 64.0 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,586 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:82.00 Median:81.50 stddev:3.30 (4.0%) stddev-sans-first:3.32 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: Values: 79.0 80.0 80.0 88.0 81.0 88.0 80.0 82.0 82.0 80.0 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:118.30 Median:121.50 stddev:5.48 (4.5%) stddev-sans-first:5.25 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: Values: 125.0 122.0 123.0 124.0 113.0 121.0 113.0 119.0 112.0 111.0 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.00 Median:144.00 stddev:6.46 (4.5%) stddev-sans-first:6.17 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: Values: 136.0 160.0 143.0 147.0 144.0 144.0 141.0 138.0 143.0 144.0 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.30 Median:65.00 stddev:2.58 (4.0%) stddev-sans-first:2.70 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: Values: 64.0 64.0 65.0 65.0 65.0 67.0 64.0 63.0 64.0 72.0 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:46:58 INFO - 2015-12-26 06:46:58,587 DEBUG : BROWSER_OUTPUT: 06:46:59 INFO - 2015-12-26 06:46:59,484 INFO : Browser exited with error code: 0 06:46:59 INFO - 2015-12-26 06:46:59,591 INFO : Completed test kraken (00:00:59) 06:46:59 INFO - 2015-12-26 06:46:59,591 INFO : Starting test v8_7 06:46:59 INFO - 2015-12-26 06:46:59,591 DEBUG : operating with platform_type : linux_ 06:46:59 INFO - 2015-12-26 06:46:59,591 INFO : Initialising browser for v8_7 test... 06:46:59 INFO - 2015-12-26 06:46:59,597 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpAkBerJ/profile http://localhost:58158/getInfo.html 06:47:03 INFO - 2015-12-26 06:47:03,776 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:47:03 INFO - 2015-12-26 06:47:03,777 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:47:03 INFO - 2015-12-26 06:47:03,777 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 06:47:03 INFO - 2015-12-26 06:47:03,777 DEBUG : BROWSER_OUTPUT: __metrics 06:47:04 INFO - 2015-12-26 06:47:04,704 INFO : Browser initialized. 06:47:04 INFO - 2015-12-26 06:47:04,704 INFO : Running cycle 1/1 for v8_7 test... 06:47:04 INFO - 2015-12-26 06:47:04,705 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpAkBerJ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:47:16 INFO - 2015-12-26 06:47:16,514 DEBUG : BROWSER_OUTPUT: RSS: Main: 138321920 06:47:16 INFO - 2015-12-26 06:47:16,515 DEBUG : BROWSER_OUTPUT: 06:47:37 INFO - 2015-12-26 06:47:37,938 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58158/tests/v8_7/run.html (next: http://localhost:58158/tests/v8_7/run.html) 06:47:38 INFO - 2015-12-26 06:47:38,189 DEBUG : BROWSER_OUTPUT: RSS: Main: 136179712 06:47:38 INFO - 2015-12-26 06:47:38,189 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,189 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:47:38 INFO - 2015-12-26 06:47:38,190 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:47:38 INFO - 2015-12-26 06:47:38,190 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:47:38 INFO - 2015-12-26 06:47:38,190 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:47:38 INFO - 2015-12-26 06:47:38,190 DEBUG : BROWSER_OUTPUT: |0;Richards;164.12276382734285 06:47:38 INFO - 2015-12-26 06:47:38,191 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;173.04031839418585 06:47:38 INFO - 2015-12-26 06:47:38,191 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.08676307007784 06:47:38 INFO - 2015-12-26 06:47:38,191 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5148.717948717948 06:47:38 INFO - 2015-12-26 06:47:38,192 DEBUG : BROWSER_OUTPUT: |4;RayTrace;960.6147934678194 06:47:38 INFO - 2015-12-26 06:47:38,192 DEBUG : BROWSER_OUTPUT: |5;Earley;545.8515283842795 06:47:38 INFO - 2015-12-26 06:47:38,192 DEBUG : BROWSER_OUTPUT: |6;Boyer;11120.87912087912 06:47:38 INFO - 2015-12-26 06:47:38,192 DEBUG : BROWSER_OUTPUT: |7;RegExp;23581.39534883721 06:47:38 INFO - 2015-12-26 06:47:38,192 DEBUG : BROWSER_OUTPUT: |8;Splay;548.1400437636762 06:47:38 INFO - 2015-12-26 06:47:38,193 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4830.917874396136 06:47:38 INFO - 2015-12-26 06:47:38,193 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:47:38 INFO - 2015-12-26 06:47:38,193 DEBUG : BROWSER_OUTPUT: __startTimestamp1451141258187__endTimestamp 06:47:38 INFO - 2015-12-26 06:47:38,194 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,194 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:47:38 INFO - 2015-12-26 06:47:38,194 DEBUG : BROWSER_OUTPUT: Number of tests: 10 06:47:38 INFO - 2015-12-26 06:47:38,194 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,195 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:164.12 Median:164.12 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,195 DEBUG : BROWSER_OUTPUT: Values: 164.1 06:47:38 INFO - 2015-12-26 06:47:38,195 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,195 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:173.04 Median:173.04 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: Values: 173.0 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.09 Median:278.09 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: Values: 278.1 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,196 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5148.72 Median:5148.72 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: Values: 5148.7 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:960.61 Median:960.61 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: Values: 960.6 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:545.85 Median:545.85 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: Values: 545.9 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,197 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11120.88 Median:11120.88 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,198 DEBUG : BROWSER_OUTPUT: Values: 11120.9 06:47:38 INFO - 2015-12-26 06:47:38,198 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:23581.40 Median:23581.40 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: Values: 23581.4 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:548.14 Median:548.14 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: Values: 548.1 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: Values: 4830.9 06:47:38 INFO - 2015-12-26 06:47:38,199 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:47:38 INFO - 2015-12-26 06:47:38,200 DEBUG : BROWSER_OUTPUT: 06:47:38 INFO - 2015-12-26 06:47:38,980 INFO : Browser exited with error code: 0 06:47:38 INFO - 2015-12-26 06:47:38,992 INFO : Completed test v8_7 (00:00:39) 06:47:39 INFO - 2015-12-26 06:47:39,197 INFO : Completed test suite (00:20:06) 06:47:39 INFO - 2015-12-26 06:47:39,197 DEBUG : Working with test: dromaeo_css 06:47:39 INFO - 2015-12-26 06:47:39,197 DEBUG : Generating results file: dromaeo_css 06:47:39 INFO - 2015-12-26 06:47:39,198 DEBUG : Working with test: kraken 06:47:39 INFO - 2015-12-26 06:47:39,199 DEBUG : Generating results file: kraken 06:47:39 INFO - 2015-12-26 06:47:39,199 INFO : javascript benchmark 06:47:39 INFO - 2015-12-26 06:47:39,199 DEBUG : Working with test: v8_7 06:47:39 INFO - 2015-12-26 06:47:39,199 DEBUG : Generating results file: v8_7 06:47:39 INFO - 2015-12-26 06:47:39,200 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:47:39 INFO - 2015-12-26 06:47:39,260 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 06:47:39 INFO - 2015-12-26 06:47:39,260 DEBUG : process_Request line: dromaeo_css 7287.97 graph.html#tests=[[72,52,43]] 06:47:39 INFO - 2015-12-26 06:47:39,260 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:47:39 INFO - 2015-12-26 06:47:39,290 DEBUG : process_Request line: kraken 1494.00 graph.html#tests=[[232,52,43]] 06:47:39 INFO - 2015-12-26 06:47:39,291 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:47:39 INFO - 2015-12-26 06:47:39,321 DEBUG : process_Request line: v8_7 23032.93 graph.html#tests=[[230,52,43]] 06:47:39 INFO - 2015-12-26 06:47:39,322 INFO : javascript benchmark 06:47:39 INFO - 2015-12-26 06:47:39,324 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3306.4544350182223, 3335.7831740936836, 3344.7156991655706, 3344.732421406288, 3373.190434295769, 5415.9458405416035, 5424.566034717223, 5447.400785913546, 5459.235707001018, 5459.563234941205, 5460.34475862896, 5480.808171713991, 5493.533049690781, 5509.228707980876, 5546.278983732109, 4944.851654450372, 5030.547250747432, 5070.315507406508, 5095.668781529189, 5106.412762532319, 4856.611471082322, 4993.076280888029, 5000.949990500085, 5003.224500202475, 5067.771950262247, 4969.552740253376, 5018.673786203904, 5019.949800502003, 5033.496650334955, 5083.415407228179, 5071.492850714936, 5149.0474262261605, 5156.0, 5167.276581278624, 5170.6122040847085, 4861.368022157132, 4950.4307004694565, 4964.925526117111, 5051.646384753069, 5058.671186372874, 5294.311739473844, 5312.60155488336, 5321.148616221386, 5341.332333458317, 5354.892902141974, 5919.763209471616, 5936.5250779937505, 5955.404459554054, 5957.910631340534, 5968.0, 5796.391378905197, 5893.351731309553, 5914.645121292736, 5939.554533409968, 6017.458428741391, 5583.720813959327, 5588.6646801191655, 5595.272614560122, 5596.27248457702, 5602.663840169603, 6022.518198544193, 6025.78909738157, 6028.517718582503, 6045.3652366501765, 6045.879082418327, 5657.858553536194, 5749.885002300014, 5766.163906233573, 5815.389384114692, 5838.299404071538, 5926.911096333559, 5928.318243401977, 5962.0, 5980.162777211194, 5982.4316689914385, 5697.230873832063, 5891.617044892068, 5931.1992880960515, 5939.554533409925, 5944.227250457413, 5744.51171650406, 5800.767969281182, 5817.7382017809305, 5818.912716309259, 5863.501602363847, 4466.9553304466535, 4484.955150448519, 4487.349334346502, 4505.61702255312, 4514.390557274726, 3998.220347032359, 4092.263392589303, 4103.117829666636, 4106.958930410718, 4112.383142528584, 5624.3250809903075, 5656.745446454919, 5688.914666280009, 5703.914441283384, 5741.598088133791, 5995.970020149872, 6008.0, 6025.789097381658, 6043.063325184604, 6056.818295451144, 5407.756650950717, 5575.749091290902, 5618.073017952074, 5698.17376480408, 5716.314042314949, 5137.717425541631, 5139.6145289102715, 5140.742962851842, 5142.1772516397195, 5189.7405129743365, 6059.182010428536, 6060.939390606126, 6080.0, 6080.726367313481, 6088.8782224356155, 5859.062549991981, 5950.642961422415, 5962.5528085394635, 5990.951583472787, 6061.818145455643, 6107.786227482017, 6127.14220009208, 6128.325884152829, 6134.6625935573975, 6143.96928015357, 5786.132080188006, 5863.384344643751, 5868.38381969887, 5885.323187833454, 5890.587658863838, 5830.125481177857, 5866.266716660418, 5870.706464676664, 5932.466078052996, 5973.671448070398, 5825.213596164633, 5828.912566311594, 5871.6183448075735, 5871.853203669943, 5873.500752436091, 5625.774969001194, 5851.765929362949, 5852.648841069549, 5855.063189889597, 5856.677882716492, 5580.581456390706, 5672.432756724294, 5673.262475878109, 5695.231143795535, 5709.628874123168, 5804.1293805929445, 5829.912551311649, 5837.5329973601165, 5848.678322692293, 5862.208601838697, 5532.695701736282, 5630.774769009357, 5728.026235540052, 5752.511036561939, 5760.193572899713], "unit": "ms", "name": "dojo.html", "value": 5460.353262612385}, {"lowerIsBetter": false, "replicates": [590.3093380744529, 631.1353445779282, 633.9651319177447, 638.0716058135414, 656.9375909288616, 38553.61446385535, 38556.03609909754, 38603.0, 38693.806530967304, 38919.416208756855, 44604.0, 45145.548544514626, 45293.094138117216, 45321.32018019733, 45329.7733511332, 9072.954635226815, 9267.72196834096, 9277.118673725985, 9296.488693121875, 9301.581428835718, 8951.955240223822, 8989.235914947238, 9028.548572571379, 9038.18656320931, 9051.728448146567, 9024.729258122234, 9147.085291470867, 9150.725478235663, 9157.862632060524, 9162.541872906362, 9109.498977556232, 9178.311626627996, 9183.357164998453, 9206.17144457002, 9234.492102934337, 9014.098590140999, 9137.086291370877, 9143.177114059767, 9151.588178531916, 9169.495677737721, 42973.14053718939, 43141.13717725628, 43354.0, 43493.56506434927, 43626.12747745059, 3684.2263124743836, 4172.123853990665, 4260.68044896634, 4301.591348821857, 4340.435743353375, 32516.6748332516, 32600.184995375304, 32852.835735821405, 32917.50623740646, 33584.16039599005, 4048.7570745755347, 4073.5315438724333, 4096.242195193869, 4097.282975479279, 4127.200601261254, 275568.0, 277638.0, 277764.0, 277772.0, 277810.0, 59977.0, 60988.39011609827, 72962.63518682373, 74496.27518624047, 74548.25451745522, 64394.678026610505, 64970.67514662491, 65016.67491662606, 65067.34932650708, 65081.67459162674, 16194.433194838124, 16568.83431165697, 16626.334946602, 16661.916690416714, 16723.247453864606, 11790.351530665725, 11928.986036187021, 11935.880641193651, 12033.699157521132, 12035.759284814254, 21759.564808704054, 22074.889625552092, 22104.115835366407, 22121.66817497739, 22130.225442109448, 7694.384449244159, 7859.6463159157975, 7919.643616037292, 7997.920020799834, 8037.557934313669, 1081.8802539371713, 1115.1747706696985, 1127.1208457403238, 1180.5454899863614, 1229.2931564350356, 30000.69999299979, 30194.24514387158, 30467.542986855216, 30562.388752225277, 30697.38605227883, 1132.445101900063, 1165.2367699157066, 1200.3518100225954, 1222.3155033181447, 1235.3452670084869, 15652.452164174427, 16142.919285403497, 16228.918855405884, 16365.181740912907, 16389.180540972902, 349102.0, 365844.0, 367657.0, 368196.0, 380264.0, 47685.523144768806, 47866.760666196446, 48010.75994620074, 48065.75967120142, 48281.75859120752, 1449.3188201545468, 1457.8979471436899, 1459.2411945788342, 1464.934077966494, 1478.0392744715805, 26441.471170576096, 29742.553861692526, 29893.0, 30165.09504714862, 30278.69721302847, 53753.19370209372, 55018.449815501335, 55164.0, 55282.447175527726, 55397.44602554084, 206946.0, 207496.0, 208120.0, 209323.0, 209700.0, 31669.841650791597, 31808.363832722753, 31810.840945795124, 31921.68078319187, 32361.676383235867, 41973.79013104915, 42608.14783704247, 42785.786071069444, 43528.129437411706, 47023.76488117674, 39782.2043559133, 40107.398389023605, 40649.78050658485, 40716.59283407128, 41121.58878411177, 40098.0, 40252.597474024886, 40292.270375001, 40497.1900561993, 40675.79662101671, 38986.4152037714, 39137.80431097826, 39265.607343926196, 39485.0, 39652.40521392239, 34636.82681586576, 35091.12272193216, 43224.0, 46607.0, 47757.283640746115, 32362.0, 32473.0, 32523.349533008735, 32645.34709305848, 34593.308133836676], "unit": "ms", "name": "ext.html", "value": 19834.194482553936}, {"lowerIsBetter": false, "replicates": [373.64130434782606, 378.647857492532, 381.3345711733026, 386.24874618866284, 387.31831975722736, 15998.76001859973, 17042.318307267695, 18051.368202112895, 19120.521986950316, 19167.712484312728, 11117.166212534072, 11176.776464470706, 11319.0, 11328.660140195787, 11409.429528523562, 5067.873303167432, 5161.200013997836, 5177.042247184283, 5180.352455943007, 5183.222516622499, 5129.307543481638, 5196.506331898464, 5395.406505284415, 5395.757190926418, 5418.4039755626845, 5355.946440535603, 5365.543928766059, 5389.6496727712765, 6127.724252408652, 6134.662593557353, 6098.2682078150465, 6105.145279660851, 6105.65675551378, 6105.786297479567, 6114.0828875668785, 5344.91982620261, 5412.296401467784, 5438.891222175574, 5456.0997435423105, 5519.061759500894, 13343.532976345781, 13549.322533873266, 13786.793198102036, 21346.25288114924, 21476.892615536977, 2344.8827558622, 2364.5861974154454, 2440.97559024411, 2459.446624509489, 2463.1132792194794, 10102.949485252526, 10233.9488302558, 10472.895271047268, 11974.640760777103, 13950.651233719136, 1949.0741897598668, 1954.5602239496143, 2010.7762566114654, 2013.2953466286683, 2094.790520947908, 70780.2921970784, 71324.28675713229, 71360.6431967842, 71667.2833271671, 72925.0, 16273.267702953159, 16904.40834570784, 17280.654386912443, 17437.65124697499, 17555.473335799947, 25857.482850343265, 25916.8704156478, 25990.6101408479, 26071.0, 26309.868450657625, 9094.0, 9221.170094691375, 9246.982831888487, 9251.07489251083, 9303.53482325881, 7746.0704715433385, 7758.7672369829, 7801.219878012267, 7818.0, 7840.9215907841335, 4585.72485650862, 4674.761188285107, 8441.915580844114, 8453.746387608382, 8490.745277641681, 1881.3979526551645, 1908.3034692337474, 1938.2925232290113, 1955.5795503966715, 1957.2855907593625, 929.3958926697566, 934.45334479329, 993.2997236947934, 1000.9849852252222, 1070.0904231403401, 16920.746188807178, 17381.739273910902, 17469.65060698804, 17742.20160092799, 17861.0, 479.38399157082983, 480.4042986696471, 488.3773189183819, 492.88663607370506, 1086.3481910853425, 6126.264848218153, 6185.350538193515, 6214.720337584819, 6348.111264422984, 10298.073173414428, 438720.0, 450238.0, 453306.0, 453642.0, 465208.0, 77530.0, 78834.0, 84348.0, 91581.54209229044, 92863.0, 507.47476361965187, 513.9229115632685, 513.9845804625793, 518.7769259218496, 519.5999080707834, 10873.78252434931, 11075.889241107487, 11102.333859968428, 11148.0, 11389.715257118638, 35478.64521354857, 36338.81830590936, 36925.44611830771, 37498.8125059373, 39045.6095439042, 46559.76720116378, 49035.0, 49219.753901230266, 51684.22473662973, 52493.47506524886, 10076.647317343857, 10255.282130250811, 10256.38461692301, 10345.172386208935, 10370.170386368922, 17475.56311092233, 17798.559861364123, 18193.545161371072, 18212.36256731008, 18875.716864247323, 14916.701665966402, 15149.697006059596, 15430.5370838875, 15522.689546209238, 16092.678146436772, 14938.327775249922, 15048.548543543711, 15405.691886162438, 15464.381424743335, 15536.223188840288, 16124.758128627846, 16407.097609631586, 16485.91757041207, 16680.999140051637, 16771.32914683399, 10144.695659129942, 10318.896811032095, 10347.793044139225, 10720.303180293256, 10737.0, 10939.0, 12593.496260149857, 15586.14276214819, 15614.84385156134, 16164.515064548083], "unit": "ms", "name": "jquery.html", "value": 9115.695379908948}, {"lowerIsBetter": false, "replicates": [1467.310364128859, 1492.6343045953743, 1669.1487341455854, 1788.6601545706314, 1821.945341639751, 7421.740239091633, 7576.280253375928, 7589.279018493235, 7607.885881711772, 7812.062552493709, 7736.65185066672, 7775.30022297993, 7790.0, 7792.766217013499, 7839.647215875285, 2292.896819643116, 2318.4435735423463, 2325.023490134148, 2325.2094287942095, 2333.393317737392, 2312.2947501012186, 2324.2213858357472, 2365.8580485170946, 2366.5503554324623, 2367.822413318999, 2245.2702871566726, 2268.3081660093667, 2274.3972847195505, 2300.5168914527967, 2303.9193628223015, 2239.2050821958296, 2242.5963326601204, 2258.762829902853, 2259.378670865517, 2259.6949411829437, 2272.8409011369213, 2276.5333106713083, 2293.6674182243646, 2295.047555264563, 2302.8503147295373, 7672.539647621161, 7706.190849960785, 7728.497647652885, 7737.226277372218, 7760.456768026241, 4500.144972455256, 4578.839740609096, 4591.816327346902, 4598.885027874297, 4610.354550362952, 3069.6469905960653, 3082.1215953453384, 3153.8107713537033, 3168.5564021036844, 3171.6511183769767, 1026.9794604107876, 1047.2459828923163, 1049.2340591368343, 1071.0681706914957, 1082.0, 10191.337563058378, 10266.538005789758, 10271.48642567876, 10276.588936442533, 10291.845622315597, 3935.8622448214173, 3974.642282194616, 3978.522577290744, 3983.661388781986, 4025.8590949316635, 8475.32197424217, 8537.274331681876, 8581.914180858237, 8603.655853765778, 8618.353623478139, 4535.206338890681, 4563.0, 4594.816207351669, 4607.562281583244, 4644.024754801462, 4177.039280965395, 4228.830846766156, 4246.193223287565, 4259.680523960716, 4290.978545107255, 3511.613722490524, 3520.2255503789124, 3542.875999340011, 3549.112721819545, 3578.516900218437, 1006.0995409108807, 1011.7824667696333, 1019.8419245017034, 1028.475477506477, 1028.8919663435381, 1102.090775110537, 1115.1580556679655, 1116.7487315354142, 1167.229628445222, 1208.6796998795326, 7285.890711639329, 7295.051643286339, 7307.963460182665, 7308.451866110063, 7342.70629174827, 1190.839236703034, 1206.9517219311306, 1209.4255228766442, 1214.4777745569313, 1221.9024772202424, 5922.3485416604135, 5923.111533270044, 5951.642901425928, 5953.553483488756, 5993.4905533029305, 8774.429662072072, 9150.08499150093, 9177.495237761854, 9243.861342079874, 9276.860847087299, 8916.420432671985, 8999.415038022507, 9010.098990100938, 9028.0, 9118.908810911806, 7132.572045677276, 7196.532225405436, 7209.423246140296, 7240.674169662378, 7280.0, 7272.309130632581, 7278.272172782679, 7331.41348692114, 7358.300961408658, 7398.778036658909, 8150.144234855492, 8212.384071194803, 8322.916770832457, 8348.415610907177, 8420.5789710513, 8385.1195624461, 8430.283425908867, 8434.704785332484, 8466.449680770731, 8572.3999320047, 6036.939630603638, 6158.599691020069, 6470.676466176767, 6882.277360877236, 6969.54697944632, 7291.927080729125, 7318.377937875341, 7360.77917662471, 7381.188069312264, 7402.888956665546, 6838.93161068383, 7018.192907815666, 7020.22777494465, 7120.750773723102, 7146.678399471933, 6925.757598484029, 6947.5831450113155, 7007.719691212498, 7036.331548502884, 7077.433805295667, 6858.862822743617, 6869.896951545631, 6906.965465172843, 7106.964465177641, 7152.9284707152265, 6510.869782604226, 6515.12045873801, 6525.804225873231, 6561.606303621798, 6564.540482166202, 6394.776182833579, 6489.967550162219, 6495.610263384212, 6504.869902601827, 6533.803985880431], "unit": "ms", "name": "mootools.html", "value": 4454.687814414149}, {"lowerIsBetter": false, "replicates": [345.7631522407151, 349.9755017148799, 352.6720150260257, 356.0990693545331, 358.97128229741617, 6457.870842583157, 6465.9353406465925, 6489.05908643247, 6521.250056243533, 6572.07990881277, 6388.584741991767, 6404.519661025419, 6416.967915160418, 6444.871102577946, 6484.6433446160445, 4914.287428322882, 4922.606191504689, 4925.729084900329, 4927.6550641455115, 4934.777934992916, 4925.82759603414, 4926.950730492685, 4938.234573641092, 4944.8516544503545, 4946.554810067111, 4466.12910482456, 4803.831865884695, 4804.351412559295, 4815.374001379833, 4815.398075240595, 4846.61227101831, 4848.151573474663, 4852.344933433977, 4854.732989685566, 4859.902801943959, 4206.432131662217, 4207.558206388347, 4211.936820947688, 4215.789210539491, 4221.957780422187, 5959.076343166773, 6112.877742445171, 6126.846828829271, 6140.6929653517145, 6144.600600960924, 5653.406392328788, 5694.829155125353, 5713.14302854571, 5718.885622287531, 5722.027255366597, 6845.623490708009, 6853.17761868574, 6866.107406037183, 6880.862382752317, 6881.690323935435, 4710.5289471052965, 4710.5524975127655, 4714.0, 4718.8584342469785, 4726.480087190406, 6875.621840798754, 7050.6827192776445, 7057.929420705778, 7057.964710176468, 7059.470539709491, 4783.736894470838, 4794.9280760787915, 4803.567678908845, 4810.63920205979, 4812.326274321597, 4821.300911367832, 4866.29438731389, 4867.148249056472, 4870.050340183701, 4882.0, 5545.833624991256, 5653.406392328829, 5655.915161272585, 5656.688882111441, 5685.971570142123, 6850.280720524373, 6850.897236541456, 6852.5203235773015, 6868.828279292958, 6894.758683446055, 1676.9077700726334, 1704.377902065737, 1706.6245426006258, 1711.2812618700175, 1716.4678949525687, 1132.2017977325966, 1132.473399869065, 1138.1009002887793, 1153.106342584487, 1170.4966864248454, 6524.934750652527, 6533.673316334164, 6541.672916354163, 6556.114924485133, 6573.835654108686, 6925.203601585781, 6971.268016858258, 6984.196817365966, 6984.546004509691, 6990.790276291719, 6454.515911306671, 6478.805635830932, 6522.249941256721, 6531.510136739764, 6544.051112588743, 3771.962280377216, 3806.5051543299196, 3810.333191691443, 3814.065553939303, 3818.961810381916, 7190.06529151207, 7201.243869393743, 7254.056972593529, 7255.818604534928, 7266.63666816657, 6985.93014069863, 7133.643317834088, 7190.532615380088, 7192.352688257977, 7205.063341765642, 7191.208967013625, 7210.170830354471, 7211.891821622575, 7217.24218957002, 7262.382697470668, 6952.443804495527, 6957.199922009034, 6981.79054628362, 6985.336393042653, 6994.61529615876, 6775.119234499483, 6909.378155965987, 6916.55042422241, 6929.965350173217, 6936.618485983319, 7182.6408679564765, 7233.638318083969, 7240.0, 7254.854902901807, 7282.490225684363, 4825.30033145199, 4829.27560865873, 4831.227003679394, 4831.468538460696, 4841.709497430165, 6872.10662613857, 6978.755743548952, 7004.089468369079, 7009.439244860501, 7157.57054576727, 6939.548929319578, 6974.128233970754, 6990.895136573057, 6999.965000175171, 7008.0, 6917.757878474229, 6948.687309071205, 6976.895346569704, 6983.196932352845, 6990.09128813251, 6690.665466726741, 6807.965960170168, 6810.523263371517, 6818.795436136726, 6825.1127353443735, 6918.515703900679, 6947.166340039228, 6985.755498557526, 6985.79042628722, 6990.056342393712, 6747.325267473213, 6829.658517074027, 6840.486963477859, 6849.691763870737, 6852.314768523108], "unit": "ms", "name": "prototype.html", "value": 5134.152781467682}, {"lowerIsBetter": false, "replicates": [739.1352118021914, 826.4834478450969, 829.2453866981049, 881.8544940084886, 914.1726737302739, 16998.150092495373, 17422.12889355532, 17435.5641108972, 17480.737788933176, 17498.82501174988, 15959.202039898017, 16041.598960026005, 16108.677826443463, 16175.110368929703, 16230.269637866295, 738.3428748413916, 743.1528058013869, 874.873143394209, 875.8423483772918, 877.1360210192987, 885.2386947225381, 885.3050355470957, 887.9822403551957, 890.461270931087, 891.0, 935.8128374325128, 936.7143021378511, 939.746268507506, 940.3981451870808, 942.5993952570165, 926.6339795780628, 930.3766476460754, 931.753085432361, 932.5803388475146, 935.4106912645024, 690.6995456976181, 691.3466773898667, 693.0470602920983, 693.7883945396702, 696.2341424433133, 14469.78295325571, 14659.34032968519, 14661.193634350106, 14695.63260918475, 14733.852661473355, 12811.359432028361, 12869.742605147845, 12956.09307348486, 13125.0, 13135.540256090992, 10936.289141205796, 11434.199606027581, 11597.76804463906, 11652.126090543159, 11804.70488237801, 3754.3805272130066, 3840.116773142165, 3842.269968705965, 3852.903677408059, 3931.76409415436, 45525.54474455246, 45776.77111614454, 45786.54213457889, 45808.0, 45913.31130033085, 10303.433311167808, 10737.51681174349, 10749.57173021002, 10803.459827008775, 10874.72813179661, 18686.532836678918, 18759.531011724543, 18779.530511737317, 18810.81189188118, 18815.153318100718, 7532.322091011725, 7582.507137036075, 7714.382849372037, 7719.729809456642, 7811.882821757678, 4264.744115353089, 4268.317069268965, 4301.784910754513, 4307.913841723148, 4376.14665140301, 3191.920201994969, 3226.080567038383, 3227.5481432598986, 3227.8547465364113, 3228.3704677587643, 591.3879135095156, 602.9909551356733, 605.1074664869283, 613.4969325153331, 613.9508839292846, 649.9220093588799, 650.0541711809401, 658.3021996683435, 667.5160508631203, 702.1433850702135, 7706.653200605986, 7957.482763620462, 8183.263506284463, 8231.259186673227, 8238.423310368216, 613.6285402126244, 662.2781168526329, 695.1831597872581, 698.7240040184099, 708.7554793596202, 3758.267137908136, 4035.3139966205817, 4221.514525829508, 4299.849505267301, 4324.372965919924, 57164.42835571591, 61482.385176148564, 61614.0, 62390.68804655947, 62595.6870215646, 52857.0, 53385.46614533805, 54048.0, 54169.1874621881, 55280.51237694314, 48738.512614874104, 48857.511424886005, 48867.5113248863, 48877.02245955061, 49553.50446495561, 8516.872246916177, 8756.4308319959, 8953.194212520904, 9104.271658267455, 9261.398009129385, 35440.29119417649, 35454.290914182086, 36045.91862244137, 36468.63531364759, 36725.63274367329, 43159.9210019752, 48973.26540101973, 49170.75414622904, 50060.0, 50439.49560504495, 11537.192396532499, 11608.0, 11613.0, 11740.58907938218, 11819.645410637695, 11809.881901180877, 11977.940110299392, 12171.939140304596, 12278.693032673897, 12809.61571152867, 11051.0, 11079.0, 11590.652280431601, 11667.241629294069, 12086.637400877988, 10748.946255268673, 10773.569057237622, 10833.67498975032, 11080.445977701243, 11129.944350278196, 10794.56821727122, 10831.295965762516, 10972.725681858017, 11041.503132358903, 11346.489407976826, 9570.760730981781, 9931.851022234816, 10316.638917637847, 10473.162147028068, 10648.574057037631, 9856.162226210852, 9867.506624668882, 9955.054269844353, 9964.252681049094, 10013.19894408431], "unit": "ms", "name": "yui.html", "value": 6635.728980691575}], "name": "dromaeo_css", "value": 7287.968340050781}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 110.0, 111.0, 112.0, 123.0, 111.0, 111.0, 110.0, 112.0], "unit": "ms", "name": "ai-astar", "value": 111.8}, {"lowerIsBetter": true, "replicates": [152.0, 120.0, 148.0, 151.0, 122.0, 147.0, 148.0, 127.0, 165.0, 126.0], "unit": "ms", "name": "audio-beat-detection", "value": 140.6}, {"lowerIsBetter": true, "replicates": [160.0, 161.0, 161.0, 162.0, 162.0, 162.0, 161.0, 160.0, 164.0, 161.0], "unit": "ms", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [72.0, 71.0, 72.0, 153.0, 73.0, 70.0, 73.0, 72.0, 161.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 89.0}, {"lowerIsBetter": true, "replicates": [91.0, 93.0, 134.0, 92.0, 92.0, 94.0, 140.0, 92.0, 94.0, 134.0], "unit": "ms", "name": "audio-oscillator", "value": 105.6}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 110.0, 110.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.3}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 153.0, 147.0, 147.0, 146.0, 146.0, 146.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 147.0}, {"lowerIsBetter": true, "replicates": [97.0, 95.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 96.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [60.0, 61.0, 59.0, 59.0, 59.0, 62.0, 62.0, 59.0, 61.0, 57.0], "unit": "ms", "name": "json-parse-financial", "value": 59.9}, {"lowerIsBetter": true, "replicates": [64.0, 65.0, 66.0, 63.0, 64.0, 63.0, 64.0, 65.0, 64.0, 64.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 64.2}, {"lowerIsBetter": true, "replicates": [79.0, 80.0, 80.0, 88.0, 81.0, 88.0, 80.0, 82.0, 82.0, 80.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 82.0}, {"lowerIsBetter": true, "replicates": [125.0, 122.0, 123.0, 124.0, 113.0, 121.0, 113.0, 119.0, 112.0, 111.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 118.3}, {"lowerIsBetter": true, "replicates": [136.0, 160.0, 143.0, 147.0, 144.0, 144.0, 141.0, 138.0, 143.0, 144.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 144.0}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 65.0, 65.0, 65.0, 67.0, 64.0, 63.0, 64.0, 72.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 65.3}], "name": "kraken", "value": 1493.9999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [164.12276382734285], "unit": "score", "name": "Richards", "value": 215.095086}, {"lowerIsBetter": false, "replicates": [173.04031839418585], "unit": "score", "name": "DeltaBlue", "value": 382.095922}, {"lowerIsBetter": false, "replicates": [278.08676307007784], "unit": "score", "name": "Encrypt", "value": 957.1868759999999}, {"lowerIsBetter": false, "replicates": [5148.717948717948], "unit": "score", "name": "Decrypt", "value": 51.69850099601596}, {"lowerIsBetter": false, "replicates": [960.6147934678194], "unit": "score", "name": "RayTrace", "value": 770.3285489999998}, {"lowerIsBetter": false, "replicates": [545.8515283842795], "unit": "score", "name": "Earley", "value": 1220.9602159999997}, {"lowerIsBetter": false, "replicates": [11120.87912087912], "unit": "score", "name": "Boyer", "value": 59.92898517786557}, {"lowerIsBetter": false, "replicates": [23581.39534883721], "unit": "score", "name": "RegExp", "value": 38.631513806706096}, {"lowerIsBetter": false, "replicates": [548.1400437636762], "unit": "score", "name": "Splay", "value": 148.6682115768463}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 23032.934452414152}]} 06:47:39 INFO - RETURN: dromaeo_css: 7287.97 06:47:39 INFO - RETURN: kraken: 1494.00 06:47:39 INFO - RETURN: v8_7: 23032.93 06:47:39 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "23032.93"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1494.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7287.97"}}} 06:47:39 INFO - Return code: 0 06:47:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 06:47:39 INFO - # TBPL SUCCESS # 06:47:39 INFO - Running post-action listener: _resource_record_post_action 06:47:39 INFO - Running post-run listener: _resource_record_post_run 06:47:40 INFO - Total resource usage - Wall time: 1223s; CPU: 13.0%; Read bytes: 4096; Write bytes: 513097728; Read time: 16; Write time: 393448 06:47:40 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 236642304; Read time: 0; Write time: 268852 06:47:40 INFO - run-tests - Wall time: 1208s; CPU: 13.0%; Read bytes: 4096; Write bytes: 275562496; Read time: 16; Write time: 124532 06:47:40 INFO - Running post-run listener: _upload_blobber_files 06:47:40 INFO - Blob upload gear active. 06:47:40 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 06:47:40 INFO - Copying logs to upload dir... 06:47:40 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1269.712174 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2015-12-26 06:47:39.946734) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-26 06:47:39.950496) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009966 build_url: 'https://queue.taskcluster.net/v1/task/NMb6CQBfSyiGbV08CnN5oQ/artifacts/public/build/firefox-45.0a2.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-26 06:47:40.002137) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:47:40.002493) ========= 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=dd132779db58144225c4cf24000001c8-1451139335.99602-1995705158 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004613 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-26 06:47:40.051971) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-26 06:47:40.052296) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-26 06:47:40.052581) ========= ========= Total master_lag: 1.08 =========