builder: b2g-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-009 starttime: 1450724377.68 results: success (0) buildid: 20151221083151 builduid: eb649c9fcbfc439f80deb3e05b140e81 revision: 902e8490f2ce792a31474dc0c98c1f869c7de5f6 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.681317) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.682138) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.682591) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006346 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.714665) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.714964) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.732309) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.732590) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004547 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.782880) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.783219) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.783597) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.783902) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-21 10:59:38-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.5M=0s 2015-12-21 10:59:38 (43.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.180680 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.976757) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:37.977086) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014812 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.026635) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.026958) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 902e8490f2ce792a31474dc0c98c1f869c7de5f6 --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 902e8490f2ce792a31474dc0c98c1f869c7de5f6 --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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-21 10:59:38,858 truncating revision to first 12 chars 2015-12-21 10:59:38,858 Setting DEBUG logging. 2015-12-21 10:59:38,859 attempt 1/10 2015-12-21 10:59:38,859 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/902e8490f2ce?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-21 10:59:39,157 unpacking tar archive at: b2g-inbound-902e8490f2ce/testing/mozharness/ program finished with exit code 0 elapsedTime=0.573586 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.613540) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.613969) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.621616) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.621887) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 10:59:38.622338) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2015-12-21 10:59:38.622648) ========= /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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:59:39 INFO - MultiFileLogger online at 20151221 10:59:39 in /builds/slave/test-pgo 10:59:39 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 10:59:39 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 10:59:39 INFO - {'append_to_log': False, 10:59:39 INFO - 'base_work_dir': '/builds/slave/test-pgo', 10:59:39 INFO - 'blob_upload_branch': 'B2G-Inbound', 10:59:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 10:59:39 INFO - 'branch': 'B2G-Inbound', 10:59:39 INFO - 'buildbot_json_path': 'buildprops.json', 10:59:39 INFO - 'config_files': ('talos/linux_config.py',), 10:59:39 INFO - 'default_actions': ('clobber', 10:59:39 INFO - 'read-buildbot-config', 10:59:39 INFO - 'download-and-extract', 10:59:39 INFO - 'populate-webroot', 10:59:39 INFO - 'create-virtualenv', 10:59:39 INFO - 'install', 10:59:39 INFO - 'run-tests'), 10:59:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:59:39 INFO - 'download_minidump_stackwalk': True, 10:59:39 INFO - 'download_symbols': 'ondemand', 10:59:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:59:39 INFO - 'tooltool.py': '/tools/tooltool.py', 10:59:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:59:39 INFO - '/tools/misc-python/virtualenv.py')}, 10:59:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:59:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:59:39 INFO - 'installer_path': 'installer.exe', 10:59:39 INFO - 'log_level': 'info', 10:59:39 INFO - 'log_name': 'talos', 10:59:39 INFO - 'log_to_console': True, 10:59:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:59:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:59:39 INFO - 'opt_config_files': (), 10:59:39 INFO - 'pip_index': False, 10:59:39 INFO - 'sps_profile': False, 10:59:39 INFO - 'sps_profile_interval': 0, 10:59:39 INFO - 'suite': 'dromaeojs', 10:59:39 INFO - 'system_bits': '64', 10:59:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:59:39 INFO - 'title': 'talos-linux64-ix-009', 10:59:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:59:39 INFO - 'use_talos_json': True, 10:59:39 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 10:59:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:59:39 INFO - 'work_dir': 'build'} 10:59:39 INFO - ##### 10:59:39 INFO - ##### Running clobber step. 10:59:39 INFO - ##### 10:59:39 INFO - Running pre-action listener: _resource_record_pre_action 10:59:39 INFO - Running main action method: clobber 10:59:39 INFO - rmtree: /builds/slave/test-pgo/build 10:59:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 10:59:39 INFO - Running post-action listener: _resource_record_post_action 10:59:39 INFO - ##### 10:59:39 INFO - ##### Running read-buildbot-config step. 10:59:39 INFO - ##### 10:59:39 INFO - Running pre-action listener: _resource_record_pre_action 10:59:39 INFO - Running main action method: read_buildbot_config 10:59:39 INFO - Using buildbot properties: 10:59:39 INFO - { 10:59:39 INFO - "project": "", 10:59:39 INFO - "product": "firefox", 10:59:39 INFO - "script_repo_revision": "production", 10:59:39 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 10:59:39 INFO - "repository": "", 10:59:39 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound pgo talos dromaeojs", 10:59:39 INFO - "buildid": "20151221083151", 10:59:39 INFO - "pgo_build": "True", 10:59:39 INFO - "basedir": "/builds/slave/test-pgo", 10:59:39 INFO - "buildnumber": 1073, 10:59:39 INFO - "slavename": "talos-linux64-ix-009", 10:59:39 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 10:59:39 INFO - "platform": "ubuntu64_hw", 10:59:39 INFO - "scheduler": "tests-b2g-inbound-linux64-pgo-talos", 10:59:39 INFO - "branch": "b2g-inbound", 10:59:39 INFO - "repo_path": "integration/b2g-inbound", 10:59:39 INFO - "revision": "902e8490f2ce792a31474dc0c98c1f869c7de5f6", 10:59:39 INFO - "stage_platform": "linux64-pgo", 10:59:39 INFO - "builduid": "eb649c9fcbfc439f80deb3e05b140e81", 10:59:39 INFO - "slavebuilddir": "test" 10:59:39 INFO - } 10:59:39 INFO - Found installer url https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 10:59:39 INFO - Running post-action listener: _resource_record_post_action 10:59:39 INFO - ##### 10:59:39 INFO - ##### Running download-and-extract step. 10:59:39 INFO - ##### 10:59:39 INFO - Running pre-action listener: _resource_record_pre_action 10:59:39 INFO - Running main action method: download_and_extract 10:59:39 INFO - mkdir: /builds/slave/test-pgo/build/tests 10:59: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')]} 10:59:39 INFO - https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 10:59:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/test_packages.json 10:59:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/test_packages.json 10:59:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 10:59:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 10:59:41 INFO - Downloaded 1302 bytes. 10:59:41 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 10:59:41 INFO - Using the following test package requirements: 10:59:41 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 10:59:41 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:59:41 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'jsshell-linux-x86_64.zip'], 10:59:41 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:59:41 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 10:59:41 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:59:41 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:59:41 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:59:41 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 10:59:41 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 10:59:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:59:41 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:59:41 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')]} 10:59:41 INFO - https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:59:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:42 INFO - Downloaded 23174975 bytes. 10:59:42 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 10:59:42 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:42 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 10:59:43 INFO - Return code: 0 10:59:43 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 10:59:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:43 INFO - https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:59:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:44 INFO - Downloaded 23174975 bytes. 10:59:44 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 10:59:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 10:59:44 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 10:59:46 INFO - Return code: 0 10:59:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:46 INFO - https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:59:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 10:59:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 10:59:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:46 INFO - Downloaded 11132277 bytes. 10:59:46 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 10:59:46 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 10:59:46 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 10:59:47 INFO - Return code: 0 10:59:47 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')]} 10:59:47 INFO - https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:59:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 10:59:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 10:59:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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 10:59:49 INFO - Downloaded 54916150 bytes. 10:59:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 10:59:49 INFO - mkdir: /builds/slave/test-pgo/properties 10:59:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 10:59:49 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 10:59:49 INFO - Contents: 10:59:49 INFO - build_url:https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 10:59:49 INFO - Running post-action listener: _resource_record_post_action 10:59:49 INFO - Running post-action listener: set_extra_try_arguments 10:59:49 INFO - ##### 10:59:49 INFO - ##### Running populate-webroot step. 10:59:49 INFO - ##### 10:59:49 INFO - Running pre-action listener: _resource_record_pre_action 10:59:49 INFO - Running main action method: populate_webroot 10:59:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:59:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:59:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:59:49 INFO - '--tppagecycles', 10:59:49 INFO - '7'], 10:59:49 INFO - 'tests': ['tsvgm']}}, 10:59:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 10:59:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:59:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 10:59:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 10:59:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:59:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:59:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'tests': ['damp', 'tps']}, 10:59:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['damp', 'tps']}, 10:59:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 10:59:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:59:49 INFO - 'other': {'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'other_l64': {'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'other_nol64': {'tests': ['a11yr', 10:59:49 INFO - 'ts_paint', 10:59:49 INFO - 'tpaint', 10:59:49 INFO - 'sessionrestore', 10:59:49 INFO - 'sessionrestore_no_auto_restore']}, 10:59:49 INFO - 'svgr': {'tests': ['tsvgx', 10:59:49 INFO - 'tsvgr_opacity', 10:59:49 INFO - 'tart', 10:59:49 INFO - 'tscrollx', 10:59:49 INFO - 'cart']}, 10:59:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['tsvgx', 10:59:49 INFO - 'tsvgr_opacity', 10:59:49 INFO - 'tart', 10:59:49 INFO - 'tscrollx', 10:59:49 INFO - 'cart']}, 10:59:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'tests': ['tp5o']}, 10:59:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'talos_options': ['--e10s'], 10:59:49 INFO - 'tests': ['tp5o']}, 10:59:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'talos_options': ['--xperf_path', 10:59:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:59:49 INFO - 'tests': ['tp5n']}, 10:59:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:59:49 INFO - 'talos_options': ['--e10s', 10:59:49 INFO - '--xperf_path', 10:59:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:59:49 INFO - 'tests': ['tp5n']}}, 10:59:49 INFO - 'talos.zip': {'path': '', 10:59:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:59:49 INFO - Running post-action listener: _resource_record_post_action 10:59:49 INFO - ##### 10:59:49 INFO - ##### Running create-virtualenv step. 10:59:49 INFO - ##### 10:59:49 INFO - Running pre-action listener: _resource_record_pre_action 10:59:49 INFO - Running main action method: create_virtualenv 10:59:49 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 10:59:49 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 10:59:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 10:59:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:59:49 INFO - Using real prefix '/usr' 10:59:49 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 10:59:49 INFO - Installing distribute.............................................................................................................................................................................................done. 10:59:51 INFO - Installing pip.................done. 10:59:51 INFO - Return code: 0 10:59:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 10:59:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:51 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', '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 10:59:51 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 10:59:51 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 10:59:51 INFO - Using env: {'DISPLAY': ':0', 10:59:51 INFO - 'HOME': '/home/cltbld', 10:59:51 INFO - 'LANG': 'en_US.UTF-8', 10:59:51 INFO - 'LANGUAGE': 'en_US:en', 10:59:51 INFO - 'LOGNAME': 'cltbld', 10:59:51 INFO - 'MAIL': '/var/mail/cltbld', 10:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:59:51 INFO - 'MOZ_NO_REMOTE': '1', 10:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:59:51 INFO - 'NO_EM_RESTART': '1', 10:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:59:51 INFO - 'PWD': '/builds/slave/test-pgo', 10:59:51 INFO - 'SHELL': '/bin/bash', 10:59:51 INFO - 'SHLVL': '1', 10:59:51 INFO - 'TERM': 'linux', 10:59:51 INFO - 'TMOUT': '86400', 10:59:51 INFO - 'USER': 'cltbld', 10:59:51 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 10:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:59:51 INFO - '_': '/tools/buildbot/bin/python'} 10:59:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:59:52 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 10:59:52 INFO - Cleaning up... 10:59:52 INFO - Return code: 0 10:59:52 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 10:59:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:59:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:59:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:59:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:52 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', '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 10:59:52 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 10:59:52 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 10:59:52 INFO - Using env: {'DISPLAY': ':0', 10:59:52 INFO - 'HOME': '/home/cltbld', 10:59:52 INFO - 'LANG': 'en_US.UTF-8', 10:59:52 INFO - 'LANGUAGE': 'en_US:en', 10:59:52 INFO - 'LOGNAME': 'cltbld', 10:59:52 INFO - 'MAIL': '/var/mail/cltbld', 10:59:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:59:52 INFO - 'MOZ_NO_REMOTE': '1', 10:59:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:59:52 INFO - 'NO_EM_RESTART': '1', 10:59:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:59:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:59:52 INFO - 'PWD': '/builds/slave/test-pgo', 10:59:52 INFO - 'SHELL': '/bin/bash', 10:59:52 INFO - 'SHLVL': '1', 10:59:52 INFO - 'TERM': 'linux', 10:59:52 INFO - 'TMOUT': '86400', 10:59:52 INFO - 'USER': 'cltbld', 10:59:52 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 10:59:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:59:52 INFO - '_': '/tools/buildbot/bin/python'} 10:59:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:59:52 INFO - Downloading/unpacking psutil>=0.7.1 10:59: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 10:59: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 10:59: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 10:59: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 10:59: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 10:59: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 10:59:53 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 10:59:54 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 10:59:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 10:59:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:59:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:59:54 INFO - Installing collected packages: psutil 10:59:54 INFO - Running setup.py install for psutil 10:59:54 INFO - building 'psutil._psutil_linux' extension 10:59:54 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 10:59:54 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 10:59:54 INFO - building 'psutil._psutil_posix' extension 10:59:54 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 10:59:54 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 10:59:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:59:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:59:54 INFO - Successfully installed psutil 10:59:54 INFO - Cleaning up... 10:59:54 INFO - Return code: 0 10:59:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 10:59:54 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')]} 10:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:59:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:54 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')]} 10:59:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:59:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:54 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', '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 10:59:54 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 10:59:54 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 10:59:54 INFO - Using env: {'DISPLAY': ':0', 10:59:54 INFO - 'HOME': '/home/cltbld', 10:59:54 INFO - 'LANG': 'en_US.UTF-8', 10:59:54 INFO - 'LANGUAGE': 'en_US:en', 10:59:54 INFO - 'LOGNAME': 'cltbld', 10:59:54 INFO - 'MAIL': '/var/mail/cltbld', 10:59:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:59:54 INFO - 'MOZ_NO_REMOTE': '1', 10:59:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:59:54 INFO - 'NO_EM_RESTART': '1', 10:59:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:59:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:59:54 INFO - 'PWD': '/builds/slave/test-pgo', 10:59:54 INFO - 'SHELL': '/bin/bash', 10:59:54 INFO - 'SHLVL': '1', 10:59:54 INFO - 'TERM': 'linux', 10:59:54 INFO - 'TMOUT': '86400', 10:59:54 INFO - 'USER': 'cltbld', 10:59:54 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 10:59:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:59:54 INFO - '_': '/tools/buildbot/bin/python'} 10:59:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:59:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:59:54 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 10:59:54 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 10:59:54 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 10:59:54 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 10:59:54 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 10:59:54 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 10:59:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:59:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 10:59:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:59:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:59:56 INFO - Installing collected packages: mozsystemmonitor 10:59:56 INFO - Running setup.py install for mozsystemmonitor 10:59:56 INFO - Successfully installed mozsystemmonitor 10:59:56 INFO - Cleaning up... 10:59:56 INFO - Return code: 0 10:59:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 10:59: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')]} 10:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:59:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59: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')]} 10:59:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:59:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', '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 10:59:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 10:59:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:59:56 INFO - Using env: {'DISPLAY': ':0', 10:59:56 INFO - 'HOME': '/home/cltbld', 10:59:56 INFO - 'LANG': 'en_US.UTF-8', 10:59:56 INFO - 'LANGUAGE': 'en_US:en', 10:59:56 INFO - 'LOGNAME': 'cltbld', 10:59:56 INFO - 'MAIL': '/var/mail/cltbld', 10:59:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:59:56 INFO - 'MOZ_NO_REMOTE': '1', 10:59:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:59:56 INFO - 'NO_EM_RESTART': '1', 10:59:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:59:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:59:56 INFO - 'PWD': '/builds/slave/test-pgo', 10:59:56 INFO - 'SHELL': '/bin/bash', 10:59:56 INFO - 'SHLVL': '1', 10:59:56 INFO - 'TERM': 'linux', 10:59:56 INFO - 'TMOUT': '86400', 10:59:56 INFO - 'USER': 'cltbld', 10:59:56 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 10:59:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:59:56 INFO - '_': '/tools/buildbot/bin/python'} 10:59:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:59:56 INFO - Downloading/unpacking blobuploader==1.2.4 10:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:59:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:59:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:59:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:59:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:59:58 INFO - Downloading blobuploader-1.2.4.tar.gz 10:59:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 10:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:59:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:59: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 10:59: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 10:59: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 10:59: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 10:59: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 10:59: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 10:59:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 10:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 10:59:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:59:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:59:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:59:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:59:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:59:59 INFO - Downloading docopt-0.6.1.tar.gz 10:59:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 10:59:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 10:59:59 INFO - Installing collected packages: blobuploader, requests, docopt 10:59:59 INFO - Running setup.py install for blobuploader 10:59:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:59:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 10:59:59 INFO - Running setup.py install for requests 10:59:59 INFO - Running setup.py install for docopt 10:59:59 INFO - Successfully installed blobuploader requests docopt 10:59:59 INFO - Cleaning up... 10:59:59 INFO - Return code: 0 10:59:59 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 10:59:59 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')]} 10:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:59:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:59 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')]} 10:59:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:59:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:59:59 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', '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 10:59:59 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 10:59:59 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 10:59:59 INFO - Using env: {'DISPLAY': ':0', 10:59:59 INFO - 'HOME': '/home/cltbld', 10:59:59 INFO - 'LANG': 'en_US.UTF-8', 10:59:59 INFO - 'LANGUAGE': 'en_US:en', 10:59:59 INFO - 'LOGNAME': 'cltbld', 10:59:59 INFO - 'MAIL': '/var/mail/cltbld', 10:59:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:59:59 INFO - 'MOZ_NO_REMOTE': '1', 10:59:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:59:59 INFO - 'NO_EM_RESTART': '1', 10:59:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:59:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 10:59:59 INFO - 'PWD': '/builds/slave/test-pgo', 10:59:59 INFO - 'SHELL': '/bin/bash', 10:59:59 INFO - 'SHLVL': '1', 10:59:59 INFO - 'TERM': 'linux', 10:59:59 INFO - 'TMOUT': '86400', 10:59:59 INFO - 'USER': 'cltbld', 10:59:59 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 10:59:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:59:59 INFO - '_': '/tools/buildbot/bin/python'} 11:00:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:00:00 INFO - Running setup.py (path:/tmp/pip-BloIWl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:00:00 INFO - Running setup.py (path:/tmp/pip-u6m4Ts-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:00:00 INFO - Running setup.py (path:/tmp/pip-C8mtQD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:00:00 INFO - Running setup.py (path:/tmp/pip-xYLSxA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:00:00 INFO - Running setup.py (path:/tmp/pip-VJsuNy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:00:00 INFO - Running setup.py (path:/tmp/pip-HzKazY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:00:00 INFO - Running setup.py (path:/tmp/pip-wUcqWj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:00:00 INFO - Running setup.py (path:/tmp/pip-jnVr4l-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:00:00 INFO - Running setup.py (path:/tmp/pip-QaPlIN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:00:00 INFO - Running setup.py (path:/tmp/pip-DC0X0U-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:00:00 INFO - Running setup.py (path:/tmp/pip-jxUxQy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:00:00 INFO - Running setup.py (path:/tmp/pip-rUQkFQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:00:01 INFO - Running setup.py (path:/tmp/pip-G0VgAK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:00:01 INFO - Running setup.py (path:/tmp/pip-_KT0x8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:00:01 INFO - Running setup.py (path:/tmp/pip-uSls2e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:00:01 INFO - Running setup.py (path:/tmp/pip-PB_pqu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:00:01 INFO - Running setup.py (path:/tmp/pip-6OTdmo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:00:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:00:01 INFO - Running setup.py install for manifestparser 11:00:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 11:00:01 INFO - Running setup.py install for mozcrash 11:00:01 INFO - Running setup.py install for mozdebug 11:00:01 INFO - Running setup.py install for mozdevice 11:00:01 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 11:00:01 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 11:00:01 INFO - Running setup.py install for mozfile 11:00:01 INFO - Running setup.py install for mozhttpd 11:00:01 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozinfo 11:00:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozInstall 11:00:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozleak 11:00:02 INFO - Running setup.py install for mozlog 11:00:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for moznetwork 11:00:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozprocess 11:00:02 INFO - Running setup.py install for mozprofile 11:00:02 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozrunner 11:00:02 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 11:00:02 INFO - Running setup.py install for mozscreenshot 11:00:02 INFO - Running setup.py install for moztest 11:00:03 INFO - Running setup.py install for mozversion 11:00:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 11:00:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:00:03 INFO - Cleaning up... 11:00:03 INFO - Return code: 0 11:00:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:00:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:03 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:00:03 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 11:00:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:00:03 INFO - Using env: {'DISPLAY': ':0', 11:00:03 INFO - 'HOME': '/home/cltbld', 11:00:03 INFO - 'LANG': 'en_US.UTF-8', 11:00:03 INFO - 'LANGUAGE': 'en_US:en', 11:00:03 INFO - 'LOGNAME': 'cltbld', 11:00:03 INFO - 'MAIL': '/var/mail/cltbld', 11:00:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:03 INFO - 'MOZ_NO_REMOTE': '1', 11:00:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:03 INFO - 'NO_EM_RESTART': '1', 11:00:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:00:03 INFO - 'PWD': '/builds/slave/test-pgo', 11:00:03 INFO - 'SHELL': '/bin/bash', 11:00:03 INFO - 'SHLVL': '1', 11:00:03 INFO - 'TERM': 'linux', 11:00:03 INFO - 'TMOUT': '86400', 11:00:03 INFO - 'USER': 'cltbld', 11:00:03 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 11:00:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:03 INFO - '_': '/tools/buildbot/bin/python'} 11:00:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:00:03 INFO - Running setup.py (path:/tmp/pip-0UeZox-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:00:03 INFO - Running setup.py (path:/tmp/pip-nZwG3g-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:00:03 INFO - Running setup.py (path:/tmp/pip-BhssvG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:00:03 INFO - Running setup.py (path:/tmp/pip-eX6yAF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:00:03 INFO - Running setup.py (path:/tmp/pip-FKU1Zc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:00:03 INFO - Running setup.py (path:/tmp/pip-XNErrC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:00:03 INFO - Running setup.py (path:/tmp/pip-HV9Eng-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:00:03 INFO - Running setup.py (path:/tmp/pip-twC2bh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 11:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:00:03 INFO - Running setup.py (path:/tmp/pip-kXNO5N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:00:04 INFO - Running setup.py (path:/tmp/pip-KhZSTg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:00:04 INFO - Running setup.py (path:/tmp/pip-QrPJuw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:00:04 INFO - Running setup.py (path:/tmp/pip-TfXqy9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:00:04 INFO - Running setup.py (path:/tmp/pip-TB6B67-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:00:04 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)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:00:04 INFO - Running setup.py (path:/tmp/pip-1mMKn8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:00:04 INFO - Running setup.py (path:/tmp/pip-5xDqiX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:00:04 INFO - Running setup.py (path:/tmp/pip-4KinBU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 11:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:00:04 INFO - Running setup.py (path:/tmp/pip-CnvmMb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 11:00:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 11:00:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:00: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 11:00: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 11:00: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 11:00: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 11:00: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 11:00: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 11:00:06 INFO - Downloading blessings-1.5.1.tar.gz 11:00:06 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 11:00:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 11:00:06 INFO - Installing collected packages: blessings 11:00:06 INFO - Running setup.py install for blessings 11:00:06 INFO - Successfully installed blessings 11:00:06 INFO - Cleaning up... 11:00:06 INFO - Return code: 0 11:00:06 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 11:00:06 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:00:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:00:06 INFO - Reading from file tmpfile_stdout 11:00:06 INFO - Current package versions: 11:00:06 INFO - argparse == 1.2.1 11:00:06 INFO - blessings == 1.5.1 11:00:06 INFO - blobuploader == 1.2.4 11:00:06 INFO - docopt == 0.6.1 11:00:06 INFO - manifestparser == 1.1 11:00:06 INFO - mozInstall == 1.12 11:00:06 INFO - mozcrash == 0.16 11:00:06 INFO - mozdebug == 0.1 11:00:06 INFO - mozdevice == 0.47 11:00:06 INFO - mozfile == 1.2 11:00:06 INFO - mozhttpd == 0.7 11:00:06 INFO - mozinfo == 0.9 11:00:06 INFO - mozleak == 0.1 11:00:06 INFO - mozlog == 3.1 11:00:06 INFO - moznetwork == 0.27 11:00:06 INFO - mozprocess == 0.22 11:00:06 INFO - mozprofile == 0.28 11:00:06 INFO - mozrunner == 6.11 11:00:06 INFO - mozscreenshot == 0.1 11:00:06 INFO - mozsystemmonitor == 0.0 11:00:06 INFO - moztest == 0.7 11:00:06 INFO - mozversion == 1.4 11:00:06 INFO - psutil == 3.1.1 11:00:06 INFO - requests == 1.2.3 11:00:06 INFO - wsgiref == 0.1.2 11:00:06 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:00:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:06 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:00:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 11:00:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:00:06 INFO - Using env: {'DISPLAY': ':0', 11:00:06 INFO - 'HOME': '/home/cltbld', 11:00:06 INFO - 'LANG': 'en_US.UTF-8', 11:00:06 INFO - 'LANGUAGE': 'en_US:en', 11:00:06 INFO - 'LOGNAME': 'cltbld', 11:00:06 INFO - 'MAIL': '/var/mail/cltbld', 11:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:06 INFO - 'MOZ_NO_REMOTE': '1', 11:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:06 INFO - 'NO_EM_RESTART': '1', 11:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 11:00:06 INFO - 'SHELL': '/bin/bash', 11:00:06 INFO - 'SHLVL': '1', 11:00:06 INFO - 'TERM': 'linux', 11:00:06 INFO - 'TMOUT': '86400', 11:00:06 INFO - 'USER': 'cltbld', 11:00:06 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 11:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:06 INFO - '_': '/tools/buildbot/bin/python'} 11:00:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 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)) 11:00:06 INFO - Cleaning up... 11:00:06 INFO - Return code: 0 11:00:06 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 11:00:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:06 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 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:00:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 11:00:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:00:06 INFO - Using env: {'DISPLAY': ':0', 11:00:06 INFO - 'HOME': '/home/cltbld', 11:00:06 INFO - 'LANG': 'en_US.UTF-8', 11:00:06 INFO - 'LANGUAGE': 'en_US:en', 11:00:06 INFO - 'LOGNAME': 'cltbld', 11:00:06 INFO - 'MAIL': '/var/mail/cltbld', 11:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:06 INFO - 'MOZ_NO_REMOTE': '1', 11:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:06 INFO - 'NO_EM_RESTART': '1', 11:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 11:00:06 INFO - 'SHELL': '/bin/bash', 11:00:06 INFO - 'SHLVL': '1', 11:00:06 INFO - 'TERM': 'linux', 11:00:06 INFO - 'TMOUT': '86400', 11:00:06 INFO - 'USER': 'cltbld', 11:00:06 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 11:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:06 INFO - '_': '/tools/buildbot/bin/python'} 11:00:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:07 INFO - Downloading/unpacking jsonschema 11:00:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:00:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 11:00:09 INFO - Downloading/unpacking functools32 (from jsonschema) 11:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:09 INFO - Downloading functools32-3.2.3-2.tar.gz 11:00:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 11:00:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 11:00:09 INFO - warning: no files found matching '*.txt' 11:00:09 INFO - no previously-included directories found matching 'build' 11:00:09 INFO - no previously-included directories found matching 'dist' 11:00:09 INFO - no previously-included directories found matching '.git*' 11:00:09 INFO - Installing collected packages: jsonschema, functools32 11:00:09 INFO - Running setup.py install for functools32 11:00:09 INFO - warning: no files found matching '*.txt' 11:00:09 INFO - no previously-included directories found matching 'build' 11:00:09 INFO - no previously-included directories found matching 'dist' 11:00:09 INFO - no previously-included directories found matching '.git*' 11:00:09 INFO - Successfully installed jsonschema functools32 11:00:09 INFO - Cleaning up... 11:00:10 INFO - Return code: 0 11:00:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 11:00:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:00:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:00:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:00:10 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f366da84f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x152b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15fb630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, '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': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 11:00:10 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 11:00:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 11:00:10 INFO - Using env: {'DISPLAY': ':0', 11:00:10 INFO - 'HOME': '/home/cltbld', 11:00:10 INFO - 'LANG': 'en_US.UTF-8', 11:00:10 INFO - 'LANGUAGE': 'en_US:en', 11:00:10 INFO - 'LOGNAME': 'cltbld', 11:00:10 INFO - 'MAIL': '/var/mail/cltbld', 11:00:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:10 INFO - 'MOZ_NO_REMOTE': '1', 11:00:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:10 INFO - 'NO_EM_RESTART': '1', 11:00:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:00:10 INFO - 'PWD': '/builds/slave/test-pgo', 11:00:10 INFO - 'SHELL': '/bin/bash', 11:00:10 INFO - 'SHLVL': '1', 11:00:10 INFO - 'TERM': 'linux', 11:00:10 INFO - 'TMOUT': '86400', 11:00:10 INFO - 'USER': 'cltbld', 11:00:10 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 11:00:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:10 INFO - '_': '/tools/buildbot/bin/python'} 11:00:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:00:10 INFO - Downloading/unpacking flake8 11:00:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:11 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:00:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 11:00:11 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:12 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:00:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 11:00:12 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 11:00:12 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:00:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:00:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 11:00:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 11:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:00:12 INFO - no previously-included directories found matching 'docs/_build' 11:00:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:00:12 INFO - Running setup.py install for pep8 11:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:00:12 INFO - no previously-included directories found matching 'docs/_build' 11:00:12 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 11:00:12 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:00:12 INFO - Cleaning up... 11:00:12 INFO - Return code: 0 11:00:12 INFO - Running post-action listener: _resource_record_post_action 11:00:12 INFO - Running post-action listener: _start_resource_monitoring 11:00:12 INFO - Starting resource monitoring. 11:00:12 INFO - ##### 11:00:12 INFO - ##### Running install step. 11:00:12 INFO - ##### 11:00:12 INFO - Running pre-action listener: _resource_record_pre_action 11:00:12 INFO - Running main action method: install 11:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:00:13 INFO - Reading from file tmpfile_stdout 11:00:13 INFO - Detecting whether we're running mozinstall >=1.0... 11:00:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 11:00:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 11:00:13 INFO - Reading from file tmpfile_stdout 11:00:13 INFO - Output received: 11:00:13 INFO - Usage: mozinstall [options] installer 11:00:13 INFO - Options: 11:00:13 INFO - -h, --help show this help message and exit 11:00:13 INFO - -d DEST, --destination=DEST 11:00:13 INFO - Directory to install application into. [default: 11:00:13 INFO - "/builds/slave/test-pgo"] 11:00:13 INFO - --app=APP Application being installed. [default: firefox] 11:00:13 INFO - mkdir: /builds/slave/test-pgo/build/application 11:00:13 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'] 11:00:13 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 11:00:29 INFO - Reading from file tmpfile_stdout 11:00:29 INFO - Output received: 11:00:29 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 11:00:29 INFO - Running post-action listener: _resource_record_post_action 11:00:29 INFO - ##### 11:00:29 INFO - ##### Running run-tests step. 11:00:29 INFO - ##### 11:00:29 INFO - Running pre-action listener: _resource_record_pre_action 11:00:29 INFO - Running main action method: run_tests 11:00:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 11:00:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 11:00:29 INFO - Python 2.7.3 11:00:29 INFO - Return code: 0 11:00:29 INFO - grabbing minidump binary from tooltool 11:00:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:00:29 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 0x168c840>, '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 0x15f96b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f9b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 11:00:29 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 11:00:29 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 11:00:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:00:29 INFO - Return code: 0 11:00:29 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 11:00:29 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 11:00:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 11:00:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 11:00:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 11:00:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 11:00:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 11:00:30 INFO - Return code: 0 11:00:30 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/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--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 11:00:30 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/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-009 --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 11:00:30 INFO - Using env: {'DISPLAY': ':0', 11:00:30 INFO - 'HOME': '/home/cltbld', 11:00:30 INFO - 'LANG': 'en_US.UTF-8', 11:00:30 INFO - 'LANGUAGE': 'en_US:en', 11:00:30 INFO - 'LOGNAME': 'cltbld', 11:00:30 INFO - 'MAIL': '/var/mail/cltbld', 11:00:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:00:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 11:00:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:00:30 INFO - 'MOZ_NO_REMOTE': '1', 11:00:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:00:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:00:30 INFO - 'NO_EM_RESTART': '1', 11:00:30 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:00:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:00:30 INFO - 'PWD': '/builds/slave/test-pgo', 11:00:30 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 11:00:30 INFO - 'SHELL': '/bin/bash', 11:00:30 INFO - 'SHLVL': '1', 11:00:30 INFO - 'TERM': 'linux', 11:00:30 INFO - 'TMOUT': '86400', 11:00:30 INFO - 'USER': 'cltbld', 11:00:30 INFO - 'XDG_SESSION_COOKIE': 'a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019', 11:00:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:00:30 INFO - '_': '/tools/buildbot/bin/python'} 11:00:30 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/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-009', '--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 11:00:31 INFO - mozversion application_buildid: 20151221083151 11:00:31 INFO - mozversion application_changeset: 902e8490f2ce792a31474dc0c98c1f869c7de5f6 11:00:31 INFO - mozversion application_display_name: Nightly 11:00:31 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:00:31 INFO - mozversion application_name: Firefox 11:00:31 INFO - mozversion application_remotingname: firefox 11:00:31 INFO - mozversion application_repository: https://hg.mozilla.org/integration/b2g-inbound 11:00:31 INFO - mozversion application_vendor: Mozilla 11:00:31 INFO - mozversion application_version: 46.0a1 11:00:31 INFO - mozversion platform_buildid: 20151221083151 11:00:31 INFO - mozversion platform_changeset: 902e8490f2ce792a31474dc0c98c1f869c7de5f6 11:00:31 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/b2g-inbound 11:00:31 INFO - mozversion platform_version: 46.0a1 11:00:31 INFO - using testdate: 1450724431 11:00:31 INFO - actual date: 1450724431 11:00:31 INFO - starting webserver on 'localhost:52158' 11:00:31 INFO - SUITE-START | Running 3 tests 11:00:31 INFO - TEST-START | dromaeo_css 11:00:31 INFO - operating with platform_type : linux_ 11:00:31 INFO - Initialising browser for dromaeo_css test... 11:00:31 INFO - TEST-INFO | started process 1703 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5FwM_e/profile http://localhost:52158/getInfo.html) 11:00:34 INFO - PROCESS | 1703 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 11:00:34 INFO - PROCESS | 1703 | __metrics Screen width/height:1600/1200 11:00:34 INFO - PROCESS | 1703 | colorDepth:24 11:00:34 INFO - PROCESS | 1703 | Browser inner width/height: 1024/697 11:00:34 INFO - PROCESS | 1703 | __metrics 11:00:34 INFO - PROCESS | 1703 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 11:00:35 INFO - PROCESS | 1703 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:00:35 INFO - TEST-INFO | 1703: exit 0 11:00:35 INFO - Browser initialized. 11:00:35 INFO - Running cycle 1/1 for dromaeo_css test... 11:00:35 INFO - TEST-INFO | started process 1795 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5FwM_e/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:00:47 INFO - PROCESS | 1795 | RSS: Main: 149794816 11:00:47 INFO - PROCESS | 1795 | 11:01:39 INFO - PROCESS | 1795 | 1450724499250 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 11:03:47 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52158/tests/dromaeo/cssquery-ext.html) 11:03:48 INFO - PROCESS | 1795 | RSS: Main: 273960960 11:03:48 INFO - PROCESS | 1795 | 11:06:51 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-ext.html (next: http://localhost:52158/tests/dromaeo/cssquery-jquery.html) 11:06:51 INFO - PROCESS | 1795 | RSS: Main: 235577344 11:06:51 INFO - PROCESS | 1795 | 11:09:53 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52158/tests/dromaeo/cssquery-mootools.html) 11:09:54 INFO - PROCESS | 1795 | RSS: Main: 221700096 11:09:54 INFO - PROCESS | 1795 | 11:12:56 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52158/tests/dromaeo/cssquery-prototype.html) 11:12:56 INFO - PROCESS | 1795 | RSS: Main: 212320256 11:12:56 INFO - PROCESS | 1795 | 11:15:59 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52158/tests/dromaeo/cssquery-yui.html) 11:15:59 INFO - PROCESS | 1795 | RSS: Main: 216006656 11:15:59 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | Cycle 1(1): loaded http://localhost:52158/tests/dromaeo/cssquery-yui.html (next: http://localhost:52158/tests/dromaeo/cssquery-dojo.html) 11:19:02 INFO - PROCESS | 1795 | RSS: Main: 258744320 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | __start_tp_report 11:19:02 INFO - PROCESS | 1795 | _x_x_mozilla_page_load 11:19:02 INFO - PROCESS | 1795 | _x_x_mozilla_page_load_details 11:19:02 INFO - PROCESS | 1795 | |i|pagename|runs| 11:19:02 INFO - PROCESS | 1795 | |0;dojo.html;3098.426791043657;3156.352947645733;3194.121616555447;3202.4715921872894;3209.181658677038;5118.692878427297;5242;5281.260623512707;5283.867903302415;5339.786408543654;5152.716600586966;5172.250023746555;5191.662541934781;5211.035958347698;5282.339707536558;4772.546608072236;4802.279658051303;4813.085513752376;4864;4907.1657818171;4892.584130348907;4904.337914381566;4922.458529561745;4984.626153038518;5013.849584512471;4748.999999999983;4801.2798080287885;4849.199882019462;4908.656394052417;4923.4091908970795;4844.079624871299;4866.732329721864;4877.487863774323;4897.657163998521;4904.2643603459765;4808.735519546423;4844.442889067767;4855.223164293696;4857.82997595086;4887.3402090717655;5066.797328106872;5073.1122053640465;5162.070827251093;5193.428722840485;5220.216967454912;5622.690752008638;5652.236948012007;5657.886842263131;5666.263385759866;5666.858328541778;5677.261955945742;5698.971505142447;5700.600957932947;5701.0878259478695;5705.885882282331;5192.480751924815;5246.344206974129;5250.422453530108;5308.893822123536;5401.162819762943;5767.625104368202;5770.047942089592;5778.422157784272;5800.0429929062075;5841.182234487175;5630.0991841305195;5644.576656750678;5645.5201307888465;5654.773809047592;5656.434356564393;5524.309461317335;5574.9721251393485;5629.662220266797;5665.858353541194;5775.393583673737;5620.831375058755;5647.830565083054;5663.9716801415725;5669.433056694297;5677.233573467612;5666;5669.886602268014;5671.432856714296;5673.3475650299915;5674.404187560329;4255.638270746959;4342.630876375543;4349.608535231844;4429.889252768642;4445.022095139064;3915.7063220258024;3929.7838618876235;3930.587288334741;3948.190620922704;3954.3277642800795;5352.518273355339;5354.11657076578;5360.901015291855;5361.973190134025;5367.677939323653;5573.665580065209;5710.057840456278;5711.771529138871;5732.082866741302;5841.2990441146485;5362.383325917569;5365.9731701342025;5378.19327100938;5379.112446446371;5388.245645609618;4993.700377977333;4995.400551933792;4996.375453068366;5006.048850718352;5048.7728052237735;5594.13290939905;5658.151277308437;5702.2301989231755;5763.971180144073;5851.9999999999145;5646.576506761927;5654.943450565442;5692.0608099663095;5700.401457846866;5719.056355701263;5774.769009239583;5777.884442311214;5788.305403351625;5791.189233507396;5795.217645617788;5398.7300634967305;5491.341039075336;5493.560515158858;5563;5660.773569057192;5685.857853553694;5738.368779434176;5765.94234057654;5766;5820.039693450533;5661.575381846295;5674.092145256739;5678.858028549319;5696.971515142398;5697.259356283656;5309.442508536548;5464.754086066216;5477.4796394342475;5516.172574113915;5615.382307946041;5439.37447193562;5465.289512363367;5466.289382380265;5468.644538105011;5469.75386107634;5603.635763675348;5611.551075913835;5611.859703507445;5616.69108199053;5659.094544872801;5287.471252874836;5391.029614669397;5392.649477783932;5393.8112166074;5497.422770609029 11:19:02 INFO - PROCESS | 1795 | |1;ext.html;568.2073507457095;599.1940839570776;607.4897086447384;609.1015751766145;614.311970592936;29699.554506682416;30274;30298.939537116206;30332.241693957636;30356.24109397266;31005.22486937828;34068.318633627314;34106.829465852636;34387.656123438755;34504.137396565035;8800.95599522003;8922.197002269795;8935.508547029911;8942.239909607692;8945.95527022364;7841.6079196040255;8669.69656062038;8768.254698350647;8774.912250877473;8783.253423458982;7793.4934229275195;10723.14214862809;10965.122790176767;10983.231173817836;10993.505292261867;10460.843087353696;10475.476226188737;10518.579256829718;10566.577336906554;10568.52441640128;7872.921270787333;8044.155363686846;10325.173986081096;10452.94773526135;10627.202959778047;39350.40974385387;39542.20915581672;39902.401463978065;40041.59958400408;40065.19869602621;3241.6272128705264;3289.276359200972;3532.1699400640828;3634.4003239465455;4016;30296.091117266296;30684.38631227385;30747;30820.537691934638;31261.374772504423;3707.8146092695256;3826.540815102178;3847.76913385195;3926.705497087701;4054.290499162664;271980.7608657615;272956;273892.999999998;274482;274601;59767.402325977055;60718.69640651769;60748.69625651844;60809.08786368208;60814;55543.44456555464;55785.72107139519;55866.72066639641;55880.16179757307;55930.16104758432;15518.379264829506;15662.686746265012;15675.372985080698;15681.529554113395;15687.529374118567;12260.44827982743;12263.93868030654;12307.630771076882;12343.6914077147;12375.195612285173;18991.81008189928;19906.203751850055;19944.3019494317;19951.70313929619;19964.60070798576;7551.5091519052185;7761.534307941429;7807.609619519001;7820.178881217504;7869.409794265453;886.9955650221708;905.3979103895967;996.3274789517047;1027.6557353286732;1031.9690409287734;27929.44141117166;28908;29424.852875735483;29429.85285073561;29518.704812951597;926.8517037274004;976.7948730766476;986.5313975861409;986.9506524673737;1007.0936157458347;13321.267330296732;13756.380962856696;14021;15422.845771542365;15825;248036;250771;251845;251888;252531;48812.755936220805;49390.25914611284;49402.50597494051;49534.75232623886;49553.75223123861;1317.0385618498358;1321.7951217561294;1322.8677132286693;1345.0584590786489;1358.4023029866828;26304.21087367382;27687.86156069207;27717;29187.416251675273;30084.24789380283;42619.7214083578;43283.78358108315;47561.76219118882;49360.75319623379;50272;235195;238394;238640;239266;240086;27994.300142496602;30696.693033070278;31105.688943111185;31349.529757053206;31382;33600.49599255964;39103;40234.39648405335;40557.18885622212;40805;33205.50191747078;33875.322493550484;34428.31143377168;36515;36593.81703091467;37387;38053.61946380501;38105;38145.618543814206;38244.23511529698;36544.26911461809;37003.44494832634;37132.44301335428;37212;37313.253734924605;30566.84716576403;33626.32747345088;33713;33954.92540895109;34002.31995360128;25153.622695659215;25297;25408.74591254064;25546.722663867105;25904.8704756475 11:19:02 INFO - PROCESS | 1795 | |2;jquery.html;331.3422855631571;332.0685477236351;345.08208166277706;351.7397126126666;355.51827274043677;14152.575422737309;14528.564143075699;16581;16707.749383759252;17517.386891458802;10766.676999690022;13485.730285394286;14354.425822967069;16298.348066077373;16299.185040747945;4798.0643774464;4952.801887924478;4953.702777833341;4962.900741985158;4964.379452568429;3733.607971163016;3761.736678432511;4927.18701414268;4948.134076536592;4957.479464656213;4846.636502262327;5475.5072043516275;5491.093969495028;5500.669959802404;5500.752466139013;5322;5435.374931882845;5456;5471.644343117705;5473.28847249859;5218.243354713545;5231.476852314776;5236;5236.581073514109;5240.423553409122;12154.149209555335;14295.57113286603;16320.020798751993;19758.70361944572;19792.40622781319;2004.9498762530907;2047.2936836791282;2103.074647155247;2131.435169680036;2269.8184145268337;9254.953725231398;9532.714018579454;12208.145429819917;12258.938705306417;12727.490900363975;1806.5813309975583;1834.3579747088545;1842.5946291815778;1861.0601646168734;1876.2119909637984;57859.710701446646;61633.383666163216;62276.68861655708;63284.367156328306;63778.3622163777;10186.694399168036;10188.898111018794;10215.693529194135;10228.59085636581;10290.948545257226;13270.933645331712;13285.402156902963;13292.73414531704;13311.134776239513;13314.267715275753;7606.923930760732;7635.732749353857;7643.847123057619;7680.9615951921;7697.653605587762;7340.082489688789;7411.814704632319;7453.217412171753;7473.701051957861;7484.850302993909;4271.914561708749;4290.485141782943;4311.9784401077795;4411.514733379326;4472.016156445577;1725.30125299254;1738.852197563196;1774.8136445673276;1810.2259785410108;1841.4255811281162;879.5382424227332;917.2984114467699;947.8388673925449;959.3572306554626;986.6842610364614;15259.62663360303;15595;16124;16237.106959117125;16270.105144217181;804.7907544038592;895.3106108296575;908.2416182487565;930.9767255818658;974.64425484699;8622.482651040958;8910.420822646507;8976.632069645706;9071.455712657262;9414.15272625467;544546;546649;553860;571444;573690;81800;85601.57199213964;86059.56970215109;86919.13080869237;90310.54844725865;1120.4957769003981;1144.4220668562489;1147.94260286987;1153.2273376837538;1154.584349634131;15796.131212783408;15839.366425342858;15885.602859928133;15959;16373.181340932668;34401.48397773985;36509.817450912575;36984.815075924445;37846;39176.41235381414;37573.43639845459;45353.31970020518;47456;48839.5116048835;49112.75443622759;9275.86086208694;9569.3779904306;9740.172085372822;9760.853587196056;9777.755556111155;11476.4261786912;11476.598319058792;11526.366049867001;11528;11616.825747613624;13569.52506662262;14787.408503659733;14788.11271323724;15138.470153545013;15183.164925928739;9053.366264361432;9171.495567743837;14546.41814327415;14795.852041479448;14937.327820247898;9027.909720902708;9207.631694732403;9737.415755054719;10048.246381521269;10369.118624916664;14498.347574358968;14535;14839.183844888636;15054.247287635793;15071.623209419853;15491;15586.03865265596;16070.43753468623;16671.91664041672;16941 11:19:02 INFO - PROCESS | 1795 | |3;mootools.html;1299.3762993762987;1678.6223099802544;1721.793384793824;1738.5914310137123;1739.9478015659531;6537.150170477843;7179.389751871091;7361.963190184055;7363.263673632634;7364.079490063748;7287.198408175096;7458.850822983537;7459.254074592538;7463.477556571042;7465.552066875991;1925.86518943674;1976.723258743777;1978.4855937456293;2265.558216147856;2307.9884600576975;1986.0665487221056;1990.9104090315898;2212.856164349312;2257.1761307122947;2257.4582100295893;2214.4795972946345;2238.876861772602;2242.114364825901;2244.2257421189665;2255.4474153832252;2229.308914236584;2259.378670865509;2261.2424837679314;2261.412032871457;2270.5231901300745;2256.255435706213;2305.654151877215;2307.273208939179;2308.1690591387087;2309.90760369585;7338.743143989988;7381.11426628808;7397.149327827315;7398.852022959564;7416;4560.361549383089;4630.351750754897;4638.884027899296;4640.002399484127;4647.9535204647855;2938.853057347124;3016.728494435489;3024;3041;3053.5419687046897;954.4178051388648;959.4627008875052;976.3751199232497;994.2145704893126;994.7463396833762;10350.792984140351;10363.481825908675;10363.844542331872;10364.067233948905;10413.895861041445;4274.829006839692;4277.101808620162;4305.806238719265;4337.0458499130145;4339.7830108494445;8974.551272436353;9023.684171054112;9025.41334813235;9042.367034307666;9051.9137703476;4775;4782.713037217778;4787.8563643090765;4787.904241915142;4792.544708252711;4314.266574682311;4326.848560300437;4345.326474396474;4361;4361.694681372337;3127.405792899342;3655.762375445641;3689.1330537323706;3690.686291665185;3731.402975523903;1121.6635009497118;1145.5131569083105;1192.272713644676;1201.2612243470378;1204.6867814368327;894.8434024045766;899.7885496908222;949.3639261694543;1026.3585259212991;1298.6039258026392;6933.479989000845;7006.544574602634;7016.947457881359;7027.227005029443;7031.542949708252;1089.841972913939;1099.8625171853519;1112.5660992213043;1119.2724728926264;1153.6596703972348;5630.042892708249;5666.716664166775;5680.318361796528;5682.659040457585;5690.2887139107615;8547.487150770974;8926.196642302224;8973.641054357753;8977.685780997634;9001.189892909539;8734.432261902955;8792.47245165292;8801.735947921572;8855.955720221358;8861.24679402245;6975.895361569581;7017.754378596725;7064.823379415453;7077.433805295564;7156.284371562906;6800.489963252875;6805.727770889109;6807.285235050248;6840.521163518705;6847.383735463832;7981.2018798119725;8040.517568945882;8041.678332866853;8061.113277539349;8086.8786968194345;8177.304929081095;8178.83642327162;8190.959045204736;8298.377621678519;8305.418620696493;6627.237867645283;6714.261431242462;6736.966315168393;6751.86496270062;6757.45940324763;6201.96899015502;6437.324080971618;7177.533460325062;7219.061522002106;7302.56184628924;6385.87228255423;6540.444062254762;6655.134832471747;6725.730970761115;6771.86456270862;6421.357864213542;6541.313162117909;6544.509161812788;6578.868422631616;6612.537122401386;6639.236487803964;6684.565503242274;6703.128593282842;6707.496937729592;6707.765228216989;6282.3089460158435;6323.430891219812;6338;6360.809175724736;6361.745530178741;6176.413240742302;6179.980303250093;6225.221847269091;6246.4383904024;6294.213223347082 11:19:02 INFO - PROCESS | 1795 | |4;prototype.html;316.69438991373335;333.1604357020309;338.754403057783;342.45207667731626;347.8208722507909;6011.398860113992;6056.515478761699;6088.117223002662;6101.603395779277;6103.420175083371;5734.340550836655;5750.511206547438;5875.618084824494;5912.17229587858;5969.522438204944;4608.101420223058;4613.538646135393;4621.44542654881;4624.537546245382;4631.490536041033;4405.515393306734;4602.539746025404;4626.398568186131;4627.5603817637275;4640.860774176763;4413.293872980324;4450.688451808374;4469.553044695521;4476.216662084138;4493.52817954115;4451.844185453509;4473.552644735533;4504.594586487199;4520.276755719102;4521.027978984501;3993.201359728066;3993.740406873544;3994.660453861396;3995.1210733638554;3998.0604557928864;5492.231087647732;5583.3300003999375;5590.608657393984;5591.692456914868;5593.468620481089;5252.684838909639;5271.920921186185;5292.153255479105;5300.416954135042;5300.946990530084;6147;6201.782937597208;6203.038529028008;6209.348018458088;6215.96892015537;4428.269335559628;4429.800658970354;4431.9778401108115;4433.202023635744;4439.1121775645;6285.340039295854;6379.0112532558;6408.07082972971;6439.613623182578;6444.838879028015;4533.252013417749;4540.8637740867825;4541.931871021938;4542.364069030338;4543.023250001265;4588.885277868013;4598.425196850394;4603.332516785114;4611.654125940568;4611.884702882455;5272.130098533776;5275.050490911596;5279.366476022902;5283.524482796567;5292.2326262691695;6142.447179753844;6291.842703932438;6294.8426289342215;6299.905501417483;6304.716287767062;1642.3430627748996;1666.7333226683672;1666.9831402844254;1667.6664667066634;1669.699454098274;1070.4754670211696;1084.3385534823751;1084.343971896991;1085.5549224817787;1110.2394859521253;6144.293406258337;6146.293176284695;6152.446279834837;6155.907661385083;6166.105914642351;6560.639164845884;6561.0814485972005;6566.047923051131;6567.146270984741;6568.770093046721;5925.111233315038;5940.910886336708;6054.122152287981;6124.540659450559;6130.295016073209;3517.66582174693;3570.339487194877;3579.588347340037;3591.7665351752053;3595.1191957970464;6729.158855143107;6745.2242992056545;6754.966225168842;6756.155480564929;6758.05387245786;6660.433863121689;6796.4562834973085;6809.523333366716;6821.965890170517;6827.0783444235385;6757.054012438262;6763.903190011112;6764.729410823512;6767.1202743644;6782.220044694924;6568;6617.43751781104;6624.536282460182;6633.071370008106;6634.767783127761;6427.903581446189;6595.043718660863;6604.504662150454;6608.207015158212;6615.768448104293;6780.491463140185;6782.28785977485;6784.830379240559;6787.796366109024;6800.693968771318;4537.092581483783;4563.840265590688;4575.222212223864;4575.771211439348;4590.42619672541;6432.614043157426;6595.670216489252;6635.469162466895;6658.067870498231;6660.200775906728;6441.066045423481;6442.935570644234;6449.96775016122;6455.289918109098;6456.063870738811;6387.552871298964;6443.677816109082;6446.033095035782;6448.1295025171;6459.160309159779;6086.482648974887;6271.43557079865;6277.937220627918;6296.275928268308;6297.307296197506;6456.612603243821;6483.675816209265;6488.059231411513;6491.740330386731;6495.577787443801;6181.979973304355;6290.087937248982;6324.683765811599;6331.050342448485;6333 11:19:02 INFO - PROCESS | 1795 | |5;yui.html;602.2892986276194;607.9361667024959;611.1321922869524;617.5461036138438;628.858506835962;13743.31283435828;13836.100653457519;13881.583552493415;13913.095648782823;13941.163530188183;11966.700832479193;12013.27920324779;12025.51897924082;12971.221726696405;13131.277779722112;805.907320658126;824.2458150792019;825.983480330393;826.5247482697473;829.0714399872152;822.3010441125056;832.4505826154739;834.2450082675189;834.6911642692182;835.064727505192;865.212656482601;867.488181972636;876.6142897125276;876.8027193881358;877.5743764274322;868.1578868497547;871.2768402226137;871.6818361298112;872.31959071924;872.3239489395705;637.2862394118571;637.4422380417135;637.8214100051993;638.2691817868515;643.1157158906503;12200.145989780718;12399.504019839196;12420.068494862922;12446.190997585129;12449.190802597803;10013.249006324555;10398.712283297738;10629.468526573717;10647.627333043383;11015.944920275348;8496.745097647081;8664.39349245553;8813.07462716412;8826.426282291695;8828.24959878411;3236.8219747913854;3246.2858171202297;3268.8038717677014;3301.224212310105;3311.602607687069;42258.78870605658;42476.57523424788;42670.57329426697;43433.782831085955;47834.76082619634;9278.768030799283;9361.297902657192;9621.134097931219;10462;10537.683869483775;17535.123243837756;17702.114894255235;17708.114594270493;17719.911400443172;17724.37964671256;6445.16212892321;6678.7328506859185;6708.463322934153;6735.730570777114;7726.806829829186;4019.196160767858;4065.854691274977;4108.876733697994;4130.91738165241;4363.978180109143;3145.968540314613;3188.8883889063773;3189.4259033374215;3195.4248235317864;3200.119967009091;550.309361751;567.9858003549945;573.0344369737006;573.0401577357992;573.3120255693185;523.4085483403729;534.4148157767239;587.3627114580643;600.8137477382026;632.2286810091681;7481.102267727908;7533.058367704037;7605.6957721691615;7618.885716714254;7665.770026899202;575.6776205325032;578.739567194764;589.0398650200146;628.4846425930784;633.4742164003866;3526.4710293456187;3590.3537363274863;3643.216708407705;3644.1436262478296;3850.9229815403537;54217.45782542203;54411.72794136004;54507.45492545103;54519;54762.17856732152;47612.761936190094;47976.04047919022;48187.759061204466;48373.27440088331;48472.757636211594;39773.60226397699;41816;48450.515494845306;49363.25955110748;49593.50406495889;8170.223828736261;8459.154084591491;8490.363222758195;8606.291612009158;8757.605907734294;30738.84630576833;31288.217794554406;31764.364712705155;36114.27771444504;36876.81561592175;41967.370489443296;42071.7896410516;42308.36537451879;42693.78653106715;42784;10541.209409294486;10912.836307455236;10953.780924381308;11071.778564428505;11097.38964356968;11487.597934072268;11832.17174797756;12349.073819463396;12620;12719.300438475973;10721.678349649523;10912.236143469881;10946.562137514411;11509.850975618301;11745.588904388305;10788.730281743019;11265;11354.318740875575;11362.091032717197;11563.30620162793;10225;10417.631216054278;10494.94752526263;10573.682789516326;11325.603603873826;9063.637454501746;9173.44959302444;9341.439513629204;9443.386179898285;9843.901560984299;8539.530325832138;8954.194122529003;9068.682596109105;9350.906490935004;9489.003654616443 11:19:02 INFO - PROCESS | 1795 | __end_tp_report 11:19:02 INFO - PROCESS | 1795 | __start_cc_report 11:19:02 INFO - PROCESS | 1795 | _x_x_mozilla_cycle_collect,929 11:19:02 INFO - PROCESS | 1795 | __end_cc_report 11:19:02 INFO - PROCESS | 1795 | __startTimestamp1450725542861__endTimestamp 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | ------- Summary: start ------- 11:19:02 INFO - PROCESS | 1795 | Number of tests: 6 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#0] dojo.html Cycles:165 Average:5272.66 Median:5464.75 stddev:571.17 (10.5%) stddev-sans-first:546.86 11:19:02 INFO - PROCESS | 1795 | Values: 3098.4 3156.4 3194.1 3202.5 3209.2 5118.7 5242.0 5281.3 5283.9 5339.8 5152.7 5172.3 5191.7 5211.0 5282.3 4772.5 4802.3 4813.1 4864.0 4907.2 4892.6 4904.3 4922.5 4984.6 5013.8 4749.0 4801.3 4849.2 4908.7 4923.4 4844.1 4866.7 4877.5 4897.7 4904.3 4808.7 4844.4 4855.2 4857.8 4887.3 5066.8 5073.1 5162.1 5193.4 5220.2 5622.7 5652.2 5657.9 5666.3 5666.9 5677.3 5699.0 5700.6 5701.1 5705.9 5192.5 5246.3 5250.4 5308.9 5401.2 5767.6 5770.0 5778.4 5800.0 5841.2 5630.1 5644.6 5645.5 5654.8 5656.4 5524.3 5575.0 5629.7 5665.9 5775.4 5620.8 5647.8 5664.0 5669.4 5677.2 5666.0 5669.9 5671.4 5673.3 5674.4 4255.6 4342.6 4349.6 4429.9 4445.0 3915.7 3929.8 3930.6 3948.2 3954.3 5352.5 5354.1 5360.9 5362.0 5367.7 5573.7 5710.1 5711.8 5732.1 5841.3 5362.4 5366.0 5378.2 5379.1 5388.2 4993.7 4995.4 4996.4 5006.0 5048.8 5594.1 5658.2 5702.2 5764.0 5852.0 5646.6 5654.9 5692.1 5700.4 5719.1 5774.8 5777.9 5788.3 5791.2 5795.2 5398.7 5491.3 5493.6 5563.0 5660.8 5685.9 5738.4 5765.9 5766.0 5820.0 5661.6 5674.1 5678.9 5697.0 5697.3 5309.4 5464.8 5477.5 5516.2 5615.4 5439.4 5465.3 5466.3 5468.6 5469.8 5603.6 5611.6 5611.9 5616.7 5659.1 5287.5 5391.0 5392.6 5393.8 5497.4 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#1] ext.html Cycles:180 Average:42604.66 Median:33613.41 stddev:66162.13 (196.8%) stddev-sans-first:66272.45 11:19:02 INFO - PROCESS | 1795 | Values: 568.2 599.2 607.5 609.1 614.3 29699.6 30274.0 30298.9 30332.2 30356.2 31005.2 34068.3 34106.8 34387.7 34504.1 8801.0 8922.2 8935.5 8942.2 8946.0 7841.6 8669.7 8768.3 8774.9 8783.3 7793.5 10723.1 10965.1 10983.2 10993.5 10460.8 10475.5 10518.6 10566.6 10568.5 7872.9 8044.2 10325.2 10452.9 10627.2 39350.4 39542.2 39902.4 40041.6 40065.2 3241.6 3289.3 3532.2 3634.4 4016.0 30296.1 30684.4 30747.0 30820.5 31261.4 3707.8 3826.5 3847.8 3926.7 4054.3 271980.8 272956.0 273893.0 274482.0 274601.0 59767.4 60718.7 60748.7 60809.1 60814.0 55543.4 55785.7 55866.7 55880.2 55930.2 15518.4 15662.7 15675.4 15681.5 15687.5 12260.4 12263.9 12307.6 12343.7 12375.2 18991.8 19906.2 19944.3 19951.7 19964.6 7551.5 7761.5 7807.6 7820.2 7869.4 887.0 905.4 996.3 1027.7 1032.0 27929.4 28908.0 29424.9 29429.9 29518.7 926.9 976.8 986.5 987.0 1007.1 13321.3 13756.4 14021.0 15422.8 15825.0 248036.0 250771.0 251845.0 251888.0 252531.0 48812.8 49390.3 49402.5 49534.8 49553.8 1317.0 1321.8 1322.9 1345.1 1358.4 26304.2 27687.9 27717.0 29187.4 30084.2 42619.7 43283.8 47561.8 49360.8 50272.0 235195.0 238394.0 238640.0 239266.0 240086.0 27994.3 30696.7 31105.7 31349.5 31382.0 33600.5 39103.0 40234.4 40557.2 40805.0 33205.5 33875.3 34428.3 36515.0 36593.8 37387.0 38053.6 38105.0 38145.6 38244.2 36544.3 37003.4 37132.4 37212.0 37313.3 30566.8 33626.3 33713.0 33954.9 34002.3 25153.6 25297.0 25408.7 25546.7 25904.9 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#2] jquery.html Cycles:180 Average:29268.56 Median:20359.21 stddev:91333.20 (448.6%) stddev-sans-first:91563.57 11:19:02 INFO - PROCESS | 1795 | Values: 331.3 332.1 345.1 351.7 355.5 14152.6 14528.6 16581.0 16707.7 17517.4 10766.7 13485.7 14354.4 16298.3 16299.2 4798.1 4952.8 4953.7 4962.9 4964.4 3733.6 3761.7 4927.2 4948.1 4957.5 4846.6 5475.5 5491.1 5500.7 5500.8 5322.0 5435.4 5456.0 5471.6 5473.3 5218.2 5231.5 5236.0 5236.6 5240.4 12154.1 14295.6 16320.0 19758.7 19792.4 2004.9 2047.3 2103.1 2131.4 2269.8 9255.0 9532.7 12208.1 12258.9 12727.5 1806.6 1834.4 1842.6 1861.1 1876.2 57859.7 61633.4 62276.7 63284.4 63778.4 10186.7 10188.9 10215.7 10228.6 10290.9 13270.9 13285.4 13292.7 13311.1 13314.3 7606.9 7635.7 7643.8 7681.0 7697.7 7340.1 7411.8 7453.2 7473.7 7484.9 4271.9 4290.5 4312.0 4411.5 4472.0 1725.3 1738.9 1774.8 1810.2 1841.4 879.5 917.3 947.8 959.4 986.7 15259.6 15595.0 16124.0 16237.1 16270.1 804.8 895.3 908.2 931.0 974.6 8622.5 8910.4 8976.6 9071.5 9414.2 544546.0 546649.0 553860.0 571444.0 573690.0 81800.0 85601.6 86059.6 86919.1 90310.5 1120.5 1144.4 1147.9 1153.2 1154.6 15796.1 15839.4 15885.6 15959.0 16373.2 34401.5 36509.8 36984.8 37846.0 39176.4 37573.4 45353.3 47456.0 48839.5 49112.8 9275.9 9569.4 9740.2 9760.9 9777.8 11476.4 11476.6 11526.4 11528.0 11616.8 13569.5 14787.4 14788.1 15138.5 15183.2 9053.4 9171.5 14546.4 14795.9 14937.3 9027.9 9207.6 9737.4 10048.2 10369.1 14498.3 14535.0 14839.2 15054.2 15071.6 15491.0 15586.0 16070.4 16671.9 16941.0 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#3] mootools.html Cycles:180 Average:5262.89 Median:6349.40 stddev:2681.89 (42.2%) stddev-sans-first:2672.86 11:19:02 INFO - PROCESS | 1795 | Values: 1299.4 1678.6 1721.8 1738.6 1739.9 6537.2 7179.4 7362.0 7363.3 7364.1 7287.2 7458.9 7459.3 7463.5 7465.6 1925.9 1976.7 1978.5 2265.6 2308.0 1986.1 1990.9 2212.9 2257.2 2257.5 2214.5 2238.9 2242.1 2244.2 2255.4 2229.3 2259.4 2261.2 2261.4 2270.5 2256.3 2305.7 2307.3 2308.2 2309.9 7338.7 7381.1 7397.1 7398.9 7416.0 4560.4 4630.4 4638.9 4640.0 4648.0 2938.9 3016.7 3024.0 3041.0 3053.5 954.4 959.5 976.4 994.2 994.7 10350.8 10363.5 10363.8 10364.1 10413.9 4274.8 4277.1 4305.8 4337.0 4339.8 8974.6 9023.7 9025.4 9042.4 9051.9 4775.0 4782.7 4787.9 4787.9 4792.5 4314.3 4326.8 4345.3 4361.0 4361.7 3127.4 3655.8 3689.1 3690.7 3731.4 1121.7 1145.5 1192.3 1201.3 1204.7 894.8 899.8 949.4 1026.4 1298.6 6933.5 7006.5 7016.9 7027.2 7031.5 1089.8 1099.9 1112.6 1119.3 1153.7 5630.0 5666.7 5680.3 5682.7 5690.3 8547.5 8926.2 8973.6 8977.7 9001.2 8734.4 8792.5 8801.7 8856.0 8861.2 6975.9 7017.8 7064.8 7077.4 7156.3 6800.5 6805.7 6807.3 6840.5 6847.4 7981.2 8040.5 8041.7 8061.1 8086.9 8177.3 8178.8 8191.0 8298.4 8305.4 6627.2 6714.3 6737.0 6751.9 6757.5 6202.0 6437.3 7177.5 7219.1 7302.6 6385.9 6540.4 6655.1 6725.7 6771.9 6421.4 6541.3 6544.5 6578.9 6612.5 6639.2 6684.6 6703.1 6707.5 6707.8 6282.3 6323.4 6338.0 6360.8 6361.7 6176.4 6180.0 6225.2 6246.4 6294.2 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#4] prototype.html Cycles:180 Average:5316.32 Median:6087.30 stddev:1597.85 (26.2%) stddev-sans-first:1557.64 11:19:02 INFO - PROCESS | 1795 | Values: 316.7 333.2 338.8 342.5 347.8 6011.4 6056.5 6088.1 6101.6 6103.4 5734.3 5750.5 5875.6 5912.2 5969.5 4608.1 4613.5 4621.4 4624.5 4631.5 4405.5 4602.5 4626.4 4627.6 4640.9 4413.3 4450.7 4469.6 4476.2 4493.5 4451.8 4473.6 4504.6 4520.3 4521.0 3993.2 3993.7 3994.7 3995.1 3998.1 5492.2 5583.3 5590.6 5591.7 5593.5 5252.7 5271.9 5292.2 5300.4 5300.9 6147.0 6201.8 6203.0 6209.3 6216.0 4428.3 4429.8 4432.0 4433.2 4439.1 6285.3 6379.0 6408.1 6439.6 6444.8 4533.3 4540.9 4541.9 4542.4 4543.0 4588.9 4598.4 4603.3 4611.7 4611.9 5272.1 5275.1 5279.4 5283.5 5292.2 6142.4 6291.8 6294.8 6299.9 6304.7 1642.3 1666.7 1667.0 1667.7 1669.7 1070.5 1084.3 1084.3 1085.6 1110.2 6144.3 6146.3 6152.4 6155.9 6166.1 6560.6 6561.1 6566.0 6567.1 6568.8 5925.1 5940.9 6054.1 6124.5 6130.3 3517.7 3570.3 3579.6 3591.8 3595.1 6729.2 6745.2 6755.0 6756.2 6758.1 6660.4 6796.5 6809.5 6822.0 6827.1 6757.1 6763.9 6764.7 6767.1 6782.2 6568.0 6617.4 6624.5 6633.1 6634.8 6427.9 6595.0 6604.5 6608.2 6615.8 6780.5 6782.3 6784.8 6787.8 6800.7 4537.1 4563.8 4575.2 4575.8 4590.4 6432.6 6595.7 6635.5 6658.1 6660.2 6441.1 6442.9 6450.0 6455.3 6456.1 6387.6 6443.7 6446.0 6448.1 6459.2 6086.5 6271.4 6277.9 6296.3 6297.3 6456.6 6483.7 6488.1 6491.7 6495.6 6182.0 6290.1 6324.7 6331.1 6333.0 11:19:02 INFO - PROCESS | 1795 | 11:19:02 INFO - PROCESS | 1795 | [#5] yui.html Cycles:180 Average:13097.70 Median:48081.90 stddev:15123.90 (31.5%) stddev-sans-first:15137.22 11:19:02 INFO - PROCESS | 1795 | Values: 602.3 607.9 611.1 617.5 628.9 13743.3 13836.1 13881.6 13913.1 13941.2 11966.7 12013.3 12025.5 12971.2 13131.3 805.9 824.2 826.0 826.5 829.1 822.3 832.5 834.2 834.7 835.1 865.2 867.5 876.6 876.8 877.6 868.2 871.3 871.7 872.3 872.3 637.3 637.4 637.8 638.3 643.1 12200.1 12399.5 12420.1 12446.2 12449.2 10013.2 10398.7 10629.5 10647.6 11015.9 8496.7 8664.4 8813.1 8826.4 8828.2 3236.8 3246.3 3268.8 3301.2 3311.6 42258.8 42476.6 42670.6 43433.8 47834.8 9278.8 9361.3 9621.1 10462.0 10537.7 17535.1 17702.1 17708.1 17719.9 17724.4 6445.2 6678.7 6708.5 6735.7 7726.8 4019.2 4065.9 4108.9 4130.9 4364.0 3146.0 3188.9 3189.4 3195.4 3200.1 550.3 568.0 573.0 573.0 573.3 523.4 534.4 587.4 600.8 632.2 7481.1 7533.1 7605.7 7618.9 7665.8 575.7 578.7 589.0 628.5 633.5 3526.5 3590.4 3643.2 3644.1 3850.9 54217.5 54411.7 54507.5 54519.0 54762.2 47612.8 47976.0 48187.8 48373.3 48472.8 39773.6 41816.0 48450.5 49363.3 49593.5 8170.2 8459.2 8490.4 8606.3 8757.6 30738.8 31288.2 31764.4 36114.3 36876.8 41967.4 42071.8 42308.4 42693.8 42784.0 10541.2 10912.8 10953.8 11071.8 11097.4 11487.6 11832.2 12349.1 12620.0 12719.3 10721.7 10912.2 10946.6 11509.9 11745.6 10788.7 11265.0 11354.3 11362.1 11563.3 10225.0 10417.6 10494.9 10573.7 11325.6 9063.6 9173.4 9341.4 9443.4 9843.9 8539.5 8954.2 9068.7 9350.9 9489.0 11:19:02 INFO - PROCESS | 1795 | -------- Summary: end -------- 11:19:02 INFO - PROCESS | 1795 | 11:19:03 INFO - TEST-INFO | 1795: exit 0 11:19:03 INFO - TEST-OK | dromaeo_css | took 1112530ms 11:19:03 INFO - TEST-START | kraken 11:19:03 INFO - operating with platform_type : linux_ 11:19:03 INFO - Initialising browser for kraken test... 11:19:03 INFO - TEST-INFO | started process 1993 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpmtYuLZ/profile http://localhost:52158/getInfo.html) 11:19:07 INFO - PROCESS | 1993 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 11:19:07 INFO - PROCESS | 1993 | __metrics Screen width/height:1600/1200 11:19:07 INFO - PROCESS | 1993 | colorDepth:24 11:19:07 INFO - PROCESS | 1993 | Browser inner width/height: 1024/697 11:19:07 INFO - PROCESS | 1993 | __metrics 11:19:07 INFO - PROCESS | 1993 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 11:19:07 INFO - PROCESS | 1993 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:19:08 INFO - TEST-INFO | 1993: exit 0 11:19:08 INFO - Browser initialized. 11:19:08 INFO - Running cycle 1/1 for kraken test... 11:19:08 INFO - TEST-INFO | started process 2076 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpmtYuLZ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:19:20 INFO - PROCESS | 2076 | RSS: Main: 150224896 11:19:20 INFO - PROCESS | 2076 | 11:19:22 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52158/tests/kraken/driver.html?testName=audio-beat-detection) 11:19:23 INFO - PROCESS | 2076 | RSS: Main: 186568704 11:19:23 INFO - PROCESS | 2076 | 11:19:25 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52158/tests/kraken/driver.html?testName=audio-dft) 11:19:26 INFO - PROCESS | 2076 | RSS: Main: 176087040 11:19:26 INFO - PROCESS | 2076 | 11:19:29 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52158/tests/kraken/driver.html?testName=audio-fft) 11:19:29 INFO - PROCESS | 2076 | RSS: Main: 160604160 11:19:29 INFO - PROCESS | 2076 | 11:19:31 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52158/tests/kraken/driver.html?testName=audio-oscillator) 11:19:32 INFO - PROCESS | 2076 | RSS: Main: 163725312 11:19:32 INFO - PROCESS | 2076 | 11:19:34 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52158/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:19:35 INFO - PROCESS | 2076 | RSS: Main: 165814272 11:19:35 INFO - PROCESS | 2076 | 11:19:38 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52158/tests/kraken/driver.html?testName=imaging-darkroom) 11:19:38 INFO - PROCESS | 2076 | RSS: Main: 164925440 11:19:38 INFO - PROCESS | 2076 | 11:19:42 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52158/tests/kraken/driver.html?testName=imaging-desaturate) 11:19:42 INFO - PROCESS | 2076 | RSS: Main: 165593088 11:19:42 INFO - PROCESS | 2076 | 11:19:45 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52158/tests/kraken/driver.html?testName=json-parse-financial) 11:19:46 INFO - PROCESS | 2076 | RSS: Main: 166379520 11:19:46 INFO - PROCESS | 2076 | 11:19:47 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52158/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:19:48 INFO - PROCESS | 2076 | RSS: Main: 176775168 11:19:48 INFO - PROCESS | 2076 | 11:19:49 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:19:50 INFO - PROCESS | 2076 | RSS: Main: 174985216 11:19:50 INFO - PROCESS | 2076 | 11:19:52 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:19:53 INFO - PROCESS | 2076 | RSS: Main: 186068992 11:19:53 INFO - PROCESS | 2076 | 11:19:55 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:19:56 INFO - PROCESS | 2076 | RSS: Main: 191377408 11:19:56 INFO - PROCESS | 2076 | 11:19:58 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:19:59 INFO - PROCESS | 2076 | RSS: Main: 188895232 11:19:59 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | Cycle 1(1): loaded http://localhost:52158/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52158/tests/kraken/driver.html?testName=ai-astar) 11:20:01 INFO - PROCESS | 2076 | RSS: Main: 247238656 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | __start_tp_report 11:20:01 INFO - PROCESS | 2076 | _x_x_mozilla_page_load 11:20:01 INFO - PROCESS | 2076 | _x_x_mozilla_page_load_details 11:20:01 INFO - PROCESS | 2076 | |i|pagename|runs| 11:20:01 INFO - PROCESS | 2076 | |0;ai-astar;107;110;103;109;110;110;101;111;109;117 11:20:01 INFO - PROCESS | 2076 | |1;audio-beat-detection;151;123;152;165;126;147;145;123;164;125 11:20:01 INFO - PROCESS | 2076 | |2;audio-dft;163;163;162;161;161;161;160;164;164;162 11:20:01 INFO - PROCESS | 2076 | |3;audio-fft;74;71;85;104;71;73;71;93;100;71 11:20:01 INFO - PROCESS | 2076 | |4;audio-oscillator;92;94;141;92;94;94;141;94;93;137 11:20:01 INFO - PROCESS | 2076 | |5;imaging-gaussian-blur;109;109;109;109;109;109;110;109;110;110 11:20:01 INFO - PROCESS | 2076 | |6;imaging-darkroom;146;146;146;146;147;145;145;145;145;146 11:20:01 INFO - PROCESS | 2076 | |7;imaging-desaturate;95;95;96;96;95;96;96;97;96;96 11:20:01 INFO - PROCESS | 2076 | |8;json-parse-financial;60;60;60;59;60;68;59;67;57;58 11:20:01 INFO - PROCESS | 2076 | |9;json-stringify-tinderbox;68;69;68;68;69;68;69;69;73;69 11:20:01 INFO - PROCESS | 2076 | |10;stanford-crypto-aes;83;84;85;84;84;85;84;83;85;84 11:20:01 INFO - PROCESS | 2076 | |11;stanford-crypto-ccm;123;117;115;116;127;119;117;123;121;119 11:20:01 INFO - PROCESS | 2076 | |12;stanford-crypto-pbkdf2;139;149;154;148;151;144;150;148;147;140 11:20:01 INFO - PROCESS | 2076 | |13;stanford-crypto-sha256-iterative;70;69;66;69;67;66;68;68;65;67 11:20:01 INFO - PROCESS | 2076 | __end_tp_report 11:20:01 INFO - PROCESS | 2076 | __start_cc_report 11:20:01 INFO - PROCESS | 2076 | _x_x_mozilla_cycle_collect,953 11:20:01 INFO - PROCESS | 2076 | __end_cc_report 11:20:01 INFO - PROCESS | 2076 | __startTimestamp1450725601257__endTimestamp 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | ------- Summary: start ------- 11:20:01 INFO - PROCESS | 2076 | Number of tests: 14 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#0] ai-astar Cycles:10 Average:108.70 Median:110.00 stddev:4.40 (4.0%) stddev-sans-first:4.62 11:20:01 INFO - PROCESS | 2076 | Values: 107.0 110.0 103.0 109.0 110.0 110.0 101.0 111.0 109.0 117.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#1] audio-beat-detection Cycles:10 Average:142.10 Median:149.00 stddev:16.65 (11.2%) stddev-sans-first:17.35 11:20:01 INFO - PROCESS | 2076 | Values: 151.0 123.0 152.0 165.0 126.0 147.0 145.0 123.0 164.0 125.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#2] audio-dft Cycles:10 Average:162.10 Median:162.50 stddev:1.37 (0.8%) stddev-sans-first:1.41 11:20:01 INFO - PROCESS | 2076 | Values: 163.0 163.0 162.0 161.0 161.0 161.0 160.0 164.0 164.0 162.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#3] audio-fft Cycles:10 Average:81.30 Median:72.00 stddev:13.17 (18.3%) stddev-sans-first:13.71 11:20:01 INFO - PROCESS | 2076 | Values: 74.0 71.0 85.0 104.0 71.0 73.0 71.0 93.0 100.0 71.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#4] audio-oscillator Cycles:10 Average:107.20 Median:93.50 stddev:22.44 (24.0%) stddev-sans-first:23.12 11:20:01 INFO - PROCESS | 2076 | Values: 92.0 94.0 141.0 92.0 94.0 94.0 141.0 94.0 93.0 137.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#5] imaging-gaussian-blur Cycles:10 Average:109.30 Median:109.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 11:20:01 INFO - PROCESS | 2076 | Values: 109.0 109.0 109.0 109.0 109.0 109.0 110.0 109.0 110.0 110.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#6] imaging-darkroom Cycles:10 Average:145.70 Median:146.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 11:20:01 INFO - PROCESS | 2076 | Values: 146.0 146.0 146.0 146.0 147.0 145.0 145.0 145.0 145.0 146.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.63 (0.7%) stddev-sans-first:0.60 11:20:01 INFO - PROCESS | 2076 | Values: 95.0 95.0 96.0 96.0 95.0 96.0 96.0 97.0 96.0 96.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#8] json-parse-financial Cycles:10 Average:60.80 Median:60.00 stddev:3.68 (6.1%) stddev-sans-first:3.89 11:20:01 INFO - PROCESS | 2076 | Values: 60.0 60.0 60.0 59.0 60.0 68.0 59.0 67.0 57.0 58.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#9] json-stringify-tinderbox Cycles:10 Average:69.00 Median:69.00 stddev:1.49 (2.2%) stddev-sans-first:1.54 11:20:01 INFO - PROCESS | 2076 | Values: 68.0 69.0 68.0 68.0 69.0 68.0 69.0 69.0 73.0 69.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#10] stanford-crypto-aes Cycles:10 Average:84.10 Median:84.00 stddev:0.74 (0.9%) stddev-sans-first:0.67 11:20:01 INFO - PROCESS | 2076 | Values: 83.0 84.0 85.0 84.0 84.0 85.0 84.0 83.0 85.0 84.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#11] stanford-crypto-ccm Cycles:10 Average:119.70 Median:120.00 stddev:3.77 (3.1%) stddev-sans-first:3.81 11:20:01 INFO - PROCESS | 2076 | Values: 123.0 117.0 115.0 116.0 127.0 119.0 117.0 123.0 121.0 119.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.00 Median:148.50 stddev:4.74 (3.2%) stddev-sans-first:4.04 11:20:01 INFO - PROCESS | 2076 | Values: 139.0 149.0 154.0 148.0 151.0 144.0 150.0 148.0 147.0 140.0 11:20:01 INFO - PROCESS | 2076 | 11:20:01 INFO - PROCESS | 2076 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.50 Median:68.00 stddev:1.58 (2.3%) stddev-sans-first:1.39 11:20:01 INFO - PROCESS | 2076 | Values: 70.0 69.0 66.0 69.0 67.0 66.0 68.0 68.0 65.0 67.0 11:20:01 INFO - PROCESS | 2076 | -------- Summary: end -------- 11:20:01 INFO - PROCESS | 2076 | 11:20:02 INFO - TEST-INFO | 2076: exit 0 11:20:02 INFO - TEST-OK | kraken | took 58604ms 11:20:02 INFO - TEST-START | v8_7 11:20:02 INFO - operating with platform_type : linux_ 11:20:02 INFO - Initialising browser for v8_7 test... 11:20:02 INFO - TEST-INFO | started process 2324 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp27suKi/profile http://localhost:52158/getInfo.html) 11:20:05 INFO - PROCESS | 2324 | JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 11:20:05 INFO - PROCESS | 2324 | __metrics Screen width/height:1600/1200 11:20:05 INFO - PROCESS | 2324 | colorDepth:24 11:20:05 INFO - PROCESS | 2324 | Browser inner width/height: 1024/697 11:20:05 INFO - PROCESS | 2324 | __metrics 11:20:05 INFO - PROCESS | 2324 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 11:20:05 INFO - PROCESS | 2324 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:20:06 INFO - TEST-INFO | 2324: exit 0 11:20:06 INFO - Browser initialized. 11:20:06 INFO - Running cycle 1/1 for v8_7 test... 11:20:06 INFO - TEST-INFO | started process 2498 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp27suKi/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:20:18 INFO - PROCESS | 2498 | RSS: Main: 149524480 11:20:18 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | Cycle 1(1): loaded http://localhost:52158/tests/v8_7/run.html (next: http://localhost:52158/tests/v8_7/run.html) 11:20:40 INFO - PROCESS | 2498 | RSS: Main: 556740608 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | __start_tp_report 11:20:40 INFO - PROCESS | 2498 | _x_x_mozilla_page_load 11:20:40 INFO - PROCESS | 2498 | _x_x_mozilla_page_load_details 11:20:40 INFO - PROCESS | 2498 | |i|pagename|runs| 11:20:40 INFO - PROCESS | 2498 | |0;Richards;165.45334215751157 11:20:40 INFO - PROCESS | 2498 | |1;DeltaBlue;189.0359168241966 11:20:40 INFO - PROCESS | 2498 | |2;Encrypt;279.9552071668533 11:20:40 INFO - PROCESS | 2498 | |3;Decrypt;5191.709844559586 11:20:40 INFO - PROCESS | 2498 | |4;RayTrace;1096.4912280701753 11:20:40 INFO - PROCESS | 2498 | |5;Earley;786.331500392773 11:20:40 INFO - PROCESS | 2498 | |6;Boyer;12329.268292682927 11:20:40 INFO - PROCESS | 2498 | |7;RegExp;25948.71794871795 11:20:40 INFO - PROCESS | 2498 | |8;Splay;584.7953216374269 11:20:40 INFO - PROCESS | 2498 | |9;NavierStokes;4840.579710144928 11:20:40 INFO - PROCESS | 2498 | __end_tp_report 11:20:40 INFO - PROCESS | 2498 | __startTimestamp1450725640265__endTimestamp 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | ------- Summary: start ------- 11:20:40 INFO - PROCESS | 2498 | Number of tests: 10 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#0] Richards Cycles:1 Average:165.45 Median:165.45 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 165.5 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#1] DeltaBlue Cycles:1 Average:189.04 Median:189.04 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 189.0 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#2] Encrypt Cycles:1 Average:279.96 Median:279.96 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 280.0 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#3] Decrypt Cycles:1 Average:5191.71 Median:5191.71 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 5191.7 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#4] RayTrace Cycles:1 Average:1096.49 Median:1096.49 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 1096.5 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#5] Earley Cycles:1 Average:786.33 Median:786.33 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 786.3 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#6] Boyer Cycles:1 Average:12329.27 Median:12329.27 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 12329.3 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#7] RegExp Cycles:1 Average:25948.72 Median:25948.72 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 25948.7 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#8] Splay Cycles:1 Average:584.80 Median:584.80 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 584.8 11:20:40 INFO - PROCESS | 2498 | 11:20:40 INFO - PROCESS | 2498 | [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 11:20:40 INFO - PROCESS | 2498 | Values: 4840.6 11:20:40 INFO - PROCESS | 2498 | -------- Summary: end -------- 11:20:40 INFO - PROCESS | 2498 | 11:20:41 INFO - TEST-INFO | 2498: exit 0 11:20:41 INFO - TEST-OK | v8_7 | took 38933ms 11:20:41 INFO - SUITE-END | took 1210s 11:20:41 INFO - Completed test suite (00:20:10) 11:20:41 INFO - Working with test: dromaeo_css 11:20:41 INFO - Generating results file: dromaeo_css 11:20:41 INFO - Working with test: kraken 11:20:41 INFO - Generating results file: kraken 11:20:41 INFO - javascript benchmark 11:20:41 INFO - Working with test: v8_7 11:20:41 INFO - Generating results file: v8_7 11:20:41 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:20:41 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,201,35]] 11:20:41 INFO - process_Request line: dromaeo_css 6851.58 graph.html#tests=[[72,201,35]] 11:20:41 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:20:41 INFO - process_Request line: kraken 1500.30 graph.html#tests=[[232,201,35]] 11:20:41 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:20:41 INFO - process_Request line: v8_7 21108.36 graph.html#tests=[[230,201,35]] 11:20:41 INFO - RETURN: dromaeo_css: 6851.58 11:20:41 INFO - RETURN: kraken: 1500.30 11:20:41 INFO - RETURN: v8_7: 21108.36 11:20:41 INFO - javascript benchmark 11:20:41 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3098.426791043657, 3156.352947645733, 3194.121616555447, 3202.4715921872894, 3209.181658677038, 5118.692878427297, 5242.0, 5281.260623512707, 5283.867903302415, 5339.786408543654, 5152.716600586966, 5172.250023746555, 5191.662541934781, 5211.035958347698, 5282.339707536558, 4772.546608072236, 4802.279658051303, 4813.085513752376, 4864.0, 4907.1657818171, 4892.584130348907, 4904.337914381566, 4922.458529561745, 4984.626153038518, 5013.849584512471, 4748.999999999983, 4801.2798080287885, 4849.199882019462, 4908.656394052417, 4923.4091908970795, 4844.079624871299, 4866.732329721864, 4877.487863774323, 4897.657163998521, 4904.2643603459765, 4808.735519546423, 4844.442889067767, 4855.223164293696, 4857.82997595086, 4887.3402090717655, 5066.797328106872, 5073.1122053640465, 5162.070827251093, 5193.428722840485, 5220.216967454912, 5622.690752008638, 5652.236948012007, 5657.886842263131, 5666.263385759866, 5666.858328541778, 5677.261955945742, 5698.971505142447, 5700.600957932947, 5701.0878259478695, 5705.885882282331, 5192.480751924815, 5246.344206974129, 5250.422453530108, 5308.893822123536, 5401.162819762943, 5767.625104368202, 5770.047942089592, 5778.422157784272, 5800.0429929062075, 5841.182234487175, 5630.0991841305195, 5644.576656750678, 5645.5201307888465, 5654.773809047592, 5656.434356564393, 5524.309461317335, 5574.9721251393485, 5629.662220266797, 5665.858353541194, 5775.393583673737, 5620.831375058755, 5647.830565083054, 5663.9716801415725, 5669.433056694297, 5677.233573467612, 5666.0, 5669.886602268014, 5671.432856714296, 5673.3475650299915, 5674.404187560329, 4255.638270746959, 4342.630876375543, 4349.608535231844, 4429.889252768642, 4445.022095139064, 3915.7063220258024, 3929.7838618876235, 3930.587288334741, 3948.190620922704, 3954.3277642800795, 5352.518273355339, 5354.11657076578, 5360.901015291855, 5361.973190134025, 5367.677939323653, 5573.665580065209, 5710.057840456278, 5711.771529138871, 5732.082866741302, 5841.2990441146485, 5362.383325917569, 5365.9731701342025, 5378.19327100938, 5379.112446446371, 5388.245645609618, 4993.700377977333, 4995.400551933792, 4996.375453068366, 5006.048850718352, 5048.7728052237735, 5594.13290939905, 5658.151277308437, 5702.2301989231755, 5763.971180144073, 5851.9999999999145, 5646.576506761927, 5654.943450565442, 5692.0608099663095, 5700.401457846866, 5719.056355701263, 5774.769009239583, 5777.884442311214, 5788.305403351625, 5791.189233507396, 5795.217645617788, 5398.7300634967305, 5491.341039075336, 5493.560515158858, 5563.0, 5660.773569057192, 5685.857853553694, 5738.368779434176, 5765.94234057654, 5766.0, 5820.039693450533, 5661.575381846295, 5674.092145256739, 5678.858028549319, 5696.971515142398, 5697.259356283656, 5309.442508536548, 5464.754086066216, 5477.4796394342475, 5516.172574113915, 5615.382307946041, 5439.37447193562, 5465.289512363367, 5466.289382380265, 5468.644538105011, 5469.75386107634, 5603.635763675348, 5611.551075913835, 5611.859703507445, 5616.69108199053, 5659.094544872801, 5287.471252874836, 5391.029614669397, 5392.649477783932, 5393.8112166074, 5497.422770609029], "unit": "score", "name": "dojo.html", "value": 5236.286128761147}, {"lowerIsBetter": false, "replicates": [568.2073507457095, 599.1940839570776, 607.4897086447384, 609.1015751766145, 614.311970592936, 29699.554506682416, 30274.0, 30298.939537116206, 30332.241693957636, 30356.24109397266, 31005.22486937828, 34068.318633627314, 34106.829465852636, 34387.656123438755, 34504.137396565035, 8800.95599522003, 8922.197002269795, 8935.508547029911, 8942.239909607692, 8945.95527022364, 7841.6079196040255, 8669.69656062038, 8768.254698350647, 8774.912250877473, 8783.253423458982, 7793.4934229275195, 10723.14214862809, 10965.122790176767, 10983.231173817836, 10993.505292261867, 10460.843087353696, 10475.476226188737, 10518.579256829718, 10566.577336906554, 10568.52441640128, 7872.921270787333, 8044.155363686846, 10325.173986081096, 10452.94773526135, 10627.202959778047, 39350.40974385387, 39542.20915581672, 39902.401463978065, 40041.59958400408, 40065.19869602621, 3241.6272128705264, 3289.276359200972, 3532.1699400640828, 3634.4003239465455, 4016.0, 30296.091117266296, 30684.38631227385, 30747.0, 30820.537691934638, 31261.374772504423, 3707.8146092695256, 3826.540815102178, 3847.76913385195, 3926.705497087701, 4054.290499162664, 271980.7608657615, 272956.0, 273892.999999998, 274482.0, 274601.0, 59767.402325977055, 60718.69640651769, 60748.69625651844, 60809.08786368208, 60814.0, 55543.44456555464, 55785.72107139519, 55866.72066639641, 55880.16179757307, 55930.16104758432, 15518.379264829506, 15662.686746265012, 15675.372985080698, 15681.529554113395, 15687.529374118567, 12260.44827982743, 12263.93868030654, 12307.630771076882, 12343.6914077147, 12375.195612285173, 18991.81008189928, 19906.203751850055, 19944.3019494317, 19951.70313929619, 19964.60070798576, 7551.5091519052185, 7761.534307941429, 7807.609619519001, 7820.178881217504, 7869.409794265453, 886.9955650221708, 905.3979103895967, 996.3274789517047, 1027.6557353286732, 1031.9690409287734, 27929.44141117166, 28908.0, 29424.852875735483, 29429.85285073561, 29518.704812951597, 926.8517037274004, 976.7948730766476, 986.5313975861409, 986.9506524673737, 1007.0936157458347, 13321.267330296732, 13756.380962856696, 14021.0, 15422.845771542365, 15825.0, 248036.0, 250771.0, 251845.0, 251888.0, 252531.0, 48812.755936220805, 49390.25914611284, 49402.50597494051, 49534.75232623886, 49553.75223123861, 1317.0385618498358, 1321.7951217561294, 1322.8677132286693, 1345.0584590786489, 1358.4023029866828, 26304.21087367382, 27687.86156069207, 27717.0, 29187.416251675273, 30084.24789380283, 42619.7214083578, 43283.78358108315, 47561.76219118882, 49360.75319623379, 50272.0, 235195.0, 238394.0, 238640.0, 239266.0, 240086.0, 27994.300142496602, 30696.693033070278, 31105.688943111185, 31349.529757053206, 31382.0, 33600.49599255964, 39103.0, 40234.39648405335, 40557.18885622212, 40805.0, 33205.50191747078, 33875.322493550484, 34428.31143377168, 36515.0, 36593.81703091467, 37387.0, 38053.61946380501, 38105.0, 38145.618543814206, 38244.23511529698, 36544.26911461809, 37003.44494832634, 37132.44301335428, 37212.0, 37313.253734924605, 30566.84716576403, 33626.32747345088, 33713.0, 33954.92540895109, 34002.31995360128, 25153.622695659215, 25297.0, 25408.74591254064, 25546.722663867105, 25904.8704756475], "unit": "score", "name": "ext.html", "value": 18181.05147970928}, {"lowerIsBetter": false, "replicates": [331.3422855631571, 332.0685477236351, 345.08208166277706, 351.7397126126666, 355.51827274043677, 14152.575422737309, 14528.564143075699, 16581.0, 16707.749383759252, 17517.386891458802, 10766.676999690022, 13485.730285394286, 14354.425822967069, 16298.348066077373, 16299.185040747945, 4798.0643774464, 4952.801887924478, 4953.702777833341, 4962.900741985158, 4964.379452568429, 3733.607971163016, 3761.736678432511, 4927.18701414268, 4948.134076536592, 4957.479464656213, 4846.636502262327, 5475.5072043516275, 5491.093969495028, 5500.669959802404, 5500.752466139013, 5322.0, 5435.374931882845, 5456.0, 5471.644343117705, 5473.28847249859, 5218.243354713545, 5231.476852314776, 5236.0, 5236.581073514109, 5240.423553409122, 12154.149209555335, 14295.57113286603, 16320.020798751993, 19758.70361944572, 19792.40622781319, 2004.9498762530907, 2047.2936836791282, 2103.074647155247, 2131.435169680036, 2269.8184145268337, 9254.953725231398, 9532.714018579454, 12208.145429819917, 12258.938705306417, 12727.490900363975, 1806.5813309975583, 1834.3579747088545, 1842.5946291815778, 1861.0601646168734, 1876.2119909637984, 57859.710701446646, 61633.383666163216, 62276.68861655708, 63284.367156328306, 63778.3622163777, 10186.694399168036, 10188.898111018794, 10215.693529194135, 10228.59085636581, 10290.948545257226, 13270.933645331712, 13285.402156902963, 13292.73414531704, 13311.134776239513, 13314.267715275753, 7606.923930760732, 7635.732749353857, 7643.847123057619, 7680.9615951921, 7697.653605587762, 7340.082489688789, 7411.814704632319, 7453.217412171753, 7473.701051957861, 7484.850302993909, 4271.914561708749, 4290.485141782943, 4311.9784401077795, 4411.514733379326, 4472.016156445577, 1725.30125299254, 1738.852197563196, 1774.8136445673276, 1810.2259785410108, 1841.4255811281162, 879.5382424227332, 917.2984114467699, 947.8388673925449, 959.3572306554626, 986.6842610364614, 15259.62663360303, 15595.0, 16124.0, 16237.106959117125, 16270.105144217181, 804.7907544038592, 895.3106108296575, 908.2416182487565, 930.9767255818658, 974.64425484699, 8622.482651040958, 8910.420822646507, 8976.632069645706, 9071.455712657262, 9414.15272625467, 544546.0, 546649.0, 553860.0, 571444.0, 573690.0, 81800.0, 85601.57199213964, 86059.56970215109, 86919.13080869237, 90310.54844725865, 1120.4957769003981, 1144.4220668562489, 1147.94260286987, 1153.2273376837538, 1154.584349634131, 15796.131212783408, 15839.366425342858, 15885.602859928133, 15959.0, 16373.181340932668, 34401.48397773985, 36509.817450912575, 36984.815075924445, 37846.0, 39176.41235381414, 37573.43639845459, 45353.31970020518, 47456.0, 48839.5116048835, 49112.75443622759, 9275.86086208694, 9569.3779904306, 9740.172085372822, 9760.853587196056, 9777.755556111155, 11476.4261786912, 11476.598319058792, 11526.366049867001, 11528.0, 11616.825747613624, 13569.52506662262, 14787.408503659733, 14788.11271323724, 15138.470153545013, 15183.164925928739, 9053.366264361432, 9171.495567743837, 14546.41814327415, 14795.852041479448, 14937.327820247898, 9027.909720902708, 9207.631694732403, 9737.415755054719, 10048.246381521269, 10369.118624916664, 14498.347574358968, 14535.0, 14839.183844888636, 15054.247287635793, 15071.623209419853, 15491.0, 15586.03865265596, 16070.43753468623, 16671.91664041672, 16941.0], "unit": "score", "name": "jquery.html", "value": 8670.75458544866}, {"lowerIsBetter": false, "replicates": [1299.3762993762987, 1678.6223099802544, 1721.793384793824, 1738.5914310137123, 1739.9478015659531, 6537.150170477843, 7179.389751871091, 7361.963190184055, 7363.263673632634, 7364.079490063748, 7287.198408175096, 7458.850822983537, 7459.254074592538, 7463.477556571042, 7465.552066875991, 1925.86518943674, 1976.723258743777, 1978.4855937456293, 2265.558216147856, 2307.9884600576975, 1986.0665487221056, 1990.9104090315898, 2212.856164349312, 2257.1761307122947, 2257.4582100295893, 2214.4795972946345, 2238.876861772602, 2242.114364825901, 2244.2257421189665, 2255.4474153832252, 2229.308914236584, 2259.378670865509, 2261.2424837679314, 2261.412032871457, 2270.5231901300745, 2256.255435706213, 2305.654151877215, 2307.273208939179, 2308.1690591387087, 2309.90760369585, 7338.743143989988, 7381.11426628808, 7397.149327827315, 7398.852022959564, 7416.0, 4560.361549383089, 4630.351750754897, 4638.884027899296, 4640.002399484127, 4647.9535204647855, 2938.853057347124, 3016.728494435489, 3024.0, 3041.0, 3053.5419687046897, 954.4178051388648, 959.4627008875052, 976.3751199232497, 994.2145704893126, 994.7463396833762, 10350.792984140351, 10363.481825908675, 10363.844542331872, 10364.067233948905, 10413.895861041445, 4274.829006839692, 4277.101808620162, 4305.806238719265, 4337.0458499130145, 4339.7830108494445, 8974.551272436353, 9023.684171054112, 9025.41334813235, 9042.367034307666, 9051.9137703476, 4775.0, 4782.713037217778, 4787.8563643090765, 4787.904241915142, 4792.544708252711, 4314.266574682311, 4326.848560300437, 4345.326474396474, 4361.0, 4361.694681372337, 3127.405792899342, 3655.762375445641, 3689.1330537323706, 3690.686291665185, 3731.402975523903, 1121.6635009497118, 1145.5131569083105, 1192.272713644676, 1201.2612243470378, 1204.6867814368327, 894.8434024045766, 899.7885496908222, 949.3639261694543, 1026.3585259212991, 1298.6039258026392, 6933.479989000845, 7006.544574602634, 7016.947457881359, 7027.227005029443, 7031.542949708252, 1089.841972913939, 1099.8625171853519, 1112.5660992213043, 1119.2724728926264, 1153.6596703972348, 5630.042892708249, 5666.716664166775, 5680.318361796528, 5682.659040457585, 5690.2887139107615, 8547.487150770974, 8926.196642302224, 8973.641054357753, 8977.685780997634, 9001.189892909539, 8734.432261902955, 8792.47245165292, 8801.735947921572, 8855.955720221358, 8861.24679402245, 6975.895361569581, 7017.754378596725, 7064.823379415453, 7077.433805295564, 7156.284371562906, 6800.489963252875, 6805.727770889109, 6807.285235050248, 6840.521163518705, 6847.383735463832, 7981.2018798119725, 8040.517568945882, 8041.678332866853, 8061.113277539349, 8086.8786968194345, 8177.304929081095, 8178.83642327162, 8190.959045204736, 8298.377621678519, 8305.418620696493, 6627.237867645283, 6714.261431242462, 6736.966315168393, 6751.86496270062, 6757.45940324763, 6201.96899015502, 6437.324080971618, 7177.533460325062, 7219.061522002106, 7302.56184628924, 6385.87228255423, 6540.444062254762, 6655.134832471747, 6725.730970761115, 6771.86456270862, 6421.357864213542, 6541.313162117909, 6544.509161812788, 6578.868422631616, 6612.537122401386, 6639.236487803964, 6684.565503242274, 6703.128593282842, 6707.496937729592, 6707.765228216989, 6282.3089460158435, 6323.430891219812, 6338.0, 6360.809175724736, 6361.745530178741, 6176.413240742302, 6179.980303250093, 6225.221847269091, 6246.4383904024, 6294.213223347082], "unit": "score", "name": "mootools.html", "value": 4346.9304474448845}, {"lowerIsBetter": false, "replicates": [316.69438991373335, 333.1604357020309, 338.754403057783, 342.45207667731626, 347.8208722507909, 6011.398860113992, 6056.515478761699, 6088.117223002662, 6101.603395779277, 6103.420175083371, 5734.340550836655, 5750.511206547438, 5875.618084824494, 5912.17229587858, 5969.522438204944, 4608.101420223058, 4613.538646135393, 4621.44542654881, 4624.537546245382, 4631.490536041033, 4405.515393306734, 4602.539746025404, 4626.398568186131, 4627.5603817637275, 4640.860774176763, 4413.293872980324, 4450.688451808374, 4469.553044695521, 4476.216662084138, 4493.52817954115, 4451.844185453509, 4473.552644735533, 4504.594586487199, 4520.276755719102, 4521.027978984501, 3993.201359728066, 3993.740406873544, 3994.660453861396, 3995.1210733638554, 3998.0604557928864, 5492.231087647732, 5583.3300003999375, 5590.608657393984, 5591.692456914868, 5593.468620481089, 5252.684838909639, 5271.920921186185, 5292.153255479105, 5300.416954135042, 5300.946990530084, 6147.0, 6201.782937597208, 6203.038529028008, 6209.348018458088, 6215.96892015537, 4428.269335559628, 4429.800658970354, 4431.9778401108115, 4433.202023635744, 4439.1121775645, 6285.340039295854, 6379.0112532558, 6408.07082972971, 6439.613623182578, 6444.838879028015, 4533.252013417749, 4540.8637740867825, 4541.931871021938, 4542.364069030338, 4543.023250001265, 4588.885277868013, 4598.425196850394, 4603.332516785114, 4611.654125940568, 4611.884702882455, 5272.130098533776, 5275.050490911596, 5279.366476022902, 5283.524482796567, 5292.2326262691695, 6142.447179753844, 6291.842703932438, 6294.8426289342215, 6299.905501417483, 6304.716287767062, 1642.3430627748996, 1666.7333226683672, 1666.9831402844254, 1667.6664667066634, 1669.699454098274, 1070.4754670211696, 1084.3385534823751, 1084.343971896991, 1085.5549224817787, 1110.2394859521253, 6144.293406258337, 6146.293176284695, 6152.446279834837, 6155.907661385083, 6166.105914642351, 6560.639164845884, 6561.0814485972005, 6566.047923051131, 6567.146270984741, 6568.770093046721, 5925.111233315038, 5940.910886336708, 6054.122152287981, 6124.540659450559, 6130.295016073209, 3517.66582174693, 3570.339487194877, 3579.588347340037, 3591.7665351752053, 3595.1191957970464, 6729.158855143107, 6745.2242992056545, 6754.966225168842, 6756.155480564929, 6758.05387245786, 6660.433863121689, 6796.4562834973085, 6809.523333366716, 6821.965890170517, 6827.0783444235385, 6757.054012438262, 6763.903190011112, 6764.729410823512, 6767.1202743644, 6782.220044694924, 6568.0, 6617.43751781104, 6624.536282460182, 6633.071370008106, 6634.767783127761, 6427.903581446189, 6595.043718660863, 6604.504662150454, 6608.207015158212, 6615.768448104293, 6780.491463140185, 6782.28785977485, 6784.830379240559, 6787.796366109024, 6800.693968771318, 4537.092581483783, 4563.840265590688, 4575.222212223864, 4575.771211439348, 4590.42619672541, 6432.614043157426, 6595.670216489252, 6635.469162466895, 6658.067870498231, 6660.200775906728, 6441.066045423481, 6442.935570644234, 6449.96775016122, 6455.289918109098, 6456.063870738811, 6387.552871298964, 6443.677816109082, 6446.033095035782, 6448.1295025171, 6459.160309159779, 6086.482648974887, 6271.43557079865, 6277.937220627918, 6296.275928268308, 6297.307296197506, 6456.612603243821, 6483.675816209265, 6488.059231411513, 6491.740330386731, 6495.577787443801, 6181.979973304355, 6290.087937248982, 6324.683765811599, 6331.050342448485, 6333.0], "unit": "score", "name": "prototype.html", "value": 4798.837163130389}, {"lowerIsBetter": false, "replicates": [602.2892986276194, 607.9361667024959, 611.1321922869524, 617.5461036138438, 628.858506835962, 13743.31283435828, 13836.100653457519, 13881.583552493415, 13913.095648782823, 13941.163530188183, 11966.700832479193, 12013.27920324779, 12025.51897924082, 12971.221726696405, 13131.277779722112, 805.907320658126, 824.2458150792019, 825.983480330393, 826.5247482697473, 829.0714399872152, 822.3010441125056, 832.4505826154739, 834.2450082675189, 834.6911642692182, 835.064727505192, 865.212656482601, 867.488181972636, 876.6142897125276, 876.8027193881358, 877.5743764274322, 868.1578868497547, 871.2768402226137, 871.6818361298112, 872.31959071924, 872.3239489395705, 637.2862394118571, 637.4422380417135, 637.8214100051993, 638.2691817868515, 643.1157158906503, 12200.145989780718, 12399.504019839196, 12420.068494862922, 12446.190997585129, 12449.190802597803, 10013.249006324555, 10398.712283297738, 10629.468526573717, 10647.627333043383, 11015.944920275348, 8496.745097647081, 8664.39349245553, 8813.07462716412, 8826.426282291695, 8828.24959878411, 3236.8219747913854, 3246.2858171202297, 3268.8038717677014, 3301.224212310105, 3311.602607687069, 42258.78870605658, 42476.57523424788, 42670.57329426697, 43433.782831085955, 47834.76082619634, 9278.768030799283, 9361.297902657192, 9621.134097931219, 10462.0, 10537.683869483775, 17535.123243837756, 17702.114894255235, 17708.114594270493, 17719.911400443172, 17724.37964671256, 6445.16212892321, 6678.7328506859185, 6708.463322934153, 6735.730570777114, 7726.806829829186, 4019.196160767858, 4065.854691274977, 4108.876733697994, 4130.91738165241, 4363.978180109143, 3145.968540314613, 3188.8883889063773, 3189.4259033374215, 3195.4248235317864, 3200.119967009091, 550.309361751, 567.9858003549945, 573.0344369737006, 573.0401577357992, 573.3120255693185, 523.4085483403729, 534.4148157767239, 587.3627114580643, 600.8137477382026, 632.2286810091681, 7481.102267727908, 7533.058367704037, 7605.6957721691615, 7618.885716714254, 7665.770026899202, 575.6776205325032, 578.739567194764, 589.0398650200146, 628.4846425930784, 633.4742164003866, 3526.4710293456187, 3590.3537363274863, 3643.216708407705, 3644.1436262478296, 3850.9229815403537, 54217.45782542203, 54411.72794136004, 54507.45492545103, 54519.0, 54762.17856732152, 47612.761936190094, 47976.04047919022, 48187.759061204466, 48373.27440088331, 48472.757636211594, 39773.60226397699, 41816.0, 48450.515494845306, 49363.25955110748, 49593.50406495889, 8170.223828736261, 8459.154084591491, 8490.363222758195, 8606.291612009158, 8757.605907734294, 30738.84630576833, 31288.217794554406, 31764.364712705155, 36114.27771444504, 36876.81561592175, 41967.370489443296, 42071.7896410516, 42308.36537451879, 42693.78653106715, 42784.0, 10541.209409294486, 10912.836307455236, 10953.780924381308, 11071.778564428505, 11097.38964356968, 11487.597934072268, 11832.17174797756, 12349.073819463396, 12620.0, 12719.300438475973, 10721.678349649523, 10912.236143469881, 10946.562137514411, 11509.850975618301, 11745.588904388305, 10788.730281743019, 11265.0, 11354.318740875575, 11362.091032717197, 11563.30620162793, 10225.0, 10417.631216054278, 10494.94752526263, 10573.682789516326, 11325.603603873826, 9063.637454501746, 9173.44959302444, 9341.439513629204, 9443.386179898285, 9843.901560984299, 8539.530325832138, 8954.194122529003, 9068.682596109105, 9350.906490935004, 9489.003654616443], "unit": "score", "name": "yui.html", "value": 6007.432261527313}], "name": "dromaeo_css", "value": 6851.584571274789}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [107.0, 110.0, 103.0, 109.0, 110.0, 110.0, 101.0, 111.0, 109.0, 117.0], "unit": "score", "name": "ai-astar", "value": 108.7}, {"lowerIsBetter": true, "replicates": [151.0, 123.0, 152.0, 165.0, 126.0, 147.0, 145.0, 123.0, 164.0, 125.0], "unit": "score", "name": "audio-beat-detection", "value": 142.1}, {"lowerIsBetter": true, "replicates": [163.0, 163.0, 162.0, 161.0, 161.0, 161.0, 160.0, 164.0, 164.0, 162.0], "unit": "score", "name": "audio-dft", "value": 162.1}, {"lowerIsBetter": true, "replicates": [74.0, 71.0, 85.0, 104.0, 71.0, 73.0, 71.0, 93.0, 100.0, 71.0], "unit": "score", "name": "audio-fft", "value": 81.3}, {"lowerIsBetter": true, "replicates": [92.0, 94.0, 141.0, 92.0, 94.0, 94.0, 141.0, 94.0, 93.0, 137.0], "unit": "score", "name": "audio-oscillator", "value": 107.2}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 110.0, 109.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.3}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 146.0, 147.0, 145.0, 145.0, 145.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.7}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 97.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [60.0, 60.0, 60.0, 59.0, 60.0, 68.0, 59.0, 67.0, 57.0, 58.0], "unit": "score", "name": "json-parse-financial", "value": 60.8}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 68.0, 68.0, 69.0, 68.0, 69.0, 69.0, 73.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 69.0}, {"lowerIsBetter": true, "replicates": [83.0, 84.0, 85.0, 84.0, 84.0, 85.0, 84.0, 83.0, 85.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.1}, {"lowerIsBetter": true, "replicates": [123.0, 117.0, 115.0, 116.0, 127.0, 119.0, 117.0, 123.0, 121.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.7}, {"lowerIsBetter": true, "replicates": [139.0, 149.0, 154.0, 148.0, 151.0, 144.0, 150.0, 148.0, 147.0, 140.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 147.0}, {"lowerIsBetter": true, "replicates": [70.0, 69.0, 66.0, 69.0, 67.0, 66.0, 68.0, 68.0, 65.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.5}], "name": "kraken", "value": 1500.2999999999997}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.45334215751157], "unit": "score", "name": "Richards", "value": 213.36528799999996}, {"lowerIsBetter": false, "replicates": [189.0359168241966], "unit": "score", "name": "DeltaBlue", "value": 349.7642200000001}, {"lowerIsBetter": false, "replicates": [279.9552071668533], "unit": "score", "name": "Encrypt", "value": 950.7985320000004}, {"lowerIsBetter": false, "replicates": [5191.709844559586], "unit": "score", "name": "Decrypt", "value": 51.270392215568904}, {"lowerIsBetter": false, "replicates": [1096.4912280701753], "unit": "score", "name": "RayTrace", "value": 674.869968}, {"lowerIsBetter": false, "replicates": [786.331500392773], "unit": "score", "name": "Earley", "value": 847.5598391608395}, {"lowerIsBetter": false, "replicates": [12329.268292682927], "unit": "score", "name": "Boyer", "value": 54.05535707220569}, {"lowerIsBetter": false, "replicates": [25948.71794871795], "unit": "score", "name": "RegExp", "value": 35.107129446640336}, {"lowerIsBetter": false, "replicates": [584.7953216374269], "unit": "score", "name": "Splay", "value": 139.34960999999998}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 21108.359372589428}]} 11:20:41 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,201,35]]", "result": "21108.36"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,201,35]]", "result": "1500.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,201,35]]", "result": "6851.58"}}} 11:20:41 INFO - Return code: 0 11:20:41 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 11:20:41 INFO - # TBPL SUCCESS # 11:20:41 INFO - Running post-action listener: _resource_record_post_action 11:20:41 INFO - Running post-run listener: _resource_record_post_run 11:20:42 INFO - Total resource usage - Wall time: 1228s; CPU: 13.0%; Read bytes: 8192; Write bytes: 559476736; Read time: 16; Write time: 826200 11:20:42 INFO - install - Wall time: 17s; CPU: 16.0%; Read bytes: 0; Write bytes: 244682752; Read time: 0; Write time: 499720 11:20:42 INFO - run-tests - Wall time: 1212s; CPU: 13.0%; Read bytes: 8192; Write bytes: 310784000; Read time: 16; Write time: 325460 11:20:42 INFO - Running post-run listener: _upload_blobber_files 11:20:42 INFO - Blob upload gear active. 11:20:42 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 11:20:42 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 11:20:42 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'] 11:20:42 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 11:20:43 INFO - (blobuploader) - INFO - Open directory for files ... 11:20:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 11:20:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:20:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:20:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:20:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:20:44 INFO - (blobuploader) - INFO - Done attempting. 11:20:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:20:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:20:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:20:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:20:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:20:45 INFO - (blobuploader) - INFO - Done attempting. 11:20:45 INFO - (blobuploader) - INFO - Iteration through files over. 11:20:45 INFO - Return code: 0 11:20:45 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 11:20:45 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 11:20:45 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/c472446bba1a182b48e271928725c75923fcbbe02149c8406f19bcfb9074a67d130445e1f9046c533af90da92e025ec68c1711ebfc80eedb6195aa50a2147cce", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/420ea817036e0a7b63fd1546fd954acdddf93b94b3aa0d01b54b911d689f33c7d133d7e455e2aa54f1b0d6ecb9866a52e9bf58a62efd85de94ce0f98615341c7"} 11:20:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 11:20:45 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 11:20:45 INFO - Contents: 11:20:45 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/c472446bba1a182b48e271928725c75923fcbbe02149c8406f19bcfb9074a67d130445e1f9046c533af90da92e025ec68c1711ebfc80eedb6195aa50a2147cce", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/420ea817036e0a7b63fd1546fd954acdddf93b94b3aa0d01b54b911d689f33c7d133d7e455e2aa54f1b0d6ecb9866a52e9bf58a62efd85de94ce0f98615341c7"} 11:20:45 INFO - Copying logs to upload dir... 11:20:45 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1265.640752 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2015-12-21 11:20:44.280772) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-21 11:20:44.284465) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 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/c472446bba1a182b48e271928725c75923fcbbe02149c8406f19bcfb9074a67d130445e1f9046c533af90da92e025ec68c1711ebfc80eedb6195aa50a2147cce", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/420ea817036e0a7b63fd1546fd954acdddf93b94b3aa0d01b54b911d689f33c7d133d7e455e2aa54f1b0d6ecb9866a52e9bf58a62efd85de94ce0f98615341c7"} build_url:https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011230 build_url: 'https://queue.taskcluster.net/v1/task/v1bFBNKCRmGh0oIg8mvoQA/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/c472446bba1a182b48e271928725c75923fcbbe02149c8406f19bcfb9074a67d130445e1f9046c533af90da92e025ec68c1711ebfc80eedb6195aa50a2147cce", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/420ea817036e0a7b63fd1546fd954acdddf93b94b3aa0d01b54b911d689f33c7d133d7e455e2aa54f1b0d6ecb9866a52e9bf58a62efd85de94ce0f98615341c7"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-21 11:20:44.309540) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 11:20:44.309857) ========= 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=a732b360c9c0c9a4a8cfc42c000001d9-1450722706.867015-1147764019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004469 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 11:20:44.392046) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 11:20:44.392385) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 11:20:44.392725) ========= ========= Total master_lag: 0.24 =========