builder: b2g-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-061 starttime: 1454505748.17 results: success (0) buildid: 20160203023033 builduid: 37df844c6d87461b963351a954a3e843 revision: d72389fdc5899749238c8f86a3bb9358af56133d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.170206) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.171014) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.171496) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006250 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.196528) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.197018) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.210740) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.211048) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004551 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.260645) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.261047) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.261523) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.261874) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-03 05:22:29-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.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% 76.9K=0.2s 2016-02-03 05:22:29 (76.9 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.330687 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.606666) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.607164) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016413 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.659605) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:28.660001) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev d72389fdc5899749238c8f86a3bb9358af56133d --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 d72389fdc5899749238c8f86a3bb9358af56133d --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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-03 05:22:29,726 truncating revision to first 12 chars 2016-02-03 05:22:29,726 Setting DEBUG logging. 2016-02-03 05:22:29,726 attempt 1/10 2016-02-03 05:22:29,726 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/d72389fdc589?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-03 05:22:29,990 unpacking tar archive at: b2g-inbound-d72389fdc589/testing/mozharness/ program finished with exit code 0 elapsedTime=0.528590 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:29.202580) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:29.202971) ========= echo d72389fdc5899749238c8f86a3bb9358af56133d in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'd72389fdc5899749238c8f86a3bb9358af56133d'] 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False d72389fdc5899749238c8f86a3bb9358af56133d program finished with exit code 0 elapsedTime=0.003548 script_repo_revision: 'd72389fdc5899749238c8f86a3bb9358af56133d' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:29.251560) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:29.251912) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-03 05:22:29.262493) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-02-03 05:22:29.262880) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --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', '--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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:22:30 INFO - MultiFileLogger online at 20160203 05:22:30 in /builds/slave/test-pgo 05:22:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound 05:22:30 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:22:30 INFO - {'append_to_log': False, 05:22:30 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:22:30 INFO - 'blob_upload_branch': 'B2G-Inbound', 05:22:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:22:30 INFO - 'branch': 'B2G-Inbound', 05:22:30 INFO - 'buildbot_json_path': 'buildprops.json', 05:22:30 INFO - 'config_files': ('talos/linux_config.py',), 05:22:30 INFO - 'default_actions': ('clobber', 05:22:30 INFO - 'read-buildbot-config', 05:22:30 INFO - 'download-and-extract', 05:22:30 INFO - 'populate-webroot', 05:22:30 INFO - 'create-virtualenv', 05:22:30 INFO - 'install', 05:22:30 INFO - 'run-tests'), 05:22:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:22:30 INFO - 'download_minidump_stackwalk': True, 05:22:30 INFO - 'download_symbols': 'ondemand', 05:22:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:22:30 INFO - 'tooltool.py': '/tools/tooltool.py', 05:22:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:22:30 INFO - '/tools/misc-python/virtualenv.py')}, 05:22:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:22:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:22:30 INFO - 'installer_path': 'installer.exe', 05:22:30 INFO - 'log_level': 'info', 05:22:30 INFO - 'log_name': 'talos', 05:22:30 INFO - 'log_to_console': True, 05:22:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:22:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:22:30 INFO - 'opt_config_files': (), 05:22:30 INFO - 'pip_index': False, 05:22:30 INFO - 'sps_profile': False, 05:22:30 INFO - 'sps_profile_interval': 0, 05:22:30 INFO - 'suite': 'dromaeojs', 05:22:30 INFO - 'system_bits': '32', 05:22:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:22:30 INFO - 'title': 'talos-linux64-ix-061', 05:22:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:22:30 INFO - 'use_talos_json': True, 05:22:30 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:22:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:22:30 INFO - 'work_dir': 'build'} 05:22:30 INFO - ##### 05:22:30 INFO - ##### Running clobber step. 05:22:30 INFO - ##### 05:22:30 INFO - Running pre-action listener: _resource_record_pre_action 05:22:30 INFO - Running main action method: clobber 05:22:30 INFO - rmtree: /builds/slave/test-pgo/build 05:22:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:22:30 INFO - Running post-action listener: _resource_record_post_action 05:22:30 INFO - ##### 05:22:30 INFO - ##### Running read-buildbot-config step. 05:22:30 INFO - ##### 05:22:30 INFO - Running pre-action listener: _resource_record_pre_action 05:22:30 INFO - Running main action method: read_buildbot_config 05:22:30 INFO - Using buildbot properties: 05:22:30 INFO - { 05:22:30 INFO - "project": "", 05:22:30 INFO - "product": "firefox", 05:22:30 INFO - "script_repo_revision": "production", 05:22:30 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 05:22:30 INFO - "repository": "", 05:22:30 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound pgo talos dromaeojs", 05:22:30 INFO - "buildid": "20160203023033", 05:22:30 INFO - "pgo_build": "True", 05:22:30 INFO - "basedir": "/builds/slave/test-pgo", 05:22:30 INFO - "buildnumber": 36, 05:22:30 INFO - "slavename": "talos-linux64-ix-061", 05:22:30 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 05:22:30 INFO - "platform": "ubuntu64_hw", 05:22:30 INFO - "scheduler": "tests-b2g-inbound-linux64-pgo-talos", 05:22:30 INFO - "branch": "b2g-inbound", 05:22:30 INFO - "repo_path": "integration/b2g-inbound", 05:22:30 INFO - "revision": "d72389fdc5899749238c8f86a3bb9358af56133d", 05:22:30 INFO - "stage_platform": "linux64-pgo", 05:22:30 INFO - "builduid": "37df844c6d87461b963351a954a3e843", 05:22:30 INFO - "slavebuilddir": "test" 05:22:30 INFO - } 05:22:30 INFO - Found installer url https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 05:22:30 INFO - Running post-action listener: _resource_record_post_action 05:22:30 INFO - ##### 05:22:30 INFO - ##### Running download-and-extract step. 05:22:30 INFO - ##### 05:22:30 INFO - Running pre-action listener: _resource_record_pre_action 05:22:30 INFO - Running main action method: download_and_extract 05:22:30 INFO - mkdir: /builds/slave/test-pgo/build/tests 05:22:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:30 INFO - https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:22:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/test_packages.json 05:22:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/test_packages.json 05:22:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 05:22:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 05:22:31 INFO - Downloaded 1448 bytes. 05:22:31 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:22:31 INFO - Using the following test package requirements: 05:22:31 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:22:31 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:22:31 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:22:31 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'jsshell-linux-x86_64.zip'], 05:22:31 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:22:31 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:22:31 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:22:31 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:22:31 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:22:31 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 05:22:31 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 05:22:31 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:22:31 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:22:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:31 INFO - https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:22:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:22:32 INFO - Downloaded 22498938 bytes. 05:22:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:22:32 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:22:33 INFO - Return code: 0 05:22:33 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:22:33 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')]} 05:22:33 INFO - https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:22:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 05:22:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:22:35 INFO - Downloaded 22498938 bytes. 05:22:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:22:35 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:22:36 INFO - Return code: 0 05:22:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:36 INFO - https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:22:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:22:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:22:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 05:22:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:22:37 INFO - Downloaded 10706572 bytes. 05:22:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:22:37 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 05:22:38 INFO - Return code: 0 05:22:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:38 INFO - https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:22:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:22:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:22:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:22:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:22:39 INFO - Downloaded 55990681 bytes. 05:22:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:22:39 INFO - mkdir: /builds/slave/test-pgo/properties 05:22:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:22:39 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:22:39 INFO - Contents: 05:22:39 INFO - build_url:https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 05:22:39 INFO - Running post-action listener: _resource_record_post_action 05:22:39 INFO - Running post-action listener: set_extra_try_arguments 05:22:39 INFO - ##### 05:22:39 INFO - ##### Running populate-webroot step. 05:22:39 INFO - ##### 05:22:39 INFO - Running pre-action listener: _resource_record_pre_action 05:22:39 INFO - Running main action method: populate_webroot 05:22:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:22:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:22:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:22:39 INFO - '--tppagecycles', 05:22:39 INFO - '7'], 05:22:39 INFO - 'tests': ['tsvgm']}}, 05:22:39 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:22:39 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:22:39 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:22:39 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:22:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:22:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:22:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'tests': ['damp', 'tps']}, 05:22:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['damp', 'tps']}, 05:22:39 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:22:39 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:22:39 INFO - 'other': {'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'other_l64': {'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'other_nol64': {'tests': ['a11yr', 05:22:39 INFO - 'ts_paint', 05:22:39 INFO - 'tpaint', 05:22:39 INFO - 'sessionrestore', 05:22:39 INFO - 'sessionrestore_no_auto_restore']}, 05:22:39 INFO - 'svgr': {'tests': ['tsvgx', 05:22:39 INFO - 'tsvgr_opacity', 05:22:39 INFO - 'tart', 05:22:39 INFO - 'tscrollx', 05:22:39 INFO - 'cart']}, 05:22:39 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['tsvgx', 05:22:39 INFO - 'tsvgr_opacity', 05:22:39 INFO - 'tart', 05:22:39 INFO - 'tscrollx', 05:22:39 INFO - 'cart']}, 05:22:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'tests': ['tp5o']}, 05:22:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'talos_options': ['--e10s'], 05:22:39 INFO - 'tests': ['tp5o']}, 05:22:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'talos_options': ['--xperf_path', 05:22:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:22:39 INFO - 'tests': ['tp5n']}, 05:22:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:22:39 INFO - 'talos_options': ['--e10s', 05:22:39 INFO - '--xperf_path', 05:22:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:22:39 INFO - 'tests': ['tp5n']}}, 05:22:39 INFO - 'talos.zip': {'path': '', 05:22:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:22:39 INFO - Running post-action listener: _resource_record_post_action 05:22:39 INFO - ##### 05:22:39 INFO - ##### Running create-virtualenv step. 05:22:39 INFO - ##### 05:22:39 INFO - Running pre-action listener: _resource_record_pre_action 05:22:39 INFO - Running main action method: create_virtualenv 05:22:39 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:22:39 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 05:22:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:22:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:22:40 INFO - Using real prefix '/usr' 05:22:40 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:22:40 INFO - Installing distribute.............................................................................................................................................................................................done. 05:22:42 INFO - Installing pip.................done. 05:22:42 INFO - Return code: 0 05:22:42 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:22:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:42 INFO - Using env: {'DISPLAY': ':0', 05:22:42 INFO - 'HOME': '/home/cltbld', 05:22:42 INFO - 'LANG': 'en_US.UTF-8', 05:22:42 INFO - 'LANGUAGE': 'en_US:en', 05:22:42 INFO - 'LOGNAME': 'cltbld', 05:22:42 INFO - 'MAIL': '/var/mail/cltbld', 05:22:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:42 INFO - 'MOZ_NO_REMOTE': '1', 05:22:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:42 INFO - 'NO_EM_RESTART': '1', 05:22:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:42 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:42 INFO - 'SHELL': '/bin/bash', 05:22:42 INFO - 'SHLVL': '1', 05:22:42 INFO - 'TERM': 'linux', 05:22:42 INFO - 'TMOUT': '86400', 05:22:42 INFO - 'USER': 'cltbld', 05:22:42 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:42 INFO - '_': '/tools/buildbot/bin/python'} 05:22:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:42 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 05:22:42 INFO - Cleaning up... 05:22:42 INFO - Return code: 0 05:22:42 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:22:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:42 INFO - Using env: {'DISPLAY': ':0', 05:22:42 INFO - 'HOME': '/home/cltbld', 05:22:42 INFO - 'LANG': 'en_US.UTF-8', 05:22:42 INFO - 'LANGUAGE': 'en_US:en', 05:22:42 INFO - 'LOGNAME': 'cltbld', 05:22:42 INFO - 'MAIL': '/var/mail/cltbld', 05:22:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:42 INFO - 'MOZ_NO_REMOTE': '1', 05:22:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:42 INFO - 'NO_EM_RESTART': '1', 05:22:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:42 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:42 INFO - 'SHELL': '/bin/bash', 05:22:42 INFO - 'SHLVL': '1', 05:22:42 INFO - 'TERM': 'linux', 05:22:42 INFO - 'TMOUT': '86400', 05:22:42 INFO - 'USER': 'cltbld', 05:22:42 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:42 INFO - '_': '/tools/buildbot/bin/python'} 05:22:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:42 INFO - Downloading/unpacking psutil>=0.7.1 05:22:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:22:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:22:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:22:44 INFO - Installing collected packages: psutil 05:22:44 INFO - Running setup.py install for psutil 05:22:44 INFO - building 'psutil._psutil_linux' extension 05:22:44 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 05:22:45 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 05:22:45 INFO - building 'psutil._psutil_posix' extension 05:22:45 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 05:22:45 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 05:22:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:22:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:22:45 INFO - Successfully installed psutil 05:22:45 INFO - Cleaning up... 05:22:45 INFO - Return code: 0 05:22:45 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:22:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:45 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:45 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:45 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:45 INFO - Using env: {'DISPLAY': ':0', 05:22:45 INFO - 'HOME': '/home/cltbld', 05:22:45 INFO - 'LANG': 'en_US.UTF-8', 05:22:45 INFO - 'LANGUAGE': 'en_US:en', 05:22:45 INFO - 'LOGNAME': 'cltbld', 05:22:45 INFO - 'MAIL': '/var/mail/cltbld', 05:22:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:45 INFO - 'MOZ_NO_REMOTE': '1', 05:22:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:45 INFO - 'NO_EM_RESTART': '1', 05:22:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:45 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:45 INFO - 'SHELL': '/bin/bash', 05:22:45 INFO - 'SHLVL': '1', 05:22:45 INFO - 'TERM': 'linux', 05:22:45 INFO - 'TMOUT': '86400', 05:22:45 INFO - 'USER': 'cltbld', 05:22:45 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:45 INFO - '_': '/tools/buildbot/bin/python'} 05:22:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:45 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:22:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:47 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:22:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:22:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:22:47 INFO - Installing collected packages: mozsystemmonitor 05:22:47 INFO - Running setup.py install for mozsystemmonitor 05:22:47 INFO - Successfully installed mozsystemmonitor 05:22:47 INFO - Cleaning up... 05:22:47 INFO - Return code: 0 05:22:47 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 05:22: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')]} 05:22:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22: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')]} 05:22:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:47 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:47 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:47 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:47 INFO - Using env: {'DISPLAY': ':0', 05:22:47 INFO - 'HOME': '/home/cltbld', 05:22:47 INFO - 'LANG': 'en_US.UTF-8', 05:22:47 INFO - 'LANGUAGE': 'en_US:en', 05:22:47 INFO - 'LOGNAME': 'cltbld', 05:22:47 INFO - 'MAIL': '/var/mail/cltbld', 05:22:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:47 INFO - 'MOZ_NO_REMOTE': '1', 05:22:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:47 INFO - 'NO_EM_RESTART': '1', 05:22:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:47 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:47 INFO - 'SHELL': '/bin/bash', 05:22:47 INFO - 'SHLVL': '1', 05:22:47 INFO - 'TERM': 'linux', 05:22:47 INFO - 'TMOUT': '86400', 05:22:47 INFO - 'USER': 'cltbld', 05:22:47 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:47 INFO - '_': '/tools/buildbot/bin/python'} 05:22:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:47 INFO - Downloading/unpacking blobuploader==1.2.4 05:22:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:49 INFO - Downloading blobuploader-1.2.4.tar.gz 05:22:49 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:22:49 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:22:49 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 05:22:49 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 05:22:49 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 05:22:49 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 05:22:49 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 05:22:49 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 05:22:49 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:22:50 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:22:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:22:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:22:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:22:50 INFO - Downloading docopt-0.6.1.tar.gz 05:22:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:22:50 INFO - Installing collected packages: blobuploader, requests, docopt 05:22:50 INFO - Running setup.py install for blobuploader 05:22:50 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:22:50 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:22:50 INFO - Running setup.py install for requests 05:22:50 INFO - Running setup.py install for docopt 05:22:50 INFO - Successfully installed blobuploader requests docopt 05:22:50 INFO - Cleaning up... 05:22:50 INFO - Return code: 0 05:22:50 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:22:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:50 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:50 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--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 05:22:50 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --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 05:22:50 INFO - Using env: {'DISPLAY': ':0', 05:22:50 INFO - 'HOME': '/home/cltbld', 05:22:50 INFO - 'LANG': 'en_US.UTF-8', 05:22:50 INFO - 'LANGUAGE': 'en_US:en', 05:22:50 INFO - 'LOGNAME': 'cltbld', 05:22:50 INFO - 'MAIL': '/var/mail/cltbld', 05:22:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:50 INFO - 'MOZ_NO_REMOTE': '1', 05:22:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:50 INFO - 'NO_EM_RESTART': '1', 05:22:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:50 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:50 INFO - 'SHELL': '/bin/bash', 05:22:50 INFO - 'SHLVL': '1', 05:22:50 INFO - 'TERM': 'linux', 05:22:50 INFO - 'TMOUT': '86400', 05:22:50 INFO - 'USER': 'cltbld', 05:22:50 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:50 INFO - '_': '/tools/buildbot/bin/python'} 05:22:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:22:51 INFO - Running setup.py (path:/tmp/pip-zVsW6E-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:22:51 INFO - Running setup.py (path:/tmp/pip-ktJ34a-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:22:51 INFO - Running setup.py (path:/tmp/pip-pRx0DS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:22:51 INFO - Running setup.py (path:/tmp/pip-2KFhmF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:22:51 INFO - Running setup.py (path:/tmp/pip-74DgPA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:22:51 INFO - Running setup.py (path:/tmp/pip-NJSAnV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:22:51 INFO - Running setup.py (path:/tmp/pip-TEebGr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:22:51 INFO - Running setup.py (path:/tmp/pip-1ijRbI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:22:51 INFO - Running setup.py (path:/tmp/pip-QbbtT_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:22:51 INFO - Running setup.py (path:/tmp/pip-rAf_bq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:22:51 INFO - Running setup.py (path:/tmp/pip-Be3Exe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:22:51 INFO - Running setup.py (path:/tmp/pip-W_CIrm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:22:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:22:51 INFO - Running setup.py (path:/tmp/pip-5xa8eY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:22:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:22:52 INFO - Running setup.py (path:/tmp/pip-fRAT8J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:22:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:22:52 INFO - Running setup.py (path:/tmp/pip-BjtSKD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:22:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:22:52 INFO - Running setup.py (path:/tmp/pip-vtFdrd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:22:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:22:52 INFO - Running setup.py (path:/tmp/pip-mg0PBn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:22:52 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:22:52 INFO - Running setup.py install for manifestparser 05:22:52 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:22:52 INFO - Running setup.py install for mozcrash 05:22:52 INFO - Running setup.py install for mozdebug 05:22:52 INFO - Running setup.py install for mozdevice 05:22:52 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:22:52 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:22:52 INFO - Running setup.py install for mozfile 05:22:52 INFO - Running setup.py install for mozhttpd 05:22:52 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:22:52 INFO - Running setup.py install for mozinfo 05:22:53 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for mozInstall 05:22:53 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for mozleak 05:22:53 INFO - Running setup.py install for mozlog 05:22:53 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for moznetwork 05:22:53 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for mozprocess 05:22:53 INFO - Running setup.py install for mozprofile 05:22:53 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for mozrunner 05:22:53 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:22:53 INFO - Running setup.py install for mozscreenshot 05:22:53 INFO - Running setup.py install for moztest 05:22:53 INFO - Running setup.py install for mozversion 05:22:54 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:22:54 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:22:54 INFO - Cleaning up... 05:22:54 INFO - Return code: 0 05:22:54 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:22: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')]} 05:22:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22: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')]} 05:22:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:54 INFO - Using env: {'DISPLAY': ':0', 05:22:54 INFO - 'HOME': '/home/cltbld', 05:22:54 INFO - 'LANG': 'en_US.UTF-8', 05:22:54 INFO - 'LANGUAGE': 'en_US:en', 05:22:54 INFO - 'LOGNAME': 'cltbld', 05:22:54 INFO - 'MAIL': '/var/mail/cltbld', 05:22:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:54 INFO - 'MOZ_NO_REMOTE': '1', 05:22:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:54 INFO - 'NO_EM_RESTART': '1', 05:22:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:54 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:54 INFO - 'SHELL': '/bin/bash', 05:22:54 INFO - 'SHLVL': '1', 05:22:54 INFO - 'TERM': 'linux', 05:22:54 INFO - 'TMOUT': '86400', 05:22:54 INFO - 'USER': 'cltbld', 05:22:54 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:54 INFO - '_': '/tools/buildbot/bin/python'} 05:22:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:22:54 INFO - Running setup.py (path:/tmp/pip-b8wJx5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:22:54 INFO - Running setup.py (path:/tmp/pip-uSOTb4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:22:54 INFO - Running setup.py (path:/tmp/pip-1GoehH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:22:54 INFO - Running setup.py (path:/tmp/pip-psdD4w-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:22:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:22:54 INFO - Running setup.py (path:/tmp/pip-GUbhD3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:22:54 INFO - Running setup.py (path:/tmp/pip-_YX1Qb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:22:54 INFO - Running setup.py (path:/tmp/pip-g_hQnQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:22:54 INFO - Running setup.py (path:/tmp/pip-sr5NC9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:22:54 INFO - Running setup.py (path:/tmp/pip-1QAEuB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:22:54 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)) 05:22:54 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:22:54 INFO - Running setup.py (path:/tmp/pip-wDOntM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:22:55 INFO - Running setup.py (path:/tmp/pip-njV1yG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:22:55 INFO - Running setup.py (path:/tmp/pip-QA6xHc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:22:55 INFO - Running setup.py (path:/tmp/pip-Mckkg3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:22:55 INFO - Running setup.py (path:/tmp/pip-c0QexZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:22:55 INFO - Running setup.py (path:/tmp/pip-9L8SgM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:22:55 INFO - Running setup.py (path:/tmp/pip-h3QI3f-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:22:55 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)) 05:22:55 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:22:55 INFO - Running setup.py (path:/tmp/pip-lknn9d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:22:55 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)) 05:22:55 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)) 05:22:55 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)) 05:22:55 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)) 05:22:55 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.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 05:22:55 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.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 05:22:55 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:22:55 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 05:22:55 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 05:22:55 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 05:22:55 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 05:22:55 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 05:22:55 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 05:22:57 INFO - Downloading blessings-1.6.tar.gz 05:22:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:22:57 INFO - Installing collected packages: blessings 05:22:57 INFO - Running setup.py install for blessings 05:22:57 INFO - Successfully installed blessings 05:22:57 INFO - Cleaning up... 05:22:57 INFO - Return code: 0 05:22:57 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:22:57 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:22:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:22:57 INFO - Reading from file tmpfile_stdout 05:22:57 INFO - Current package versions: 05:22:57 INFO - argparse == 1.2.1 05:22:57 INFO - blessings == 1.6 05:22:57 INFO - blobuploader == 1.2.4 05:22:57 INFO - docopt == 0.6.1 05:22:57 INFO - manifestparser == 1.1 05:22:57 INFO - mozInstall == 1.12 05:22:57 INFO - mozcrash == 0.16 05:22:57 INFO - mozdebug == 0.1 05:22:57 INFO - mozdevice == 0.48 05:22:57 INFO - mozfile == 1.2 05:22:57 INFO - mozhttpd == 0.7 05:22:57 INFO - mozinfo == 0.9 05:22:57 INFO - mozleak == 0.1 05:22:57 INFO - mozlog == 3.1 05:22:57 INFO - moznetwork == 0.27 05:22:57 INFO - mozprocess == 0.22 05:22:57 INFO - mozprofile == 0.28 05:22:57 INFO - mozrunner == 6.11 05:22:57 INFO - mozscreenshot == 0.1 05:22:57 INFO - mozsystemmonitor == 0.0 05:22:57 INFO - moztest == 0.7 05:22:57 INFO - mozversion == 1.4 05:22:57 INFO - psutil == 3.1.1 05:22:57 INFO - requests == 1.2.3 05:22:57 INFO - wsgiref == 0.1.2 05:22:57 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:22:57 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')]} 05:22:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:57 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')]} 05:22:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:57 INFO - Using env: {'DISPLAY': ':0', 05:22:57 INFO - 'HOME': '/home/cltbld', 05:22:57 INFO - 'LANG': 'en_US.UTF-8', 05:22:57 INFO - 'LANGUAGE': 'en_US:en', 05:22:57 INFO - 'LOGNAME': 'cltbld', 05:22:57 INFO - 'MAIL': '/var/mail/cltbld', 05:22:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:57 INFO - 'MOZ_NO_REMOTE': '1', 05:22:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:57 INFO - 'NO_EM_RESTART': '1', 05:22:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:57 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:57 INFO - 'SHELL': '/bin/bash', 05:22:57 INFO - 'SHLVL': '1', 05:22:57 INFO - 'TERM': 'linux', 05:22:57 INFO - 'TMOUT': '86400', 05:22:57 INFO - 'USER': 'cltbld', 05:22:57 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:57 INFO - '_': '/tools/buildbot/bin/python'} 05:22:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 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)) 05:22:58 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 05:22:58 INFO - Cleaning up... 05:22:58 INFO - Return code: 0 05:22:58 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 05:22:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:22:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:22:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:22:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:22:58 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:22:58 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:22:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:22:58 INFO - Using env: {'DISPLAY': ':0', 05:22:58 INFO - 'HOME': '/home/cltbld', 05:22:58 INFO - 'LANG': 'en_US.UTF-8', 05:22:58 INFO - 'LANGUAGE': 'en_US:en', 05:22:58 INFO - 'LOGNAME': 'cltbld', 05:22:58 INFO - 'MAIL': '/var/mail/cltbld', 05:22:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:22:58 INFO - 'MOZ_NO_REMOTE': '1', 05:22:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:22:58 INFO - 'NO_EM_RESTART': '1', 05:22:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:22:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:22:58 INFO - 'PWD': '/builds/slave/test-pgo', 05:22:58 INFO - 'SHELL': '/bin/bash', 05:22:58 INFO - 'SHLVL': '1', 05:22:58 INFO - 'TERM': 'linux', 05:22:58 INFO - 'TMOUT': '86400', 05:22:58 INFO - 'USER': 'cltbld', 05:22:58 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:22:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:22:58 INFO - '_': '/tools/buildbot/bin/python'} 05:22:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:22:58 INFO - Downloading/unpacking jsonschema 05:22: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 05:22: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 05:22: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 05:22: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 05:22: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 05:22: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 05:22:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:23:00 INFO - Downloading/unpacking functools32 (from jsonschema) 05:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:00 INFO - Downloading functools32-3.2.3-2.tar.gz 05:23:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 05:23:00 INFO - warning: no files found matching '*.txt' 05:23:00 INFO - no previously-included directories found matching 'build' 05:23:00 INFO - no previously-included directories found matching 'dist' 05:23:00 INFO - no previously-included directories found matching '.git*' 05:23:00 INFO - Installing collected packages: jsonschema, functools32 05:23:00 INFO - Running setup.py install for functools32 05:23:00 INFO - warning: no files found matching '*.txt' 05:23:00 INFO - no previously-included directories found matching 'build' 05:23:00 INFO - no previously-included directories found matching 'dist' 05:23:00 INFO - no previously-included directories found matching '.git*' 05:23:00 INFO - Successfully installed jsonschema functools32 05:23:00 INFO - Cleaning up... 05:23:00 INFO - Return code: 0 05:23:00 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 05:23:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:23:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:23:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:23:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7f821073bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19168a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x19e6630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', '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 05:23:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 05:23:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 05:23:00 INFO - Using env: {'DISPLAY': ':0', 05:23:00 INFO - 'HOME': '/home/cltbld', 05:23:00 INFO - 'LANG': 'en_US.UTF-8', 05:23:00 INFO - 'LANGUAGE': 'en_US:en', 05:23:00 INFO - 'LOGNAME': 'cltbld', 05:23:00 INFO - 'MAIL': '/var/mail/cltbld', 05:23:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:00 INFO - 'MOZ_NO_REMOTE': '1', 05:23:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:23:00 INFO - 'NO_EM_RESTART': '1', 05:23:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:23:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:23:00 INFO - 'PWD': '/builds/slave/test-pgo', 05:23:00 INFO - 'SHELL': '/bin/bash', 05:23:00 INFO - 'SHLVL': '1', 05:23:00 INFO - 'TERM': 'linux', 05:23:00 INFO - 'TMOUT': '86400', 05:23:00 INFO - 'USER': 'cltbld', 05:23:00 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:23:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:00 INFO - '_': '/tools/buildbot/bin/python'} 05:23:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:23:00 INFO - Downloading/unpacking flake8 05:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:23:02 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:23:02 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:23:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:23:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:23:03 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 05:23:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:23:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:23:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:23:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:23:03 INFO - no previously-included directories found matching 'docs/_build' 05:23:03 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:23:03 INFO - Running setup.py install for pep8 05:23:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:23:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:23:03 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:23:03 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:23:03 INFO - no previously-included directories found matching 'docs/_build' 05:23:03 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 05:23:03 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:23:03 INFO - Cleaning up... 05:23:03 INFO - Return code: 0 05:23:03 INFO - Running post-action listener: _resource_record_post_action 05:23:03 INFO - Running post-action listener: _start_resource_monitoring 05:23:03 INFO - Starting resource monitoring. 05:23:03 INFO - ##### 05:23:03 INFO - ##### Running install step. 05:23:03 INFO - ##### 05:23:03 INFO - Running pre-action listener: _resource_record_pre_action 05:23:03 INFO - Running main action method: install 05:23:03 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:23:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:23:03 INFO - Reading from file tmpfile_stdout 05:23:03 INFO - Detecting whether we're running mozinstall >=1.0... 05:23:03 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:23:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:23:03 INFO - Reading from file tmpfile_stdout 05:23:03 INFO - Output received: 05:23:03 INFO - Usage: mozinstall [options] installer 05:23:03 INFO - Options: 05:23:03 INFO - -h, --help show this help message and exit 05:23:03 INFO - -d DEST, --destination=DEST 05:23:03 INFO - Directory to install application into. [default: 05:23:03 INFO - "/builds/slave/test-pgo"] 05:23:03 INFO - --app=APP Application being installed. [default: firefox] 05:23:03 INFO - mkdir: /builds/slave/test-pgo/build/application 05:23:03 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 05:23:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 05:23:19 INFO - Reading from file tmpfile_stdout 05:23:19 INFO - Output received: 05:23:19 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:23:19 INFO - Running post-action listener: _resource_record_post_action 05:23:19 INFO - ##### 05:23:19 INFO - ##### Running run-tests step. 05:23:19 INFO - ##### 05:23:19 INFO - Running pre-action listener: _resource_record_pre_action 05:23:19 INFO - Running main action method: run_tests 05:23:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:23:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:23:19 INFO - Python 2.7.3 05:23:19 INFO - Return code: 0 05:23:19 INFO - grabbing minidump binary from tooltool 05:23:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:23:19 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 0x1a77840>, '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 0x19e46b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19e4b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:23:19 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 05:23:19 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 05:23:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:23:19 INFO - Return code: 0 05:23:19 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:23:19 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:23:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:23:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:23:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:23:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 05:23:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 05:23:20 INFO - Return code: 0 05:23:20 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/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--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 05:23:20 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/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-061 --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 05:23:20 INFO - Using env: {'DISPLAY': ':0', 05:23:20 INFO - 'HOME': '/home/cltbld', 05:23:20 INFO - 'LANG': 'en_US.UTF-8', 05:23:20 INFO - 'LANGUAGE': 'en_US:en', 05:23:20 INFO - 'LOGNAME': 'cltbld', 05:23:20 INFO - 'MAIL': '/var/mail/cltbld', 05:23:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:23:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:23:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:23:20 INFO - 'MOZ_NO_REMOTE': '1', 05:23:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:23:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:23:20 INFO - 'NO_EM_RESTART': '1', 05:23:20 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:23:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:23:20 INFO - 'PWD': '/builds/slave/test-pgo', 05:23:20 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:23:20 INFO - 'SHELL': '/bin/bash', 05:23:20 INFO - 'SHLVL': '1', 05:23:20 INFO - 'TERM': 'linux', 05:23:20 INFO - 'TMOUT': '86400', 05:23:20 INFO - 'USER': 'cltbld', 05:23:20 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871', 05:23:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:23:20 INFO - '_': '/tools/buildbot/bin/python'} 05:23:20 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/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--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 05:23:21 INFO - mozversion application_buildid: 20160203023033 05:23:21 INFO - mozversion application_changeset: d72389fdc5899749238c8f86a3bb9358af56133d 05:23:21 INFO - mozversion application_display_name: Nightly 05:23:21 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:23:21 INFO - mozversion application_name: Firefox 05:23:21 INFO - mozversion application_remotingname: firefox 05:23:21 INFO - mozversion application_repository: https://hg.mozilla.org/integration/b2g-inbound 05:23:21 INFO - mozversion application_vendor: Mozilla 05:23:21 INFO - mozversion application_version: 47.0a1 05:23:21 INFO - mozversion platform_buildid: 20160203023033 05:23:21 INFO - mozversion platform_changeset: d72389fdc5899749238c8f86a3bb9358af56133d 05:23:21 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/b2g-inbound 05:23:21 INFO - mozversion platform_version: 47.0a1 05:23:21 INFO - using testdate: 1454505801 05:23:21 INFO - actual date: 1454505801 05:23:21 INFO - starting webserver on 'localhost:55527' 05:23:21 INFO - SUITE-START | Running 3 tests 05:23:21 INFO - TEST-START | dromaeo_css 05:23:21 INFO - operating with platform_type : linux_ 05:23:21 INFO - Initialising browser for dromaeo_css test... 05:23:21 INFO - TEST-INFO | started process 26300 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpC4oJuq/profile http://localhost:55527/getInfo.html) 05:23:25 INFO - PROCESS | 26300 | __metrics Screen width/height:1600/1200 05:23:25 INFO - PROCESS | 26300 | colorDepth:24 05:23:25 INFO - PROCESS | 26300 | Browser inner width/height: 1024/697 05:23:25 INFO - PROCESS | 26300 | __metrics 05:23:25 INFO - PROCESS | 26300 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:23:25 INFO - PROCESS | 26300 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:23:27 INFO - TEST-INFO | 26300: exit 0 05:23:27 INFO - Browser initialized. 05:23:27 INFO - Running cycle 1/1 for dromaeo_css test... 05:23:27 INFO - TEST-INFO | started process 26392 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpC4oJuq/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:23:38 INFO - PROCESS | 26392 | RSS: Main: 148041728 05:23:38 INFO - PROCESS | 26392 | 05:24:30 INFO - PROCESS | 26392 | 1454505870192 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] 05:26:38 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55527/tests/dromaeo/cssquery-ext.html) 05:26:39 INFO - PROCESS | 26392 | RSS: Main: 228851712 05:26:39 INFO - PROCESS | 26392 | 05:29:42 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-ext.html (next: http://localhost:55527/tests/dromaeo/cssquery-jquery.html) 05:29:42 INFO - PROCESS | 26392 | RSS: Main: 239702016 05:29:42 INFO - PROCESS | 26392 | 05:32:44 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55527/tests/dromaeo/cssquery-mootools.html) 05:32:45 INFO - PROCESS | 26392 | RSS: Main: 241946624 05:32:45 INFO - PROCESS | 26392 | 05:35:47 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55527/tests/dromaeo/cssquery-prototype.html) 05:35:47 INFO - PROCESS | 26392 | RSS: Main: 216645632 05:35:47 INFO - PROCESS | 26392 | 05:38:50 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55527/tests/dromaeo/cssquery-yui.html) 05:38:50 INFO - PROCESS | 26392 | RSS: Main: 218398720 05:38:50 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | Cycle 1(1): loaded http://localhost:55527/tests/dromaeo/cssquery-yui.html (next: http://localhost:55527/tests/dromaeo/cssquery-dojo.html) 05:41:53 INFO - PROCESS | 26392 | RSS: Main: 302133248 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | __start_tp_report 05:41:53 INFO - PROCESS | 26392 | _x_x_mozilla_page_load 05:41:53 INFO - PROCESS | 26392 | _x_x_mozilla_page_load_details 05:41:53 INFO - PROCESS | 26392 | |i|pagename|runs| 05:41:53 INFO - PROCESS | 26392 | |0;dojo.html;3076.7384772294354;3122.2194451387154;3164.066600352896;3171.0962375722925;3187.0279564732764;4966.329545511355;5031.874203144918;5046.142155833508;5061.822836200734;5064.392272927249;5024.974875125628;5073.797048118071;5076.187809950408;5085.262636917645;5088.211327244274;4420.646348292129;4585.931211031837;4597.471290801559;4657.8835529111875;4735.763211839394;4591.311303304497;4648.186567350717;4664.5335466453425;4673.112108699336;4738.170820106485;4593.1961906666365;4609.055143695535;4627.120847039086;4631.421072365954;4672.509386514418;4637.814487420499;4638.420197475316;4654.232051711463;4672.859814205579;4721.032188401404;4434.957784920541;4505.639548836085;4640.443146822403;4640.976795116037;4641.257398816173;4906.828261010847;4957.801687932479;4959.380077490314;4960.107180707471;4970.13022721026;5427.972860135714;5448.45515448452;5448.700321482317;5450.91823622646;5497.587680923907;5257.1588545832865;5387.9461205388225;5453.991011662855;5495.890082198373;5576.358718747356;5135.845924622267;5143.6399452037995;5144.5369916707305;5158.613104017176;5165.9225111623355;5538.9169162462595;5543.584231182596;5546.168074788733;5548.167774833726;5554;5257.526822585985;5336.17289320156;5346.984073026113;5355.437679043722;5365.812196573102;5496.532794712414;5498.532624726863;5500.532454741392;5501.477359650827;5526;5359;5420.07858664028;5421.010904848098;5426.2674538936735;5478.561715062785;5259.658122222043;5343.19852022192;5411.621186516906;5423.593230507728;5426.825307195256;4241.236577416094;4274.636655884223;4290.163418133497;4291.356296555542;4313.439252897103;3829.349010668193;3835.712321575893;3843.0392401899526;3866.9806650966566;3868.883933482;4928.507149285043;5004.949950500449;5034.899302014012;5075.416327122428;5122.538971492583;5405.567554595623;5409.5131438169965;5425.050616142159;5429.864253393696;5430.91853622196;4806.95193048072;5030.84907452777;5038.924416133761;5039.4708555601865;5069.467705890902;4637.281221410687;4638.466576343763;4651.5813576778255;4667.579917807414;4697.154512187771;5591.30108736408;5610.326760788732;5613.522850557667;5621.522170615462;5658.85852853682;5282.788688452419;5370.704611246263;5389.730513474389;5390.05674007055;5395.757190926339;5517.448255174611;5628.296462942132;5632.183333416713;5680.318361796446;5689.146628005832;5316;5332.760025798926;5349.705766182898;5352.170413585901;5355.089634762022;5297.496737809902;5331.120365139864;5398.1902714593125;5406.864828379322;5453;5249.632525723316;5269.341332333458;5283.286756287852;5340.385855626652;5372.247885296139;5192.065428222956;5193.9092790512905;5215.16557350822;5241.921371179359;5275.103232450416;5190.987757387274;5191.870203244949;5192.273081768631;5203.375594928632;5241.554467870274;5240.71176085319;5250.97374513125;5314.654547454403;5337.839864804062;5387.542058924879;5186.714730689698;5213.322268105274;5215.191645294985;5217.765200565907;5235.424103348552 05:41:53 INFO - PROCESS | 26392 | |1;ext.html;528.19186644434;534.0360649028504;548.8545535433109;552.3206456059047;589.0839744197773;27532.03637872675;28055.633324001123;36112.458313125295;36608.63391366086;36702;39223;39558.60441395592;39795.40306895399;39815.60184398155;39912;8329.333653307736;8518.318534517224;8519.148085191493;8520.360972927025;8520.488770673779;8268.255856972872;8351.83296334073;8385.916140838604;8404.327653787683;8414.49513029217;8597.269232115277;8673.566321683922;8674.56627168639;8675;8692.739217823444;8569.828603427928;8649.221570058726;8651.178138076873;8654.221120099159;8654.697085601974;8411.579421028986;8555.572221388906;8563.143685631449;8563.614637341272;8564.186402291773;38791;39183.60816391828;39234.41148382777;39292.41061384082;39324.60675393267;3055.236190952262;3372.696457318853;3515.771474854152;3664.9450258246147;3880.1269714314335;29163.427614662516;29675.554866677016;29717.405651886842;29975.700242997726;30446.54330185049;3735.1595890924596;3742.5696044954907;3744.962550374516;3837.884863454101;3957.98021009896;265417;265782;266148;266342;266710.66644666845;52674;53562.73218633882;57803.71098144483;59071.40928590745;59143.40856591379;52357.738211309465;52555;52631.21053184205;52769.73615131977;52795;11541;12338.136330456782;12585.181963172365;12588.244705317527;12597.055220858472;8446.239838414573;8839.116088391109;8953.4180278283;8955.910440895637;8959.462432254086;18254.908725456287;18263.72604410935;18448.81551184498;18487.630247395246;18487.70586058963;6661.2006559213205;6956.165260168711;7026.43788496919;7053.329933656294;7078.327558881898;870.4994628088748;921.6129225725211;988.5106872098214;999.3104757717297;1002.644061358222;28105.43789124206;28174.71825281721;28212.85893570519;28232.15303540897;28581.714182857904;1064.5741703318579;1067.4235912607105;1106.9446527673583;1124.6176300058019;1193.8149586814059;14666.193359365125;14722.852771472362;14848.62878428048;14969.775453368207;15154.16652084146;306158;309425;312619;313342;313740;50860.49139508631;51030.489695103315;51039;51499;51510;1270.39021269791;1270.987290127087;1278.1755767530076;1287.6973911130876;1288.8968882489378;27072.864635676695;27553.17340479789;27995;28024.159275221777;28254.57618135771;46089.53910460853;46676;46701;46705.29942050804;46764.53235467602;277360;280116;281782;287756;289310;27363.863180684766;27491.17526474209;27508;27519.174424766486;27530.724692753618;36617;37101.6289837109;37451;37470.250594988494;37602.24795504129;33367.16582085467;35380.46929296011;35779.10552236215;36098;36347.27305453929;31949.840250798596;32293;32318.35363292768;32348;32457.837710811295;32049;35032.474512882836;35534.46698299476;35551;35631.28737425289;27450.45099098047;29365.41269174562;30065;31326;32199.195020124684;22729.545409092058;23695.407614809767;24091.27726168218;24091.518169636158;24444.388890277885 05:41:53 INFO - PROCESS | 26392 | |2;jquery.html;358.23516791649837;358.77576514678327;367.1152522420966;369.2301551265611;375.73698411112196;13599.52401665942;13717.451301947935;15658.686826263482;16995.025870472666;18113.094345282734;15254.466093686724;15262.923685381586;15662.216889155525;15732.134732589702;15867.52397428076;5196.090684130271;5412.484504338791;5415.783368665268;5416.295881535395;5418.106012507951;4024.134811015631;4181.3309870420735;5413.729313534327;5498.395176530598;5618.213450116987;5665.3287280252425;5766.423357664242;5808.767649294024;5813.6802475863815;5815.447532484407;5833.970830145843;5966.37353077927;5983.670898100603;5987.790427335022;5989.371116032819;4839.951600483985;5043.067032598944;5044.8234311798915;5278.392984806758;5282.154855223184;12038.578649747304;12346.75306493874;12478.126531142823;12480.687982800411;12573.434195461135;2039.9184032638677;2053.3839848045527;2124.2034237161065;2171.706819579352;2264.094362255095;9004.729858104267;9233.769155771091;9369.672061477815;9409.717708468757;9411.62353505859;1805.5937414081857;1805.873588848781;1838.8988605626685;1845.796962334142;1893.1575448925234;55653.72173139149;57275;57406.425935740524;58771.70614146902;59050.11424828631;9768.21854251658;9928;10021.498925053718;10028.348157369748;10127.544260508295;13015.609531713875;13133.277669728066;13139.14595551286;13142.145760525535;13154.802677959839;6691.933080669131;6762.560433571802;6831.248562658104;6860.142482189726;6951.826204344932;6360.14138091361;6362.936370636327;6429.421352078335;6430.260520040255;6435.742570297136;4327.350897365421;4335.739855608674;4353.73877567347;4368.301071828492;4441.31230132554;1621.878359123047;1700.2433916906857;1706.3686436018504;1794.4078454110113;1795.64087182564;893.3567831161554;904.8687940248627;963.2005435488528;998.6953979036318;1067.631667074858;13526.86473135256;15115.622109447131;15327.923360383127;16098.67802643964;17374.39189628382;886.3396769406704;907.274180655473;909.5861383070687;943.2689665509286;1017.4556612212431;9089.727308180765;9337.393069450463;9370.203532699661;9377.531123443801;9513.143817056498;371053;375546;378983;534119;539671;50515.49484505108;66683.66658166678;69447;69456.65271673609;69480;1088.2382332367217;1107.0479387726548;1117.6423544465856;1119.4290911635126;1120.1039168665036;14750.926245368704;14912.552623421314;15279.312430940412;15291.61770955735;15295.082295062331;32966.50550241796;33052.83473582617;33057.66942330546;33652.663473364955;33674.326513470085;41921.58078419177;42141.367879482445;42661.78669106634;42834.14331713286;43004.56995430006;7055.470839686941;7160;7200;7378.778636640909;7403.111626604842;8891.510966896883;10992.725181870197;11040.668779936294;11115.777684446104;11253.606123785956;9518.666846660333;9877.40735555869;9903.752406189615;9918.156956658764;9978.700638980843;9418.811623767624;9714.951425242829;10141.49292535385;10204.979502050033;10415.218858585486;7633.602986932172;9066.818663626822;9623.711288661072;9898.851517227391;10040.69877903664;7064.258252883374;7069.22238553769;7166.605836678824;7200.675969581277;7299.087614048244;8783.91216087831;9780.217582593234;9853.655122070693;10106.090451859369;10124.190064794946 05:41:53 INFO - PROCESS | 26392 | |3;mootools.html;1336.826212592363;1459.8540145985403;1474.5871156076296;1637.647905700275;1802.1710013393847;7257.673404696789;7739.303462688357;7884.842303153933;7891.408144389172;7896.92103078969;7842.098158711749;8044.477108987911;8046.03447586289;8060.153683863183;8068.152843951389;2022.9898850505726;2071.1301253473503;2073.409078412653;2291.8510296830696;2320.8491448055825;2088.3943656339643;2233.7319521657423;2277.2485079923586;2282.3723476044056;2286.8056215221727;2227.532218234173;2253.7070180876462;2257.4694946687514;2261.6155253606844;2302.343832007878;2292.255017119426;2314.3751187179537;2321.2339927823778;2321.7910388065156;2322.6283794592955;2233.6314508106143;2253.211376018397;2254.3124347074136;2255.12050300383;2266.478709896733;8245.13426090258;8316.875246871301;8318.085010648823;8318.83362332756;8321.16788321163;4766.594839438651;4872.074305881906;4875.926861097087;4880.951190488086;4888.144574699449;3061.8315992620396;3160.178353628073;3252.9186770330693;3266.167127382526;3272.1839379144567;987.8468837330225;991.7124034030122;1007.0885848307294;1015.1117771949545;1053.0154305724172;11371.488283027284;11383;11398.772024559463;11409.885901141048;11425.771484570345;4208.22147902639;4246.766427846498;4279.33670281107;4280.785960702015;4320.179165958458;9904.851427228597;9931.155851752537;9938.304318697767;9938.503074846229;9966.15287700539;4802.207635740134;4808.735519546459;4809.2305231162845;4809.735464549413;4814.687045342112;4350.195213885441;4352.564743525622;4387.517373088957;4412.227860124465;4417.447819022622;3454.844531996066;3694.630536946284;3713.1274150574595;3728.440733889884;3764.924701506009;1119.5969450997634;1164.6738913104175;1171.1918776044502;1172.1794743679459;1198.5026214121217;1071.9678409647722;1073.9463026848625;1235.9382030898419;1331.40086960868;1359.1437394441439;7198.7840364789145;7257.963710181415;7265.382442492341;7274.636268186569;7317.5609463432365;1091.8908109189176;1118.697951553076;1121;1137.4085475552665;1140.0708422635525;5850.473457388855;5900.468957793733;5907.438793314628;5916.083007133901;5919.852003699856;9868.80262394748;9931.205503559842;10069.446180459998;10219.795604088025;10222.335548189492;9961.750956226153;10021.849672254923;10061.899381006242;10101.69694909154;10102.545385457672;7558.962205188939;7649.120351159577;7717.691292348243;7743.574103424253;7837.09873364559;7459.36595389398;7535.962320188364;7566.772996810105;7567.545947243183;7578.166401695919;8473.27977121927;8719.12808719123;8757.299416046573;8909.465432074096;8937.59780809878;8858.291336693179;8887.37788354809;8975.32685048611;9032.45805251687;9032.819343613222;7095.184053833668;7187.604681742554;7229;7236.20401755796;7250.637468126678;6580.374864387875;6925.515213934977;7731.536107833548;7834.294913457816;7860.449768516378;7224.2053374129855;7306.415486761152;7324.304191101837;7395.7041718330665;7429.44279179053;7175.928240717526;7226.566406015656;7246.239144889711;7340.2292759261645;7371.415145743691;7292.307230813064;7335.266473352622;7336.339729424378;7354.816129596803;7356.926430735624;6435.388638079375;6751.527393082437;6767.120274364301;6784.219814721173;6785.830354241183;6955.478339124687;7004.579725216299;7008.264132266038;7010.75462358815;7015.543989640657 05:41:53 INFO - PROCESS | 26392 | |4;prototype.html;328.7632904308898;337.6370401818046;338.11919948534086;345.5283537970669;345.80116433051;5759.193712880189;5935.139404786309;5962.284525856892;5986.012307969186;6002.3097343805475;5694.971525142369;5827.300723913126;5859.1797148399255;5881.647101173932;5884.499817515506;4525.524819893922;4537.750423726694;4538.591526762591;4542.432195975503;4544.954550454486;4406.933895991563;4493.123840851019;4529.524399938008;4533.0253995390985;4580.175568397687;4521.751303678297;4547.136044151617;4549.1584056949405;4554.6336099170285;4556;4564.064366804797;4568.931466027996;4574.702644328108;4579.129965306614;4579.885502862455;4035.4955630546183;4035.7982100895133;4037.7375470594316;4038.2125485530332;4049.919001619951;5437.646552974044;5580.972095139498;5582.162675598652;5592.972035139839;5651.943480565224;5227.712475813829;5234.031704134747;5235.476452354772;5235.764390602432;5236.162214045772;5928.229330187048;6227.314995350508;6229.221347331583;6230.87538249237;6237.7816776413065;4167.291560434734;4200.70595058346;4282.164977829325;4285.121550082225;4285.5928686774705;6398.776042838478;6446.838829029265;6451.967740161316;6470.514711396664;6487.18910136233;4446.510883802779;4448.065906159678;4451.443569553806;4455.1535208310315;4457.866264012085;4345.087531618332;4479.238529450001;4496.64026877849;4501.729896206238;4503.527129651405;5177.119889618773;5177.7152256625495;5180.766865491062;5191.273221748958;5192.8961420771375;6181.227346581677;6202.4417802398;6203.100550420164;6211.844703882439;6215.906761398583;1564.5462815783296;1586.3337398292745;1588.7458006718869;1590.3320605345782;1590.721623715845;1063.5426766490484;1067.6690226029955;1074.4949873559415;1085.8914108589079;1096.0464395975553;5842.883142337129;5907.291125064934;5912.231409916683;5922.466977971917;5924.407559244041;6328.778492752732;6338.080978258126;6407.775727849503;6414.871702566016;6481.935180648133;5868.882622347614;5888.882222355529;5898.587098903122;5910.822675319747;5913.467787899023;3397.405454045532;3495.2485215678753;3496.650334966534;3502.6847583717586;3517.1031386996665;6749.257581666013;6752.155980502437;6760.459163266927;6764.5603035802515;6767.830804229835;6660.8667826643195;6661.533692641566;6662.333766623299;6665.566738162004;6670.232923213893;6566.67166641666;6730.730770769114;6734.562253453608;6744.325567443217;6751.3923746864;6192.752289908533;6425.871482570229;6462.063000864754;6463.385978332051;6465.321141280286;6281.654509001866;6352.174217351715;6377.840553986188;6382.0745991831855;6388.201474815648;6733.595984240961;6739.797806065826;6740.460763139035;6740.797776066725;6742.6291553965;4307.8492252771;4404.273294906433;4437.134758722018;4438.822447102079;4440.689151759346;6416.807495775134;6430.871382572229;6443.96778016107;6453.225612926479;6472.967635161983;6268.968655156695;6274.152989346379;6282.340354262737;6284.528660350584;6285.057241413824;6140.416660417253;6188.257409110935;6189.535784816247;6263.561550691408;6270.811875643738;6169.352218017044;6188.597741146811;6194.690265486798;6203.4416902479;6216.316205217332;6350.110984462087;6360.395762402564;6361.7137228823885;6369.9681501592195;6373.6175829450385;6090.908636370369;6209.472194863487;6217.409346112112;6223.439890409885;6227.252729672287 05:41:53 INFO - PROCESS | 26392 | |5;yui.html;727.4507746651278;734.3024127079276;791.4262159934049;821.9543919169546;837.133566758405;13509.32453377331;13631.386587603569;13658.180509169457;13662.111962722416;13684.863151368483;12946.935265323684;12993.93503032486;14368.784468232985;14867.107973521597;14867.628309292273;673.2426020726682;816.0778320497844;828.6354004238146;828.9751307460785;830.4643504939311;673.2426020726682;795.1055063054064;810.7365106340434;812.2770734046703;813.7518056992615;856.4347530629785;857.6226460357454;859.6045818923271;859.6948083430354;864.8529749942494;690.5580428525723;703.5989485992986;830.1573902488979;854.9615267312955;855.4995327733284;620.6462316479608;621.226572916717;626.5332327416058;628.246104674388;628.937106289372;13509.662258443519;13576.93211533946;13585.796213056812;13599.388027538784;13606.183628982293;11694.532218711242;12141;12178.269303841798;12197.573084942072;12768.744625107445;10499.73750656232;10736.946315268451;10760.40817755023;10776.40729759863;10943.343399396063;3599.748017638766;3668.284684486526;3688.4836122942543;3782;3785.0915780212827;44720.55279447229;44877;45146.77426612846;45216.54783452156;45348.77325613351;9149.817003660022;9474;9541.952290238505;9554.856677149848;9737.90262097384;17025.914870425568;17444.5638859027;17456.5635859102;17470.56323591895;17481.300747970192;7224.74713385029;7258.165310989199;7311.963440182872;7367.8158046049275;7369.963150184215;4279.336702811007;4308.9353659695125;4311.116221174651;4347.282698354736;4456.5766252205985;2961.7334439900515;2980.910572682823;2990.7607391408637;3003.969960300413;3006;591.3436085944599;598.3298705449924;599.4395240450193;610.2432983100923;610.9266887973472;523.5235935298936;531.9521243088141;542.736772665257;597.7758340622266;646.2987658390605;7751.1861254568585;8055.2153627226235;8060.476069055492;8101.554414507141;8169.387295952827;550.4303046347012;653.2259272761793;660.9107770451023;662.3111963557942;683.7948615415355;3906.7851268180525;3909.863154789569;3987.76073435589;4038.172174704179;4153.813078411479;54901.725491372286;57278.71360643253;57926.42073579295;58037.70981145067;58148.418515815145;49150.26274605884;49235.50764492381;49294.50705492899;49929.50070499321;50638.493615064115;44245.55754442414;45159;45208.095838083056;45505.77247113743;45873;7374.33630973215;7710.460267781202;7721.691132354643;7723.9227607723205;7949.562774047252;34305;34887.825560872036;34900.825495873374;35115;36204.81897590495;44281.557184427744;44321.33517997297;44608.77695611501;44863.102737944406;45674.77162614166;10371.740706482096;10387.480625968823;10678.252522323362;10694.89305106939;10898.618548350769;11274.436278186222;11598.594049208237;11915.2255103418;11934.28394296345;12237.571684990982;11661.125415593695;11971.940140299243;11995.76008479843;12301.630951071482;12410.627681169579;11100.333979961228;11157.051650609788;11482;11498.885011150116;11867.228630139014;8284.029582250601;11062.557497700001;11748.647540573797;11762.70593235176;11801.409929503663;9346.20557252641;9484.573194206416;9586.233101351736;9746.366486178376;9763;9000.774980625536;9665.951670241604;9686.418814871131;9704.70885873425;9761.121499065119 05:41:53 INFO - PROCESS | 26392 | __end_tp_report 05:41:53 INFO - PROCESS | 26392 | __start_cc_report 05:41:53 INFO - PROCESS | 26392 | _x_x_mozilla_cycle_collect,965 05:41:53 INFO - PROCESS | 26392 | __end_cc_report 05:41:53 INFO - PROCESS | 26392 | __startTimestamp1454506913598__endTimestamp 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | ------- Summary: start ------- 05:41:53 INFO - PROCESS | 26392 | Number of tests: 6 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#0] dojo.html Cycles:165 Average:5041.36 Median:5213.32 stddev:529.85 (10.2%) stddev-sans-first:508.56 05:41:53 INFO - PROCESS | 26392 | Values: 3076.7 3122.2 3164.1 3171.1 3187.0 4966.3 5031.9 5046.1 5061.8 5064.4 5025.0 5073.8 5076.2 5085.3 5088.2 4420.6 4585.9 4597.5 4657.9 4735.8 4591.3 4648.2 4664.5 4673.1 4738.2 4593.2 4609.1 4627.1 4631.4 4672.5 4637.8 4638.4 4654.2 4672.9 4721.0 4435.0 4505.6 4640.4 4641.0 4641.3 4906.8 4957.8 4959.4 4960.1 4970.1 5428.0 5448.5 5448.7 5450.9 5497.6 5257.2 5387.9 5454.0 5495.9 5576.4 5135.8 5143.6 5144.5 5158.6 5165.9 5538.9 5543.6 5546.2 5548.2 5554.0 5257.5 5336.2 5347.0 5355.4 5365.8 5496.5 5498.5 5500.5 5501.5 5526.0 5359.0 5420.1 5421.0 5426.3 5478.6 5259.7 5343.2 5411.6 5423.6 5426.8 4241.2 4274.6 4290.2 4291.4 4313.4 3829.3 3835.7 3843.0 3867.0 3868.9 4928.5 5004.9 5034.9 5075.4 5122.5 5405.6 5409.5 5425.1 5429.9 5430.9 4807.0 5030.8 5038.9 5039.5 5069.5 4637.3 4638.5 4651.6 4667.6 4697.2 5591.3 5610.3 5613.5 5621.5 5658.9 5282.8 5370.7 5389.7 5390.1 5395.8 5517.4 5628.3 5632.2 5680.3 5689.1 5316.0 5332.8 5349.7 5352.2 5355.1 5297.5 5331.1 5398.2 5406.9 5453.0 5249.6 5269.3 5283.3 5340.4 5372.2 5192.1 5193.9 5215.2 5241.9 5275.1 5191.0 5191.9 5192.3 5203.4 5241.6 5240.7 5251.0 5314.7 5337.8 5387.5 5186.7 5213.3 5215.2 5217.8 5235.4 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#1] ext.html Cycles:180 Average:44478.26 Median:36229.87 stddev:75188.28 (207.5%) stddev-sans-first:75326.79 05:41:53 INFO - PROCESS | 26392 | Values: 528.2 534.0 548.9 552.3 589.1 27532.0 28055.6 36112.5 36608.6 36702.0 39223.0 39558.6 39795.4 39815.6 39912.0 8329.3 8518.3 8519.1 8520.4 8520.5 8268.3 8351.8 8385.9 8404.3 8414.5 8597.3 8673.6 8674.6 8675.0 8692.7 8569.8 8649.2 8651.2 8654.2 8654.7 8411.6 8555.6 8563.1 8563.6 8564.2 38791.0 39183.6 39234.4 39292.4 39324.6 3055.2 3372.7 3515.8 3664.9 3880.1 29163.4 29675.6 29717.4 29975.7 30446.5 3735.2 3742.6 3745.0 3837.9 3958.0 265417.0 265782.0 266148.0 266342.0 266710.7 52674.0 53562.7 57803.7 59071.4 59143.4 52357.7 52555.0 52631.2 52769.7 52795.0 11541.0 12338.1 12585.2 12588.2 12597.1 8446.2 8839.1 8953.4 8955.9 8959.5 18254.9 18263.7 18448.8 18487.6 18487.7 6661.2 6956.2 7026.4 7053.3 7078.3 870.5 921.6 988.5 999.3 1002.6 28105.4 28174.7 28212.9 28232.2 28581.7 1064.6 1067.4 1106.9 1124.6 1193.8 14666.2 14722.9 14848.6 14969.8 15154.2 306158.0 309425.0 312619.0 313342.0 313740.0 50860.5 51030.5 51039.0 51499.0 51510.0 1270.4 1271.0 1278.2 1287.7 1288.9 27072.9 27553.2 27995.0 28024.2 28254.6 46089.5 46676.0 46701.0 46705.3 46764.5 277360.0 280116.0 281782.0 287756.0 289310.0 27363.9 27491.2 27508.0 27519.2 27530.7 36617.0 37101.6 37451.0 37470.3 37602.2 33367.2 35380.5 35779.1 36098.0 36347.3 31949.8 32293.0 32318.4 32348.0 32457.8 32049.0 35032.5 35534.5 35551.0 35631.3 27450.5 29365.4 30065.0 31326.0 32199.2 22729.5 23695.4 24091.3 24091.5 24444.4 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#2] jquery.html Cycles:180 Average:24220.53 Median:4941.51 stddev:73159.07 (1480.5%) stddev-sans-first:73342.36 05:41:53 INFO - PROCESS | 26392 | Values: 358.2 358.8 367.1 369.2 375.7 13599.5 13717.5 15658.7 16995.0 18113.1 15254.5 15262.9 15662.2 15732.1 15867.5 5196.1 5412.5 5415.8 5416.3 5418.1 4024.1 4181.3 5413.7 5498.4 5618.2 5665.3 5766.4 5808.8 5813.7 5815.4 5834.0 5966.4 5983.7 5987.8 5989.4 4840.0 5043.1 5044.8 5278.4 5282.2 12038.6 12346.8 12478.1 12480.7 12573.4 2039.9 2053.4 2124.2 2171.7 2264.1 9004.7 9233.8 9369.7 9409.7 9411.6 1805.6 1805.9 1838.9 1845.8 1893.2 55653.7 57275.0 57406.4 58771.7 59050.1 9768.2 9928.0 10021.5 10028.3 10127.5 13015.6 13133.3 13139.1 13142.1 13154.8 6691.9 6762.6 6831.2 6860.1 6951.8 6360.1 6362.9 6429.4 6430.3 6435.7 4327.4 4335.7 4353.7 4368.3 4441.3 1621.9 1700.2 1706.4 1794.4 1795.6 893.4 904.9 963.2 998.7 1067.6 13526.9 15115.6 15327.9 16098.7 17374.4 886.3 907.3 909.6 943.3 1017.5 9089.7 9337.4 9370.2 9377.5 9513.1 371053.0 375546.0 378983.0 534119.0 539671.0 50515.5 66683.7 69447.0 69456.7 69480.0 1088.2 1107.0 1117.6 1119.4 1120.1 14750.9 14912.6 15279.3 15291.6 15295.1 32966.5 33052.8 33057.7 33652.7 33674.3 41921.6 42141.4 42661.8 42834.1 43004.6 7055.5 7160.0 7200.0 7378.8 7403.1 8891.5 10992.7 11040.7 11115.8 11253.6 9518.7 9877.4 9903.8 9918.2 9978.7 9418.8 9715.0 10141.5 10205.0 10415.2 7633.6 9066.8 9623.7 9898.9 10040.7 7064.3 7069.2 7166.6 7200.7 7299.1 8783.9 9780.2 9853.7 10106.1 10124.2 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#3] mootools.html Cycles:180 Average:5675.36 Median:5875.47 stddev:3021.87 (51.4%) stddev-sans-first:3012.75 05:41:53 INFO - PROCESS | 26392 | Values: 1336.8 1459.9 1474.6 1637.6 1802.2 7257.7 7739.3 7884.8 7891.4 7896.9 7842.1 8044.5 8046.0 8060.2 8068.2 2023.0 2071.1 2073.4 2291.9 2320.8 2088.4 2233.7 2277.2 2282.4 2286.8 2227.5 2253.7 2257.5 2261.6 2302.3 2292.3 2314.4 2321.2 2321.8 2322.6 2233.6 2253.2 2254.3 2255.1 2266.5 8245.1 8316.9 8318.1 8318.8 8321.2 4766.6 4872.1 4875.9 4881.0 4888.1 3061.8 3160.2 3252.9 3266.2 3272.2 987.8 991.7 1007.1 1015.1 1053.0 11371.5 11383.0 11398.8 11409.9 11425.8 4208.2 4246.8 4279.3 4280.8 4320.2 9904.9 9931.2 9938.3 9938.5 9966.2 4802.2 4808.7 4809.2 4809.7 4814.7 4350.2 4352.6 4387.5 4412.2 4417.4 3454.8 3694.6 3713.1 3728.4 3764.9 1119.6 1164.7 1171.2 1172.2 1198.5 1072.0 1073.9 1235.9 1331.4 1359.1 7198.8 7258.0 7265.4 7274.6 7317.6 1091.9 1118.7 1121.0 1137.4 1140.1 5850.5 5900.5 5907.4 5916.1 5919.9 9868.8 9931.2 10069.4 10219.8 10222.3 9961.8 10021.8 10061.9 10101.7 10102.5 7559.0 7649.1 7717.7 7743.6 7837.1 7459.4 7536.0 7566.8 7567.5 7578.2 8473.3 8719.1 8757.3 8909.5 8937.6 8858.3 8887.4 8975.3 9032.5 9032.8 7095.2 7187.6 7229.0 7236.2 7250.6 6580.4 6925.5 7731.5 7834.3 7860.4 7224.2 7306.4 7324.3 7395.7 7429.4 7175.9 7226.6 7246.2 7340.2 7371.4 7292.3 7335.3 7336.3 7354.8 7356.9 6435.4 6751.5 6767.1 6784.2 6785.8 6955.5 7004.6 7008.3 7010.8 7015.5 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#4] prototype.html Cycles:180 Average:5231.32 Median:5909.06 stddev:1571.86 (26.6%) stddev-sans-first:1532.60 05:41:53 INFO - PROCESS | 26392 | Values: 328.8 337.6 338.1 345.5 345.8 5759.2 5935.1 5962.3 5986.0 6002.3 5695.0 5827.3 5859.2 5881.6 5884.5 4525.5 4537.8 4538.6 4542.4 4545.0 4406.9 4493.1 4529.5 4533.0 4580.2 4521.8 4547.1 4549.2 4554.6 4556.0 4564.1 4568.9 4574.7 4579.1 4579.9 4035.5 4035.8 4037.7 4038.2 4049.9 5437.6 5581.0 5582.2 5593.0 5651.9 5227.7 5234.0 5235.5 5235.8 5236.2 5928.2 6227.3 6229.2 6230.9 6237.8 4167.3 4200.7 4282.2 4285.1 4285.6 6398.8 6446.8 6452.0 6470.5 6487.2 4446.5 4448.1 4451.4 4455.2 4457.9 4345.1 4479.2 4496.6 4501.7 4503.5 5177.1 5177.7 5180.8 5191.3 5192.9 6181.2 6202.4 6203.1 6211.8 6215.9 1564.5 1586.3 1588.7 1590.3 1590.7 1063.5 1067.7 1074.5 1085.9 1096.0 5842.9 5907.3 5912.2 5922.5 5924.4 6328.8 6338.1 6407.8 6414.9 6481.9 5868.9 5888.9 5898.6 5910.8 5913.5 3397.4 3495.2 3496.7 3502.7 3517.1 6749.3 6752.2 6760.5 6764.6 6767.8 6660.9 6661.5 6662.3 6665.6 6670.2 6566.7 6730.7 6734.6 6744.3 6751.4 6192.8 6425.9 6462.1 6463.4 6465.3 6281.7 6352.2 6377.8 6382.1 6388.2 6733.6 6739.8 6740.5 6740.8 6742.6 4307.8 4404.3 4437.1 4438.8 4440.7 6416.8 6430.9 6444.0 6453.2 6473.0 6269.0 6274.2 6282.3 6284.5 6285.1 6140.4 6188.3 6189.5 6263.6 6270.8 6169.4 6188.6 6194.7 6203.4 6216.3 6350.1 6360.4 6361.7 6370.0 6373.6 6090.9 6209.5 6217.4 6223.4 6227.3 05:41:53 INFO - PROCESS | 26392 | 05:41:53 INFO - PROCESS | 26392 | [#5] yui.html Cycles:180 Average:13569.36 Median:45427.27 stddev:15607.02 (34.4%) stddev-sans-first:15621.01 05:41:53 INFO - PROCESS | 26392 | Values: 727.5 734.3 791.4 822.0 837.1 13509.3 13631.4 13658.2 13662.1 13684.9 12946.9 12993.9 14368.8 14867.1 14867.6 673.2 816.1 828.6 829.0 830.5 673.2 795.1 810.7 812.3 813.8 856.4 857.6 859.6 859.7 864.9 690.6 703.6 830.2 855.0 855.5 620.6 621.2 626.5 628.2 628.9 13509.7 13576.9 13585.8 13599.4 13606.2 11694.5 12141.0 12178.3 12197.6 12768.7 10499.7 10736.9 10760.4 10776.4 10943.3 3599.7 3668.3 3688.5 3782.0 3785.1 44720.6 44877.0 45146.8 45216.5 45348.8 9149.8 9474.0 9542.0 9554.9 9737.9 17025.9 17444.6 17456.6 17470.6 17481.3 7224.7 7258.2 7312.0 7367.8 7370.0 4279.3 4308.9 4311.1 4347.3 4456.6 2961.7 2980.9 2990.8 3004.0 3006.0 591.3 598.3 599.4 610.2 610.9 523.5 532.0 542.7 597.8 646.3 7751.2 8055.2 8060.5 8101.6 8169.4 550.4 653.2 660.9 662.3 683.8 3906.8 3909.9 3987.8 4038.2 4153.8 54901.7 57278.7 57926.4 58037.7 58148.4 49150.3 49235.5 49294.5 49929.5 50638.5 44245.6 45159.0 45208.1 45505.8 45873.0 7374.3 7710.5 7721.7 7723.9 7949.6 34305.0 34887.8 34900.8 35115.0 36204.8 44281.6 44321.3 44608.8 44863.1 45674.8 10371.7 10387.5 10678.3 10694.9 10898.6 11274.4 11598.6 11915.2 11934.3 12237.6 11661.1 11971.9 11995.8 12301.6 12410.6 11100.3 11157.1 11482.0 11498.9 11867.2 8284.0 11062.6 11748.6 11762.7 11801.4 9346.2 9484.6 9586.2 9746.4 9763.0 9000.8 9666.0 9686.4 9704.7 9761.1 05:41:53 INFO - PROCESS | 26392 | -------- Summary: end -------- 05:41:53 INFO - PROCESS | 26392 | 05:41:54 INFO - TEST-INFO | 26392: exit 0 05:41:54 INFO - TEST-OK | dromaeo_css | took 1113149ms 05:41:54 INFO - TEST-START | kraken 05:41:54 INFO - operating with platform_type : linux_ 05:41:54 INFO - Initialising browser for kraken test... 05:41:54 INFO - TEST-INFO | started process 26588 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5ZtZGH/profile http://localhost:55527/getInfo.html) 05:41:58 INFO - PROCESS | 26588 | __metrics Screen width/height:1600/1200 05:41:58 INFO - PROCESS | 26588 | colorDepth:24 05:41:58 INFO - PROCESS | 26588 | Browser inner width/height: 1024/697 05:41:58 INFO - PROCESS | 26588 | __metrics 05:41:58 INFO - PROCESS | 26588 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:41:58 INFO - PROCESS | 26588 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:41:59 INFO - TEST-INFO | 26588: exit 0 05:41:59 INFO - Browser initialized. 05:41:59 INFO - Running cycle 1/1 for kraken test... 05:41:59 INFO - TEST-INFO | started process 26674 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5ZtZGH/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:42:11 INFO - PROCESS | 26674 | RSS: Main: 148729856 05:42:11 INFO - PROCESS | 26674 | 05:42:13 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55527/tests/kraken/driver.html?testName=audio-beat-detection) 05:42:14 INFO - PROCESS | 26674 | RSS: Main: 188215296 05:42:14 INFO - PROCESS | 26674 | 05:42:16 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55527/tests/kraken/driver.html?testName=audio-dft) 05:42:17 INFO - PROCESS | 26674 | RSS: Main: 177606656 05:42:17 INFO - PROCESS | 26674 | 05:42:20 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55527/tests/kraken/driver.html?testName=audio-fft) 05:42:21 INFO - PROCESS | 26674 | RSS: Main: 163295232 05:42:21 INFO - PROCESS | 26674 | 05:42:23 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55527/tests/kraken/driver.html?testName=audio-oscillator) 05:42:23 INFO - PROCESS | 26674 | RSS: Main: 165715968 05:42:23 INFO - PROCESS | 26674 | 05:42:25 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55527/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:42:26 INFO - PROCESS | 26674 | RSS: Main: 167706624 05:42:26 INFO - PROCESS | 26674 | 05:42:29 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55527/tests/kraken/driver.html?testName=imaging-darkroom) 05:42:30 INFO - PROCESS | 26674 | RSS: Main: 167251968 05:42:30 INFO - PROCESS | 26674 | 05:42:33 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55527/tests/kraken/driver.html?testName=imaging-desaturate) 05:42:33 INFO - PROCESS | 26674 | RSS: Main: 166858752 05:42:33 INFO - PROCESS | 26674 | 05:42:36 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55527/tests/kraken/driver.html?testName=json-parse-financial) 05:42:37 INFO - PROCESS | 26674 | RSS: Main: 169115648 05:42:37 INFO - PROCESS | 26674 | 05:42:38 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55527/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:42:39 INFO - PROCESS | 26674 | RSS: Main: 178286592 05:42:39 INFO - PROCESS | 26674 | 05:42:41 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:42:41 INFO - PROCESS | 26674 | RSS: Main: 178221056 05:42:41 INFO - PROCESS | 26674 | 05:42:43 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:42:44 INFO - PROCESS | 26674 | RSS: Main: 187277312 05:42:44 INFO - PROCESS | 26674 | 05:42:46 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:42:47 INFO - PROCESS | 26674 | RSS: Main: 195575808 05:42:47 INFO - PROCESS | 26674 | 05:42:49 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:42:50 INFO - PROCESS | 26674 | RSS: Main: 195723264 05:42:50 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | Cycle 1(1): loaded http://localhost:55527/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55527/tests/kraken/driver.html?testName=ai-astar) 05:42:52 INFO - PROCESS | 26674 | RSS: Main: 255197184 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | __start_tp_report 05:42:52 INFO - PROCESS | 26674 | _x_x_mozilla_page_load 05:42:52 INFO - PROCESS | 26674 | _x_x_mozilla_page_load_details 05:42:52 INFO - PROCESS | 26674 | |i|pagename|runs| 05:42:52 INFO - PROCESS | 26674 | |0;ai-astar;111;110;105;109;111;109;110;110;102;110 05:42:52 INFO - PROCESS | 26674 | |1;audio-beat-detection;152;125;175;173;126;157;155;128;168;127 05:42:52 INFO - PROCESS | 26674 | |2;audio-dft;160;160;161;162;160;161;161;161;162;161 05:42:52 INFO - PROCESS | 26674 | |3;audio-fft;72;77;92;93;74;74;72;106;94;73 05:42:52 INFO - PROCESS | 26674 | |4;audio-oscillator;96;97;146;97;97;97;143;96;98;145 05:42:52 INFO - PROCESS | 26674 | |5;imaging-gaussian-blur;120;115;115;114;114;114;114;115;115;115 05:42:52 INFO - PROCESS | 26674 | |6;imaging-darkroom;146;146;145;146;147;145;145;146;145;145 05:42:52 INFO - PROCESS | 26674 | |7;imaging-desaturate;96;96;96;96;96;96;96;96;95;96 05:42:52 INFO - PROCESS | 26674 | |8;json-parse-financial;57;56;56;57;55;56;57;56;63;58 05:42:52 INFO - PROCESS | 26674 | |9;json-stringify-tinderbox;67;69;68;66;66;67;68;75;67;67 05:42:52 INFO - PROCESS | 26674 | |10;stanford-crypto-aes;83;83;89;81;83;82;90;81;82;82 05:42:52 INFO - PROCESS | 26674 | |11;stanford-crypto-ccm;115;116;114;115;111;116;122;117;127;115 05:42:52 INFO - PROCESS | 26674 | |12;stanford-crypto-pbkdf2;145;144;154;132;145;144;154;144;140;145 05:42:52 INFO - PROCESS | 26674 | |13;stanford-crypto-sha256-iterative;70;68;68;67;67;68;69;68;69;69 05:42:52 INFO - PROCESS | 26674 | __end_tp_report 05:42:52 INFO - PROCESS | 26674 | __start_cc_report 05:42:52 INFO - PROCESS | 26674 | _x_x_mozilla_cycle_collect,970 05:42:52 INFO - PROCESS | 26674 | __end_cc_report 05:42:52 INFO - PROCESS | 26674 | __startTimestamp1454506972522__endTimestamp 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | ------- Summary: start ------- 05:42:52 INFO - PROCESS | 26674 | Number of tests: 14 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#0] ai-astar Cycles:10 Average:108.70 Median:110.00 stddev:2.91 (2.6%) stddev-sans-first:2.96 05:42:52 INFO - PROCESS | 26674 | Values: 111.0 110.0 105.0 109.0 111.0 109.0 110.0 110.0 102.0 110.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#1] audio-beat-detection Cycles:10 Average:148.60 Median:156.00 stddev:20.41 (13.1%) stddev-sans-first:21.61 05:42:52 INFO - PROCESS | 26674 | Values: 152.0 125.0 175.0 173.0 126.0 157.0 155.0 128.0 168.0 127.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#2] audio-dft Cycles:10 Average:160.90 Median:161.00 stddev:0.74 (0.5%) stddev-sans-first:0.71 05:42:52 INFO - PROCESS | 26674 | Values: 160.0 160.0 161.0 162.0 160.0 161.0 161.0 161.0 162.0 161.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#3] audio-fft Cycles:10 Average:82.70 Median:75.50 stddev:12.34 (16.3%) stddev-sans-first:12.46 05:42:52 INFO - PROCESS | 26674 | Values: 72.0 77.0 92.0 93.0 74.0 74.0 72.0 106.0 94.0 73.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#4] audio-oscillator Cycles:10 Average:111.20 Median:97.00 stddev:23.11 (23.8%) stddev-sans-first:23.85 05:42:52 INFO - PROCESS | 26674 | Values: 96.0 97.0 146.0 97.0 97.0 97.0 143.0 96.0 98.0 145.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#5] imaging-gaussian-blur Cycles:10 Average:115.10 Median:115.00 stddev:1.79 (1.6%) stddev-sans-first:0.53 05:42:52 INFO - PROCESS | 26674 | Values: 120.0 115.0 115.0 114.0 114.0 114.0 114.0 115.0 115.0 115.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 05:42:52 INFO - PROCESS | 26674 | Values: 146.0 146.0 145.0 146.0 147.0 145.0 145.0 146.0 145.0 145.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 05:42:52 INFO - PROCESS | 26674 | Values: 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0 96.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:57.00 stddev:2.23 (3.9%) stddev-sans-first:2.37 05:42:52 INFO - PROCESS | 26674 | Values: 57.0 56.0 56.0 57.0 55.0 56.0 57.0 56.0 63.0 58.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#9] json-stringify-tinderbox Cycles:10 Average:68.00 Median:67.50 stddev:2.62 (3.9%) stddev-sans-first:2.76 05:42:52 INFO - PROCESS | 26674 | Values: 67.0 69.0 68.0 66.0 66.0 67.0 68.0 75.0 67.0 67.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:83.00 stddev:3.20 (3.9%) stddev-sans-first:3.39 05:42:52 INFO - PROCESS | 26674 | Values: 83.0 83.0 89.0 81.0 83.0 82.0 90.0 81.0 82.0 82.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#11] stanford-crypto-ccm Cycles:10 Average:116.80 Median:116.00 stddev:4.52 (3.9%) stddev-sans-first:4.74 05:42:52 INFO - PROCESS | 26674 | Values: 115.0 116.0 114.0 115.0 111.0 116.0 122.0 117.0 127.0 115.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.70 Median:145.00 stddev:6.31 (4.4%) stddev-sans-first:6.69 05:42:52 INFO - PROCESS | 26674 | Values: 145.0 144.0 154.0 132.0 145.0 144.0 154.0 144.0 140.0 145.0 05:42:52 INFO - PROCESS | 26674 | 05:42:52 INFO - PROCESS | 26674 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.30 Median:68.50 stddev:0.95 (1.4%) stddev-sans-first:0.78 05:42:52 INFO - PROCESS | 26674 | Values: 70.0 68.0 68.0 67.0 67.0 68.0 69.0 68.0 69.0 69.0 05:42:52 INFO - PROCESS | 26674 | -------- Summary: end -------- 05:42:52 INFO - PROCESS | 26674 | 05:42:53 INFO - TEST-INFO | 26674: exit 0 05:42:53 INFO - TEST-OK | kraken | took 59197ms 05:42:53 INFO - TEST-START | v8_7 05:42:53 INFO - operating with platform_type : linux_ 05:42:53 INFO - Initialising browser for v8_7 test... 05:42:53 INFO - TEST-INFO | started process 26924 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpnF78En/profile http://localhost:55527/getInfo.html) 05:42:57 INFO - PROCESS | 26924 | __metrics Screen width/height:1600/1200 05:42:57 INFO - PROCESS | 26924 | colorDepth:24 05:42:57 INFO - PROCESS | 26924 | Browser inner width/height: 1024/697 05:42:57 INFO - PROCESS | 26924 | __metrics 05:42:58 INFO - PROCESS | 26924 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:42:58 INFO - PROCESS | 26924 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:42:58 INFO - TEST-INFO | 26924: exit 0 05:42:58 INFO - Browser initialized. 05:42:58 INFO - Running cycle 1/1 for v8_7 test... 05:42:58 INFO - TEST-INFO | started process 27006 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpnF78En/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:43:10 INFO - PROCESS | 27006 | RSS: Main: 148156416 05:43:10 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | Cycle 1(1): loaded http://localhost:55527/tests/v8_7/run.html (next: http://localhost:55527/tests/v8_7/run.html) 05:43:33 INFO - PROCESS | 27006 | RSS: Main: 568074240 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | __start_tp_report 05:43:33 INFO - PROCESS | 27006 | _x_x_mozilla_page_load 05:43:33 INFO - PROCESS | 27006 | _x_x_mozilla_page_load_details 05:43:33 INFO - PROCESS | 27006 | |i|pagename|runs| 05:43:33 INFO - PROCESS | 27006 | |0;Richards;167.000668002672 05:43:33 INFO - PROCESS | 27006 | |1;DeltaBlue;189.9335232668566 05:43:33 INFO - PROCESS | 27006 | |2;Encrypt;273.8975623116954 05:43:33 INFO - PROCESS | 27006 | |3;Decrypt;5251.308900523561 05:43:33 INFO - PROCESS | 27006 | |4;RayTrace;2014.0845070422536 05:43:33 INFO - PROCESS | 27006 | |5;Earley;797.4481658692185 05:43:33 INFO - PROCESS | 27006 | |6;Boyer;12256.09756097561 05:43:33 INFO - PROCESS | 27006 | |7;RegExp;43042.55319148936 05:43:33 INFO - PROCESS | 27006 | |8;Splay;601.6847172081829 05:43:33 INFO - PROCESS | 27006 | |9;NavierStokes;4826.923076923077 05:43:33 INFO - PROCESS | 27006 | __end_tp_report 05:43:33 INFO - PROCESS | 27006 | __startTimestamp1454507013468__endTimestamp 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | ------- Summary: start ------- 05:43:33 INFO - PROCESS | 27006 | Number of tests: 10 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#0] Richards Cycles:1 Average:167.00 Median:167.00 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 167.0 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#1] DeltaBlue Cycles:1 Average:189.93 Median:189.93 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 189.9 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#2] Encrypt Cycles:1 Average:273.90 Median:273.90 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 273.9 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#3] Decrypt Cycles:1 Average:5251.31 Median:5251.31 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 5251.3 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#4] RayTrace Cycles:1 Average:2014.08 Median:2014.08 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 2014.1 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#5] Earley Cycles:1 Average:797.45 Median:797.45 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 797.4 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#6] Boyer Cycles:1 Average:12256.10 Median:12256.10 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 12256.1 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#7] RegExp Cycles:1 Average:43042.55 Median:43042.55 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 43042.6 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#8] Splay Cycles:1 Average:601.68 Median:601.68 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 601.7 05:43:33 INFO - PROCESS | 27006 | 05:43:33 INFO - PROCESS | 27006 | [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 05:43:33 INFO - PROCESS | 27006 | Values: 4826.9 05:43:33 INFO - PROCESS | 27006 | -------- Summary: end -------- 05:43:33 INFO - PROCESS | 27006 | 05:43:34 INFO - TEST-INFO | 27006: exit 0 05:43:34 INFO - TEST-OK | v8_7 | took 40866ms 05:43:34 INFO - SUITE-END | took 1213s 05:43:34 INFO - Completed test suite (00:20:13) 05:43:34 INFO - Working with test: dromaeo_css 05:43:34 INFO - Generating results file: dromaeo_css 05:43:34 INFO - Working with test: kraken 05:43:34 INFO - Generating results file: kraken 05:43:34 INFO - javascript benchmark 05:43:34 INFO - Working with test: v8_7 05:43:34 INFO - Generating results file: v8_7 05:43:34 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:43:34 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,201,35]] 05:43:34 INFO - process_Request line: dromaeo_css 6737.71 graph.html#tests=[[72,201,35]] 05:43:34 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:43:34 INFO - process_Request line: kraken 1507.20 graph.html#tests=[[232,201,35]] 05:43:34 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:43:34 INFO - process_Request line: v8_7 18838.93 graph.html#tests=[[230,201,35]] 05:43:34 INFO - RETURN: dromaeo_css: 6737.71 05:43:34 INFO - RETURN: kraken: 1507.20 05:43:34 INFO - RETURN: v8_7: 18838.93 05:43:34 INFO - javascript benchmark 05:43:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3076.7384772294354, 3122.2194451387154, 3164.066600352896, 3171.0962375722925, 3187.0279564732764, 4966.329545511355, 5031.874203144918, 5046.142155833508, 5061.822836200734, 5064.392272927249, 5024.974875125628, 5073.797048118071, 5076.187809950408, 5085.262636917645, 5088.211327244274, 4420.646348292129, 4585.931211031837, 4597.471290801559, 4657.8835529111875, 4735.763211839394, 4591.311303304497, 4648.186567350717, 4664.5335466453425, 4673.112108699336, 4738.170820106485, 4593.1961906666365, 4609.055143695535, 4627.120847039086, 4631.421072365954, 4672.509386514418, 4637.814487420499, 4638.420197475316, 4654.232051711463, 4672.859814205579, 4721.032188401404, 4434.957784920541, 4505.639548836085, 4640.443146822403, 4640.976795116037, 4641.257398816173, 4906.828261010847, 4957.801687932479, 4959.380077490314, 4960.107180707471, 4970.13022721026, 5427.972860135714, 5448.45515448452, 5448.700321482317, 5450.91823622646, 5497.587680923907, 5257.1588545832865, 5387.9461205388225, 5453.991011662855, 5495.890082198373, 5576.358718747356, 5135.845924622267, 5143.6399452037995, 5144.5369916707305, 5158.613104017176, 5165.9225111623355, 5538.9169162462595, 5543.584231182596, 5546.168074788733, 5548.167774833726, 5554.0, 5257.526822585985, 5336.17289320156, 5346.984073026113, 5355.437679043722, 5365.812196573102, 5496.532794712414, 5498.532624726863, 5500.532454741392, 5501.477359650827, 5526.0, 5359.0, 5420.07858664028, 5421.010904848098, 5426.2674538936735, 5478.561715062785, 5259.658122222043, 5343.19852022192, 5411.621186516906, 5423.593230507728, 5426.825307195256, 4241.236577416094, 4274.636655884223, 4290.163418133497, 4291.356296555542, 4313.439252897103, 3829.349010668193, 3835.712321575893, 3843.0392401899526, 3866.9806650966566, 3868.883933482, 4928.507149285043, 5004.949950500449, 5034.899302014012, 5075.416327122428, 5122.538971492583, 5405.567554595623, 5409.5131438169965, 5425.050616142159, 5429.864253393696, 5430.91853622196, 4806.95193048072, 5030.84907452777, 5038.924416133761, 5039.4708555601865, 5069.467705890902, 4637.281221410687, 4638.466576343763, 4651.5813576778255, 4667.579917807414, 4697.154512187771, 5591.30108736408, 5610.326760788732, 5613.522850557667, 5621.522170615462, 5658.85852853682, 5282.788688452419, 5370.704611246263, 5389.730513474389, 5390.05674007055, 5395.757190926339, 5517.448255174611, 5628.296462942132, 5632.183333416713, 5680.318361796446, 5689.146628005832, 5316.0, 5332.760025798926, 5349.705766182898, 5352.170413585901, 5355.089634762022, 5297.496737809902, 5331.120365139864, 5398.1902714593125, 5406.864828379322, 5453.0, 5249.632525723316, 5269.341332333458, 5283.286756287852, 5340.385855626652, 5372.247885296139, 5192.065428222956, 5193.9092790512905, 5215.16557350822, 5241.921371179359, 5275.103232450416, 5190.987757387274, 5191.870203244949, 5192.273081768631, 5203.375594928632, 5241.554467870274, 5240.71176085319, 5250.97374513125, 5314.654547454403, 5337.839864804062, 5387.542058924879, 5186.714730689698, 5213.322268105274, 5215.191645294985, 5217.765200565907, 5235.424103348552], "unit": "score", "name": "dojo.html", "value": 5009.413213788081}, {"lowerIsBetter": false, "replicates": [528.19186644434, 534.0360649028504, 548.8545535433109, 552.3206456059047, 589.0839744197773, 27532.03637872675, 28055.633324001123, 36112.458313125295, 36608.63391366086, 36702.0, 39223.0, 39558.60441395592, 39795.40306895399, 39815.60184398155, 39912.0, 8329.333653307736, 8518.318534517224, 8519.148085191493, 8520.360972927025, 8520.488770673779, 8268.255856972872, 8351.83296334073, 8385.916140838604, 8404.327653787683, 8414.49513029217, 8597.269232115277, 8673.566321683922, 8674.56627168639, 8675.0, 8692.739217823444, 8569.828603427928, 8649.221570058726, 8651.178138076873, 8654.221120099159, 8654.697085601974, 8411.579421028986, 8555.572221388906, 8563.143685631449, 8563.614637341272, 8564.186402291773, 38791.0, 39183.60816391828, 39234.41148382777, 39292.41061384082, 39324.60675393267, 3055.236190952262, 3372.696457318853, 3515.771474854152, 3664.9450258246147, 3880.1269714314335, 29163.427614662516, 29675.554866677016, 29717.405651886842, 29975.700242997726, 30446.54330185049, 3735.1595890924596, 3742.5696044954907, 3744.962550374516, 3837.884863454101, 3957.98021009896, 265417.0, 265782.0, 266148.0, 266342.0, 266710.66644666845, 52674.0, 53562.73218633882, 57803.71098144483, 59071.40928590745, 59143.40856591379, 52357.738211309465, 52555.0, 52631.21053184205, 52769.73615131977, 52795.0, 11541.0, 12338.136330456782, 12585.181963172365, 12588.244705317527, 12597.055220858472, 8446.239838414573, 8839.116088391109, 8953.4180278283, 8955.910440895637, 8959.462432254086, 18254.908725456287, 18263.72604410935, 18448.81551184498, 18487.630247395246, 18487.70586058963, 6661.2006559213205, 6956.165260168711, 7026.43788496919, 7053.329933656294, 7078.327558881898, 870.4994628088748, 921.6129225725211, 988.5106872098214, 999.3104757717297, 1002.644061358222, 28105.43789124206, 28174.71825281721, 28212.85893570519, 28232.15303540897, 28581.714182857904, 1064.5741703318579, 1067.4235912607105, 1106.9446527673583, 1124.6176300058019, 1193.8149586814059, 14666.193359365125, 14722.852771472362, 14848.62878428048, 14969.775453368207, 15154.16652084146, 306158.0, 309425.0, 312619.0, 313342.0, 313740.0, 50860.49139508631, 51030.489695103315, 51039.0, 51499.0, 51510.0, 1270.39021269791, 1270.987290127087, 1278.1755767530076, 1287.6973911130876, 1288.8968882489378, 27072.864635676695, 27553.17340479789, 27995.0, 28024.159275221777, 28254.57618135771, 46089.53910460853, 46676.0, 46701.0, 46705.29942050804, 46764.53235467602, 277360.0, 280116.0, 281782.0, 287756.0, 289310.0, 27363.863180684766, 27491.17526474209, 27508.0, 27519.174424766486, 27530.724692753618, 36617.0, 37101.6289837109, 37451.0, 37470.250594988494, 37602.24795504129, 33367.16582085467, 35380.46929296011, 35779.10552236215, 36098.0, 36347.27305453929, 31949.840250798596, 32293.0, 32318.35363292768, 32348.0, 32457.837710811295, 32049.0, 35032.474512882836, 35534.46698299476, 35551.0, 35631.28737425289, 27450.45099098047, 29365.41269174562, 30065.0, 31326.0, 32199.195020124684, 22729.545409092058, 23695.407614809767, 24091.27726168218, 24091.518169636158, 24444.388890277885], "unit": "score", "name": "ext.html", "value": 17484.68062838361}, {"lowerIsBetter": false, "replicates": [358.23516791649837, 358.77576514678327, 367.1152522420966, 369.2301551265611, 375.73698411112196, 13599.52401665942, 13717.451301947935, 15658.686826263482, 16995.025870472666, 18113.094345282734, 15254.466093686724, 15262.923685381586, 15662.216889155525, 15732.134732589702, 15867.52397428076, 5196.090684130271, 5412.484504338791, 5415.783368665268, 5416.295881535395, 5418.106012507951, 4024.134811015631, 4181.3309870420735, 5413.729313534327, 5498.395176530598, 5618.213450116987, 5665.3287280252425, 5766.423357664242, 5808.767649294024, 5813.6802475863815, 5815.447532484407, 5833.970830145843, 5966.37353077927, 5983.670898100603, 5987.790427335022, 5989.371116032819, 4839.951600483985, 5043.067032598944, 5044.8234311798915, 5278.392984806758, 5282.154855223184, 12038.578649747304, 12346.75306493874, 12478.126531142823, 12480.687982800411, 12573.434195461135, 2039.9184032638677, 2053.3839848045527, 2124.2034237161065, 2171.706819579352, 2264.094362255095, 9004.729858104267, 9233.769155771091, 9369.672061477815, 9409.717708468757, 9411.62353505859, 1805.5937414081857, 1805.873588848781, 1838.8988605626685, 1845.796962334142, 1893.1575448925234, 55653.72173139149, 57275.0, 57406.425935740524, 58771.70614146902, 59050.11424828631, 9768.21854251658, 9928.0, 10021.498925053718, 10028.348157369748, 10127.544260508295, 13015.609531713875, 13133.277669728066, 13139.14595551286, 13142.145760525535, 13154.802677959839, 6691.933080669131, 6762.560433571802, 6831.248562658104, 6860.142482189726, 6951.826204344932, 6360.14138091361, 6362.936370636327, 6429.421352078335, 6430.260520040255, 6435.742570297136, 4327.350897365421, 4335.739855608674, 4353.73877567347, 4368.301071828492, 4441.31230132554, 1621.878359123047, 1700.2433916906857, 1706.3686436018504, 1794.4078454110113, 1795.64087182564, 893.3567831161554, 904.8687940248627, 963.2005435488528, 998.6953979036318, 1067.631667074858, 13526.86473135256, 15115.622109447131, 15327.923360383127, 16098.67802643964, 17374.39189628382, 886.3396769406704, 907.274180655473, 909.5861383070687, 943.2689665509286, 1017.4556612212431, 9089.727308180765, 9337.393069450463, 9370.203532699661, 9377.531123443801, 9513.143817056498, 371053.0, 375546.0, 378983.0, 534119.0, 539671.0, 50515.49484505108, 66683.66658166678, 69447.0, 69456.65271673609, 69480.0, 1088.2382332367217, 1107.0479387726548, 1117.6423544465856, 1119.4290911635126, 1120.1039168665036, 14750.926245368704, 14912.552623421314, 15279.312430940412, 15291.61770955735, 15295.082295062331, 32966.50550241796, 33052.83473582617, 33057.66942330546, 33652.663473364955, 33674.326513470085, 41921.58078419177, 42141.367879482445, 42661.78669106634, 42834.14331713286, 43004.56995430006, 7055.470839686941, 7160.0, 7200.0, 7378.778636640909, 7403.111626604842, 8891.510966896883, 10992.725181870197, 11040.668779936294, 11115.777684446104, 11253.606123785956, 9518.666846660333, 9877.40735555869, 9903.752406189615, 9918.156956658764, 9978.700638980843, 9418.811623767624, 9714.951425242829, 10141.49292535385, 10204.979502050033, 10415.218858585486, 7633.602986932172, 9066.818663626822, 9623.711288661072, 9898.851517227391, 10040.69877903664, 7064.258252883374, 7069.22238553769, 7166.605836678824, 7200.675969581277, 7299.087614048244, 8783.91216087831, 9780.217582593234, 9853.655122070693, 10106.090451859369, 10124.190064794946], "unit": "score", "name": "jquery.html", "value": 7894.044515410183}, {"lowerIsBetter": false, "replicates": [1336.826212592363, 1459.8540145985403, 1474.5871156076296, 1637.647905700275, 1802.1710013393847, 7257.673404696789, 7739.303462688357, 7884.842303153933, 7891.408144389172, 7896.92103078969, 7842.098158711749, 8044.477108987911, 8046.03447586289, 8060.153683863183, 8068.152843951389, 2022.9898850505726, 2071.1301253473503, 2073.409078412653, 2291.8510296830696, 2320.8491448055825, 2088.3943656339643, 2233.7319521657423, 2277.2485079923586, 2282.3723476044056, 2286.8056215221727, 2227.532218234173, 2253.7070180876462, 2257.4694946687514, 2261.6155253606844, 2302.343832007878, 2292.255017119426, 2314.3751187179537, 2321.2339927823778, 2321.7910388065156, 2322.6283794592955, 2233.6314508106143, 2253.211376018397, 2254.3124347074136, 2255.12050300383, 2266.478709896733, 8245.13426090258, 8316.875246871301, 8318.085010648823, 8318.83362332756, 8321.16788321163, 4766.594839438651, 4872.074305881906, 4875.926861097087, 4880.951190488086, 4888.144574699449, 3061.8315992620396, 3160.178353628073, 3252.9186770330693, 3266.167127382526, 3272.1839379144567, 987.8468837330225, 991.7124034030122, 1007.0885848307294, 1015.1117771949545, 1053.0154305724172, 11371.488283027284, 11383.0, 11398.772024559463, 11409.885901141048, 11425.771484570345, 4208.22147902639, 4246.766427846498, 4279.33670281107, 4280.785960702015, 4320.179165958458, 9904.851427228597, 9931.155851752537, 9938.304318697767, 9938.503074846229, 9966.15287700539, 4802.207635740134, 4808.735519546459, 4809.2305231162845, 4809.735464549413, 4814.687045342112, 4350.195213885441, 4352.564743525622, 4387.517373088957, 4412.227860124465, 4417.447819022622, 3454.844531996066, 3694.630536946284, 3713.1274150574595, 3728.440733889884, 3764.924701506009, 1119.5969450997634, 1164.6738913104175, 1171.1918776044502, 1172.1794743679459, 1198.5026214121217, 1071.9678409647722, 1073.9463026848625, 1235.9382030898419, 1331.40086960868, 1359.1437394441439, 7198.7840364789145, 7257.963710181415, 7265.382442492341, 7274.636268186569, 7317.5609463432365, 1091.8908109189176, 1118.697951553076, 1121.0, 1137.4085475552665, 1140.0708422635525, 5850.473457388855, 5900.468957793733, 5907.438793314628, 5916.083007133901, 5919.852003699856, 9868.80262394748, 9931.205503559842, 10069.446180459998, 10219.795604088025, 10222.335548189492, 9961.750956226153, 10021.849672254923, 10061.899381006242, 10101.69694909154, 10102.545385457672, 7558.962205188939, 7649.120351159577, 7717.691292348243, 7743.574103424253, 7837.09873364559, 7459.36595389398, 7535.962320188364, 7566.772996810105, 7567.545947243183, 7578.166401695919, 8473.27977121927, 8719.12808719123, 8757.299416046573, 8909.465432074096, 8937.59780809878, 8858.291336693179, 8887.37788354809, 8975.32685048611, 9032.45805251687, 9032.819343613222, 7095.184053833668, 7187.604681742554, 7229.0, 7236.20401755796, 7250.637468126678, 6580.374864387875, 6925.515213934977, 7731.536107833548, 7834.294913457816, 7860.449768516378, 7224.2053374129855, 7306.415486761152, 7324.304191101837, 7395.7041718330665, 7429.44279179053, 7175.928240717526, 7226.566406015656, 7246.239144889711, 7340.2292759261645, 7371.415145743691, 7292.307230813064, 7335.266473352622, 7336.339729424378, 7354.816129596803, 7356.926430735624, 6435.388638079375, 6751.527393082437, 6767.120274364301, 6784.219814721173, 6785.830354241183, 6955.478339124687, 7004.579725216299, 7008.264132266038, 7010.75462358815, 7015.543989640657], "unit": "score", "name": "mootools.html", "value": 4614.959372928456}, {"lowerIsBetter": false, "replicates": [328.7632904308898, 337.6370401818046, 338.11919948534086, 345.5283537970669, 345.80116433051, 5759.193712880189, 5935.139404786309, 5962.284525856892, 5986.012307969186, 6002.3097343805475, 5694.971525142369, 5827.300723913126, 5859.1797148399255, 5881.647101173932, 5884.499817515506, 4525.524819893922, 4537.750423726694, 4538.591526762591, 4542.432195975503, 4544.954550454486, 4406.933895991563, 4493.123840851019, 4529.524399938008, 4533.0253995390985, 4580.175568397687, 4521.751303678297, 4547.136044151617, 4549.1584056949405, 4554.6336099170285, 4556.0, 4564.064366804797, 4568.931466027996, 4574.702644328108, 4579.129965306614, 4579.885502862455, 4035.4955630546183, 4035.7982100895133, 4037.7375470594316, 4038.2125485530332, 4049.919001619951, 5437.646552974044, 5580.972095139498, 5582.162675598652, 5592.972035139839, 5651.943480565224, 5227.712475813829, 5234.031704134747, 5235.476452354772, 5235.764390602432, 5236.162214045772, 5928.229330187048, 6227.314995350508, 6229.221347331583, 6230.87538249237, 6237.7816776413065, 4167.291560434734, 4200.70595058346, 4282.164977829325, 4285.121550082225, 4285.5928686774705, 6398.776042838478, 6446.838829029265, 6451.967740161316, 6470.514711396664, 6487.18910136233, 4446.510883802779, 4448.065906159678, 4451.443569553806, 4455.1535208310315, 4457.866264012085, 4345.087531618332, 4479.238529450001, 4496.64026877849, 4501.729896206238, 4503.527129651405, 5177.119889618773, 5177.7152256625495, 5180.766865491062, 5191.273221748958, 5192.8961420771375, 6181.227346581677, 6202.4417802398, 6203.100550420164, 6211.844703882439, 6215.906761398583, 1564.5462815783296, 1586.3337398292745, 1588.7458006718869, 1590.3320605345782, 1590.721623715845, 1063.5426766490484, 1067.6690226029955, 1074.4949873559415, 1085.8914108589079, 1096.0464395975553, 5842.883142337129, 5907.291125064934, 5912.231409916683, 5922.466977971917, 5924.407559244041, 6328.778492752732, 6338.080978258126, 6407.775727849503, 6414.871702566016, 6481.935180648133, 5868.882622347614, 5888.882222355529, 5898.587098903122, 5910.822675319747, 5913.467787899023, 3397.405454045532, 3495.2485215678753, 3496.650334966534, 3502.6847583717586, 3517.1031386996665, 6749.257581666013, 6752.155980502437, 6760.459163266927, 6764.5603035802515, 6767.830804229835, 6660.8667826643195, 6661.533692641566, 6662.333766623299, 6665.566738162004, 6670.232923213893, 6566.67166641666, 6730.730770769114, 6734.562253453608, 6744.325567443217, 6751.3923746864, 6192.752289908533, 6425.871482570229, 6462.063000864754, 6463.385978332051, 6465.321141280286, 6281.654509001866, 6352.174217351715, 6377.840553986188, 6382.0745991831855, 6388.201474815648, 6733.595984240961, 6739.797806065826, 6740.460763139035, 6740.797776066725, 6742.6291553965, 4307.8492252771, 4404.273294906433, 4437.134758722018, 4438.822447102079, 4440.689151759346, 6416.807495775134, 6430.871382572229, 6443.96778016107, 6453.225612926479, 6472.967635161983, 6268.968655156695, 6274.152989346379, 6282.340354262737, 6284.528660350584, 6285.057241413824, 6140.416660417253, 6188.257409110935, 6189.535784816247, 6263.561550691408, 6270.811875643738, 6169.352218017044, 6188.597741146811, 6194.690265486798, 6203.4416902479, 6216.316205217332, 6350.110984462087, 6360.395762402564, 6361.7137228823885, 6369.9681501592195, 6373.6175829450385, 6090.908636370369, 6209.472194863487, 6217.409346112112, 6223.439890409885, 6227.252729672287], "unit": "score", "name": "prototype.html", "value": 4723.86855326764}, {"lowerIsBetter": false, "replicates": [727.4507746651278, 734.3024127079276, 791.4262159934049, 821.9543919169546, 837.133566758405, 13509.32453377331, 13631.386587603569, 13658.180509169457, 13662.111962722416, 13684.863151368483, 12946.935265323684, 12993.93503032486, 14368.784468232985, 14867.107973521597, 14867.628309292273, 673.2426020726682, 816.0778320497844, 828.6354004238146, 828.9751307460785, 830.4643504939311, 673.2426020726682, 795.1055063054064, 810.7365106340434, 812.2770734046703, 813.7518056992615, 856.4347530629785, 857.6226460357454, 859.6045818923271, 859.6948083430354, 864.8529749942494, 690.5580428525723, 703.5989485992986, 830.1573902488979, 854.9615267312955, 855.4995327733284, 620.6462316479608, 621.226572916717, 626.5332327416058, 628.246104674388, 628.937106289372, 13509.662258443519, 13576.93211533946, 13585.796213056812, 13599.388027538784, 13606.183628982293, 11694.532218711242, 12141.0, 12178.269303841798, 12197.573084942072, 12768.744625107445, 10499.73750656232, 10736.946315268451, 10760.40817755023, 10776.40729759863, 10943.343399396063, 3599.748017638766, 3668.284684486526, 3688.4836122942543, 3782.0, 3785.0915780212827, 44720.55279447229, 44877.0, 45146.77426612846, 45216.54783452156, 45348.77325613351, 9149.817003660022, 9474.0, 9541.952290238505, 9554.856677149848, 9737.90262097384, 17025.914870425568, 17444.5638859027, 17456.5635859102, 17470.56323591895, 17481.300747970192, 7224.74713385029, 7258.165310989199, 7311.963440182872, 7367.8158046049275, 7369.963150184215, 4279.336702811007, 4308.9353659695125, 4311.116221174651, 4347.282698354736, 4456.5766252205985, 2961.7334439900515, 2980.910572682823, 2990.7607391408637, 3003.969960300413, 3006.0, 591.3436085944599, 598.3298705449924, 599.4395240450193, 610.2432983100923, 610.9266887973472, 523.5235935298936, 531.9521243088141, 542.736772665257, 597.7758340622266, 646.2987658390605, 7751.1861254568585, 8055.2153627226235, 8060.476069055492, 8101.554414507141, 8169.387295952827, 550.4303046347012, 653.2259272761793, 660.9107770451023, 662.3111963557942, 683.7948615415355, 3906.7851268180525, 3909.863154789569, 3987.76073435589, 4038.172174704179, 4153.813078411479, 54901.725491372286, 57278.71360643253, 57926.42073579295, 58037.70981145067, 58148.418515815145, 49150.26274605884, 49235.50764492381, 49294.50705492899, 49929.50070499321, 50638.493615064115, 44245.55754442414, 45159.0, 45208.095838083056, 45505.77247113743, 45873.0, 7374.33630973215, 7710.460267781202, 7721.691132354643, 7723.9227607723205, 7949.562774047252, 34305.0, 34887.825560872036, 34900.825495873374, 35115.0, 36204.81897590495, 44281.557184427744, 44321.33517997297, 44608.77695611501, 44863.102737944406, 45674.77162614166, 10371.740706482096, 10387.480625968823, 10678.252522323362, 10694.89305106939, 10898.618548350769, 11274.436278186222, 11598.594049208237, 11915.2255103418, 11934.28394296345, 12237.571684990982, 11661.125415593695, 11971.940140299243, 11995.76008479843, 12301.630951071482, 12410.627681169579, 11100.333979961228, 11157.051650609788, 11482.0, 11498.885011150116, 11867.228630139014, 8284.029582250601, 11062.557497700001, 11748.647540573797, 11762.70593235176, 11801.409929503663, 9346.20557252641, 9484.573194206416, 9586.233101351736, 9746.366486178376, 9763.0, 9000.774980625536, 9665.951670241604, 9686.418814871131, 9704.70885873425, 9761.121499065119], "unit": "score", "name": "yui.html", "value": 6206.238018023216}], "name": "dromaeo_css", "value": 6737.710452020383}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 110.0, 105.0, 109.0, 111.0, 109.0, 110.0, 110.0, 102.0, 110.0], "unit": "score", "name": "ai-astar", "value": 108.7}, {"lowerIsBetter": true, "replicates": [152.0, 125.0, 175.0, 173.0, 126.0, 157.0, 155.0, 128.0, 168.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 148.6}, {"lowerIsBetter": true, "replicates": [160.0, 160.0, 161.0, 162.0, 160.0, 161.0, 161.0, 161.0, 162.0, 161.0], "unit": "score", "name": "audio-dft", "value": 160.9}, {"lowerIsBetter": true, "replicates": [72.0, 77.0, 92.0, 93.0, 74.0, 74.0, 72.0, 106.0, 94.0, 73.0], "unit": "score", "name": "audio-fft", "value": 82.7}, {"lowerIsBetter": true, "replicates": [96.0, 97.0, 146.0, 97.0, 97.0, 97.0, 143.0, 96.0, 98.0, 145.0], "unit": "score", "name": "audio-oscillator", "value": 111.2}, {"lowerIsBetter": true, "replicates": [120.0, 115.0, 115.0, 114.0, 114.0, 114.0, 114.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.1}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 145.0, 146.0, 147.0, 145.0, 145.0, 146.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [57.0, 56.0, 56.0, 57.0, 55.0, 56.0, 57.0, 56.0, 63.0, 58.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [67.0, 69.0, 68.0, 66.0, 66.0, 67.0, 68.0, 75.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.0}, {"lowerIsBetter": true, "replicates": [83.0, 83.0, 89.0, 81.0, 83.0, 82.0, 90.0, 81.0, 82.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.6}, {"lowerIsBetter": true, "replicates": [115.0, 116.0, 114.0, 115.0, 111.0, 116.0, 122.0, 117.0, 127.0, 115.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.8}, {"lowerIsBetter": true, "replicates": [145.0, 144.0, 154.0, 132.0, 145.0, 144.0, 154.0, 144.0, 140.0, 145.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 144.7}, {"lowerIsBetter": true, "replicates": [70.0, 68.0, 68.0, 67.0, 67.0, 68.0, 69.0, 68.0, 69.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.3}], "name": "kraken", "value": 1507.1999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.000668002672], "unit": "score", "name": "Richards", "value": 211.38837599999997}, {"lowerIsBetter": false, "replicates": [189.9335232668566], "unit": "score", "name": "DeltaBlue", "value": 348.11126999999993}, {"lowerIsBetter": false, "replicates": [273.8975623116954], "unit": "score", "name": "Encrypt", "value": 971.8268310000004}, {"lowerIsBetter": false, "replicates": [5251.308900523561], "unit": "score", "name": "Decrypt", "value": 50.68850548354939}, {"lowerIsBetter": false, "replicates": [2014.0845070422536], "unit": "score", "name": "RayTrace", "value": 367.4071258741258}, {"lowerIsBetter": false, "replicates": [797.4481658692185], "unit": "score", "name": "Earley", "value": 835.7446020000003}, {"lowerIsBetter": false, "replicates": [12256.09756097561], "unit": "score", "name": "Boyer", "value": 54.378075621890574}, {"lowerIsBetter": false, "replicates": [43042.55319148936], "unit": "score", "name": "RegExp", "value": 21.16475284231339}, {"lowerIsBetter": false, "replicates": [601.6847172081829], "unit": "score", "name": "Splay", "value": 135.43804200000002}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 18838.933262368657}]} 05:43:34 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,201,35]]", "result": "18838.93"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,201,35]]", "result": "1507.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,201,35]]", "result": "6737.71"}}} 05:43:34 INFO - Return code: 0 05:43:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 05:43:34 INFO - # TBPL SUCCESS # 05:43:34 INFO - Running post-action listener: _resource_record_post_action 05:43:34 INFO - Running post-run listener: _resource_record_post_run 05:43:35 INFO - Total resource usage - Wall time: 1231s; CPU: 13.0%; Read bytes: 0; Write bytes: 554053632; Read time: 0; Write time: 569936 05:43:35 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 236474368; Read time: 0; Write time: 287936 05:43:35 INFO - run-tests - Wall time: 1215s; CPU: 13.0%; Read bytes: 0; Write bytes: 313700352; Read time: 0; Write time: 281220 05:43:35 INFO - Running post-run listener: _upload_blobber_files 05:43:35 INFO - Blob upload gear active. 05:43:35 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 05:43:35 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 05:43:35 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'] 05:43:35 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 05:43:36 INFO - (blobuploader) - INFO - Open directory for files ... 05:43:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 05:43:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:43:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:43:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:43:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:43:37 INFO - (blobuploader) - INFO - Done attempting. 05:43:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:43:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:43:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:43:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:43:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:43:37 INFO - (blobuploader) - INFO - Done attempting. 05:43:37 INFO - (blobuploader) - INFO - Iteration through files over. 05:43:37 INFO - Return code: 0 05:43:37 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 05:43:37 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 05:43:37 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/c5fd4b41f7278a7b0f583b7b7a4c2de8049bbd6a678b573dedb5eae6264f37ba9576a066d95259ab389f5b40baf365325cd98ba870cfd4257a969302fca0f909", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/8fad87246f785d394f7d8e912565b9cb58f98daebda34a0585ff22c2a2317fb6c7452c06900bb2279cd05c16b4c42e333aa5bddb32a33879d83fce0fae0505a2"} 05:43:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 05:43:37 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 05:43:37 INFO - Contents: 05:43:37 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/c5fd4b41f7278a7b0f583b7b7a4c2de8049bbd6a678b573dedb5eae6264f37ba9576a066d95259ab389f5b40baf365325cd98ba870cfd4257a969302fca0f909", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/8fad87246f785d394f7d8e912565b9cb58f98daebda34a0585ff22c2a2317fb6c7452c06900bb2279cd05c16b4c42e333aa5bddb32a33879d83fce0fae0505a2"} 05:43:37 INFO - Running post-run listener: copy_logs_to_upload_dir 05:43:37 INFO - Copying logs to upload dir... 05:43:37 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 05:43:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1267.659020 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-02-03 05:43:36.928493) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-03 05:43:36.931713) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 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/c5fd4b41f7278a7b0f583b7b7a4c2de8049bbd6a678b573dedb5eae6264f37ba9576a066d95259ab389f5b40baf365325cd98ba870cfd4257a969302fca0f909", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/8fad87246f785d394f7d8e912565b9cb58f98daebda34a0585ff22c2a2317fb6c7452c06900bb2279cd05c16b4c42e333aa5bddb32a33879d83fce0fae0505a2"} build_url:https://queue.taskcluster.net/v1/task/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.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/LDqwkVukT6iZ1d1hD6Abkg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/c5fd4b41f7278a7b0f583b7b7a4c2de8049bbd6a678b573dedb5eae6264f37ba9576a066d95259ab389f5b40baf365325cd98ba870cfd4257a969302fca0f909", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/8fad87246f785d394f7d8e912565b9cb58f98daebda34a0585ff22c2a2317fb6c7452c06900bb2279cd05c16b4c42e333aa5bddb32a33879d83fce0fae0505a2"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-03 05:43:36.956825) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:43:36.957163) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1454505748.382963-456446871 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004557 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-03 05:43:37.039427) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-03 05:43:37.039800) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-03 05:43:37.040122) ========= ========= Total master_lag: 0.27 =========