builder: b2g-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-069 starttime: 1450756469.13 results: success (0) buildid: 20151221173001 builduid: 4145c9ce8e0f446da0eab0a2eba9926e revision: ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.135195) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.135657) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.135931) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006425 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.159631) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.159906) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.173721) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.174077) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004640 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.223099) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.223451) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.223808) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.224089) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-21 19:54:29-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2015-12-21 19:54:29 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.096768 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.333100) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.333431) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022341 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.384082) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:29.384425) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/b2g-inbound --rev ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f --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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-21 19:54:29,943 truncating revision to first 12 chars 2015-12-21 19:54:29,943 Setting DEBUG logging. 2015-12-21 19:54:29,943 attempt 1/10 2015-12-21 19:54:29,943 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/ba95b5fd3a83?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-21 19:54:30,472 unpacking tar archive at: b2g-inbound-ba95b5fd3a83/testing/mozharness/ program finished with exit code 0 elapsedTime=0.814706 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:30.214967) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:30.215299) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:30.223102) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:30.223511) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 19:54:30.224008) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2015-12-21 19:54:30.224288) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'B2G-Inbound', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'B2G-Inbound'] 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:54:30 INFO - MultiFileLogger online at 20151221 19:54:30 in /builds/slave/test-pgo 19:54:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound 19:54:30 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 19:54:30 INFO - {'append_to_log': False, 19:54:30 INFO - 'base_work_dir': '/builds/slave/test-pgo', 19:54:30 INFO - 'blob_upload_branch': 'B2G-Inbound', 19:54:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 19:54:30 INFO - 'branch': 'B2G-Inbound', 19:54:30 INFO - 'buildbot_json_path': 'buildprops.json', 19:54:30 INFO - 'config_files': ('talos/linux_config.py',), 19:54:30 INFO - 'default_actions': ('clobber', 19:54:30 INFO - 'read-buildbot-config', 19:54:30 INFO - 'download-and-extract', 19:54:30 INFO - 'populate-webroot', 19:54:30 INFO - 'create-virtualenv', 19:54:30 INFO - 'install', 19:54:30 INFO - 'run-tests'), 19:54:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:54:30 INFO - 'download_minidump_stackwalk': True, 19:54:30 INFO - 'download_symbols': 'ondemand', 19:54:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:54:30 INFO - 'tooltool.py': '/tools/tooltool.py', 19:54:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:54:30 INFO - '/tools/misc-python/virtualenv.py')}, 19:54:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:54:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:54:30 INFO - 'installer_path': 'installer.exe', 19:54:30 INFO - 'log_level': 'info', 19:54:30 INFO - 'log_name': 'talos', 19:54:30 INFO - 'log_to_console': True, 19:54:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:54:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:54:30 INFO - 'opt_config_files': (), 19:54:30 INFO - 'pip_index': False, 19:54:30 INFO - 'sps_profile': False, 19:54:30 INFO - 'sps_profile_interval': 0, 19:54:30 INFO - 'suite': 'dromaeojs', 19:54:30 INFO - 'system_bits': '64', 19:54:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:54:30 INFO - 'title': 'talos-linux64-ix-069', 19:54:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:54:30 INFO - 'use_talos_json': True, 19:54:30 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 19:54:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:54:30 INFO - 'work_dir': 'build'} 19:54:30 INFO - ##### 19:54:30 INFO - ##### Running clobber step. 19:54:30 INFO - ##### 19:54:30 INFO - Running pre-action listener: _resource_record_pre_action 19:54:30 INFO - Running main action method: clobber 19:54:30 INFO - rmtree: /builds/slave/test-pgo/build 19:54:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 19:54:31 INFO - Running post-action listener: _resource_record_post_action 19:54:31 INFO - ##### 19:54:31 INFO - ##### Running read-buildbot-config step. 19:54:31 INFO - ##### 19:54:31 INFO - Running pre-action listener: _resource_record_pre_action 19:54:31 INFO - Running main action method: read_buildbot_config 19:54:31 INFO - Using buildbot properties: 19:54:31 INFO - { 19:54:31 INFO - "project": "", 19:54:31 INFO - "product": "firefox", 19:54:31 INFO - "script_repo_revision": "production", 19:54:31 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 19:54:31 INFO - "repository": "", 19:54:31 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound pgo talos dromaeojs", 19:54:31 INFO - "buildid": "20151221173001", 19:54:31 INFO - "pgo_build": "True", 19:54:31 INFO - "basedir": "/builds/slave/test-pgo", 19:54:31 INFO - "buildnumber": 140, 19:54:31 INFO - "slavename": "talos-linux64-ix-069", 19:54:31 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 19:54:31 INFO - "platform": "ubuntu64_hw", 19:54:31 INFO - "scheduler": "tests-b2g-inbound-linux64-pgo-talos", 19:54:31 INFO - "branch": "b2g-inbound", 19:54:31 INFO - "repo_path": "integration/b2g-inbound", 19:54:31 INFO - "revision": "ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f", 19:54:31 INFO - "stage_platform": "linux64-pgo", 19:54:31 INFO - "builduid": "4145c9ce8e0f446da0eab0a2eba9926e", 19:54:31 INFO - "slavebuilddir": "test" 19:54:31 INFO - } 19:54:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 19:54:31 INFO - Running post-action listener: _resource_record_post_action 19:54:31 INFO - ##### 19:54:31 INFO - ##### Running download-and-extract step. 19:54:31 INFO - ##### 19:54:31 INFO - Running pre-action listener: _resource_record_pre_action 19:54:31 INFO - Running main action method: download_and_extract 19:54:31 INFO - mkdir: /builds/slave/test-pgo/build/tests 19:54: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')]} 19:54:31 INFO - https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:54:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/test_packages.json 19:54:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/test_packages.json 19:54:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 19:54:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 19:54:32 INFO - Downloaded 1302 bytes. 19:54:32 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 19:54:32 INFO - Using the following test package requirements: 19:54:32 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 19:54:32 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:54:32 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'jsshell-linux-x86_64.zip'], 19:54:32 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:54:32 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 19:54:32 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:54:32 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:54:32 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:54:32 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 19:54:32 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 19:54:32 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:54:32 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:54:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:54:32 INFO - https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:54:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:54:34 INFO - Downloaded 23174933 bytes. 19:54:34 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:54:34 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:34 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:54:35 INFO - Return code: 0 19:54:35 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 19:54:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:54:35 INFO - https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:54:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:54:37 INFO - Downloaded 23174933 bytes. 19:54:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:54:37 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 19:54:37 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:54:38 INFO - Return code: 0 19:54:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:54:38 INFO - https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:54:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 19:54:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 19:54:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 19:54:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:54:39 INFO - Downloaded 11132277 bytes. 19:54:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 19:54:39 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 19:54:39 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 19:54:39 INFO - Return code: 0 19:54: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')]} 19:54:39 INFO - https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:54:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 19:54:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 19:54:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 19:54:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:54:42 INFO - Downloaded 54930086 bytes. 19:54:42 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 19:54:42 INFO - mkdir: /builds/slave/test-pgo/properties 19:54:42 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 19:54:42 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 19:54:42 INFO - Contents: 19:54:42 INFO - build_url:https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 19:54:42 INFO - Running post-action listener: _resource_record_post_action 19:54:42 INFO - Running post-action listener: set_extra_try_arguments 19:54:42 INFO - ##### 19:54:42 INFO - ##### Running populate-webroot step. 19:54:42 INFO - ##### 19:54:42 INFO - Running pre-action listener: _resource_record_pre_action 19:54:42 INFO - Running main action method: populate_webroot 19:54:42 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:54:42 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:54:42 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:54:42 INFO - '--tppagecycles', 19:54:42 INFO - '7'], 19:54:42 INFO - 'tests': ['tsvgm']}}, 19:54:42 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:54:42 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:54:42 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:54:42 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:54:42 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:54:42 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:54:42 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'tests': ['damp', 'tps']}, 19:54:42 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['damp', 'tps']}, 19:54:42 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:54:42 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:54:42 INFO - 'other': {'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'other_l64': {'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'other_nol64': {'tests': ['a11yr', 19:54:42 INFO - 'ts_paint', 19:54:42 INFO - 'tpaint', 19:54:42 INFO - 'sessionrestore', 19:54:42 INFO - 'sessionrestore_no_auto_restore']}, 19:54:42 INFO - 'svgr': {'tests': ['tsvgx', 19:54:42 INFO - 'tsvgr_opacity', 19:54:42 INFO - 'tart', 19:54:42 INFO - 'tscrollx', 19:54:42 INFO - 'cart']}, 19:54:42 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['tsvgx', 19:54:42 INFO - 'tsvgr_opacity', 19:54:42 INFO - 'tart', 19:54:42 INFO - 'tscrollx', 19:54:42 INFO - 'cart']}, 19:54:42 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'tests': ['tp5o']}, 19:54:42 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'talos_options': ['--e10s'], 19:54:42 INFO - 'tests': ['tp5o']}, 19:54:42 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'talos_options': ['--xperf_path', 19:54:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:54:42 INFO - 'tests': ['tp5n']}, 19:54:42 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:54:42 INFO - 'talos_options': ['--e10s', 19:54:42 INFO - '--xperf_path', 19:54:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:54:42 INFO - 'tests': ['tp5n']}}, 19:54:42 INFO - 'talos.zip': {'path': '', 19:54:42 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:54:42 INFO - Running post-action listener: _resource_record_post_action 19:54:42 INFO - ##### 19:54:42 INFO - ##### Running create-virtualenv step. 19:54:42 INFO - ##### 19:54:42 INFO - Running pre-action listener: _resource_record_pre_action 19:54:42 INFO - Running main action method: create_virtualenv 19:54:42 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 19:54:42 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 19:54:42 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 19:54:42 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:54:42 INFO - Using real prefix '/usr' 19:54:42 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 19:54:43 INFO - Installing distribute.............................................................................................................................................................................................done. 19:54:45 INFO - Installing pip.................done. 19:54:45 INFO - Return code: 0 19:54:45 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 19:54:45 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')]} 19:54:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:45 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')]} 19:54:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:45 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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:45 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 19:54:45 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 19:54:45 INFO - Using env: {'DISPLAY': ':0', 19:54:45 INFO - 'HOME': '/home/cltbld', 19:54:45 INFO - 'LANG': 'en_US.UTF-8', 19:54:45 INFO - 'LANGUAGE': 'en_US:en', 19:54:45 INFO - 'LOGNAME': 'cltbld', 19:54:45 INFO - 'MAIL': '/var/mail/cltbld', 19:54:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:45 INFO - 'MOZ_NO_REMOTE': '1', 19:54:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:45 INFO - 'NO_EM_RESTART': '1', 19:54:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:45 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:45 INFO - 'SHELL': '/bin/bash', 19:54:45 INFO - 'SHLVL': '1', 19:54:45 INFO - 'TERM': 'linux', 19:54:45 INFO - 'TMOUT': '86400', 19:54:45 INFO - 'USER': 'cltbld', 19:54:45 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:45 INFO - '_': '/tools/buildbot/bin/python'} 19:54:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:45 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 19:54:45 INFO - Cleaning up... 19:54:45 INFO - Return code: 0 19:54:45 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 19:54:45 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')]} 19:54:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:45 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')]} 19:54:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:45 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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:45 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 19:54:45 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 19:54:45 INFO - Using env: {'DISPLAY': ':0', 19:54:45 INFO - 'HOME': '/home/cltbld', 19:54:45 INFO - 'LANG': 'en_US.UTF-8', 19:54:45 INFO - 'LANGUAGE': 'en_US:en', 19:54:45 INFO - 'LOGNAME': 'cltbld', 19:54:45 INFO - 'MAIL': '/var/mail/cltbld', 19:54:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:45 INFO - 'MOZ_NO_REMOTE': '1', 19:54:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:45 INFO - 'NO_EM_RESTART': '1', 19:54:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:45 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:45 INFO - 'SHELL': '/bin/bash', 19:54:45 INFO - 'SHLVL': '1', 19:54:45 INFO - 'TERM': 'linux', 19:54:45 INFO - 'TMOUT': '86400', 19:54:45 INFO - 'USER': 'cltbld', 19:54:45 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:45 INFO - '_': '/tools/buildbot/bin/python'} 19:54:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:45 INFO - Downloading/unpacking psutil>=0.7.1 19:54:45 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 19:54:45 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 19:54:45 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 19:54:45 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 19:54:45 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 19:54:45 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 19:54:47 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 19:54:47 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:54:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 19:54:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:54:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:54:47 INFO - Installing collected packages: psutil 19:54:47 INFO - Running setup.py install for psutil 19:54:47 INFO - building 'psutil._psutil_linux' extension 19:54:47 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 19:54:47 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 19:54:47 INFO - building 'psutil._psutil_posix' extension 19:54:47 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 19:54:48 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 19:54:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:54:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:54:48 INFO - Successfully installed psutil 19:54:48 INFO - Cleaning up... 19:54:48 INFO - Return code: 0 19:54:48 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 19:54:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:54:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:54:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 19:54:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 19:54:48 INFO - Using env: {'DISPLAY': ':0', 19:54:48 INFO - 'HOME': '/home/cltbld', 19:54:48 INFO - 'LANG': 'en_US.UTF-8', 19:54:48 INFO - 'LANGUAGE': 'en_US:en', 19:54:48 INFO - 'LOGNAME': 'cltbld', 19:54:48 INFO - 'MAIL': '/var/mail/cltbld', 19:54:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:48 INFO - 'MOZ_NO_REMOTE': '1', 19:54:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:48 INFO - 'NO_EM_RESTART': '1', 19:54:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:48 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:48 INFO - 'SHELL': '/bin/bash', 19:54:48 INFO - 'SHLVL': '1', 19:54:48 INFO - 'TERM': 'linux', 19:54:48 INFO - 'TMOUT': '86400', 19:54:48 INFO - 'USER': 'cltbld', 19:54:48 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:48 INFO - '_': '/tools/buildbot/bin/python'} 19:54:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:48 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:54:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:54:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:54:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:54:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:54:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:54:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:54:50 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:54:50 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:54:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:54:50 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:54:50 INFO - Installing collected packages: mozsystemmonitor 19:54:50 INFO - Running setup.py install for mozsystemmonitor 19:54:50 INFO - Successfully installed mozsystemmonitor 19:54:50 INFO - Cleaning up... 19:54:50 INFO - Return code: 0 19:54:50 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 19:54: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')]} 19:54:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54: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')]} 19:54:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:50 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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:50 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 19:54:50 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 19:54:50 INFO - Using env: {'DISPLAY': ':0', 19:54:50 INFO - 'HOME': '/home/cltbld', 19:54:50 INFO - 'LANG': 'en_US.UTF-8', 19:54:50 INFO - 'LANGUAGE': 'en_US:en', 19:54:50 INFO - 'LOGNAME': 'cltbld', 19:54:50 INFO - 'MAIL': '/var/mail/cltbld', 19:54:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:50 INFO - 'MOZ_NO_REMOTE': '1', 19:54:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:50 INFO - 'NO_EM_RESTART': '1', 19:54:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:50 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:50 INFO - 'SHELL': '/bin/bash', 19:54:50 INFO - 'SHLVL': '1', 19:54:50 INFO - 'TERM': 'linux', 19:54:50 INFO - 'TMOUT': '86400', 19:54:50 INFO - 'USER': 'cltbld', 19:54:50 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:50 INFO - '_': '/tools/buildbot/bin/python'} 19:54:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:50 INFO - Downloading/unpacking blobuploader==1.2.4 19:54:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:54:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:54:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:54:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:54:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:54:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:54:52 INFO - Downloading blobuploader-1.2.4.tar.gz 19:54:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:54:52 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:54:52 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:54:52 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 19:54:52 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 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 19:54:52 INFO - Downloading docopt-0.6.1.tar.gz 19:54:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:54:52 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 19:54:52 INFO - Installing collected packages: blobuploader, requests, docopt 19:54:52 INFO - Running setup.py install for blobuploader 19:54:52 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:54:53 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 19:54:53 INFO - Running setup.py install for requests 19:54:53 INFO - Running setup.py install for docopt 19:54:53 INFO - Successfully installed blobuploader requests docopt 19:54:53 INFO - Cleaning up... 19:54:53 INFO - Return code: 0 19:54:53 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:54:53 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')]} 19:54:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:53 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')]} 19:54:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54:53 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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:53 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 19:54:53 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 19:54:53 INFO - Using env: {'DISPLAY': ':0', 19:54:53 INFO - 'HOME': '/home/cltbld', 19:54:53 INFO - 'LANG': 'en_US.UTF-8', 19:54:53 INFO - 'LANGUAGE': 'en_US:en', 19:54:53 INFO - 'LOGNAME': 'cltbld', 19:54:53 INFO - 'MAIL': '/var/mail/cltbld', 19:54:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:53 INFO - 'MOZ_NO_REMOTE': '1', 19:54:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:53 INFO - 'NO_EM_RESTART': '1', 19:54:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:53 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:53 INFO - 'SHELL': '/bin/bash', 19:54:53 INFO - 'SHLVL': '1', 19:54:53 INFO - 'TERM': 'linux', 19:54:53 INFO - 'TMOUT': '86400', 19:54:53 INFO - 'USER': 'cltbld', 19:54:53 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:53 INFO - '_': '/tools/buildbot/bin/python'} 19:54:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:54:53 INFO - Running setup.py (path:/tmp/pip-RYsbTo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:54:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:54:53 INFO - Running setup.py (path:/tmp/pip-LrvVc2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:54:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:54:53 INFO - Running setup.py (path:/tmp/pip-yep_2M-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:54:53 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:54:53 INFO - Running setup.py (path:/tmp/pip-FZFBHB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:54:54 INFO - Running setup.py (path:/tmp/pip-GECHIi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:54:54 INFO - Running setup.py (path:/tmp/pip-B0QpDb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:54:54 INFO - Running setup.py (path:/tmp/pip-yXViMA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:54:54 INFO - Running setup.py (path:/tmp/pip-WXmX5w-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:54:54 INFO - Running setup.py (path:/tmp/pip-60mSaY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:54:54 INFO - Running setup.py (path:/tmp/pip-8gF68w-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:54:54 INFO - Running setup.py (path:/tmp/pip-DJee12-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:54:54 INFO - Running setup.py (path:/tmp/pip-aqv61_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:54:54 INFO - Running setup.py (path:/tmp/pip-LUu0IR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:54:54 INFO - Running setup.py (path:/tmp/pip-Xi26T7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:54:54 INFO - Running setup.py (path:/tmp/pip-M76NYo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:54:54 INFO - Running setup.py (path:/tmp/pip-FeplkK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:54:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:54:54 INFO - Running setup.py (path:/tmp/pip-JMLn0Q-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:54:54 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:54:54 INFO - Running setup.py install for manifestparser 19:54:55 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for mozcrash 19:54:55 INFO - Running setup.py install for mozdebug 19:54:55 INFO - Running setup.py install for mozdevice 19:54:55 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for mozfile 19:54:55 INFO - Running setup.py install for mozhttpd 19:54:55 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for mozinfo 19:54:55 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for mozInstall 19:54:55 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for mozleak 19:54:55 INFO - Running setup.py install for mozlog 19:54:55 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 19:54:55 INFO - Running setup.py install for moznetwork 19:54:56 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Running setup.py install for mozprocess 19:54:56 INFO - Running setup.py install for mozprofile 19:54:56 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Running setup.py install for mozrunner 19:54:56 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Running setup.py install for mozscreenshot 19:54:56 INFO - Running setup.py install for moztest 19:54:56 INFO - Running setup.py install for mozversion 19:54:56 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 19:54:56 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:54:56 INFO - Cleaning up... 19:54:56 INFO - Return code: 0 19:54:56 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:54: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')]} 19:54:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:54:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54: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')]} 19:54:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:54:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:54: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', '-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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:54:56 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 19:54:56 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 19:54:56 INFO - Using env: {'DISPLAY': ':0', 19:54:56 INFO - 'HOME': '/home/cltbld', 19:54:56 INFO - 'LANG': 'en_US.UTF-8', 19:54:56 INFO - 'LANGUAGE': 'en_US:en', 19:54:56 INFO - 'LOGNAME': 'cltbld', 19:54:56 INFO - 'MAIL': '/var/mail/cltbld', 19:54:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:54:56 INFO - 'MOZ_NO_REMOTE': '1', 19:54:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:54:56 INFO - 'NO_EM_RESTART': '1', 19:54:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:54:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:54:56 INFO - 'PWD': '/builds/slave/test-pgo', 19:54:56 INFO - 'SHELL': '/bin/bash', 19:54:56 INFO - 'SHLVL': '1', 19:54:56 INFO - 'TERM': 'linux', 19:54:56 INFO - 'TMOUT': '86400', 19:54:56 INFO - 'USER': 'cltbld', 19:54:56 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:54:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:54:56 INFO - '_': '/tools/buildbot/bin/python'} 19:54:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:54:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:54:56 INFO - Running setup.py (path:/tmp/pip-HRaon6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:54:57 INFO - Running setup.py (path:/tmp/pip-HjxLZQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:54:57 INFO - Running setup.py (path:/tmp/pip-bh2wsd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:54:57 INFO - Running setup.py (path:/tmp/pip-EH4urA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:54:57 INFO - Running setup.py (path:/tmp/pip-9ETnPL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:54:57 INFO - Running setup.py (path:/tmp/pip-IyTODS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:54:57 INFO - Running setup.py (path:/tmp/pip-uC2n_m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:54:57 INFO - Running setup.py (path:/tmp/pip-QAY2Sr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:54:57 INFO - Running setup.py (path:/tmp/pip-g7YTJS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:54:57 INFO - Running setup.py (path:/tmp/pip-DP3c3C-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:54:57 INFO - Running setup.py (path:/tmp/pip-gSF9Kx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:54:57 INFO - Running setup.py (path:/tmp/pip-1o97LE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:54:57 INFO - Running setup.py (path:/tmp/pip-VKXOgG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:54:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:54:57 INFO - Running setup.py (path:/tmp/pip-YWamQi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:54:57 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)) 19:54:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:54:57 INFO - Running setup.py (path:/tmp/pip-hJjXCX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:54:58 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)) 19:54:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:54:58 INFO - Running setup.py (path:/tmp/pip-2M0nKX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:54:58 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)) 19:54:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:54:58 INFO - Running setup.py (path:/tmp/pip-Ec7Xe1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:54:58 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)) 19:54:58 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)) 19:54:58 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)) 19:54:58 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)) 19:54:58 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)) 19:54:58 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)) 19:54:58 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:54:58 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 19:54:58 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 19:54:58 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 19:54:58 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 19:54:58 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 19:54:58 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 19:54:59 INFO - Downloading blessings-1.5.1.tar.gz 19:54:59 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 19:54:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 19:54:59 INFO - Installing collected packages: blessings 19:54:59 INFO - Running setup.py install for blessings 19:55:00 INFO - Successfully installed blessings 19:55:00 INFO - Cleaning up... 19:55:00 INFO - Return code: 0 19:55:00 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 19:55:00 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:55:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:55:00 INFO - Reading from file tmpfile_stdout 19:55:00 INFO - Current package versions: 19:55:00 INFO - argparse == 1.2.1 19:55:00 INFO - blessings == 1.5.1 19:55:00 INFO - blobuploader == 1.2.4 19:55:00 INFO - docopt == 0.6.1 19:55:00 INFO - manifestparser == 1.1 19:55:00 INFO - mozInstall == 1.12 19:55:00 INFO - mozcrash == 0.16 19:55:00 INFO - mozdebug == 0.1 19:55:00 INFO - mozdevice == 0.47 19:55:00 INFO - mozfile == 1.2 19:55:00 INFO - mozhttpd == 0.7 19:55:00 INFO - mozinfo == 0.9 19:55:00 INFO - mozleak == 0.1 19:55:00 INFO - mozlog == 3.1 19:55:00 INFO - moznetwork == 0.27 19:55:00 INFO - mozprocess == 0.22 19:55:00 INFO - mozprofile == 0.28 19:55:00 INFO - mozrunner == 6.11 19:55:00 INFO - mozscreenshot == 0.1 19:55:00 INFO - mozsystemmonitor == 0.0 19:55:00 INFO - moztest == 0.7 19:55:00 INFO - mozversion == 1.4 19:55:00 INFO - psutil == 3.1.1 19:55:00 INFO - requests == 1.2.3 19:55:00 INFO - wsgiref == 0.1.2 19:55:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:55: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')]} 19:55:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:55:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55: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')]} 19:55:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:55:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55: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', '-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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:55:00 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 19:55:00 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 19:55:00 INFO - Using env: {'DISPLAY': ':0', 19:55:00 INFO - 'HOME': '/home/cltbld', 19:55:00 INFO - 'LANG': 'en_US.UTF-8', 19:55:00 INFO - 'LANGUAGE': 'en_US:en', 19:55:00 INFO - 'LOGNAME': 'cltbld', 19:55:00 INFO - 'MAIL': '/var/mail/cltbld', 19:55:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:55:00 INFO - 'MOZ_NO_REMOTE': '1', 19:55:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:55:00 INFO - 'NO_EM_RESTART': '1', 19:55:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:55:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:55:00 INFO - 'PWD': '/builds/slave/test-pgo', 19:55:00 INFO - 'SHELL': '/bin/bash', 19:55:00 INFO - 'SHLVL': '1', 19:55:00 INFO - 'TERM': 'linux', 19:55:00 INFO - 'TMOUT': '86400', 19:55:00 INFO - 'USER': 'cltbld', 19:55:00 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:55:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:55:00 INFO - '_': '/tools/buildbot/bin/python'} 19:55:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:55:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 19:55:00 INFO - Cleaning up... 19:55:00 INFO - Return code: 0 19:55:00 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 19:55: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')]} 19:55:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:55:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55: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')]} 19:55:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:55:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:55: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', 'jsonschema'] in /builds/slave/test-pgo/build 19:55: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 jsonschema 19:55:00 INFO - Using env: {'DISPLAY': ':0', 19:55:00 INFO - 'HOME': '/home/cltbld', 19:55:00 INFO - 'LANG': 'en_US.UTF-8', 19:55:00 INFO - 'LANGUAGE': 'en_US:en', 19:55:00 INFO - 'LOGNAME': 'cltbld', 19:55:00 INFO - 'MAIL': '/var/mail/cltbld', 19:55:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:55:00 INFO - 'MOZ_NO_REMOTE': '1', 19:55:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:55:00 INFO - 'NO_EM_RESTART': '1', 19:55:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:55:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:55:00 INFO - 'PWD': '/builds/slave/test-pgo', 19:55:00 INFO - 'SHELL': '/bin/bash', 19:55:00 INFO - 'SHLVL': '1', 19:55:00 INFO - 'TERM': 'linux', 19:55:00 INFO - 'TMOUT': '86400', 19:55:00 INFO - 'USER': 'cltbld', 19:55:00 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:55:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:55:00 INFO - '_': '/tools/buildbot/bin/python'} 19:55:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:55:00 INFO - Downloading/unpacking jsonschema 19:55:00 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 19:55:00 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 19:55:00 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 19:55:00 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 19:55:00 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 19:55:00 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 19:55:02 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 19:55:02 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 19:55:02 INFO - Downloading/unpacking functools32 (from jsonschema) 19:55: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 19:55: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 19:55: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 19:55: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 19:55: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 19:55: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 19:55:02 INFO - Downloading functools32-3.2.3-2.tar.gz 19:55:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 19:55:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 19:55:02 INFO - warning: no files found matching '*.txt' 19:55:02 INFO - no previously-included directories found matching 'build' 19:55:02 INFO - no previously-included directories found matching 'dist' 19:55:02 INFO - no previously-included directories found matching '.git*' 19:55:02 INFO - Installing collected packages: jsonschema, functools32 19:55:02 INFO - Running setup.py install for functools32 19:55:02 INFO - warning: no files found matching '*.txt' 19:55:02 INFO - no previously-included directories found matching 'build' 19:55:02 INFO - no previously-included directories found matching 'dist' 19:55:02 INFO - no previously-included directories found matching '.git*' 19:55:02 INFO - Successfully installed jsonschema functools32 19:55:02 INFO - Cleaning up... 19:55:02 INFO - Return code: 0 19:55:02 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 19:55:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:55:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:55:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:55:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:55:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:55:02 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 0x7f1c1e515f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc408a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd10630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, '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': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', '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 19:55:02 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 19:55:02 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 19:55:02 INFO - Using env: {'DISPLAY': ':0', 19:55:02 INFO - 'HOME': '/home/cltbld', 19:55:02 INFO - 'LANG': 'en_US.UTF-8', 19:55:02 INFO - 'LANGUAGE': 'en_US:en', 19:55:02 INFO - 'LOGNAME': 'cltbld', 19:55:02 INFO - 'MAIL': '/var/mail/cltbld', 19:55:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:55:02 INFO - 'MOZ_NO_REMOTE': '1', 19:55:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:55:02 INFO - 'NO_EM_RESTART': '1', 19:55:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:55:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:55:02 INFO - 'PWD': '/builds/slave/test-pgo', 19:55:02 INFO - 'SHELL': '/bin/bash', 19:55:02 INFO - 'SHLVL': '1', 19:55:02 INFO - 'TERM': 'linux', 19:55:02 INFO - 'TMOUT': '86400', 19:55:02 INFO - 'USER': 'cltbld', 19:55:02 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:55:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:55:02 INFO - '_': '/tools/buildbot/bin/python'} 19:55:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:55:03 INFO - Downloading/unpacking flake8 19:55: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 19:55: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 19:55: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 19:55: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 19:55: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 19:55: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 19:55:04 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 19:55:04 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 19:55:04 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 19:55:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:55:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:55:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:55:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:55:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:55:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:55:05 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 19:55:05 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 19:55:05 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 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 19:55:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 19:55:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 19:55:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:55:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:55:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:55:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:55:05 INFO - no previously-included directories found matching 'docs/_build' 19:55:05 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 19:55:05 INFO - Running setup.py install for pep8 19:55:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:55:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:55:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:55:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:55:05 INFO - no previously-included directories found matching 'docs/_build' 19:55:05 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 19:55:05 INFO - Successfully installed flake8 mccabe pyflakes pep8 19:55:05 INFO - Cleaning up... 19:55:05 INFO - Return code: 0 19:55:05 INFO - Running post-action listener: _resource_record_post_action 19:55:05 INFO - Running post-action listener: _start_resource_monitoring 19:55:05 INFO - Starting resource monitoring. 19:55:05 INFO - ##### 19:55:05 INFO - ##### Running install step. 19:55:05 INFO - ##### 19:55:05 INFO - Running pre-action listener: _resource_record_pre_action 19:55:05 INFO - Running main action method: install 19:55:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:55:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:55:05 INFO - Reading from file tmpfile_stdout 19:55:05 INFO - Detecting whether we're running mozinstall >=1.0... 19:55:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 19:55:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 19:55:06 INFO - Reading from file tmpfile_stdout 19:55:06 INFO - Output received: 19:55:06 INFO - Usage: mozinstall [options] installer 19:55:06 INFO - Options: 19:55:06 INFO - -h, --help show this help message and exit 19:55:06 INFO - -d DEST, --destination=DEST 19:55:06 INFO - Directory to install application into. [default: 19:55:06 INFO - "/builds/slave/test-pgo"] 19:55:06 INFO - --app=APP Application being installed. [default: firefox] 19:55:06 INFO - mkdir: /builds/slave/test-pgo/build/application 19:55:06 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 19:55:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 19:55:21 INFO - Reading from file tmpfile_stdout 19:55:21 INFO - Output received: 19:55:21 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 19:55:21 INFO - Running post-action listener: _resource_record_post_action 19:55:21 INFO - ##### 19:55:21 INFO - ##### Running run-tests step. 19:55:21 INFO - ##### 19:55:21 INFO - Running pre-action listener: _resource_record_pre_action 19:55:21 INFO - Running main action method: run_tests 19:55:21 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 19:55:21 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 19:55:21 INFO - Python 2.7.3 19:55:21 INFO - Return code: 0 19:55:21 INFO - grabbing minidump binary from tooltool 19:55:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:55:21 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 0xda1840>, '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 0xd0e6b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd0eb60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 19:55:21 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 19:55:21 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 19:55:21 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:55:21 INFO - Return code: 0 19:55:21 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 19:55:21 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 19:55:21 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 19:55:21 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 19:55:21 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 19:55:21 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 19:55:21 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 19:55:22 INFO - Return code: 0 19:55:22 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'B2G-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 19:55:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName B2G-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-069 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 19:55:22 INFO - Using env: {'DISPLAY': ':0', 19:55:22 INFO - 'HOME': '/home/cltbld', 19:55:22 INFO - 'LANG': 'en_US.UTF-8', 19:55:22 INFO - 'LANGUAGE': 'en_US:en', 19:55:22 INFO - 'LOGNAME': 'cltbld', 19:55:22 INFO - 'MAIL': '/var/mail/cltbld', 19:55:22 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:55:22 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 19:55:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:55:22 INFO - 'MOZ_NO_REMOTE': '1', 19:55:22 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:55:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:55:22 INFO - 'NO_EM_RESTART': '1', 19:55:22 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:55:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:55:22 INFO - 'PWD': '/builds/slave/test-pgo', 19:55:22 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 19:55:22 INFO - 'SHELL': '/bin/bash', 19:55:22 INFO - 'SHLVL': '1', 19:55:22 INFO - 'TERM': 'linux', 19:55:22 INFO - 'TMOUT': '86400', 19:55:22 INFO - 'USER': 'cltbld', 19:55:22 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221', 19:55:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:55:22 INFO - '_': '/tools/buildbot/bin/python'} 19:55:22 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'B2G-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 19:55:23 INFO - mozversion application_buildid: 20151221173001 19:55:23 INFO - mozversion application_changeset: ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f 19:55:23 INFO - mozversion application_display_name: Nightly 19:55:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:55:23 INFO - mozversion application_name: Firefox 19:55:23 INFO - mozversion application_remotingname: firefox 19:55:23 INFO - mozversion application_repository: https://hg.mozilla.org/integration/b2g-inbound 19:55:23 INFO - mozversion application_vendor: Mozilla 19:55:23 INFO - mozversion application_version: 46.0a1 19:55:23 INFO - mozversion platform_buildid: 20151221173001 19:55:23 INFO - mozversion platform_changeset: ba95b5fd3a837fc17a46526c7c24e8cfe1e5ad4f 19:55:23 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/b2g-inbound 19:55:23 INFO - mozversion platform_version: 46.0a1 19:55:23 INFO - using testdate: 1450756523 19:55:23 INFO - actual date: 1450756523 19:55:23 INFO - starting webserver on 'localhost:41437' 19:55:23 INFO - SUITE-START | Running 3 tests 19:55:23 INFO - TEST-START | dromaeo_css 19:55:23 INFO - operating with platform_type : linux_ 19:55:23 INFO - Initialising browser for dromaeo_css test... 19:55:23 INFO - TEST-INFO | started process 26384 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpYX6Bgz/profile http://localhost:41437/getInfo.html) 19:55:27 INFO - PROCESS | 26384 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 19:55:27 INFO - PROCESS | 26384 | __metrics Screen width/height:1600/1200 19:55:27 INFO - PROCESS | 26384 | colorDepth:24 19:55:27 INFO - PROCESS | 26384 | Browser inner width/height: 1024/697 19:55:27 INFO - PROCESS | 26384 | __metrics 19:55:27 INFO - PROCESS | 26384 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 19:55:27 INFO - PROCESS | 26384 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:55:28 INFO - TEST-INFO | 26384: exit 0 19:55:28 INFO - Browser initialized. 19:55:28 INFO - Running cycle 1/1 for dromaeo_css test... 19:55:28 INFO - TEST-INFO | started process 26479 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpYX6Bgz/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:55:40 INFO - PROCESS | 26479 | RSS: Main: 150413312 19:55:40 INFO - PROCESS | 26479 | 19:56:32 INFO - PROCESS | 26479 | 1450756592198 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] 19:58:40 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41437/tests/dromaeo/cssquery-ext.html) 19:58:42 INFO - PROCESS | 26479 | RSS: Main: 256741376 19:58:42 INFO - PROCESS | 26479 | 20:01:44 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-ext.html (next: http://localhost:41437/tests/dromaeo/cssquery-jquery.html) 20:01:45 INFO - PROCESS | 26479 | RSS: Main: 231768064 20:01:45 INFO - PROCESS | 26479 | 20:04:46 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41437/tests/dromaeo/cssquery-mootools.html) 20:04:47 INFO - PROCESS | 26479 | RSS: Main: 224641024 20:04:47 INFO - PROCESS | 26479 | 20:07:49 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41437/tests/dromaeo/cssquery-prototype.html) 20:07:49 INFO - PROCESS | 26479 | RSS: Main: 211247104 20:07:49 INFO - PROCESS | 26479 | 20:10:52 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41437/tests/dromaeo/cssquery-yui.html) 20:10:53 INFO - PROCESS | 26479 | RSS: Main: 215056384 20:10:53 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | Cycle 1(1): loaded http://localhost:41437/tests/dromaeo/cssquery-yui.html (next: http://localhost:41437/tests/dromaeo/cssquery-dojo.html) 20:13:55 INFO - PROCESS | 26479 | RSS: Main: 258969600 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | __start_tp_report 20:13:55 INFO - PROCESS | 26479 | _x_x_mozilla_page_load 20:13:55 INFO - PROCESS | 26479 | _x_x_mozilla_page_load_details 20:13:55 INFO - PROCESS | 26479 | |i|pagename|runs| 20:13:55 INFO - PROCESS | 26479 | |0;dojo.html;3142.5443310719943;3205.0384884534633;3236.0615421527773;3238.8542515586796;3269.7384209263255;5220.504052115052;5357.946420535794;5407.080796264635;5448.264484294619;5507.036268652984;5358.678479291245;5384.515393614574;5407.729613519328;5467.20725494803;5559.999200143972;4865.318855360252;4914.0908931847725;4928.950710492885;4935.901281974358;5042.168042273021;5012.774425150858;5030.57240134589;5073.771680274396;5090.287359769635;5145.048166089286;4795.928061079087;4877.3903262092235;4920.950790492085;4958.652894297401;4989.975050124763;4889.804407823683;4910.312556242129;4912.70523768575;4920.729359885205;4929.211326187793;4837.516248375135;4870.780814863339;4873.171560834667;4880.6095512358925;4909.754512274408;5116.386033675983;5219.295395121648;5226.268322434824;5250.871062721533;5299.205119232108;5834.941650583482;5848.619839710405;5849.385814489502;5849.795257165979;5877.38287479817;5877.9412205877825;5879.7648094076185;5879.853003674943;5886.764529418818;5888;5247.63266571344;5319.867003324909;5401.378841433286;5425.755840987165;5499.780008799643;5954.910676339859;5969.194158788595;5986.580939334205;6008.8798224036145;6010.128531362928;5764.7117644117625;5765.4811067004175;5765.654060756284;5769.798057067983;5770.826875193751;5605.159226116115;5690.715464226772;5728.427157284238;5811.506021988093;5844.386339434298;5770.711464426762;5796.855078623068;5832.883342333214;5836.591438599342;5877.853053673607;5837.503812175928;5838.883222335529;5839.824805255764;5846;5846.239988801429;4391.055922976575;4406.625436837905;4490.101979604092;4492.528284530143;4499.88750281239;4000.4199391088127;4007.438958545806;4028.3554631258858;4030.3349947258375;4071.0229544909007;5429.809956651498;5433.1850222466155;5436.320459942507;5436.891262174734;5438.211459338374;5578.219049333096;5626.97186514073;5680.460356266148;5859.44335288147;5864.970675146682;5295.046891559557;5318.521333080042;5373.462653734673;5375.596830237748;5418.945810541844;5049.873753156127;5071.721055341918;5075.771590278447;5083.466236045236;5124.385073791094;5791.7683292667825;5905.43898329658;5908.881822363529;5932.2881254248905;5938.970305148447;5749.367569567261;5755.424457554211;5756.856078598069;5917.437843404869;5919.112133180058;5944.910826337522;5967.37342579023;5969.641821490724;5978.521718262616;5980.252468441445;5676.801311954062;5782.710864456844;5782.884342313046;5794.1308803679785;5797.797077102281;5656.773729050957;5732.942670573241;5750.539956803529;5753;5824.271966004249;5716.514096301695;5767.971160144172;5770;5773.22061521706;5782.421757824352;5755.913661295001;5757.424257574209;5765.509931655856;5765.94234057654;5768.769249229984;5426.1318189091135;5443.101888188405;5503.752331145028;5521.861953451035;5559.972200139136;5723.971380143239;5733.226014487991;5734.655920644775;5739.799107031401;5770.105633626795;5545.722713864371;5602.3837377887585;5607.299087614048;5616.85957851057;5631.971840140773 20:13:55 INFO - PROCESS | 26479 | |1;ext.html;577.7573419163954;607.0469363099935;610.282917571853;616.3743800042957;619.4239357397619;29710.257243568896;30378.84810575944;30397.696023039764;30422.39155216897;30438;31123.533147002814;36521.63478365215;36856;36976;37001.62998370022;8679.088695686942;8826.205641492264;8833.20501154896;8840.513771742551;8851.468911865277;7755.689772409097;8544.18830211132;8648.524331161783;8658.696945606906;8659.26396256319;7691.730789422371;10403.73990650236;10620.150387968944;10631.308964917256;10648.041676249137;10266.691999240034;10289.176865850788;10378.377297362182;10384;10396.168306535497;7743.496672716312;7919.802004949865;10117.797644047077;10256.282060255786;10353.223508236912;39342.803285983675;39378.80310598428;39420.802895985624;39704.60295397038;39793.60206397928;3089.1813669377634;3128.9530657040164;3211.1490455029434;3369.7641165118453;3543.5747710274672;29595.85202073976;29875.551866722017;30053.248668783235;30197;30418.239544011576;3937.1928754605237;3956.8021598920227;3983.701222408302;4013.6187062229333;4058.188362327546;409885;411953;414429;414622.999999997;415175;59177.704111479165;59300.70349648224;59618;59777;59904;63694.681526593;63979.680101599195;64112.35887641157;64126.67936660287;64230.6788466064;14702.63243418923;14891.627709307353;14923.32845021955;15082.849171508364;15115.244237788067;10421;10457.26799124054;10487.580496780196;10487.895121048845;10487.947560262302;20268.290609828586;20620.69068963967;20649;20658.276960306317;20685.172593096107;7909.406794490321;7989.600519974094;8043.517388956681;8149.7147599833725;8182.304504117216;938.6151677812064;961.1685891703626;962.8507581324906;1016.2733645443543;1062.0282441566035;28070.2982425441;28285.717142828307;28378.716212837608;28617.14148575546;28692.71307286942;962.5812771444444;1013.7110923386947;1045.7960697663882;1109.5506319940275;1177.3171560494893;13141.408636611375;13299.800502992462;13399.129056611484;13498.797518037041;13504.257265850276;248996;249008;251291;251332;251945;46350.53649463462;46601;46736.7663161682;46749.06501869944;46759;1310.9475620975054;1349.4804500267467;1352.1819299323963;1352.8173696551037;1358.8505264420905;25128.874355628104;26054.478910422065;26060.218193454228;26140.346491337106;26179.476410471303;42096.579034209266;42106.368404473345;42327;42388.15223695447;42412.36381454219;297810;297928;299551;299857;300230;31581.684183157875;44342.77828610836;44509.77745111254;44863.55136448594;45435;41286.38070428886;41586.168276634904;41659.37510937278;41770.791146044074;42066.789666051474;34716.47925281173;34736.478952815225;35085.82457087698;35419.645803541636;35477.467837982964;39430;39953.2009359817;40600.79699601601;40608.314835923586;41566.804149481315;34321.82839085789;34809;35000;35015.82492087523;35038.299234015685;27889.721102788713;35511.82244088763;37293.440598391586;37500.812495937345;37806.81096594499;24195;24604.261872143863;24629.876850615634;24670.13654522083;24712.876435617705 20:13:55 INFO - PROCESS | 26479 | |2;jquery.html;329.59624460036446;340.70869406657295;354.2313180398535;355.5910702691904;359.6331741623544;14109.223992680398;14380.496682616083;15858.60353491162;16226;17068.231929563168;16312.510624681248;16329.918350408261;16588.419405320816;16589;16590.08754518501;4534.229181039214;4700.247960326348;4703.882402939937;4707.364505791726;4709.152352576535;3753.7935413552245;3829.808509574524;4688.64835137366;5390.568754499631;5553.055980483307;5513.558915286768;5536.252605898213;5537.778488860441;5542.362628297737;5546.972265138668;5502.477264659851;5964.284285885678;5965.1946987156825;5966.075258334965;5987.251593550806;5359.276497672803;5359.464053594648;5363.141897296453;5363.195520671891;5381.112116500773;12768.553100641433;13233.602991910258;13270.933645331712;13350.46598136083;16600.750988735057;2119.3218170185546;2159.7948194921455;2175.59751445983;2205.195103787122;2216.3018649125474;9283.396579222397;9291.907080929172;9489.66786162481;12682.175658582162;12896.419661115273;1663.4926347464018;1840.3098837935775;1866.5520275134006;1872.522506760781;1973.329068116847;52876.471235287536;53039.73480132574;53848.19227711587;54227.45772542303;55054.44945550573;9454.196393306509;9466.668666596635;9497.10057988405;9500.23998080152;9504.572294246636;11994.34031128279;12016.459259333176;12021.098417618714;12023.879761202452;12066.396680165957;7299.598522081336;7321.926780732231;7329.340359367682;7337.229590892986;7353.264673532711;7259.274072592699;7313.670884810196;7314.08573928259;7347.63261836906;7353.889691654629;4030.1133750574827;4055.878323650295;4071.3689378146437;4082.755034697928;4083.8774836754947;1580.2188148857863;1626.6258760485155;1649.653572749712;1728.6024214430752;1776.644671065792;922.5940586142076;950.9429434233969;979.8040391921644;990.0149351395407;1047.1099565369375;14464.047353607339;16492.25784839685;16567.585810354838;17085.658286834194;17107.91446042762;919.2691810011057;926.0554234680588;941.4351389166583;957.1337939165066;981.4798156976814;8975.102489751103;9266.536673166314;9310.906890931139;9460.479673618018;9488.383255088396;537247;542825;543438;545053;546592;61063.38936610666;79794.6010269945;83170.58414707887;84435;85102;1095.5124969388546;1109.1237922041496;1121.6915348279126;1137.8008848451652;1138.743782648914;14717.33771980242;14803.629909252355;15557.377704891678;15807.68384632324;16070.116143612213;34825.303493930485;35214.823925880206;35933.281334372645;36093.819530902176;36115.63884361228;45528.772356138004;46447.83880402882;46666.533334667576;47297.527024729316;50331.49668503268;9171.862422063808;9205.723828285161;9281.67514137002;9295.209907157967;9729.221662267144;16299.511014669579;17101;17243.568910777332;17446;17579.648407032044;14674.63313417173;14722.852771472148;14873.181974991046;14933.701325973203;15161.772573411628;13402.195868247936;13675.863241367459;14011;14023.158610483404;14119.082259653089;14934;15346.079235245921;15381.3078411474;15569.688606227586;15705.136217508147;8523.403361764616;8911.55442227899;8988.775280618036;9159.35884488106;9168.770780730269;9332.53337333117;11995.220310679779;13968.231747253998;14233.64415889611;14467.27663616836 20:13:55 INFO - PROCESS | 26479 | |3;mootools.html;1308.4635299527197;1432.2122832442158;1489.0618910086641;1609.5251900689295;1768.7523746675467;6427.132337134485;7557.206493318205;7590.58251796151;7650.8852367214395;7669.424793140509;7632.732854350099;7803.492772969753;7812.453128281023;7820.491668041574;7822.3351015163635;2006.2476571285767;2086.405374468277;2087.081684059017;2209.1936443198197;2237.932862014134;2089.4880754215164;2292;2342.531493701258;2348.753380895007;2349.306954448442;2271.909123635061;2296.712910886139;2305.2853615379204;2309.480366917447;2353.5645905507536;2289.290320000805;2290.6564015397657;2318.7217533895873;2320.3155069254612;2322.6632138339933;2252.234240358286;2271.829612779048;2273.1134857405623;2273.6021196290585;2277.02088102116;7791.22087791222;7866.331361834251;7867.606619669051;7879.093904201033;7884.172161922973;4825.300331451955;4856.198727210006;4861.80552777892;4870.050340183666;4922.286268491049;3108.922276943072;3140.7173354397987;3233.708966193054;3244.5944256967878;3258.5926759155104;953.4612943686794;977.0913050862695;980.4999450280337;991.6925753016516;1002.8495725641139;10818.188635852342;10820;10829.783404331947;10832.945835270852;10838.40388778617;4462.219111655448;4482.663800214997;4528.88677783058;4549.158405694957;4550.84072057483;9228.769280768034;9239.353245272767;9245.583948722324;9253.120953509406;9255.629774808933;4939.87650308738;4949.7772600233075;4957.3059771632;4959.231319145538;4963.70217786934;4442.4669039715445;4505.05393867285;4507.053518761031;4512.52618475062;4518.322251662211;3278.098522906172;3332.983335083309;3628.238070005276;3671.2840996006057;3702.20402613434;1190.2382475215868;1193.3675152169365;1224.865264820869;1244.539520377466;1258.7356655102349;1010.5503051142172;1012.0739523336065;1042.0881728487573;1118.4463690473106;1291.606060151644;7021.824454388579;7065.89401158983;7077.504574679723;7079.539829911039;7087.1849737279845;1179.604832381162;1206.6681662542871;1219.0856857356982;1232.1744431231098;1249.3503378243263;5687.3459552152035;5754.597178197486;5795.739191736382;5811.709414529257;5812.070068788974;8892.73321800334;9076.591553379982;9078.636854525745;9086.636534538544;9089.22741566961;8968.148025937526;8982.416142950688;9004.324675649352;9008.63965441388;9023.142801433853;7145.1425828900865;7284.562926224444;7285.890711639329;7339.926600733925;7355.668994895135;7172.318629730167;7304.196538380667;7324.487285889936;7357.484976051625;7362.4478164136835;8322.958385208036;8454.36592255571;8553.786155346166;8596.78508037304;8622.78443038904;8598.054214036576;8630.5253211074;8671.089535598923;8758.737237882873;8778.692745753868;7108.715651373887;7197.748078817216;7198.7840364789145;7202.207757146814;7208.171060328129;6789.524733268624;6943.68753406108;7189.2810718927685;7673.462857599914;7708.4218683600075;7045.260247674126;7054.682539285642;7139.500234983501;7182.317679820409;7220.133583969957;6933.445324373937;6973.721051157897;7014.368706816411;7095.077639906779;7140.750073747394;6971;7014.193367762773;7037.049998250171;7038.2609825969585;7053.435725141873;6245.219347581552;6284.685765711788;6292.087647291209;6292.244930608356;6306.653134077486;6519.217693876575;6573.309802470863;6578.638174900427;6580.276169621242;6586.40722334973 20:13:55 INFO - PROCESS | 26479 | |4;prototype.html;321.1585645608506;322.1993346533863;327.91310302769784;330.4662969304573;332.22591362126246;5805.24531810865;5846.3569007409205;5899.793507227248;5915.142304365864;5945.851353716159;5755.913661295084;5846.941530584703;5870.88258234835;5873.089671100986;5882.705864706758;4530.569595888385;4535.841245556406;4536.682432229745;4536.727796332214;4540.091981603692;4356;4447.577480139382;4448.822047118111;4510.436195475566;4548.545145485442;4469;4473.865784026484;4474.0380818124095;4500.257457519521;4513.7517436540975;4499.392582001421;4503.954960450386;4510.25580779171;4521.276595744682;4525.343825145368;3940.1134744682504;3940.7241493095494;3944.6844252460023;3944.842206311744;3956.1098752780395;5507.697076660782;5604.047311956977;5621.915671264935;5623.325200975909;5634.830955071355;5156;5160.303359046556;5165.793368265303;5166.4575219601775;5168.431472538018;5945.940540594625;6210.534209934228;6222.408871157233;6225.408586184305;6231.688415579249;4135.462389889325;4174.666026717855;4252.319628859399;4269.082147338338;4275.764832934187;6354.205724284465;6441.677916104176;6449.9355006449805;6453.096566480696;6464.353564643545;4351.347297905276;4352.303631419021;4354.194474022316;4356.063446358985;4358.171947329997;4278.465191851019;4392.912141757147;4406.735595864258;4411.977940110279;4418.182636212311;5119.59043276537;5122;5123.590112790967;5125.308083408767;5125.8718532037;6229.875402491924;6253;6257.405546473078;6260.812175634738;6266.561340706106;1529.9770503442458;1549.0937801386315;1561.07896341157;1563.0309208290932;1563.687262547495;1024.2113572549094;1028.311031608824;1035.0167341026056;1038.745507350704;1054.862867827193;5926.7925622603;5927.081302398049;5929.822105336847;5930.406959304035;5931.139984702194;6360.7137678804565;6367.458766004849;6367.904481432783;6369.108324834527;6374.330695277022;5911.083782013795;5919.3192782829665;5927.051671732502;5934.228550288522;5935.228420305332;3430.4168291390524;3506.1409954561295;3508.5438892943753;3513.4202856528386;3524.964750352515;6606.7026983785845;6655.700493477805;6658.5671931324305;6665.766698165541;6668.499862510331;6721.731130754715;6722.058911752359;6732.663366831639;6732.831679207961;6737.898931516032;6460.3216662250725;6631.933680663228;6641.634710090992;6646.468282537386;6651.16860392451;6298.118263443213;6435.195600549931;6525.543211975116;6528.706208220547;6542.738290468328;6306.936930630818;6373.171487706569;6412.166418365583;6478.708458119301;6478.773242936663;6520.347965203442;6533.118029066015;6555.737770489127;6591.011348297794;6615.66921653925;4211.305134652748;4331.306990881444;4376.1247750450675;4380.802863871198;4380.890477738082;6429.7749578764515;6440.710168042356;6444.355564443518;6449.064885591657;6455.225372955276;6229.190205273286;6273.404026617464;6275.215598050244;6280.371962803683;6280.497560195265;6249.50003999688;6264.436200741773;6273.96863015682;6276.497880169667;6277.466415354746;6196.442320191204;6262.373762623702;6267.561270711007;6267.9373206267355;6270.686465676789;6395.968020159869;6402.519811014099;6405.455536279468;6408.551401401857;6413.35866413355;6139.447449729546;6248.843778905563;6250.781222657367;6261.8747625046335;6265.530085243534 20:13:55 INFO - PROCESS | 26479 | |5;yui.html;761.4859969520576;783.8079670480734;837.158655551171;840.8318336332733;842.2840585502324;13363.532276370317;13625.931870340659;13629.727405451886;13638.38627261773;13653.249071301074;11859.169858109935;11924.344161071138;12384.752304953896;13198.954162104888;13274.668133296673;697.6093387702878;830.1615368477835;851.0553285852699;851.4891065360765;852.0627309959026;701.5439964023375;818.443458448255;842.1746688245523;842.5239739547167;845.0408786027872;868.431177578687;888.6001299415257;889.1375365895103;889.5463313709989;890.8930928288582;717.8169566760469;724.4059870905859;873.2533683700408;877.0396415924553;884.4825776920509;650.5316172355944;652.0349882174361;653.7875190563086;654.1038776875663;654.1365397675071;13303.733925321536;13424.463021479129;13474.663133421744;13478.932605336911;13503.797443038264;11766.235194712317;11938.164328497009;12297.3236471994;12498.437570309357;12798;9393;9651.131398174128;9817.410955342702;9863.556139973718;9903.108720215216;3551.8579256829694;3602.829080548806;3631.6005239423644;3640.526731524911;3647.5075864758182;44082.77958610187;44448;44583.108337833386;45032.54967450316;45238;10551.736206594896;10866.836997445045;11005.724856878642;11142.777144457066;11337.773244535063;18795.90602046981;18937.621247575247;18950.526236843914;18987;18996.865517189784;7927.722529711547;8021.759347219593;8036.839263214703;8114.959425202836;8141.959290203511;4515.683902126885;4528.750918699503;4563.201439748031;4565.155446242456;4610.700304480198;3140;3163.4622114240633;3172.8254945977733;3173.650898401174;3175.618925728881;593.2080672302438;598.2581598817435;601.9217501724747;605.2011345024613;608.7504123309421;565.4825834361513;650.4698670583459;658.577827879792;667.5694177255643;668.1647940074906;8144.14486478923;8201.58992050407;8204.097549269576;8351.331893448509;8524.57377131141;560.5403569073321;578.23672751967;621.5586933277424;685.6126288646899;707.9716811327489;3650;3943.3099207638547;3999.5000624921886;4066.207089617496;4067.6949228807957;53072.203916941275;53100.93798124093;54955.45044549583;55142.448575514536;58662;46147.538524614996;46172.76913615411;46384.5361546387;46876.531234687216;50509.494905051215;43995;44458.888527787065;45296.773516132205;45812.3128153078;45910;7958.681652733826;8071.762309811796;8105.189481051848;8250.21487537215;8341.916580834357;33196.66803331936;33549;34382.484262735576;34498.48252276268;34685.65314346925;41433;41435.79282103691;42064;43645;43688.29636739019;10059.949700251453;10091.545880435251;10456.372617642966;10680.072559729424;10817;11056;11128.610498632508;11131.610393636507;12170.695732606402;12539.310337931502;9935.354201976848;10060.44667543263;10166.796664066826;10173.418486320548;10461.424621645883;10427.843582346422;10449.582016719247;10513.737156571147;10589.841152382874;10824.134069274596;9734.221262299141;9876;9935.155511781579;9936.453495057842;9972.252081093802;9572.138507534077;9736.902630973884;9839;9884.901150988399;9995.779647973048;8342.958285208779;8835.204831564934;8971.461712297283;8973.28213742912;9230.861537076815 20:13:55 INFO - PROCESS | 26479 | __end_tp_report 20:13:55 INFO - PROCESS | 26479 | __start_cc_report 20:13:55 INFO - PROCESS | 26479 | _x_x_mozilla_cycle_collect,862 20:13:55 INFO - PROCESS | 26479 | __end_cc_report 20:13:55 INFO - PROCESS | 26479 | __startTimestamp1450757635876__endTimestamp 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | ------- Summary: start ------- 20:13:55 INFO - PROCESS | 26479 | Number of tests: 6 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#0] dojo.html Cycles:165 Average:5389.80 Median:5602.38 stddev:598.85 (10.7%) stddev-sans-first:574.15 20:13:55 INFO - PROCESS | 26479 | Values: 3142.5 3205.0 3236.1 3238.9 3269.7 5220.5 5357.9 5407.1 5448.3 5507.0 5358.7 5384.5 5407.7 5467.2 5560.0 4865.3 4914.1 4929.0 4935.9 5042.2 5012.8 5030.6 5073.8 5090.3 5145.0 4795.9 4877.4 4921.0 4958.7 4990.0 4889.8 4910.3 4912.7 4920.7 4929.2 4837.5 4870.8 4873.2 4880.6 4909.8 5116.4 5219.3 5226.3 5250.9 5299.2 5834.9 5848.6 5849.4 5849.8 5877.4 5877.9 5879.8 5879.9 5886.8 5888.0 5247.6 5319.9 5401.4 5425.8 5499.8 5954.9 5969.2 5986.6 6008.9 6010.1 5764.7 5765.5 5765.7 5769.8 5770.8 5605.2 5690.7 5728.4 5811.5 5844.4 5770.7 5796.9 5832.9 5836.6 5877.9 5837.5 5838.9 5839.8 5846.0 5846.2 4391.1 4406.6 4490.1 4492.5 4499.9 4000.4 4007.4 4028.4 4030.3 4071.0 5429.8 5433.2 5436.3 5436.9 5438.2 5578.2 5627.0 5680.5 5859.4 5865.0 5295.0 5318.5 5373.5 5375.6 5418.9 5049.9 5071.7 5075.8 5083.5 5124.4 5791.8 5905.4 5908.9 5932.3 5939.0 5749.4 5755.4 5756.9 5917.4 5919.1 5944.9 5967.4 5969.6 5978.5 5980.3 5676.8 5782.7 5782.9 5794.1 5797.8 5656.8 5732.9 5750.5 5753.0 5824.3 5716.5 5768.0 5770.0 5773.2 5782.4 5755.9 5757.4 5765.5 5765.9 5768.8 5426.1 5443.1 5503.8 5521.9 5560.0 5724.0 5733.2 5734.7 5739.8 5770.1 5545.7 5602.4 5607.3 5616.9 5632.0 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#1] ext.html Cycles:180 Average:48461.80 Median:35027.06 stddev:86377.76 (246.6%) stddev-sans-first:86545.25 20:13:55 INFO - PROCESS | 26479 | Values: 577.8 607.0 610.3 616.4 619.4 29710.3 30378.8 30397.7 30422.4 30438.0 31123.5 36521.6 36856.0 36976.0 37001.6 8679.1 8826.2 8833.2 8840.5 8851.5 7755.7 8544.2 8648.5 8658.7 8659.3 7691.7 10403.7 10620.2 10631.3 10648.0 10266.7 10289.2 10378.4 10384.0 10396.2 7743.5 7919.8 10117.8 10256.3 10353.2 39342.8 39378.8 39420.8 39704.6 39793.6 3089.2 3129.0 3211.1 3369.8 3543.6 29595.9 29875.6 30053.2 30197.0 30418.2 3937.2 3956.8 3983.7 4013.6 4058.2 409885.0 411953.0 414429.0 414623.0 415175.0 59177.7 59300.7 59618.0 59777.0 59904.0 63694.7 63979.7 64112.4 64126.7 64230.7 14702.6 14891.6 14923.3 15082.8 15115.2 10421.0 10457.3 10487.6 10487.9 10487.9 20268.3 20620.7 20649.0 20658.3 20685.2 7909.4 7989.6 8043.5 8149.7 8182.3 938.6 961.2 962.9 1016.3 1062.0 28070.3 28285.7 28378.7 28617.1 28692.7 962.6 1013.7 1045.8 1109.6 1177.3 13141.4 13299.8 13399.1 13498.8 13504.3 248996.0 249008.0 251291.0 251332.0 251945.0 46350.5 46601.0 46736.8 46749.1 46759.0 1310.9 1349.5 1352.2 1352.8 1358.9 25128.9 26054.5 26060.2 26140.3 26179.5 42096.6 42106.4 42327.0 42388.2 42412.4 297810.0 297928.0 299551.0 299857.0 300230.0 31581.7 44342.8 44509.8 44863.6 45435.0 41286.4 41586.2 41659.4 41770.8 42066.8 34716.5 34736.5 35085.8 35419.6 35477.5 39430.0 39953.2 40600.8 40608.3 41566.8 34321.8 34809.0 35000.0 35015.8 35038.3 27889.7 35511.8 37293.4 37500.8 37806.8 24195.0 24604.3 24629.9 24670.1 24712.9 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#2] jquery.html Cycles:180 Average:28438.47 Median:4063.62 stddev:88700.00 (2182.8%) stddev-sans-first:88923.72 20:13:55 INFO - PROCESS | 26479 | Values: 329.6 340.7 354.2 355.6 359.6 14109.2 14380.5 15858.6 16226.0 17068.2 16312.5 16329.9 16588.4 16589.0 16590.1 4534.2 4700.2 4703.9 4707.4 4709.2 3753.8 3829.8 4688.6 5390.6 5553.1 5513.6 5536.3 5537.8 5542.4 5547.0 5502.5 5964.3 5965.2 5966.1 5987.3 5359.3 5359.5 5363.1 5363.2 5381.1 12768.6 13233.6 13270.9 13350.5 16600.8 2119.3 2159.8 2175.6 2205.2 2216.3 9283.4 9291.9 9489.7 12682.2 12896.4 1663.5 1840.3 1866.6 1872.5 1973.3 52876.5 53039.7 53848.2 54227.5 55054.4 9454.2 9466.7 9497.1 9500.2 9504.6 11994.3 12016.5 12021.1 12023.9 12066.4 7299.6 7321.9 7329.3 7337.2 7353.3 7259.3 7313.7 7314.1 7347.6 7353.9 4030.1 4055.9 4071.4 4082.8 4083.9 1580.2 1626.6 1649.7 1728.6 1776.6 922.6 950.9 979.8 990.0 1047.1 14464.0 16492.3 16567.6 17085.7 17107.9 919.3 926.1 941.4 957.1 981.5 8975.1 9266.5 9310.9 9460.5 9488.4 537247.0 542825.0 543438.0 545053.0 546592.0 61063.4 79794.6 83170.6 84435.0 85102.0 1095.5 1109.1 1121.7 1137.8 1138.7 14717.3 14803.6 15557.4 15807.7 16070.1 34825.3 35214.8 35933.3 36093.8 36115.6 45528.8 46447.8 46666.5 47297.5 50331.5 9171.9 9205.7 9281.7 9295.2 9729.2 16299.5 17101.0 17243.6 17446.0 17579.6 14674.6 14722.9 14873.2 14933.7 15161.8 13402.2 13675.9 14011.0 14023.2 14119.1 14934.0 15346.1 15381.3 15569.7 15705.1 8523.4 8911.6 8988.8 9159.4 9168.8 9332.5 11995.2 13968.2 14233.6 14467.3 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#3] mootools.html Cycles:180 Average:5475.44 Median:6366.89 stddev:2806.06 (44.1%) stddev-sans-first:2796.45 20:13:55 INFO - PROCESS | 26479 | Values: 1308.5 1432.2 1489.1 1609.5 1768.8 6427.1 7557.2 7590.6 7650.9 7669.4 7632.7 7803.5 7812.5 7820.5 7822.3 2006.2 2086.4 2087.1 2209.2 2237.9 2089.5 2292.0 2342.5 2348.8 2349.3 2271.9 2296.7 2305.3 2309.5 2353.6 2289.3 2290.7 2318.7 2320.3 2322.7 2252.2 2271.8 2273.1 2273.6 2277.0 7791.2 7866.3 7867.6 7879.1 7884.2 4825.3 4856.2 4861.8 4870.1 4922.3 3108.9 3140.7 3233.7 3244.6 3258.6 953.5 977.1 980.5 991.7 1002.8 10818.2 10820.0 10829.8 10832.9 10838.4 4462.2 4482.7 4528.9 4549.2 4550.8 9228.8 9239.4 9245.6 9253.1 9255.6 4939.9 4949.8 4957.3 4959.2 4963.7 4442.5 4505.1 4507.1 4512.5 4518.3 3278.1 3333.0 3628.2 3671.3 3702.2 1190.2 1193.4 1224.9 1244.5 1258.7 1010.6 1012.1 1042.1 1118.4 1291.6 7021.8 7065.9 7077.5 7079.5 7087.2 1179.6 1206.7 1219.1 1232.2 1249.4 5687.3 5754.6 5795.7 5811.7 5812.1 8892.7 9076.6 9078.6 9086.6 9089.2 8968.1 8982.4 9004.3 9008.6 9023.1 7145.1 7284.6 7285.9 7339.9 7355.7 7172.3 7304.2 7324.5 7357.5 7362.4 8323.0 8454.4 8553.8 8596.8 8622.8 8598.1 8630.5 8671.1 8758.7 8778.7 7108.7 7197.7 7198.8 7202.2 7208.2 6789.5 6943.7 7189.3 7673.5 7708.4 7045.3 7054.7 7139.5 7182.3 7220.1 6933.4 6973.7 7014.4 7095.1 7140.8 6971.0 7014.2 7037.0 7038.3 7053.4 6245.2 6284.7 6292.1 6292.2 6306.7 6519.2 6573.3 6578.6 6580.3 6586.4 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#4] prototype.html Cycles:180 Average:5212.08 Median:5923.06 stddev:1583.89 (26.7%) stddev-sans-first:1545.20 20:13:55 INFO - PROCESS | 26479 | Values: 321.2 322.2 327.9 330.5 332.2 5805.2 5846.4 5899.8 5915.1 5945.9 5755.9 5846.9 5870.9 5873.1 5882.7 4530.6 4535.8 4536.7 4536.7 4540.1 4356.0 4447.6 4448.8 4510.4 4548.5 4469.0 4473.9 4474.0 4500.3 4513.8 4499.4 4504.0 4510.3 4521.3 4525.3 3940.1 3940.7 3944.7 3944.8 3956.1 5507.7 5604.0 5621.9 5623.3 5634.8 5156.0 5160.3 5165.8 5166.5 5168.4 5945.9 6210.5 6222.4 6225.4 6231.7 4135.5 4174.7 4252.3 4269.1 4275.8 6354.2 6441.7 6449.9 6453.1 6464.4 4351.3 4352.3 4354.2 4356.1 4358.2 4278.5 4392.9 4406.7 4412.0 4418.2 5119.6 5122.0 5123.6 5125.3 5125.9 6229.9 6253.0 6257.4 6260.8 6266.6 1530.0 1549.1 1561.1 1563.0 1563.7 1024.2 1028.3 1035.0 1038.7 1054.9 5926.8 5927.1 5929.8 5930.4 5931.1 6360.7 6367.5 6367.9 6369.1 6374.3 5911.1 5919.3 5927.1 5934.2 5935.2 3430.4 3506.1 3508.5 3513.4 3525.0 6606.7 6655.7 6658.6 6665.8 6668.5 6721.7 6722.1 6732.7 6732.8 6737.9 6460.3 6631.9 6641.6 6646.5 6651.2 6298.1 6435.2 6525.5 6528.7 6542.7 6306.9 6373.2 6412.2 6478.7 6478.8 6520.3 6533.1 6555.7 6591.0 6615.7 4211.3 4331.3 4376.1 4380.8 4380.9 6429.8 6440.7 6444.4 6449.1 6455.2 6229.2 6273.4 6275.2 6280.4 6280.5 6249.5 6264.4 6274.0 6276.5 6277.5 6196.4 6262.4 6267.6 6267.9 6270.7 6396.0 6402.5 6405.5 6408.6 6413.4 6139.4 6248.8 6250.8 6261.9 6265.5 20:13:55 INFO - PROCESS | 26479 | 20:13:55 INFO - PROCESS | 26479 | [#5] yui.html Cycles:180 Average:13268.95 Median:46278.65 stddev:15095.67 (32.6%) stddev-sans-first:15108.80 20:13:55 INFO - PROCESS | 26479 | Values: 761.5 783.8 837.2 840.8 842.3 13363.5 13625.9 13629.7 13638.4 13653.2 11859.2 11924.3 12384.8 13199.0 13274.7 697.6 830.2 851.1 851.5 852.1 701.5 818.4 842.2 842.5 845.0 868.4 888.6 889.1 889.5 890.9 717.8 724.4 873.3 877.0 884.5 650.5 652.0 653.8 654.1 654.1 13303.7 13424.5 13474.7 13478.9 13503.8 11766.2 11938.2 12297.3 12498.4 12798.0 9393.0 9651.1 9817.4 9863.6 9903.1 3551.9 3602.8 3631.6 3640.5 3647.5 44082.8 44448.0 44583.1 45032.5 45238.0 10551.7 10866.8 11005.7 11142.8 11337.8 18795.9 18937.6 18950.5 18987.0 18996.9 7927.7 8021.8 8036.8 8115.0 8142.0 4515.7 4528.8 4563.2 4565.2 4610.7 3140.0 3163.5 3172.8 3173.7 3175.6 593.2 598.3 601.9 605.2 608.8 565.5 650.5 658.6 667.6 668.2 8144.1 8201.6 8204.1 8351.3 8524.6 560.5 578.2 621.6 685.6 708.0 3650.0 3943.3 3999.5 4066.2 4067.7 53072.2 53100.9 54955.5 55142.4 58662.0 46147.5 46172.8 46384.5 46876.5 50509.5 43995.0 44458.9 45296.8 45812.3 45910.0 7958.7 8071.8 8105.2 8250.2 8341.9 33196.7 33549.0 34382.5 34498.5 34685.7 41433.0 41435.8 42064.0 43645.0 43688.3 10059.9 10091.5 10456.4 10680.1 10817.0 11056.0 11128.6 11131.6 12170.7 12539.3 9935.4 10060.4 10166.8 10173.4 10461.4 10427.8 10449.6 10513.7 10589.8 10824.1 9734.2 9876.0 9935.2 9936.5 9972.3 9572.1 9736.9 9839.0 9884.9 9995.8 8343.0 8835.2 8971.5 8973.3 9230.9 20:13:55 INFO - PROCESS | 26479 | -------- Summary: end -------- 20:13:55 INFO - PROCESS | 26479 | 20:13:56 INFO - TEST-INFO | 26479: exit 0 20:13:56 INFO - TEST-OK | dromaeo_css | took 1113530ms 20:13:56 INFO - TEST-START | kraken 20:13:56 INFO - operating with platform_type : linux_ 20:13:56 INFO - Initialising browser for kraken test... 20:13:56 INFO - TEST-INFO | started process 26664 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmprKsiom/profile http://localhost:41437/getInfo.html) 20:14:00 INFO - PROCESS | 26664 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 20:14:00 INFO - PROCESS | 26664 | __metrics Screen width/height:1600/1200 20:14:00 INFO - PROCESS | 26664 | colorDepth:24 20:14:00 INFO - PROCESS | 26664 | Browser inner width/height: 1024/697 20:14:00 INFO - PROCESS | 26664 | __metrics 20:14:00 INFO - PROCESS | 26664 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 20:14:00 INFO - PROCESS | 26664 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:14:02 INFO - TEST-INFO | 26664: exit 0 20:14:02 INFO - Browser initialized. 20:14:02 INFO - Running cycle 1/1 for kraken test... 20:14:02 INFO - TEST-INFO | started process 26752 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmprKsiom/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:14:13 INFO - PROCESS | 26752 | RSS: Main: 150163456 20:14:13 INFO - PROCESS | 26752 | 20:14:16 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41437/tests/kraken/driver.html?testName=audio-beat-detection) 20:14:16 INFO - PROCESS | 26752 | RSS: Main: 185753600 20:14:16 INFO - PROCESS | 26752 | 20:14:19 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41437/tests/kraken/driver.html?testName=audio-dft) 20:14:20 INFO - PROCESS | 26752 | RSS: Main: 176078848 20:14:20 INFO - PROCESS | 26752 | 20:14:23 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41437/tests/kraken/driver.html?testName=audio-fft) 20:14:23 INFO - PROCESS | 26752 | RSS: Main: 160763904 20:14:23 INFO - PROCESS | 26752 | 20:14:25 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41437/tests/kraken/driver.html?testName=audio-oscillator) 20:14:26 INFO - PROCESS | 26752 | RSS: Main: 164507648 20:14:26 INFO - PROCESS | 26752 | 20:14:28 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41437/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:14:28 INFO - PROCESS | 26752 | RSS: Main: 166211584 20:14:28 INFO - PROCESS | 26752 | 20:14:31 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41437/tests/kraken/driver.html?testName=imaging-darkroom) 20:14:32 INFO - PROCESS | 26752 | RSS: Main: 164229120 20:14:32 INFO - PROCESS | 26752 | 20:14:35 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41437/tests/kraken/driver.html?testName=imaging-desaturate) 20:14:36 INFO - PROCESS | 26752 | RSS: Main: 166379520 20:14:36 INFO - PROCESS | 26752 | 20:14:39 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41437/tests/kraken/driver.html?testName=json-parse-financial) 20:14:39 INFO - PROCESS | 26752 | RSS: Main: 166985728 20:14:39 INFO - PROCESS | 26752 | 20:14:41 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41437/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:14:41 INFO - PROCESS | 26752 | RSS: Main: 177115136 20:14:41 INFO - PROCESS | 26752 | 20:14:43 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:14:44 INFO - PROCESS | 26752 | RSS: Main: 175992832 20:14:44 INFO - PROCESS | 26752 | 20:14:46 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:14:46 INFO - PROCESS | 26752 | RSS: Main: 183488512 20:14:46 INFO - PROCESS | 26752 | 20:14:49 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:14:49 INFO - PROCESS | 26752 | RSS: Main: 193622016 20:14:49 INFO - PROCESS | 26752 | 20:14:52 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:14:52 INFO - PROCESS | 26752 | RSS: Main: 189595648 20:14:52 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | Cycle 1(1): loaded http://localhost:41437/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41437/tests/kraken/driver.html?testName=ai-astar) 20:14:54 INFO - PROCESS | 26752 | RSS: Main: 248496128 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | __start_tp_report 20:14:54 INFO - PROCESS | 26752 | _x_x_mozilla_page_load 20:14:54 INFO - PROCESS | 26752 | _x_x_mozilla_page_load_details 20:14:54 INFO - PROCESS | 26752 | |i|pagename|runs| 20:14:54 INFO - PROCESS | 26752 | |0;ai-astar;108;110;106;112;111;111;100;109;110;116 20:14:54 INFO - PROCESS | 26752 | |1;audio-beat-detection;150;132;155;158;124;156;156;124;172;123 20:14:54 INFO - PROCESS | 26752 | |2;audio-dft;161;161;161;159;161;161;161;160;159;161 20:14:54 INFO - PROCESS | 26752 | |3;audio-fft;71;72;81;93;72;72;72;126;94;73 20:14:54 INFO - PROCESS | 26752 | |4;audio-oscillator;94;93;140;93;94;94;140;94;94;136 20:14:54 INFO - PROCESS | 26752 | |5;imaging-gaussian-blur;110;109;109;109;110;110;109;109;110;109 20:14:54 INFO - PROCESS | 26752 | |6;imaging-darkroom;145;145;145;146;146;146;146;145;146;146 20:14:54 INFO - PROCESS | 26752 | |7;imaging-desaturate;95;95;97;97;96;97;96;95;95;95 20:14:54 INFO - PROCESS | 26752 | |8;json-parse-financial;62;61;61;60;63;61;60;72;58;60 20:14:54 INFO - PROCESS | 26752 | |9;json-stringify-tinderbox;67;67;67;67;67;67;66;74;67;68 20:14:54 INFO - PROCESS | 26752 | |10;stanford-crypto-aes;87;93;85;85;85;84;84;85;86;85 20:14:54 INFO - PROCESS | 26752 | |11;stanford-crypto-ccm;121;118;120;124;124;115;127;120;132;121 20:14:54 INFO - PROCESS | 26752 | |12;stanford-crypto-pbkdf2;144;156;155;156;153;141;154;155;152;142 20:14:54 INFO - PROCESS | 26752 | |13;stanford-crypto-sha256-iterative;67;67;70;66;68;66;67;67;68;67 20:14:54 INFO - PROCESS | 26752 | __end_tp_report 20:14:54 INFO - PROCESS | 26752 | __start_cc_report 20:14:54 INFO - PROCESS | 26752 | _x_x_mozilla_cycle_collect,928 20:14:54 INFO - PROCESS | 26752 | __end_cc_report 20:14:54 INFO - PROCESS | 26752 | __startTimestamp1450757694851__endTimestamp 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | ------- Summary: start ------- 20:14:54 INFO - PROCESS | 26752 | Number of tests: 14 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#0] ai-astar Cycles:10 Average:109.30 Median:110.50 stddev:4.19 (3.8%) stddev-sans-first:4.42 20:14:54 INFO - PROCESS | 26752 | Values: 108.0 110.0 106.0 112.0 111.0 111.0 100.0 109.0 110.0 116.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#1] audio-beat-detection Cycles:10 Average:145.00 Median:155.50 stddev:17.64 (11.3%) stddev-sans-first:18.62 20:14:54 INFO - PROCESS | 26752 | Values: 150.0 132.0 155.0 158.0 124.0 156.0 156.0 124.0 172.0 123.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#2] audio-dft Cycles:10 Average:160.50 Median:161.00 stddev:0.85 (0.5%) stddev-sans-first:0.88 20:14:54 INFO - PROCESS | 26752 | Values: 161.0 161.0 161.0 159.0 161.0 161.0 161.0 160.0 159.0 161.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#3] audio-fft Cycles:10 Average:82.60 Median:72.50 stddev:17.64 (24.3%) stddev-sans-first:18.20 20:14:54 INFO - PROCESS | 26752 | Values: 71.0 72.0 81.0 93.0 72.0 72.0 72.0 126.0 94.0 73.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#4] audio-oscillator Cycles:10 Average:107.20 Median:94.00 stddev:21.74 (23.1%) stddev-sans-first:22.53 20:14:54 INFO - PROCESS | 26752 | Values: 94.0 93.0 140.0 93.0 94.0 94.0 140.0 94.0 94.0 136.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#5] imaging-gaussian-blur Cycles:10 Average:109.40 Median:109.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 20:14:54 INFO - PROCESS | 26752 | Values: 110.0 109.0 109.0 109.0 110.0 110.0 109.0 109.0 110.0 109.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.52 (0.4%) stddev-sans-first:0.50 20:14:54 INFO - PROCESS | 26752 | Values: 145.0 145.0 145.0 146.0 146.0 146.0 146.0 145.0 146.0 146.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.92 (1.0%) stddev-sans-first:0.93 20:14:54 INFO - PROCESS | 26752 | Values: 95.0 95.0 97.0 97.0 96.0 97.0 96.0 95.0 95.0 95.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#8] json-parse-financial Cycles:10 Average:61.80 Median:61.00 stddev:3.82 (6.3%) stddev-sans-first:4.06 20:14:54 INFO - PROCESS | 26752 | Values: 62.0 61.0 61.0 60.0 63.0 61.0 60.0 72.0 58.0 60.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#9] json-stringify-tinderbox Cycles:10 Average:67.70 Median:67.00 stddev:2.26 (3.4%) stddev-sans-first:2.39 20:14:54 INFO - PROCESS | 26752 | Values: 67.0 67.0 67.0 67.0 67.0 67.0 66.0 74.0 67.0 68.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#10] stanford-crypto-aes Cycles:10 Average:85.90 Median:85.00 stddev:2.64 (3.1%) stddev-sans-first:2.77 20:14:54 INFO - PROCESS | 26752 | Values: 87.0 93.0 85.0 85.0 85.0 84.0 84.0 85.0 86.0 85.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#11] stanford-crypto-ccm Cycles:10 Average:122.20 Median:122.50 stddev:4.80 (3.9%) stddev-sans-first:5.07 20:14:54 INFO - PROCESS | 26752 | Values: 121.0 118.0 120.0 124.0 124.0 115.0 127.0 120.0 132.0 121.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.80 Median:154.50 stddev:6.01 (3.9%) stddev-sans-first:5.85 20:14:54 INFO - PROCESS | 26752 | Values: 144.0 156.0 155.0 156.0 153.0 141.0 154.0 155.0 152.0 142.0 20:14:54 INFO - PROCESS | 26752 | 20:14:54 INFO - PROCESS | 26752 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.30 Median:67.00 stddev:1.16 (1.7%) stddev-sans-first:1.22 20:14:54 INFO - PROCESS | 26752 | Values: 67.0 67.0 70.0 66.0 68.0 66.0 67.0 67.0 68.0 67.0 20:14:54 INFO - PROCESS | 26752 | -------- Summary: end -------- 20:14:54 INFO - PROCESS | 26752 | 20:14:55 INFO - TEST-INFO | 26752: exit 0 20:14:55 INFO - TEST-OK | kraken | took 59167ms 20:14:55 INFO - TEST-START | v8_7 20:14:55 INFO - operating with platform_type : linux_ 20:14:55 INFO - Initialising browser for v8_7 test... 20:14:55 INFO - TEST-INFO | started process 27001 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvNVy2h/profile http://localhost:41437/getInfo.html) 20:14:59 INFO - PROCESS | 27001 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 20:15:00 INFO - PROCESS | 27001 | __metrics Screen width/height:1600/1200 20:15:00 INFO - PROCESS | 27001 | colorDepth:24 20:15:00 INFO - PROCESS | 27001 | Browser inner width/height: 1024/697 20:15:00 INFO - PROCESS | 27001 | __metrics 20:15:00 INFO - PROCESS | 27001 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 20:15:00 INFO - PROCESS | 27001 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:15:01 INFO - TEST-INFO | 27001: exit 0 20:15:01 INFO - Browser initialized. 20:15:01 INFO - Running cycle 1/1 for v8_7 test... 20:15:01 INFO - TEST-INFO | started process 27082 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvNVy2h/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:15:13 INFO - PROCESS | 27082 | RSS: Main: 150470656 20:15:13 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | Cycle 1(1): loaded http://localhost:41437/tests/v8_7/run.html (next: http://localhost:41437/tests/v8_7/run.html) 20:15:34 INFO - PROCESS | 27082 | RSS: Main: 593747968 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | __start_tp_report 20:15:34 INFO - PROCESS | 27082 | _x_x_mozilla_page_load 20:15:34 INFO - PROCESS | 27082 | _x_x_mozilla_page_load_details 20:15:34 INFO - PROCESS | 27082 | |i|pagename|runs| 20:15:34 INFO - PROCESS | 27082 | |0;Richards;165.45334215751157 20:15:34 INFO - PROCESS | 27082 | |1;DeltaBlue;189.2147587511826 20:15:34 INFO - PROCESS | 27082 | |2;Encrypt;283.5270768358378 20:15:34 INFO - PROCESS | 27082 | |3;Decrypt;5143.589743589743 20:15:34 INFO - PROCESS | 27082 | |4;RayTrace;1964.6365422396857 20:15:34 INFO - PROCESS | 27082 | |5;Earley;796.8127490039841 20:15:34 INFO - PROCESS | 27082 | |6;Boyer;12156.626506024097 20:15:34 INFO - PROCESS | 27082 | |7;RegExp;26153.846153846152 20:15:34 INFO - PROCESS | 27082 | |8;Splay;656.5988181221273 20:15:34 INFO - PROCESS | 27082 | |9;NavierStokes;4854.368932038835 20:15:34 INFO - PROCESS | 27082 | __end_tp_report 20:15:34 INFO - PROCESS | 27082 | __startTimestamp1450757734752__endTimestamp 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | ------- Summary: start ------- 20:15:34 INFO - PROCESS | 27082 | Number of tests: 10 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#0] Richards Cycles:1 Average:165.45 Median:165.45 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 165.5 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#1] DeltaBlue Cycles:1 Average:189.21 Median:189.21 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 189.2 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#2] Encrypt Cycles:1 Average:283.53 Median:283.53 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 283.5 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#3] Decrypt Cycles:1 Average:5143.59 Median:5143.59 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 5143.6 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#4] RayTrace Cycles:1 Average:1964.64 Median:1964.64 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 1964.6 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#5] Earley Cycles:1 Average:796.81 Median:796.81 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 796.8 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#6] Boyer Cycles:1 Average:12156.63 Median:12156.63 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 12156.6 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#7] RegExp Cycles:1 Average:26153.85 Median:26153.85 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 26153.8 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#8] Splay Cycles:1 Average:656.60 Median:656.60 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 656.6 20:15:34 INFO - PROCESS | 27082 | 20:15:34 INFO - PROCESS | 27082 | [#9] NavierStokes Cycles:1 Average:4854.37 Median:4854.37 stddev:0.00 (0.0%) 20:15:34 INFO - PROCESS | 27082 | Values: 4854.4 20:15:34 INFO - PROCESS | 27082 | -------- Summary: end -------- 20:15:34 INFO - PROCESS | 27082 | 20:15:35 INFO - TEST-INFO | 27082: exit 0 20:15:35 INFO - TEST-OK | v8_7 | took 39790ms 20:15:35 INFO - SUITE-END | took 1212s 20:15:35 INFO - Completed test suite (00:20:12) 20:15:35 INFO - Working with test: dromaeo_css 20:15:35 INFO - Generating results file: dromaeo_css 20:15:35 INFO - Working with test: kraken 20:15:35 INFO - Generating results file: kraken 20:15:35 INFO - javascript benchmark 20:15:35 INFO - Working with test: v8_7 20:15:35 INFO - Generating results file: v8_7 20:15:35 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:15:35 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,201,35]] 20:15:35 INFO - process_Request line: dromaeo_css 6944.20 graph.html#tests=[[72,201,35]] 20:15:35 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:15:35 INFO - process_Request line: kraken 1511.10 graph.html#tests=[[232,201,35]] 20:15:35 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:15:35 INFO - process_Request line: v8_7 19652.21 graph.html#tests=[[230,201,35]] 20:15:35 INFO - RETURN: dromaeo_css: 6944.20 20:15:35 INFO - RETURN: kraken: 1511.10 20:15:35 INFO - RETURN: v8_7: 19652.21 20:15:35 INFO - javascript benchmark 20:15:35 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3142.5443310719943, 3205.0384884534633, 3236.0615421527773, 3238.8542515586796, 3269.7384209263255, 5220.504052115052, 5357.946420535794, 5407.080796264635, 5448.264484294619, 5507.036268652984, 5358.678479291245, 5384.515393614574, 5407.729613519328, 5467.20725494803, 5559.999200143972, 4865.318855360252, 4914.0908931847725, 4928.950710492885, 4935.901281974358, 5042.168042273021, 5012.774425150858, 5030.57240134589, 5073.771680274396, 5090.287359769635, 5145.048166089286, 4795.928061079087, 4877.3903262092235, 4920.950790492085, 4958.652894297401, 4989.975050124763, 4889.804407823683, 4910.312556242129, 4912.70523768575, 4920.729359885205, 4929.211326187793, 4837.516248375135, 4870.780814863339, 4873.171560834667, 4880.6095512358925, 4909.754512274408, 5116.386033675983, 5219.295395121648, 5226.268322434824, 5250.871062721533, 5299.205119232108, 5834.941650583482, 5848.619839710405, 5849.385814489502, 5849.795257165979, 5877.38287479817, 5877.9412205877825, 5879.7648094076185, 5879.853003674943, 5886.764529418818, 5888.0, 5247.63266571344, 5319.867003324909, 5401.378841433286, 5425.755840987165, 5499.780008799643, 5954.910676339859, 5969.194158788595, 5986.580939334205, 6008.8798224036145, 6010.128531362928, 5764.7117644117625, 5765.4811067004175, 5765.654060756284, 5769.798057067983, 5770.826875193751, 5605.159226116115, 5690.715464226772, 5728.427157284238, 5811.506021988093, 5844.386339434298, 5770.711464426762, 5796.855078623068, 5832.883342333214, 5836.591438599342, 5877.853053673607, 5837.503812175928, 5838.883222335529, 5839.824805255764, 5846.0, 5846.239988801429, 4391.055922976575, 4406.625436837905, 4490.101979604092, 4492.528284530143, 4499.88750281239, 4000.4199391088127, 4007.438958545806, 4028.3554631258858, 4030.3349947258375, 4071.0229544909007, 5429.809956651498, 5433.1850222466155, 5436.320459942507, 5436.891262174734, 5438.211459338374, 5578.219049333096, 5626.97186514073, 5680.460356266148, 5859.44335288147, 5864.970675146682, 5295.046891559557, 5318.521333080042, 5373.462653734673, 5375.596830237748, 5418.945810541844, 5049.873753156127, 5071.721055341918, 5075.771590278447, 5083.466236045236, 5124.385073791094, 5791.7683292667825, 5905.43898329658, 5908.881822363529, 5932.2881254248905, 5938.970305148447, 5749.367569567261, 5755.424457554211, 5756.856078598069, 5917.437843404869, 5919.112133180058, 5944.910826337522, 5967.37342579023, 5969.641821490724, 5978.521718262616, 5980.252468441445, 5676.801311954062, 5782.710864456844, 5782.884342313046, 5794.1308803679785, 5797.797077102281, 5656.773729050957, 5732.942670573241, 5750.539956803529, 5753.0, 5824.271966004249, 5716.514096301695, 5767.971160144172, 5770.0, 5773.22061521706, 5782.421757824352, 5755.913661295001, 5757.424257574209, 5765.509931655856, 5765.94234057654, 5768.769249229984, 5426.1318189091135, 5443.101888188405, 5503.752331145028, 5521.861953451035, 5559.972200139136, 5723.971380143239, 5733.226014487991, 5734.655920644775, 5739.799107031401, 5770.105633626795, 5545.722713864371, 5602.3837377887585, 5607.299087614048, 5616.85957851057, 5631.971840140773], "unit": "score", "name": "dojo.html", "value": 5350.81806335921}, {"lowerIsBetter": false, "replicates": [577.7573419163954, 607.0469363099935, 610.282917571853, 616.3743800042957, 619.4239357397619, 29710.257243568896, 30378.84810575944, 30397.696023039764, 30422.39155216897, 30438.0, 31123.533147002814, 36521.63478365215, 36856.0, 36976.0, 37001.62998370022, 8679.088695686942, 8826.205641492264, 8833.20501154896, 8840.513771742551, 8851.468911865277, 7755.689772409097, 8544.18830211132, 8648.524331161783, 8658.696945606906, 8659.26396256319, 7691.730789422371, 10403.73990650236, 10620.150387968944, 10631.308964917256, 10648.041676249137, 10266.691999240034, 10289.176865850788, 10378.377297362182, 10384.0, 10396.168306535497, 7743.496672716312, 7919.802004949865, 10117.797644047077, 10256.282060255786, 10353.223508236912, 39342.803285983675, 39378.80310598428, 39420.802895985624, 39704.60295397038, 39793.60206397928, 3089.1813669377634, 3128.9530657040164, 3211.1490455029434, 3369.7641165118453, 3543.5747710274672, 29595.85202073976, 29875.551866722017, 30053.248668783235, 30197.0, 30418.239544011576, 3937.1928754605237, 3956.8021598920227, 3983.701222408302, 4013.6187062229333, 4058.188362327546, 409885.0, 411953.0, 414429.0, 414622.999999997, 415175.0, 59177.704111479165, 59300.70349648224, 59618.0, 59777.0, 59904.0, 63694.681526593, 63979.680101599195, 64112.35887641157, 64126.67936660287, 64230.6788466064, 14702.63243418923, 14891.627709307353, 14923.32845021955, 15082.849171508364, 15115.244237788067, 10421.0, 10457.26799124054, 10487.580496780196, 10487.895121048845, 10487.947560262302, 20268.290609828586, 20620.69068963967, 20649.0, 20658.276960306317, 20685.172593096107, 7909.406794490321, 7989.600519974094, 8043.517388956681, 8149.7147599833725, 8182.304504117216, 938.6151677812064, 961.1685891703626, 962.8507581324906, 1016.2733645443543, 1062.0282441566035, 28070.2982425441, 28285.717142828307, 28378.716212837608, 28617.14148575546, 28692.71307286942, 962.5812771444444, 1013.7110923386947, 1045.7960697663882, 1109.5506319940275, 1177.3171560494893, 13141.408636611375, 13299.800502992462, 13399.129056611484, 13498.797518037041, 13504.257265850276, 248996.0, 249008.0, 251291.0, 251332.0, 251945.0, 46350.53649463462, 46601.0, 46736.7663161682, 46749.06501869944, 46759.0, 1310.9475620975054, 1349.4804500267467, 1352.1819299323963, 1352.8173696551037, 1358.8505264420905, 25128.874355628104, 26054.478910422065, 26060.218193454228, 26140.346491337106, 26179.476410471303, 42096.579034209266, 42106.368404473345, 42327.0, 42388.15223695447, 42412.36381454219, 297810.0, 297928.0, 299551.0, 299857.0, 300230.0, 31581.684183157875, 44342.77828610836, 44509.77745111254, 44863.55136448594, 45435.0, 41286.38070428886, 41586.168276634904, 41659.37510937278, 41770.791146044074, 42066.789666051474, 34716.47925281173, 34736.478952815225, 35085.82457087698, 35419.645803541636, 35477.467837982964, 39430.0, 39953.2009359817, 40600.79699601601, 40608.314835923586, 41566.804149481315, 34321.82839085789, 34809.0, 35000.0, 35015.82492087523, 35038.299234015685, 27889.721102788713, 35511.82244088763, 37293.440598391586, 37500.812495937345, 37806.81096594499, 24195.0, 24604.261872143863, 24629.876850615634, 24670.13654522083, 24712.876435617705], "unit": "score", "name": "ext.html", "value": 18549.88219243525}, {"lowerIsBetter": false, "replicates": [329.59624460036446, 340.70869406657295, 354.2313180398535, 355.5910702691904, 359.6331741623544, 14109.223992680398, 14380.496682616083, 15858.60353491162, 16226.0, 17068.231929563168, 16312.510624681248, 16329.918350408261, 16588.419405320816, 16589.0, 16590.08754518501, 4534.229181039214, 4700.247960326348, 4703.882402939937, 4707.364505791726, 4709.152352576535, 3753.7935413552245, 3829.808509574524, 4688.64835137366, 5390.568754499631, 5553.055980483307, 5513.558915286768, 5536.252605898213, 5537.778488860441, 5542.362628297737, 5546.972265138668, 5502.477264659851, 5964.284285885678, 5965.1946987156825, 5966.075258334965, 5987.251593550806, 5359.276497672803, 5359.464053594648, 5363.141897296453, 5363.195520671891, 5381.112116500773, 12768.553100641433, 13233.602991910258, 13270.933645331712, 13350.46598136083, 16600.750988735057, 2119.3218170185546, 2159.7948194921455, 2175.59751445983, 2205.195103787122, 2216.3018649125474, 9283.396579222397, 9291.907080929172, 9489.66786162481, 12682.175658582162, 12896.419661115273, 1663.4926347464018, 1840.3098837935775, 1866.5520275134006, 1872.522506760781, 1973.329068116847, 52876.471235287536, 53039.73480132574, 53848.19227711587, 54227.45772542303, 55054.44945550573, 9454.196393306509, 9466.668666596635, 9497.10057988405, 9500.23998080152, 9504.572294246636, 11994.34031128279, 12016.459259333176, 12021.098417618714, 12023.879761202452, 12066.396680165957, 7299.598522081336, 7321.926780732231, 7329.340359367682, 7337.229590892986, 7353.264673532711, 7259.274072592699, 7313.670884810196, 7314.08573928259, 7347.63261836906, 7353.889691654629, 4030.1133750574827, 4055.878323650295, 4071.3689378146437, 4082.755034697928, 4083.8774836754947, 1580.2188148857863, 1626.6258760485155, 1649.653572749712, 1728.6024214430752, 1776.644671065792, 922.5940586142076, 950.9429434233969, 979.8040391921644, 990.0149351395407, 1047.1099565369375, 14464.047353607339, 16492.25784839685, 16567.585810354838, 17085.658286834194, 17107.91446042762, 919.2691810011057, 926.0554234680588, 941.4351389166583, 957.1337939165066, 981.4798156976814, 8975.102489751103, 9266.536673166314, 9310.906890931139, 9460.479673618018, 9488.383255088396, 537247.0, 542825.0, 543438.0, 545053.0, 546592.0, 61063.38936610666, 79794.6010269945, 83170.58414707887, 84435.0, 85102.0, 1095.5124969388546, 1109.1237922041496, 1121.6915348279126, 1137.8008848451652, 1138.743782648914, 14717.33771980242, 14803.629909252355, 15557.377704891678, 15807.68384632324, 16070.116143612213, 34825.303493930485, 35214.823925880206, 35933.281334372645, 36093.819530902176, 36115.63884361228, 45528.772356138004, 46447.83880402882, 46666.533334667576, 47297.527024729316, 50331.49668503268, 9171.862422063808, 9205.723828285161, 9281.67514137002, 9295.209907157967, 9729.221662267144, 16299.511014669579, 17101.0, 17243.568910777332, 17446.0, 17579.648407032044, 14674.63313417173, 14722.852771472148, 14873.181974991046, 14933.701325973203, 15161.772573411628, 13402.195868247936, 13675.863241367459, 14011.0, 14023.158610483404, 14119.082259653089, 14934.0, 15346.079235245921, 15381.3078411474, 15569.688606227586, 15705.136217508147, 8523.403361764616, 8911.55442227899, 8988.775280618036, 9159.35884488106, 9168.770780730269, 9332.53337333117, 11995.220310679779, 13968.231747253998, 14233.64415889611, 14467.27663616836], "unit": "score", "name": "jquery.html", "value": 8610.283370536568}, {"lowerIsBetter": false, "replicates": [1308.4635299527197, 1432.2122832442158, 1489.0618910086641, 1609.5251900689295, 1768.7523746675467, 6427.132337134485, 7557.206493318205, 7590.58251796151, 7650.8852367214395, 7669.424793140509, 7632.732854350099, 7803.492772969753, 7812.453128281023, 7820.491668041574, 7822.3351015163635, 2006.2476571285767, 2086.405374468277, 2087.081684059017, 2209.1936443198197, 2237.932862014134, 2089.4880754215164, 2292.0, 2342.531493701258, 2348.753380895007, 2349.306954448442, 2271.909123635061, 2296.712910886139, 2305.2853615379204, 2309.480366917447, 2353.5645905507536, 2289.290320000805, 2290.6564015397657, 2318.7217533895873, 2320.3155069254612, 2322.6632138339933, 2252.234240358286, 2271.829612779048, 2273.1134857405623, 2273.6021196290585, 2277.02088102116, 7791.22087791222, 7866.331361834251, 7867.606619669051, 7879.093904201033, 7884.172161922973, 4825.300331451955, 4856.198727210006, 4861.80552777892, 4870.050340183666, 4922.286268491049, 3108.922276943072, 3140.7173354397987, 3233.708966193054, 3244.5944256967878, 3258.5926759155104, 953.4612943686794, 977.0913050862695, 980.4999450280337, 991.6925753016516, 1002.8495725641139, 10818.188635852342, 10820.0, 10829.783404331947, 10832.945835270852, 10838.40388778617, 4462.219111655448, 4482.663800214997, 4528.88677783058, 4549.158405694957, 4550.84072057483, 9228.769280768034, 9239.353245272767, 9245.583948722324, 9253.120953509406, 9255.629774808933, 4939.87650308738, 4949.7772600233075, 4957.3059771632, 4959.231319145538, 4963.70217786934, 4442.4669039715445, 4505.05393867285, 4507.053518761031, 4512.52618475062, 4518.322251662211, 3278.098522906172, 3332.983335083309, 3628.238070005276, 3671.2840996006057, 3702.20402613434, 1190.2382475215868, 1193.3675152169365, 1224.865264820869, 1244.539520377466, 1258.7356655102349, 1010.5503051142172, 1012.0739523336065, 1042.0881728487573, 1118.4463690473106, 1291.606060151644, 7021.824454388579, 7065.89401158983, 7077.504574679723, 7079.539829911039, 7087.1849737279845, 1179.604832381162, 1206.6681662542871, 1219.0856857356982, 1232.1744431231098, 1249.3503378243263, 5687.3459552152035, 5754.597178197486, 5795.739191736382, 5811.709414529257, 5812.070068788974, 8892.73321800334, 9076.591553379982, 9078.636854525745, 9086.636534538544, 9089.22741566961, 8968.148025937526, 8982.416142950688, 9004.324675649352, 9008.63965441388, 9023.142801433853, 7145.1425828900865, 7284.562926224444, 7285.890711639329, 7339.926600733925, 7355.668994895135, 7172.318629730167, 7304.196538380667, 7324.487285889936, 7357.484976051625, 7362.4478164136835, 8322.958385208036, 8454.36592255571, 8553.786155346166, 8596.78508037304, 8622.78443038904, 8598.054214036576, 8630.5253211074, 8671.089535598923, 8758.737237882873, 8778.692745753868, 7108.715651373887, 7197.748078817216, 7198.7840364789145, 7202.207757146814, 7208.171060328129, 6789.524733268624, 6943.68753406108, 7189.2810718927685, 7673.462857599914, 7708.4218683600075, 7045.260247674126, 7054.682539285642, 7139.500234983501, 7182.317679820409, 7220.133583969957, 6933.445324373937, 6973.721051157897, 7014.368706816411, 7095.077639906779, 7140.750073747394, 6971.0, 7014.193367762773, 7037.049998250171, 7038.2609825969585, 7053.435725141873, 6245.219347581552, 6284.685765711788, 6292.087647291209, 6292.244930608356, 6306.653134077486, 6519.217693876575, 6573.309802470863, 6578.638174900427, 6580.276169621242, 6586.40722334973], "unit": "score", "name": "mootools.html", "value": 4509.027279377104}, {"lowerIsBetter": false, "replicates": [321.1585645608506, 322.1993346533863, 327.91310302769784, 330.4662969304573, 332.22591362126246, 5805.24531810865, 5846.3569007409205, 5899.793507227248, 5915.142304365864, 5945.851353716159, 5755.913661295084, 5846.941530584703, 5870.88258234835, 5873.089671100986, 5882.705864706758, 4530.569595888385, 4535.841245556406, 4536.682432229745, 4536.727796332214, 4540.091981603692, 4356.0, 4447.577480139382, 4448.822047118111, 4510.436195475566, 4548.545145485442, 4469.0, 4473.865784026484, 4474.0380818124095, 4500.257457519521, 4513.7517436540975, 4499.392582001421, 4503.954960450386, 4510.25580779171, 4521.276595744682, 4525.343825145368, 3940.1134744682504, 3940.7241493095494, 3944.6844252460023, 3944.842206311744, 3956.1098752780395, 5507.697076660782, 5604.047311956977, 5621.915671264935, 5623.325200975909, 5634.830955071355, 5156.0, 5160.303359046556, 5165.793368265303, 5166.4575219601775, 5168.431472538018, 5945.940540594625, 6210.534209934228, 6222.408871157233, 6225.408586184305, 6231.688415579249, 4135.462389889325, 4174.666026717855, 4252.319628859399, 4269.082147338338, 4275.764832934187, 6354.205724284465, 6441.677916104176, 6449.9355006449805, 6453.096566480696, 6464.353564643545, 4351.347297905276, 4352.303631419021, 4354.194474022316, 4356.063446358985, 4358.171947329997, 4278.465191851019, 4392.912141757147, 4406.735595864258, 4411.977940110279, 4418.182636212311, 5119.59043276537, 5122.0, 5123.590112790967, 5125.308083408767, 5125.8718532037, 6229.875402491924, 6253.0, 6257.405546473078, 6260.812175634738, 6266.561340706106, 1529.9770503442458, 1549.0937801386315, 1561.07896341157, 1563.0309208290932, 1563.687262547495, 1024.2113572549094, 1028.311031608824, 1035.0167341026056, 1038.745507350704, 1054.862867827193, 5926.7925622603, 5927.081302398049, 5929.822105336847, 5930.406959304035, 5931.139984702194, 6360.7137678804565, 6367.458766004849, 6367.904481432783, 6369.108324834527, 6374.330695277022, 5911.083782013795, 5919.3192782829665, 5927.051671732502, 5934.228550288522, 5935.228420305332, 3430.4168291390524, 3506.1409954561295, 3508.5438892943753, 3513.4202856528386, 3524.964750352515, 6606.7026983785845, 6655.700493477805, 6658.5671931324305, 6665.766698165541, 6668.499862510331, 6721.731130754715, 6722.058911752359, 6732.663366831639, 6732.831679207961, 6737.898931516032, 6460.3216662250725, 6631.933680663228, 6641.634710090992, 6646.468282537386, 6651.16860392451, 6298.118263443213, 6435.195600549931, 6525.543211975116, 6528.706208220547, 6542.738290468328, 6306.936930630818, 6373.171487706569, 6412.166418365583, 6478.708458119301, 6478.773242936663, 6520.347965203442, 6533.118029066015, 6555.737770489127, 6591.011348297794, 6615.66921653925, 4211.305134652748, 4331.306990881444, 4376.1247750450675, 4380.802863871198, 4380.890477738082, 6429.7749578764515, 6440.710168042356, 6444.355564443518, 6449.064885591657, 6455.225372955276, 6229.190205273286, 6273.404026617464, 6275.215598050244, 6280.371962803683, 6280.497560195265, 6249.50003999688, 6264.436200741773, 6273.96863015682, 6276.497880169667, 6277.466415354746, 6196.442320191204, 6262.373762623702, 6267.561270711007, 6267.9373206267355, 6270.686465676789, 6395.968020159869, 6402.519811014099, 6405.455536279468, 6408.551401401857, 6413.35866413355, 6139.447449729546, 6248.843778905563, 6250.781222657367, 6261.8747625046335, 6265.530085243534], "unit": "score", "name": "prototype.html", "value": 4693.873900525149}, {"lowerIsBetter": false, "replicates": [761.4859969520576, 783.8079670480734, 837.158655551171, 840.8318336332733, 842.2840585502324, 13363.532276370317, 13625.931870340659, 13629.727405451886, 13638.38627261773, 13653.249071301074, 11859.169858109935, 11924.344161071138, 12384.752304953896, 13198.954162104888, 13274.668133296673, 697.6093387702878, 830.1615368477835, 851.0553285852699, 851.4891065360765, 852.0627309959026, 701.5439964023375, 818.443458448255, 842.1746688245523, 842.5239739547167, 845.0408786027872, 868.431177578687, 888.6001299415257, 889.1375365895103, 889.5463313709989, 890.8930928288582, 717.8169566760469, 724.4059870905859, 873.2533683700408, 877.0396415924553, 884.4825776920509, 650.5316172355944, 652.0349882174361, 653.7875190563086, 654.1038776875663, 654.1365397675071, 13303.733925321536, 13424.463021479129, 13474.663133421744, 13478.932605336911, 13503.797443038264, 11766.235194712317, 11938.164328497009, 12297.3236471994, 12498.437570309357, 12798.0, 9393.0, 9651.131398174128, 9817.410955342702, 9863.556139973718, 9903.108720215216, 3551.8579256829694, 3602.829080548806, 3631.6005239423644, 3640.526731524911, 3647.5075864758182, 44082.77958610187, 44448.0, 44583.108337833386, 45032.54967450316, 45238.0, 10551.736206594896, 10866.836997445045, 11005.724856878642, 11142.777144457066, 11337.773244535063, 18795.90602046981, 18937.621247575247, 18950.526236843914, 18987.0, 18996.865517189784, 7927.722529711547, 8021.759347219593, 8036.839263214703, 8114.959425202836, 8141.959290203511, 4515.683902126885, 4528.750918699503, 4563.201439748031, 4565.155446242456, 4610.700304480198, 3140.0, 3163.4622114240633, 3172.8254945977733, 3173.650898401174, 3175.618925728881, 593.2080672302438, 598.2581598817435, 601.9217501724747, 605.2011345024613, 608.7504123309421, 565.4825834361513, 650.4698670583459, 658.577827879792, 667.5694177255643, 668.1647940074906, 8144.14486478923, 8201.58992050407, 8204.097549269576, 8351.331893448509, 8524.57377131141, 560.5403569073321, 578.23672751967, 621.5586933277424, 685.6126288646899, 707.9716811327489, 3650.0, 3943.3099207638547, 3999.5000624921886, 4066.207089617496, 4067.6949228807957, 53072.203916941275, 53100.93798124093, 54955.45044549583, 55142.448575514536, 58662.0, 46147.538524614996, 46172.76913615411, 46384.5361546387, 46876.531234687216, 50509.494905051215, 43995.0, 44458.888527787065, 45296.773516132205, 45812.3128153078, 45910.0, 7958.681652733826, 8071.762309811796, 8105.189481051848, 8250.21487537215, 8341.916580834357, 33196.66803331936, 33549.0, 34382.484262735576, 34498.48252276268, 34685.65314346925, 41433.0, 41435.79282103691, 42064.0, 43645.0, 43688.29636739019, 10059.949700251453, 10091.545880435251, 10456.372617642966, 10680.072559729424, 10817.0, 11056.0, 11128.610498632508, 11131.610393636507, 12170.695732606402, 12539.310337931502, 9935.354201976848, 10060.44667543263, 10166.796664066826, 10173.418486320548, 10461.424621645883, 10427.843582346422, 10449.582016719247, 10513.737156571147, 10589.841152382874, 10824.134069274596, 9734.221262299141, 9876.0, 9935.155511781579, 9936.453495057842, 9972.252081093802, 9572.138507534077, 9736.902630973884, 9839.0, 9884.901150988399, 9995.779647973048, 8342.958285208779, 8835.204831564934, 8971.461712297283, 8973.28213742912, 9230.861537076815], "unit": "score", "name": "yui.html", "value": 6198.688694461256}], "name": "dromaeo_css", "value": 6944.195291387328}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [108.0, 110.0, 106.0, 112.0, 111.0, 111.0, 100.0, 109.0, 110.0, 116.0], "unit": "score", "name": "ai-astar", "value": 109.3}, {"lowerIsBetter": true, "replicates": [150.0, 132.0, 155.0, 158.0, 124.0, 156.0, 156.0, 124.0, 172.0, 123.0], "unit": "score", "name": "audio-beat-detection", "value": 145.0}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 161.0, 159.0, 161.0, 161.0, 161.0, 160.0, 159.0, 161.0], "unit": "score", "name": "audio-dft", "value": 160.5}, {"lowerIsBetter": true, "replicates": [71.0, 72.0, 81.0, 93.0, 72.0, 72.0, 72.0, 126.0, 94.0, 73.0], "unit": "score", "name": "audio-fft", "value": 82.6}, {"lowerIsBetter": true, "replicates": [94.0, 93.0, 140.0, 93.0, 94.0, 94.0, 140.0, 94.0, 94.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 107.2}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 109.0, 109.0, 110.0, 110.0, 109.0, 109.0, 110.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.4}, {"lowerIsBetter": true, "replicates": [145.0, 145.0, 145.0, 146.0, 146.0, 146.0, 146.0, 145.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 97.0, 97.0, 96.0, 97.0, 96.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [62.0, 61.0, 61.0, 60.0, 63.0, 61.0, 60.0, 72.0, 58.0, 60.0], "unit": "score", "name": "json-parse-financial", "value": 61.8}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 67.0, 67.0, 67.0, 66.0, 74.0, 67.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.7}, {"lowerIsBetter": true, "replicates": [87.0, 93.0, 85.0, 85.0, 85.0, 84.0, 84.0, 85.0, 86.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.9}, {"lowerIsBetter": true, "replicates": [121.0, 118.0, 120.0, 124.0, 124.0, 115.0, 127.0, 120.0, 132.0, 121.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.2}, {"lowerIsBetter": true, "replicates": [144.0, 156.0, 155.0, 156.0, 153.0, 141.0, 154.0, 155.0, 152.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.8}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 70.0, 66.0, 68.0, 66.0, 67.0, 67.0, 68.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.3}], "name": "kraken", "value": 1511.1}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.45334215751157], "unit": "score", "name": "Richards", "value": 213.36528799999996}, {"lowerIsBetter": false, "replicates": [189.2147587511826], "unit": "score", "name": "DeltaBlue", "value": 349.43363}, {"lowerIsBetter": false, "replicates": [283.5270768358378], "unit": "score", "name": "Encrypt", "value": 938.8203869999999}, {"lowerIsBetter": false, "replicates": [5143.589743589743], "unit": "score", "name": "Decrypt", "value": 51.75004486540379}, {"lowerIsBetter": false, "replicates": [1964.6365422396857], "unit": "score", "name": "RayTrace", "value": 376.654401}, {"lowerIsBetter": false, "replicates": [796.8127490039841], "unit": "score", "name": "Earley", "value": 836.4110649999999}, {"lowerIsBetter": false, "replicates": [12156.626506024097], "unit": "score", "name": "Boyer", "value": 54.82302180376615}, {"lowerIsBetter": false, "replicates": [26153.846153846152], "unit": "score", "name": "RegExp", "value": 34.8317794117647}, {"lowerIsBetter": false, "replicates": [656.5988181221273], "unit": "score", "name": "Splay", "value": 124.11079299999996}, {"lowerIsBetter": false, "replicates": [4854.368932038835], "unit": "score", "name": "NavierStokes", "value": 305.7040000000001}], "name": "v8_7", "value": 19652.210780183894}]} 20:15:35 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,201,35]]", "result": "19652.21"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,201,35]]", "result": "1511.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,201,35]]", "result": "6944.20"}}} 20:15:35 INFO - Return code: 0 20:15:36 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 20:15:36 INFO - # TBPL SUCCESS # 20:15:36 INFO - Running post-action listener: _resource_record_post_action 20:15:36 INFO - Running post-run listener: _resource_record_post_run 20:15:37 INFO - Total resource usage - Wall time: 1230s; CPU: 13.0%; Read bytes: 0; Write bytes: 570273792; Read time: 0; Write time: 922908 20:15:37 INFO - install - Wall time: 16s; CPU: 17.0%; Read bytes: 0; Write bytes: 250109952; Read time: 0; Write time: 526792 20:15:37 INFO - run-tests - Wall time: 1214s; CPU: 13.0%; Read bytes: 0; Write bytes: 320163840; Read time: 0; Write time: 396116 20:15:37 INFO - Running post-run listener: _upload_blobber_files 20:15:37 INFO - Blob upload gear active. 20:15:37 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 20:15:37 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 20:15:37 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'B2G-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 20:15:37 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b B2G-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 20:15:37 INFO - (blobuploader) - INFO - Open directory for files ... 20:15:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 20:15:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:15:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:15:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 20:15:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:15:38 INFO - (blobuploader) - INFO - Done attempting. 20:15:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 20:15:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:15:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:15:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 20:15:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:15:39 INFO - (blobuploader) - INFO - Done attempting. 20:15:39 INFO - (blobuploader) - INFO - Iteration through files over. 20:15:39 INFO - Return code: 0 20:15:39 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 20:15:39 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 20:15:39 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/70089b17241bed05935d905f536cd9714515af995793008ac55ad0173f65a13cfd73e8539fa557326f6b2b8d5756cd043e87202efaf0cff85aaf4128d56ecbbc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/3cab353741fe68b3418a293ed8a75fccb30eef8a27afaa763cc67771e895e7f9e5809d4ad9392cc5095b008cf135b4ed09b8c55b93f992606a9e379f6c95e024"} 20:15:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 20:15:39 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 20:15:39 INFO - Contents: 20:15:39 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/70089b17241bed05935d905f536cd9714515af995793008ac55ad0173f65a13cfd73e8539fa557326f6b2b8d5756cd043e87202efaf0cff85aaf4128d56ecbbc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/3cab353741fe68b3418a293ed8a75fccb30eef8a27afaa763cc67771e895e7f9e5809d4ad9392cc5095b008cf135b4ed09b8c55b93f992606a9e379f6c95e024"} 20:15:39 INFO - Copying logs to upload dir... 20:15:39 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1268.446128 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2015-12-21 20:15:38.687667) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-21 20:15:38.690718) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/70089b17241bed05935d905f536cd9714515af995793008ac55ad0173f65a13cfd73e8539fa557326f6b2b8d5756cd043e87202efaf0cff85aaf4128d56ecbbc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/3cab353741fe68b3418a293ed8a75fccb30eef8a27afaa763cc67771e895e7f9e5809d4ad9392cc5095b008cf135b4ed09b8c55b93f992606a9e379f6c95e024"} build_url:https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011547 build_url: 'https://queue.taskcluster.net/v1/task/8K0wi5qARo6ZX8d8ng-X7Q/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/70089b17241bed05935d905f536cd9714515af995793008ac55ad0173f65a13cfd73e8539fa557326f6b2b8d5756cd043e87202efaf0cff85aaf4128d56ecbbc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/3cab353741fe68b3418a293ed8a75fccb30eef8a27afaa763cc67771e895e7f9e5809d4ad9392cc5095b008cf135b4ed09b8c55b93f992606a9e379f6c95e024"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-21 20:15:38.718482) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 20:15:38.718825) ========= 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=d96ba47f58e561e1fc64d816000001cc-1450756187.760462-1276738221 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004517 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 20:15:38.800132) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 20:15:38.801112) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 20:15:38.801421) ========= ========= Total master_lag: 0.23 =========