builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-002 starttime: 1458295691.77 results: success (0) buildid: 20160317164905 builduid: 04e78941a14341488dc869ea4b7e7daf revision: b20234ac6cf4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.771860) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.772323) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.772619) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.004306 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.788740) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.789031) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.800108) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.800366) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004489 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.848755) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.849068) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.849432) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.849705) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-18 03:08:12-- 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% 37.5M=0s 2016-03-18 03:08:12 (37.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.114112 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.976063) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:11.976374) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019876 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:12.025576) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-18 03:08:12.025938) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev b20234ac6cf4 --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/mozilla-inbound --rev b20234ac6cf4 --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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-18 03:08:12,557 Setting DEBUG logging. 2016-03-18 03:08:12,557 attempt 1/10 2016-03-18 03:08:12,557 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/b20234ac6cf4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-18 03:08:13,344 unpacking tar archive at: mozilla-inbound-b20234ac6cf4/testing/mozharness/ program finished with exit code 0 elapsedTime=1.075409 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-18 03:08:13.113648) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:13.114051) ========= echo b20234ac6cf4 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'b20234ac6cf4'] 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False b20234ac6cf4 program finished with exit code 0 elapsedTime=0.003094 script_repo_revision: 'b20234ac6cf4' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:13.161555) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:13.161861) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-18 03:08:13.171484) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-03-18 03:08:13.171766) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-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', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:08:13 INFO - MultiFileLogger online at 20160318 03:08:13 in /builds/slave/test-pgo 03:08:13 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 03:08:13 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 03:08:13 INFO - {'append_to_log': False, 03:08:13 INFO - 'base_work_dir': '/builds/slave/test-pgo', 03:08:13 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 03:08:13 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 03:08:13 INFO - 'branch': 'Mozilla-Inbound', 03:08:13 INFO - 'buildbot_json_path': 'buildprops.json', 03:08:13 INFO - 'config_files': ('talos/linux_config.py',), 03:08:13 INFO - 'default_actions': ('clobber', 03:08:13 INFO - 'read-buildbot-config', 03:08:13 INFO - 'download-and-extract', 03:08:13 INFO - 'populate-webroot', 03:08:13 INFO - 'create-virtualenv', 03:08:13 INFO - 'install', 03:08:13 INFO - 'run-tests'), 03:08:13 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:08:13 INFO - 'download_minidump_stackwalk': True, 03:08:13 INFO - 'download_symbols': 'ondemand', 03:08:13 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:08:13 INFO - 'tooltool.py': '/tools/tooltool.py', 03:08:13 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:08:13 INFO - '/tools/misc-python/virtualenv.py')}, 03:08:13 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:08:13 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:08:13 INFO - 'installer_path': 'installer.exe', 03:08:13 INFO - 'log_level': 'info', 03:08:13 INFO - 'log_name': 'talos', 03:08:13 INFO - 'log_to_console': True, 03:08:13 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:08:13 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:08:13 INFO - 'opt_config_files': (), 03:08:13 INFO - 'pip_index': False, 03:08:13 INFO - 'sps_profile': False, 03:08:13 INFO - 'sps_profile_interval': 0, 03:08:13 INFO - 'suite': 'dromaeojs', 03:08:13 INFO - 'system_bits': '32', 03:08:13 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:08:13 INFO - 'title': 'talos-linux64-ix-002', 03:08:13 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:08:13 INFO - 'use_talos_json': True, 03:08:13 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 03:08:13 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:08:13 INFO - 'work_dir': 'build'} 03:08:13 INFO - ##### 03:08:13 INFO - ##### Running clobber step. 03:08:13 INFO - ##### 03:08:13 INFO - Running pre-action listener: _resource_record_pre_action 03:08:13 INFO - Running main action method: clobber 03:08:13 INFO - rmtree: /builds/slave/test-pgo/build 03:08:13 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 03:08:14 INFO - Running post-action listener: _resource_record_post_action 03:08:14 INFO - ##### 03:08:14 INFO - ##### Running read-buildbot-config step. 03:08:14 INFO - ##### 03:08:14 INFO - Running pre-action listener: _resource_record_pre_action 03:08:14 INFO - Running main action method: read_buildbot_config 03:08:14 INFO - Using buildbot properties: 03:08:14 INFO - { 03:08:14 INFO - "project": "", 03:08:14 INFO - "product": "firefox", 03:08:14 INFO - "script_repo_revision": "production", 03:08:14 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 03:08:14 INFO - "repository": "", 03:08:14 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 03:08:14 INFO - "buildid": "20160317164905", 03:08:14 INFO - "pgo_build": "True", 03:08:14 INFO - "basedir": "/builds/slave/test-pgo", 03:08:14 INFO - "buildnumber": 806, 03:08:14 INFO - "slavename": "talos-linux64-ix-002", 03:08:14 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:08:14 INFO - "platform": "ubuntu64_hw", 03:08:14 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 03:08:14 INFO - "branch": "mozilla-inbound", 03:08:14 INFO - "repo_path": "integration/mozilla-inbound", 03:08:14 INFO - "revision": "b20234ac6cf4", 03:08:14 INFO - "stage_platform": "linux64-pgo", 03:08:14 INFO - "builduid": "04e78941a14341488dc869ea4b7e7daf", 03:08:14 INFO - "slavebuilddir": "test" 03:08:14 INFO - } 03:08:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 03:08:14 INFO - Running post-action listener: _resource_record_post_action 03:08:14 INFO - ##### 03:08:14 INFO - ##### Running download-and-extract step. 03:08:14 INFO - ##### 03:08:14 INFO - Running pre-action listener: _resource_record_pre_action 03:08:14 INFO - Running main action method: download_and_extract 03:08:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 03:08:14 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')]} 03:08:14 INFO - https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:08:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 03:08:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 03:08:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 03:08:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 03:08:15 INFO - Downloaded 1361 bytes. 03:08:15 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 03:08:15 INFO - Using the following test package requirements: 03:08:15 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 03:08:15 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:08:15 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 03:08:15 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'jsshell-linux-x86_64.zip'], 03:08:15 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:08:15 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 03:08:15 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:08:15 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:08:15 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:08:15 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 03:08:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:08:15 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:08:15 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')]} 03:08:15 INFO - https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:08:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:08:16 INFO - Downloaded 23404932 bytes. 03:08:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:08:16 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 03:08:17 INFO - Return code: 0 03:08:17 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:08:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:17 INFO - https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:08:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 03:08:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:08:19 INFO - Downloaded 23404932 bytes. 03:08:19 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:08:19 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 03:08:20 INFO - Return code: 0 03:08:20 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')]} 03:08:20 INFO - https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:08:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 03:08:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 03:08:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 03:08:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:08:21 INFO - Downloaded 10845161 bytes. 03:08:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 03:08:21 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 03:08:21 INFO - Return code: 0 03:08:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:21 INFO - https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:08:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 03:08:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 03:08:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 03:08:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:08:24 INFO - Downloaded 56193409 bytes. 03:08:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 03:08:24 INFO - mkdir: /builds/slave/test-pgo/properties 03:08:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 03:08:24 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 03:08:24 INFO - Contents: 03:08:24 INFO - build_url:https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 03:08:25 INFO - Running post-action listener: _resource_record_post_action 03:08:25 INFO - Running post-action listener: set_extra_try_arguments 03:08:25 INFO - ##### 03:08:25 INFO - ##### Running populate-webroot step. 03:08:25 INFO - ##### 03:08:25 INFO - Running pre-action listener: _resource_record_pre_action 03:08:25 INFO - Running main action method: populate_webroot 03:08:25 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:08:25 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:08:25 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:08:25 INFO - '--tppagecycles', 03:08:25 INFO - '7'], 03:08:25 INFO - 'tests': ['tsvgm']}}, 03:08:25 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:08:25 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:08:25 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 03:08:25 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:08:25 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:08:25 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:08:25 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'tests': ['damp', 'tps']}, 03:08:25 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['damp', 'tps']}, 03:08:25 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:08:25 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:08:25 INFO - 'other': {'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'other_l64': {'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'other_nol64': {'tests': ['a11yr', 03:08:25 INFO - 'ts_paint', 03:08:25 INFO - 'tpaint', 03:08:25 INFO - 'sessionrestore', 03:08:25 INFO - 'sessionrestore_no_auto_restore', 03:08:25 INFO - 'tabpaint']}, 03:08:25 INFO - 'svgr': {'tests': ['tsvgx', 03:08:25 INFO - 'tsvgr_opacity', 03:08:25 INFO - 'tart', 03:08:25 INFO - 'tscrollx', 03:08:25 INFO - 'cart']}, 03:08:25 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['tsvgx', 03:08:25 INFO - 'tsvgr_opacity', 03:08:25 INFO - 'tart', 03:08:25 INFO - 'tscrollx', 03:08:25 INFO - 'cart']}, 03:08:25 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'tests': ['tp5o']}, 03:08:25 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'talos_options': ['--e10s'], 03:08:25 INFO - 'tests': ['tp5o']}, 03:08:25 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'talos_options': ['--xperf_path', 03:08:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:08:25 INFO - 'tests': ['tp5n']}, 03:08:25 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:08:25 INFO - 'talos_options': ['--e10s', 03:08:25 INFO - '--xperf_path', 03:08:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:08:25 INFO - 'tests': ['tp5n']}}, 03:08:25 INFO - 'talos.zip': {'path': '', 03:08:25 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:08:25 INFO - Running post-action listener: _resource_record_post_action 03:08:25 INFO - ##### 03:08:25 INFO - ##### Running create-virtualenv step. 03:08:25 INFO - ##### 03:08:25 INFO - Running pre-action listener: _resource_record_pre_action 03:08:25 INFO - Running main action method: create_virtualenv 03:08:25 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 03:08:25 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 03:08:25 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 03:08:25 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:08:25 INFO - Using real prefix '/usr' 03:08:25 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 03:08:26 INFO - Installing distribute.............................................................................................................................................................................................done. 03:08:28 INFO - Installing pip.................done. 03:08:28 INFO - Return code: 0 03:08:28 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 03:08:28 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')]} 03:08:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:28 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')]} 03:08:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:28 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:28 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 03:08:28 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 03:08:28 INFO - Using env: {'DISPLAY': ':0', 03:08:28 INFO - 'HOME': '/home/cltbld', 03:08:28 INFO - 'LANG': 'en_US.UTF-8', 03:08:28 INFO - 'LANGUAGE': 'en_US:en', 03:08:28 INFO - 'LOGNAME': 'cltbld', 03:08:28 INFO - 'MAIL': '/var/mail/cltbld', 03:08:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:28 INFO - 'MOZ_NO_REMOTE': '1', 03:08:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:28 INFO - 'NO_EM_RESTART': '1', 03:08:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:28 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:28 INFO - 'SHELL': '/bin/bash', 03:08:28 INFO - 'SHLVL': '1', 03:08:28 INFO - 'TERM': 'linux', 03:08:28 INFO - 'TMOUT': '86400', 03:08:28 INFO - 'USER': 'cltbld', 03:08:28 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:28 INFO - '_': '/tools/buildbot/bin/python'} 03:08:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:28 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 03:08:28 INFO - Cleaning up... 03:08:28 INFO - Return code: 0 03:08:28 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 03:08:28 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')]} 03:08:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:28 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')]} 03:08:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:28 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:28 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 03:08:28 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 03:08:28 INFO - Using env: {'DISPLAY': ':0', 03:08:28 INFO - 'HOME': '/home/cltbld', 03:08:28 INFO - 'LANG': 'en_US.UTF-8', 03:08:28 INFO - 'LANGUAGE': 'en_US:en', 03:08:28 INFO - 'LOGNAME': 'cltbld', 03:08:28 INFO - 'MAIL': '/var/mail/cltbld', 03:08:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:28 INFO - 'MOZ_NO_REMOTE': '1', 03:08:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:28 INFO - 'NO_EM_RESTART': '1', 03:08:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:28 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:28 INFO - 'SHELL': '/bin/bash', 03:08:28 INFO - 'SHLVL': '1', 03:08:28 INFO - 'TERM': 'linux', 03:08:28 INFO - 'TMOUT': '86400', 03:08:28 INFO - 'USER': 'cltbld', 03:08:28 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:28 INFO - '_': '/tools/buildbot/bin/python'} 03:08:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:28 INFO - Downloading/unpacking psutil>=0.7.1 03:08:28 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 03:08:28 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 03:08:28 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 03:08:28 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 03:08:28 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 03:08:28 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 03:08:30 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 03:08:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:08:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:08:30 INFO - Installing collected packages: psutil 03:08:30 INFO - Running setup.py install for psutil 03:08:30 INFO - building 'psutil._psutil_linux' extension 03:08:30 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 03:08:30 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 03:08:30 INFO - building 'psutil._psutil_posix' extension 03:08:30 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 03:08:31 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 03:08:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:08:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:08:31 INFO - Successfully installed psutil 03:08:31 INFO - Cleaning up... 03:08:31 INFO - Return code: 0 03:08:31 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 03:08: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')]} 03:08:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08: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')]} 03:08:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:31 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:31 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 03:08:31 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 03:08:31 INFO - Using env: {'DISPLAY': ':0', 03:08:31 INFO - 'HOME': '/home/cltbld', 03:08:31 INFO - 'LANG': 'en_US.UTF-8', 03:08:31 INFO - 'LANGUAGE': 'en_US:en', 03:08:31 INFO - 'LOGNAME': 'cltbld', 03:08:31 INFO - 'MAIL': '/var/mail/cltbld', 03:08:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:31 INFO - 'MOZ_NO_REMOTE': '1', 03:08:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:31 INFO - 'NO_EM_RESTART': '1', 03:08:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:31 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:31 INFO - 'SHELL': '/bin/bash', 03:08:31 INFO - 'SHLVL': '1', 03:08:31 INFO - 'TERM': 'linux', 03:08:31 INFO - 'TMOUT': '86400', 03:08:31 INFO - 'USER': 'cltbld', 03:08:31 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:31 INFO - '_': '/tools/buildbot/bin/python'} 03:08:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:31 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:08:31 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 03:08:31 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 03:08:31 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 03:08:31 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 03:08:31 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 03:08:31 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 03:08:33 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:08:33 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:08:33 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:08:33 INFO - Installing collected packages: mozsystemmonitor 03:08:33 INFO - Running setup.py install for mozsystemmonitor 03:08:33 INFO - Successfully installed mozsystemmonitor 03:08:33 INFO - Cleaning up... 03:08:33 INFO - Return code: 0 03:08:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 03:08: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')]} 03:08:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08: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')]} 03:08:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:33 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:33 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 03:08:33 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 03:08:33 INFO - Using env: {'DISPLAY': ':0', 03:08:33 INFO - 'HOME': '/home/cltbld', 03:08:33 INFO - 'LANG': 'en_US.UTF-8', 03:08:33 INFO - 'LANGUAGE': 'en_US:en', 03:08:33 INFO - 'LOGNAME': 'cltbld', 03:08:33 INFO - 'MAIL': '/var/mail/cltbld', 03:08:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:33 INFO - 'MOZ_NO_REMOTE': '1', 03:08:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:33 INFO - 'NO_EM_RESTART': '1', 03:08:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:33 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:33 INFO - 'SHELL': '/bin/bash', 03:08:33 INFO - 'SHLVL': '1', 03:08:33 INFO - 'TERM': 'linux', 03:08:33 INFO - 'TMOUT': '86400', 03:08:33 INFO - 'USER': 'cltbld', 03:08:33 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:33 INFO - '_': '/tools/buildbot/bin/python'} 03:08:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:33 INFO - Downloading/unpacking blobuploader==1.2.4 03:08:33 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 03:08:33 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 03:08:33 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 03:08:33 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 03:08:33 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 03:08:33 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 03:08:35 INFO - Downloading blobuploader-1.2.4.tar.gz 03:08:35 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:08:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 03:08:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:35 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 03:08:36 INFO - Downloading docopt-0.6.1.tar.gz 03:08:36 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 03:08:36 INFO - Installing collected packages: blobuploader, requests, docopt 03:08:36 INFO - Running setup.py install for blobuploader 03:08:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:08:36 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 03:08:36 INFO - Running setup.py install for requests 03:08:36 INFO - Running setup.py install for docopt 03:08:36 INFO - Successfully installed blobuploader requests docopt 03:08:36 INFO - Cleaning up... 03:08:36 INFO - Return code: 0 03:08:36 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:08: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')]} 03:08:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08: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')]} 03:08:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:36 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:36 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 03:08:36 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 03:08:36 INFO - Using env: {'DISPLAY': ':0', 03:08:36 INFO - 'HOME': '/home/cltbld', 03:08:36 INFO - 'LANG': 'en_US.UTF-8', 03:08:36 INFO - 'LANGUAGE': 'en_US:en', 03:08:36 INFO - 'LOGNAME': 'cltbld', 03:08:36 INFO - 'MAIL': '/var/mail/cltbld', 03:08:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:36 INFO - 'MOZ_NO_REMOTE': '1', 03:08:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:36 INFO - 'NO_EM_RESTART': '1', 03:08:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:36 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:36 INFO - 'SHELL': '/bin/bash', 03:08:36 INFO - 'SHLVL': '1', 03:08:36 INFO - 'TERM': 'linux', 03:08:36 INFO - 'TMOUT': '86400', 03:08:36 INFO - 'USER': 'cltbld', 03:08:36 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:36 INFO - '_': '/tools/buildbot/bin/python'} 03:08:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:08:37 INFO - Running setup.py (path:/tmp/pip-y8xc8m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:08:37 INFO - Running setup.py (path:/tmp/pip-tW0wkC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:08:37 INFO - Running setup.py (path:/tmp/pip-GhV1AM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:08:37 INFO - Running setup.py (path:/tmp/pip-oJy_fn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:08:37 INFO - Running setup.py (path:/tmp/pip-gkKJiF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:08:37 INFO - Running setup.py (path:/tmp/pip-GeivP1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:08:37 INFO - Running setup.py (path:/tmp/pip-Z2LYb4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:08:37 INFO - Running setup.py (path:/tmp/pip-yAgbcu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:08:37 INFO - Running setup.py (path:/tmp/pip-ItLCPQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:08:37 INFO - Running setup.py (path:/tmp/pip-uCX20Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:08:37 INFO - Running setup.py (path:/tmp/pip-gYysFB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:08:37 INFO - Running setup.py (path:/tmp/pip-g6hUyX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:08:37 INFO - Running setup.py (path:/tmp/pip-z5teTK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:08:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:08:37 INFO - Running setup.py (path:/tmp/pip-rjEVlo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:08:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:08:38 INFO - Running setup.py (path:/tmp/pip-2mtsUy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:08:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:08:38 INFO - Running setup.py (path:/tmp/pip-KO_uzu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:08:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:08:38 INFO - Running setup.py (path:/tmp/pip-KjLGEC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:08:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:08:38 INFO - Running setup.py install for manifestparser 03:08:38 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 03:08:38 INFO - Running setup.py install for mozcrash 03:08:38 INFO - Running setup.py install for mozdebug 03:08:38 INFO - Running setup.py install for mozdevice 03:08:38 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 03:08:38 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 03:08:38 INFO - Running setup.py install for mozfile 03:08:38 INFO - Running setup.py install for mozhttpd 03:08:38 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 03:08:38 INFO - Running setup.py install for mozinfo 03:08:38 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 03:08:38 INFO - Running setup.py install for mozInstall 03:08:39 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Running setup.py install for mozleak 03:08:39 INFO - Running setup.py install for mozlog 03:08:39 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Running setup.py install for moznetwork 03:08:39 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Running setup.py install for mozprocess 03:08:39 INFO - Running setup.py install for mozprofile 03:08:39 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Running setup.py install for mozrunner 03:08:39 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 03:08:39 INFO - Running setup.py install for mozscreenshot 03:08:39 INFO - Running setup.py install for moztest 03:08:39 INFO - Running setup.py install for mozversion 03:08:40 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 03:08:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:08:40 INFO - Cleaning up... 03:08:40 INFO - Return code: 0 03:08:40 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:08:40 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')]} 03:08:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:40 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')]} 03:08:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:40 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:40 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 03:08:40 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 03:08:40 INFO - Using env: {'DISPLAY': ':0', 03:08:40 INFO - 'HOME': '/home/cltbld', 03:08:40 INFO - 'LANG': 'en_US.UTF-8', 03:08:40 INFO - 'LANGUAGE': 'en_US:en', 03:08:40 INFO - 'LOGNAME': 'cltbld', 03:08:40 INFO - 'MAIL': '/var/mail/cltbld', 03:08:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:40 INFO - 'MOZ_NO_REMOTE': '1', 03:08:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:40 INFO - 'NO_EM_RESTART': '1', 03:08:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:40 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:40 INFO - 'SHELL': '/bin/bash', 03:08:40 INFO - 'SHLVL': '1', 03:08:40 INFO - 'TERM': 'linux', 03:08:40 INFO - 'TMOUT': '86400', 03:08:40 INFO - 'USER': 'cltbld', 03:08:40 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:40 INFO - '_': '/tools/buildbot/bin/python'} 03:08:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:08:40 INFO - Running setup.py (path:/tmp/pip-9PeHcX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:08:40 INFO - Running setup.py (path:/tmp/pip-yBz_hk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:08:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:08:40 INFO - Running setup.py (path:/tmp/pip-6PNtd4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:08:40 INFO - Running setup.py (path:/tmp/pip-HSlJYn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:08:40 INFO - Running setup.py (path:/tmp/pip-uS6W57-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:08:40 INFO - Running setup.py (path:/tmp/pip-h8ScZy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:08:40 INFO - Running setup.py (path:/tmp/pip-feIXF_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:08:40 INFO - Running setup.py (path:/tmp/pip-5zymaA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:08:40 INFO - Running setup.py (path:/tmp/pip-s02Lc6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:08:40 INFO - Running setup.py (path:/tmp/pip-rYLTNK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:08:40 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)) 03:08:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:08:40 INFO - Running setup.py (path:/tmp/pip-PPIf3R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:08:41 INFO - Running setup.py (path:/tmp/pip-QbTc8L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:08:41 INFO - Running setup.py (path:/tmp/pip-arfc52-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:08:41 INFO - Running setup.py (path:/tmp/pip-RVTfOt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:08:41 INFO - Running setup.py (path:/tmp/pip-4gFtCx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:08:41 INFO - Running setup.py (path:/tmp/pip-fKYhwY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:08:41 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)) 03:08:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:08:41 INFO - Running setup.py (path:/tmp/pip-iTWKUC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:08:41 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)) 03:08:41 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.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 03:08:41 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.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 03:08:41 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)) 03:08:41 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)) 03:08:41 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)) 03:08:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 03:08:41 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 03:08:41 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 03:08:41 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 03:08:41 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 03:08:41 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 03:08:41 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 03:08:43 INFO - Downloading blessings-1.6.tar.gz 03:08:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 03:08:43 INFO - Installing collected packages: blessings 03:08:43 INFO - Running setup.py install for blessings 03:08:43 INFO - Successfully installed blessings 03:08:43 INFO - Cleaning up... 03:08:43 INFO - Return code: 0 03:08:43 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 03:08:43 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:08:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:08:43 INFO - Reading from file tmpfile_stdout 03:08:43 INFO - Current package versions: 03:08:43 INFO - argparse == 1.2.1 03:08:43 INFO - blessings == 1.6 03:08:43 INFO - blobuploader == 1.2.4 03:08:43 INFO - docopt == 0.6.1 03:08:43 INFO - manifestparser == 1.1 03:08:43 INFO - mozInstall == 1.12 03:08:43 INFO - mozcrash == 0.17 03:08:43 INFO - mozdebug == 0.1 03:08:43 INFO - mozdevice == 0.48 03:08:43 INFO - mozfile == 1.2 03:08:43 INFO - mozhttpd == 0.7 03:08:43 INFO - mozinfo == 0.9 03:08:43 INFO - mozleak == 0.1 03:08:43 INFO - mozlog == 3.1 03:08:43 INFO - moznetwork == 0.27 03:08:43 INFO - mozprocess == 0.22 03:08:43 INFO - mozprofile == 0.28 03:08:43 INFO - mozrunner == 6.11 03:08:43 INFO - mozscreenshot == 0.1 03:08:43 INFO - mozsystemmonitor == 0.0 03:08:43 INFO - moztest == 0.7 03:08:43 INFO - mozversion == 1.4 03:08:43 INFO - psutil == 3.1.1 03:08:43 INFO - requests == 1.2.3 03:08:43 INFO - wsgiref == 0.1.2 03:08:43 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:08:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:43 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:43 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 03:08:43 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 03:08:43 INFO - Using env: {'DISPLAY': ':0', 03:08:43 INFO - 'HOME': '/home/cltbld', 03:08:43 INFO - 'LANG': 'en_US.UTF-8', 03:08:43 INFO - 'LANGUAGE': 'en_US:en', 03:08:43 INFO - 'LOGNAME': 'cltbld', 03:08:43 INFO - 'MAIL': '/var/mail/cltbld', 03:08:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:43 INFO - 'MOZ_NO_REMOTE': '1', 03:08:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:43 INFO - 'NO_EM_RESTART': '1', 03:08:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:43 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:43 INFO - 'SHELL': '/bin/bash', 03:08:43 INFO - 'SHLVL': '1', 03:08:43 INFO - 'TERM': 'linux', 03:08:43 INFO - 'TMOUT': '86400', 03:08:43 INFO - 'USER': 'cltbld', 03:08:43 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:43 INFO - '_': '/tools/buildbot/bin/python'} 03:08:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 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)) 03:08:43 INFO - Cleaning up... 03:08:44 INFO - Return code: 0 03:08:44 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 03:08:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:44 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:44 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 03:08:44 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 03:08:44 INFO - Using env: {'DISPLAY': ':0', 03:08:44 INFO - 'HOME': '/home/cltbld', 03:08:44 INFO - 'LANG': 'en_US.UTF-8', 03:08:44 INFO - 'LANGUAGE': 'en_US:en', 03:08:44 INFO - 'LOGNAME': 'cltbld', 03:08:44 INFO - 'MAIL': '/var/mail/cltbld', 03:08:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:44 INFO - 'MOZ_NO_REMOTE': '1', 03:08:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:44 INFO - 'NO_EM_RESTART': '1', 03:08:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:44 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:44 INFO - 'SHELL': '/bin/bash', 03:08:44 INFO - 'SHLVL': '1', 03:08:44 INFO - 'TERM': 'linux', 03:08:44 INFO - 'TMOUT': '86400', 03:08:44 INFO - 'USER': 'cltbld', 03:08:44 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:44 INFO - '_': '/tools/buildbot/bin/python'} 03:08:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:44 INFO - Downloading/unpacking jsonschema 03:08:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:08:46 INFO - Downloading/unpacking functools32 (from jsonschema) 03:08:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:46 INFO - Downloading functools32-3.2.3-2.tar.gz 03:08:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 03:08:46 INFO - warning: no files found matching '*.txt' 03:08:46 INFO - no previously-included directories found matching 'build' 03:08:46 INFO - no previously-included directories found matching 'dist' 03:08:46 INFO - no previously-included directories found matching '.git*' 03:08:46 INFO - Installing collected packages: jsonschema, functools32 03:08:46 INFO - Running setup.py install for functools32 03:08:46 INFO - warning: no files found matching '*.txt' 03:08:46 INFO - no previously-included directories found matching 'build' 03:08:46 INFO - no previously-included directories found matching 'dist' 03:08:46 INFO - no previously-included directories found matching '.git*' 03:08:46 INFO - Successfully installed jsonschema functools32 03:08:46 INFO - Cleaning up... 03:08:46 INFO - Return code: 0 03:08:46 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 03:08:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:08:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:08:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:08:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:08:46 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 0x7f05f1c3df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe328a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeff6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', '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 03:08:46 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 03:08:46 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 03:08:46 INFO - Using env: {'DISPLAY': ':0', 03:08:46 INFO - 'HOME': '/home/cltbld', 03:08:46 INFO - 'LANG': 'en_US.UTF-8', 03:08:46 INFO - 'LANGUAGE': 'en_US:en', 03:08:46 INFO - 'LOGNAME': 'cltbld', 03:08:46 INFO - 'MAIL': '/var/mail/cltbld', 03:08:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:08:46 INFO - 'MOZ_NO_REMOTE': '1', 03:08:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:08:46 INFO - 'NO_EM_RESTART': '1', 03:08:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:08:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:08:46 INFO - 'PWD': '/builds/slave/test-pgo', 03:08:46 INFO - 'SHELL': '/bin/bash', 03:08:46 INFO - 'SHLVL': '1', 03:08:46 INFO - 'TERM': 'linux', 03:08:46 INFO - 'TMOUT': '86400', 03:08:46 INFO - 'USER': 'cltbld', 03:08:46 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:08:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:08:46 INFO - '_': '/tools/buildbot/bin/python'} 03:08:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:08:46 INFO - Downloading/unpacking flake8 03:08:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:48 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:08:48 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:08:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:48 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:08:48 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:08:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:08:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:08:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:08:49 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:08: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 03:08: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 03:08: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 03:08: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 03:08: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 03:08: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 03:08:49 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 03:08:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:08:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:08:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:08:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:08:49 INFO - no previously-included directories found matching 'docs/_build' 03:08:49 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:08:49 INFO - Running setup.py install for pep8 03:08:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:08:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:08:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:08:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:08:49 INFO - no previously-included directories found matching 'docs/_build' 03:08:49 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 03:08:49 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:08:49 INFO - Cleaning up... 03:08:49 INFO - Return code: 0 03:08:49 INFO - Running post-action listener: _resource_record_post_action 03:08:49 INFO - Running post-action listener: _start_resource_monitoring 03:08:49 INFO - Starting resource monitoring. 03:08:49 INFO - ##### 03:08:49 INFO - ##### Running install step. 03:08:49 INFO - ##### 03:08:49 INFO - Running pre-action listener: _resource_record_pre_action 03:08:49 INFO - Running main action method: install 03:08:49 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:08:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:08:49 INFO - Reading from file tmpfile_stdout 03:08:49 INFO - Detecting whether we're running mozinstall >=1.0... 03:08:49 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 03:08:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 03:08:49 INFO - Reading from file tmpfile_stdout 03:08:49 INFO - Output received: 03:08:49 INFO - Usage: mozinstall [options] installer 03:08:49 INFO - Options: 03:08:49 INFO - -h, --help show this help message and exit 03:08:49 INFO - -d DEST, --destination=DEST 03:08:49 INFO - Directory to install application into. [default: 03:08:49 INFO - "/builds/slave/test-pgo"] 03:08:49 INFO - --app=APP Application being installed. [default: firefox] 03:08:49 INFO - mkdir: /builds/slave/test-pgo/build/application 03:08:49 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 03:08:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 03:09:05 INFO - Reading from file tmpfile_stdout 03:09:05 INFO - Output received: 03:09:05 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 03:09:05 INFO - Running post-action listener: _resource_record_post_action 03:09:05 INFO - ##### 03:09:05 INFO - ##### Running run-tests step. 03:09:05 INFO - ##### 03:09:05 INFO - Running pre-action listener: _resource_record_pre_action 03:09:05 INFO - Running main action method: run_tests 03:09:05 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 03:09:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 03:09:05 INFO - Python 2.7.3 03:09:05 INFO - Return code: 0 03:09:05 INFO - grabbing minidump binary from tooltool 03:09:05 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')]} 03:09:05 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 0xf8e920>, '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 0xf8f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf8fcb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 03:09:05 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 03:09:05 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 03:09:06 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:09:06 INFO - Return code: 0 03:09:06 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 03:09:06 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 03:09:06 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 03:09:06 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 03:09:06 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 03:09:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 03:09:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 03:09:07 INFO - Return code: 0 03:09:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 03:09:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --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 03:09:07 INFO - Using env: {'DISPLAY': ':0', 03:09:07 INFO - 'HOME': '/home/cltbld', 03:09:07 INFO - 'LANG': 'en_US.UTF-8', 03:09:07 INFO - 'LANGUAGE': 'en_US:en', 03:09:07 INFO - 'LOGNAME': 'cltbld', 03:09:07 INFO - 'MAIL': '/var/mail/cltbld', 03:09:07 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:09:07 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 03:09:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:09:07 INFO - 'MOZ_NO_REMOTE': '1', 03:09:07 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:09:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:09:07 INFO - 'NO_EM_RESTART': '1', 03:09:07 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:09:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:09:07 INFO - 'PWD': '/builds/slave/test-pgo', 03:09:07 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 03:09:07 INFO - 'SHELL': '/bin/bash', 03:09:07 INFO - 'SHLVL': '1', 03:09:07 INFO - 'TERM': 'linux', 03:09:07 INFO - 'TMOUT': '86400', 03:09:07 INFO - 'USER': 'cltbld', 03:09:07 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422', 03:09:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:09:07 INFO - '_': '/tools/buildbot/bin/python'} 03:09:07 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 03:09:07 INFO - mozversion application_buildid: 20160317164905 03:09:07 INFO - mozversion application_changeset: b20234ac6cf465c59bbc939560479c223bc282bf 03:09:07 INFO - mozversion application_display_name: Nightly 03:09:07 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:09:07 INFO - mozversion application_name: Firefox 03:09:07 INFO - mozversion application_remotingname: firefox 03:09:07 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 03:09:07 INFO - mozversion application_vendor: Mozilla 03:09:07 INFO - mozversion application_version: 48.0a1 03:09:07 INFO - mozversion platform_buildid: 20160317164905 03:09:07 INFO - mozversion platform_changeset: b20234ac6cf465c59bbc939560479c223bc282bf 03:09:07 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 03:09:07 INFO - mozversion platform_version: 48.0a1 03:09:07 INFO - using testdate: 1458295747 03:09:07 INFO - actual date: 1458295747 03:09:07 INFO - starting webserver on 'localhost:49663' 03:09:07 INFO - SUITE-START | Running 2 tests 03:09:07 INFO - TEST-START | dromaeo_css 03:09:07 INFO - operating with platform_type : linux_ 03:09:07 INFO - Initialising browser for dromaeo_css test... 03:09:07 INFO - TEST-INFO | started process 8721 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpK4e4ES/profile http://localhost:49663/getInfo.html) 03:09:11 INFO - PROCESS | 8721 | __metrics Screen width/height:1600/1200 03:09:11 INFO - PROCESS | 8721 | colorDepth:24 03:09:11 INFO - PROCESS | 8721 | Browser inner width/height: 1024/697 03:09:11 INFO - PROCESS | 8721 | __metrics 03:09:12 ERROR - PROCESS | 8721 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 03:09:13 INFO - TEST-INFO | 8721: exit 0 03:09:13 INFO - Browser initialized. 03:09:13 INFO - Running cycle 1/1 for dromaeo_css test... 03:09:13 INFO - TEST-INFO | started process 8814 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpK4e4ES/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:09:24 INFO - PROCESS | 8814 | RSS: Main: 153341952 03:09:24 INFO - PROCESS | 8814 | 03:10:15 INFO - PROCESS | 8814 | 1458295815724 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] 03:12:24 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49663/tests/dromaeo/cssquery-ext.html) 03:12:25 INFO - PROCESS | 8814 | RSS: Main: 260030464 03:12:25 INFO - PROCESS | 8814 | 03:15:28 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-ext.html (next: http://localhost:49663/tests/dromaeo/cssquery-jquery.html) 03:15:28 INFO - PROCESS | 8814 | RSS: Main: 241688576 03:15:28 INFO - PROCESS | 8814 | 03:18:30 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49663/tests/dromaeo/cssquery-mootools.html) 03:18:31 INFO - PROCESS | 8814 | RSS: Main: 238886912 03:18:31 INFO - PROCESS | 8814 | 03:21:32 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49663/tests/dromaeo/cssquery-prototype.html) 03:21:33 INFO - PROCESS | 8814 | RSS: Main: 214351872 03:21:33 INFO - PROCESS | 8814 | 03:24:36 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49663/tests/dromaeo/cssquery-yui.html) 03:24:36 INFO - PROCESS | 8814 | RSS: Main: 218030080 03:24:36 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | Cycle 1(1): loaded http://localhost:49663/tests/dromaeo/cssquery-yui.html (next: http://localhost:49663/tests/dromaeo/cssquery-dojo.html) 03:27:39 INFO - PROCESS | 8814 | RSS: Main: 307150848 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | __start_tp_report 03:27:39 INFO - PROCESS | 8814 | _x_x_mozilla_page_load 03:27:39 INFO - PROCESS | 8814 | _x_x_mozilla_page_load_details 03:27:39 INFO - PROCESS | 8814 | |i|pagename|runs| 03:27:39 INFO - PROCESS | 8814 | |0;dojo.html;3080.630324361077;3176.3806057818733;3209.454392753232;3211.967880321196;3239.5464634951104;5078.64449488536;5132.204508301214;5161.071007218704;5164.586833053356;5174.948250517494;5146.665466744659;5195.908859139576;5203.713795741232;5212.113940630093;5251.133562962116;4660.720356778587;4678.251479763238;4721.362616046841;4768.690035147722;4791.520847915215;4649.44206695197;4731.243001119804;4743.739094349809;4759.048190361924;4861.052094841507;4763.880902977453;4765.356676848615;4778.593819525309;4781.90436191276;4797.664163508538;4713.952860471386;4734.573888350065;4768.380110585602;4770.928436073462;4787.521247875219;4627.514111018362;4661.976690116561;4742.881427964294;4743.596794272491;4763.976180119112;5118.155504341779;5118.2578526113875;5121.820736274212;5133.820316288912;5163.7676304566385;5593.496585307301;5595.356533998602;5598;5609.49514543693;5611.803586874481;5516.448355164492;5564.8330550083565;5651.745671444794;5691.4024027476935;5693.402192769782;5270.051390749702;5275.788968441258;5278.181881808326;5281.551068159211;5289.233061206142;5709.25779648643;5710.885782284331;5726.226959360516;5727.455891690282;5728.856778580569;5418.485243901823;5458.399576046631;5501.697406642593;5514.420985796514;5545.805896793673;5532.087205611109;5544.029794785896;5547.278853748987;5552.916706249329;5553.77784888608;5477.3427188737605;5512.751926163332;5523.917141242885;5526.530244929226;5571.582131340166;5491.752871120809;5525.364583072998;5568.387477377485;5606.046972014768;5616.410276920865;4232.957670423318;4239.25812982733;4240.151969606091;4245.660347172219;4281.422008028876;3807.3146833569667;3839.251345987506;3848.634379733921;3870.6129387061633;3870.8838734838;5201.479852014768;5209.453007434241;5214.32213812202;5229.241759944863;5247.658902171423;5500.917486237709;5541.002619528443;5545.667259964415;5546.084895992197;5549.694766787866;5161.716105614228;5183.740812959337;5213.869653258699;5215.139501982207;5257.868553286198;4717.410323709536;4740.525947405232;4741.454732705714;4753.500882407367;4784.952150478451;5781.046127389102;5834.737436815353;5837.67892765902;5842.298924129047;5892.616979896293;5462.371827239759;5555.666660000413;5573.136163894603;5574.108142697149;5635.774569017193;5794.159846822272;5794.82615521535;5804.564657650609;5810.912836307374;5859.853503662443;5476.315460567429;5484.8354549363585;5485.259489968803;5493.972530137324;5500.642458240201;5465.726713664221;5541.722913854211;5563.109902415594;5575.693336866511;5641.294838145232;5315.3621565412395;5324.547413469743;5362.892742145057;5383.973080134574;5391.487808658171;5378.946210537844;5389.649672771257;5392.460753924576;5393.595480338912;5432.158015507603;5136.049830781318;5233.528982391603;5296.390915044819;5309.548688361532;5368.785248590013;5421.945780542144;5424.430434804289;5424.810131645373;5430.782768689208;5481.506664400223;5280.551153152025;5324.840254792362;5325.600579956596;5325.946740532545;5339.3058902342445 03:27:39 INFO - PROCESS | 8814 | |1;ext.html;516.3493997563072;536.7960175133453;574.3796699564471;578.2540522725683;610.9541784366171;31351.529727054083;37426.251474970486;38233;38254.23491530168;38363;40295.79852100735;40886.59113408865;40915.59084409155;40924.59075409245;40958.38562421566;7495.100587929456;7610.619469026554;8562.18659227374;8761.605727742235;10140.391576505397;10220.74448138795;10365.429901355423;10369.948150259239;10378.221633377527;10384.896151038507;10289.845652315222;10382.948085259563;10387.636432724856;10400.531976061058;10401.427921464354;10234.948825255864;10310.226732995055;10316.690499284996;10328.793424131512;10333;10091.848622270672;10592.046715795615;10614.363138211733;10625.990530899553;10633;41740.37389439161;42164.367534487006;42164.78917605423;42245.1550968982;42283.36574951378;3221.3396253767924;3239.2549713566013;3246.2371342734436;3258.5600943872746;3399.1672040350027;30218;30663.38673226523;30704.53943190854;30835.845820770977;30848.38303233923;3998.108935280804;4014.498187726534;4044.676425885922;4066.369712694537;4126.649234815044;281098;281522;281921;282568;282877;60903.39096609066;61465.692671537254;61559.692201539605;62134.37865621376;62145.689271553354;64552.22201668851;64844;65007.34992650013;65014.67492662601;65057.67471162614;14703.338349774285;14842;14975.700485990437;15003;15060.397584096514;10757.83863242052;10848.077913377452;10860.185486088574;11721.706957325965;12207.938960305319;17619.004688063284;19419.805801942082;20346.593068138554;20353.389398318075;20537;7490.101187857383;7615.847683046419;7624.08510978675;7681.692732290758;7714.112877019103;949.188443880486;954.8042651256476;996.3822430093244;1002.4536627538009;1092.9726057506077;28007.299817504725;28817.135485935454;29274.26814329616;29369;29453.55819662707;950.1875896108866;955.8852937647526;990.2127808392345;1000.364768372089;1007.7379881230933;14651.853481465048;15059.096454212782;15088.924555377373;15394.461193858162;15414.152221627694;317035;319685;320859;321567;321648;53537.46462535325;53917.46082539203;53925.1911221332;53941.46058539443;54009.45990540123;1201.9819702704467;1219.2562536852513;1247.189326937498;1382.5506710319187;1397.76936805428;25992.480150397263;27145.321366965985;27370.178894633194;27406.314842129108;27530.311742206606;38158;38633.42049869198;38842.417363739;38884.416733748454;39460.60539394569;155022;158109;158794;164224;164571.17714411352;27844;31572.210694732814;31924.5211321835;34029;34099.488507672904;41714.165716686104;42345.364819527116;42548.36177457279;43240;43404.78297608492;35100.82449587736;35277.82361088178;36074.45888311625;36339.45490817587;36532.63467365292;34798.82600587082;34957;35284.64715352814;35752.82123589469;35915.64084359123;35544.644553554135;35642.10894727652;35859.46210806788;36212.63787362093;36542.269154617294;30871.382572348877;32194;32281.35437291194;32680.182995425304;32804.34391312208;24568.385790355384;25009.74990250147;25038.37404064913;25171.87414062918;25235.495290093728 03:27:39 INFO - PROCESS | 8814 | |2;jquery.html;357.4995006990213;364.50427418710547;364.9343118238716;371.41687550545635;373.0654709951571;16100.194990250484;16285.755713664304;16939.74590381142;17034.74447883283;17071.317147314123;15527.146006969611;16124.355025798954;16138.354465821352;16149.83850161498;16633.41783037594;5298.523132918046;5324.627276090675;5413.377461591908;6130.540209484284;6135.263768347804;5988.3712210217955;6004.609700369484;6008.1888944992525;6019.72911218994;6037.426444487766;5886.058230683092;5900.940990590082;5917.9408205918035;5994.820155395345;6003.039513677791;5949.107633854913;5960.582759206857;5973.432523910222;5976.3724808895095;5981.850453738648;4925.950740492585;5075.720835354054;5124.897502049976;5143.254228136937;5269.130593452076;12501.562445314461;12513.874861251363;15875.52373428799;19832.80167198324;19847.305344313023;2082.3544701142696;2093.9790602093935;2156.611809874222;2727.9789649814725;2810.0024491305703;12425.31660758658;12545;12625.494980200781;12975.935120324433;13087.803682944763;1876.7278744581959;1882.265916292647;1906.5996140810446;1922.4521011511652;1928.6046360496064;60313.39686603165;64801.351986480004;66527;67596.6620166896;67812.6609366955;9799;10122.190224782;10270.486475676187;10305.896941030494;10324.793504129875;13667.931660341636;13813.240271784947;13835.446582136803;13845.930770346084;13851.930740346234;7513.511621744569;7563.697452101855;7657.272559106876;7675.884861727079;7769.456138070281;7400.592967386845;7460.925390746132;7481.064866891638;7558.281963213486;7564.394848412114;4295.785210739513;4348.195583817004;4365.454318210223;4426.889327766831;4606.055758569485;1736.5658585353663;1750.6323672029016;1784.3308759215295;1824.97262541062;1846.5568263616904;935.2751617496494;943.217129782279;950.3585080070925;992.3450522655013;1073.608133031438;16353;16555.420560280334;16672.416465423652;16752.664946701;16773.91762728372;894.9686760963335;924.3021518753433;955.7622878372524;959.1607343574373;1005.7837564923576;8942.239909607757;9181.357304988587;9234.76913077165;9308.48803315824;9500.809983800285;416758;426201.4759704851;431251;433980;444325;75797;77442;78207;78375;78653.60673196598;943.1181844974833;947.8151760406655;949.4208532794989;955.3742298794301;955.8900726416412;14509.201993890438;14734.484293049692;14756.557303280919;14774;14979.251037447866;32501.34997300088;32572;32808.17979550435;33315.83342083274;33410.49884251689;48098;48143.27785083157;48245.5175448241;48251;48422.75788621175;7701.614919254127;7774.533527988338;7855.33229675484;7933.60331983387;7955.204479551999;11508.136889733136;12450.377481126088;12457.12800103984;12463.750724985632;12654.30401327899;10345.586176552853;10618.097461715532;10790.568377265135;10953.507092180711;11003.22977391607;10456.790864182825;10595.205359597907;10918.454077295944;10974.670759877217;11037.448127593427;10138.746531336776;10458.843117353093;10767.138628909825;10945.671629851116;11004.339739615649;7816.49192802466;7892.4080693947035;7975;8030.919690803017;8062.355011599176;9438.480883551196;11033.944830275797;11068.778624427627;11078.279911805706;11288.322700637988 03:27:39 INFO - PROCESS | 8814 | |3;mootools.html;1333.433290851388;1434.3617090394773;1448.0298200205864;1591.880608954328;1775.8224177582244;7087.114110736158;7718.691252349906;7889.763307100782;7906.407019473541;7907.090684571276;7560.281773231548;7747.651355688993;7752.651130699118;7754.534727916329;7754.612269386536;2022.9696554551695;2282.7488976212603;2315.305408377488;2342.7774361435722;2343.1096183450263;2324.3840382298704;2334.6147885598857;2335.602947498929;2336.2056900653774;2338.088145623208;2136.4552039230052;2204.9889750551224;2209.359285807114;2209.9116035358566;2210.546837898235;2272.7272727272752;2286.1655495744017;2303.527776805759;2330.4989427273217;2333.696619439462;2291.9312420627407;2296.609576372021;2303.378087916253;2308.1459859851793;2332.195392589571;7668.808279792994;7699.538027718355;7722.073351197836;7724.30481256684;7739.032620922385;4782.163121453732;4916.877078073041;4918.483559226302;4921.827736029258;4923.310736496894;3155.1481100103074;3162.3991441626017;3204.006757905057;3239.2387788869596;3292.1275861896615;986.127277359542;1013.6452241715415;1036.730450082984;1064.79236548873;1094.9890501095047;11179.4969226385;11192.44037798115;11204.21570490066;11212.551497940072;11215.38315392653;4432.578905004019;4433.977830110829;4457.799399026987;4509.7970591323465;4511.142882852248;9507.049295070576;9555.952220238854;9563.61745530185;9569.186619137312;9588.424694518351;4351.151525452569;4855;4914.140025495524;4924.532169443897;4925.532074452921;3962.167944731581;4003.979980100081;4005.319095753729;4262.126264115849;4359.38968544404;3680;3765.3975363941636;3777.6033516480925;3777.8866634001024;3830.367989281737;1215.805471124616;1218.2994778002683;1223.2232532342027;1223.8103094020441;1224.4795961716236;945.4374647084974;963.1957315641517;969.4328817641617;1049.9370037797758;1342.6039318401095;7488.138864030598;7500.287472690195;7527.473076884566;7531.435142364345;7550;477.1840153337762;480.6971607887079;483.6662702735102;486.14195944158587;486.73716193255245;5491.945080549223;5493.176023596492;5541.612087153861;5554.1946417770005;5567.860803479945;9354.532273386303;9520.476373799507;9614.807703845883;9623.941366449684;9816.361936474106;9506;9554.331196816294;9633.181179599673;9700.466474343837;9705.983708490772;7570.583617900958;7635.885461718079;7675.385969122569;7677.30904218623;7697.923020769833;7486.663100160397;7598.240175982358;7617.314441700273;7631.771046868603;7671.2712292332135;8562.229399354088;8659.6103175356;8894.59974301171;8926.152015558511;8934.106589341014;8825.646974120964;8913.910860891308;9061.864072038792;9068.22920051803;9071.319651026331;6144.8771024580155;6683.532152749261;6821.590704557742;7118.857622847618;7227.494075414881;7433.8884916727375;7456.850862982601;7467.6639551221415;7484.513506622052;7490.775276741707;6580.7038683260325;6819.318068193141;6819.69311380999;6890.345417185359;6948.930510694829;6560.967195164185;6604.603723776589;6639.535232533676;6715.328467153246;6715.597064176165;6762.459003279628;6802.82992925161;6812.761553345609;6816.522843400914;6817.386435220854;6494.7726829562625;6500.447461965786;6561.442277406283;6571.868562628625;6579.868402632016;6512.804615861532;6593.241777195684;6596.736130554724;6600.63696496678;6609.107770450928 03:27:39 INFO - PROCESS | 8814 | |4;prototype.html;343.9518467414564;346.4958485403738;350.7790092241887;351.21853875127846;361.5715377277926;5870.64776113433;5880.500157486614;5885.028970219914;5936.554758393117;5974.283086029683;5855.531557475402;5860.589758716891;5864.794732184374;5870.941290587093;5872.911906321408;4348.565143485642;4415.580519850609;4559.886002849922;4563.520830312811;4585.403897493338;4539.114872599845;4577.679562430631;4581.725096494221;4598.126355992351;4609.147307748078;4525.728456292616;4559.407277053979;4559.566841150086;4559.886002849922;4578.885527861797;4350.2387082260475;4433.379326894237;4532.297493888453;4541.34150548172;4563.908721825578;4024;4026.778527181004;4032.1129351542613;4036.091879327157;4042.858499952517;5628.099504079369;5634.605577609569;5637;5646.887062258773;5654;5312.150055991062;5313.760880760375;5314.229436731691;5314.441983591744;5319.255304257407;6214.751409943597;6224.221972253468;6225.62646241227;6227.159333489966;6227.314995350508;4150.792460376969;4266.040140968288;4290.742555446684;4473.575010374009;4481.529439408848;6432.71052802625;6470.09418681385;6486.254080780724;6495.253045899734;6503.674816259216;4429.82280708768;4461.464624245112;4462.174497717868;4467.352233926127;4472.709273897186;4523.77857978344;4524.366588677588;4525.343825145335;4526.253168227206;4529.5243999380245;5218.947810521922;5223.112070947948;5228.9738551307;5229.294045303835;5232.136697444955;6064.514838812885;6208.658523781235;6268.749250030039;6271.3415091414745;6279.7488100476385;1554.2073542493183;1559.3996311420185;1563.73416519192;1565.1939251285596;1565.4286185542196;983.4787562591838;1030.9381437113648;1045.4981608827652;1051.5215576912487;1076.7738774857369;5913.58604897653;5915.37888521699;5917.615355001911;5918.763249469973;5919.408059194132;6306.716197771111;6373.1714877066615;6394.744210231632;6401.64790936503;6408;5969.641821490724;5977.163197152402;5981.252343457068;5983.790567330123;5986.102084687244;3410.0451873475467;3429.9657003430148;3446.138465383654;3453.1194545390763;3454.1191996040848;6645.966770166215;6748.527603067738;6748.898766518506;6811.114555107804;6886.345797149263;6619.3380661933425;6654;6657.068010478537;6660.167479065117;6661.733530658719;6804.421624161902;6832.350926662059;6844.623545705034;6857.314268573103;6857.485688573377;6498.187726534184;6512.34876512345;6541.934580654132;6589.374009469093;6592.604443733391;6243.063540468966;6425.58233714807;6445.4199122079235;6447.709853056717;6460.967695161494;6813.454923606;6849.48628852848;6854.554453960476;6862.348076932683;6867.587944723333;4389.23188442015;4390.209762242827;4391.670624703224;4394.780260987001;4408.074304396113;6509;6516.218053833571;6521.771737989147;6524.249711283073;6525.706343214471;6302.590331628429;6308.306086330592;6313.210848643919;6317.273513545817;6319;6082.087686847009;6274.592151510137;6316.810495685137;6317.115603815561;6334.778282760081;6164.445199932027;6186.597871138361;6198.752049917953;6202.751889924352;6204.503639708722;6331.271903730945;6334.334894835976;6335.176427064452;6342.143810585512;6344;5939.376365481562;6006.729697163725;6187.010078387437;6197.349278325711;6197.628142311476 03:27:39 INFO - PROCESS | 8814 | |5;yui.html;694.9583025018497;699.9475039372048;719.6150059718052;825.8513467575834;846.04385128694;12727.490900363986;12862.678433039155;12873.227606343615;12891.742165156691;12908;12639.115261931645;12692.492300308;12697.492100316;12730.872691273085;12731.745365092693;815.2866242038217;826.7147833997261;827.4249396669318;828.8715249136363;830.8006078541137;826.7395770332356;829.1459796409707;831.4304701279613;832.8251067275849;833.0544831616098;712.0387476906161;866.0992567729554;868.674247157316;870.7866572689668;870.8301881133182;857.9227869491745;860.3375400941303;861.4788053227801;862.3704695572204;868.3443999780188;530.8460546441528;640.2413140428607;641.4996302883758;642.5084810120262;644.6518879804946;10468.47657617116;10480.895191048068;12436.253824770543;12602.684932876751;12649.936750316281;11865.110116741193;12069;12222.327771972537;12361.134720569564;12520.937395313056;9244;9367.156955874005;9419.62321507139;9465.290103242285;9628.566714497865;3527.3650742866275;3579.069441945087;3607.1703508193;3619.438986957026;3723.050622091376;49179.262311065366;49348.753256233846;49488;49834.50165498371;49950.500494995315;9731.318807683394;9837.275892687914;9885.110340069428;10097.141742951784;10174.542145603466;18376.908115459337;18411.355602553846;18415.72376414355;18429.631407371777;18430.907845460955;7392.889106663404;7488.812779680552;7578.545287282781;7586;7667.156612772591;4225.429567008415;4333.090051089306;4352.325389564559;4364.345348197796;4407.735535867858;3004.7596192304563;3043.680413556545;3045.8933937312086;3052.8168309901475;3054.419660264587;560.0535095688274;560.3276068717555;561.0910325273084;573.8651416917021;578.0577658416838;514.7837908078616;650.9934900650933;656.6847913001786;667.2726727866649;695.09984569982;8533.445326053787;8725.127487251224;8729.258013068833;8781.165789250012;8818.647254109892;570.1988705868262;624.1636207481996;647.1877793369385;665.7037618259828;672.2907332763883;3488.267463832573;3953.5453422856162;3993.3610622300876;4084.6528045116497;4171.478565179353;53011;54501;55421;55601;55619.44380556224;44051;45936.3109553357;46174.769126154155;46248.075038499715;46511.767441163254;41786.791066044476;42160.36759448611;42395.364069538366;42663.36004959928;42673.35989960153;8379.245867871921;8612.311015118901;8645.351598630003;8698.043215246444;8739.781505462413;33489.83255083709;33570;34122.48816267708;34784.65215347814;35121.297574048884;42429.15141697087;43840.561594384926;43950.560494395926;47551;48477;10326.638567650096;10725.731856703333;10860.891391085988;10942.562297508011;11146.72133196644;11289.153313501685;11397.373144477133;11428.257163284692;12178.503406801761;12438.875611244133;10820.393387592349;10862.619808306672;11098.334099954029;11203.607873724706;11291.266067705574;10845.837312440477;10902.400367979837;11022.559097636005;11068.293939333991;11197.328160310408;10976.23166378346;11359.716007099558;11510.884891150981;11739.48296531382;11785;8871.600777964877;9042.773930651787;9202.861957070783;9204.95397523008;9615.51922403891;8898.377113601986;9364.906350936404;9495.85756213671;9543.76140596463;9920.603175873173 03:27:39 INFO - PROCESS | 8814 | __end_tp_report 03:27:39 INFO - PROCESS | 8814 | __start_cc_report 03:27:39 INFO - PROCESS | 8814 | _x_x_mozilla_cycle_collect,806 03:27:39 INFO - PROCESS | 8814 | __end_cc_report 03:27:39 INFO - PROCESS | 8814 | __startTimestamp1458296859666__endTimestamp 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | ------- Summary: start ------- 03:27:39 INFO - PROCESS | 8814 | Number of tests: 6 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#0] dojo.html Cycles:165 Average:5168.35 Median:5324.84 stddev:565.98 (10.6%) stddev-sans-first:543.50 03:27:39 INFO - PROCESS | 8814 | Values: 3080.6 3176.4 3209.5 3212.0 3239.5 5078.6 5132.2 5161.1 5164.6 5174.9 5146.7 5195.9 5203.7 5212.1 5251.1 4660.7 4678.3 4721.4 4768.7 4791.5 4649.4 4731.2 4743.7 4759.0 4861.1 4763.9 4765.4 4778.6 4781.9 4797.7 4714.0 4734.6 4768.4 4770.9 4787.5 4627.5 4662.0 4742.9 4743.6 4764.0 5118.2 5118.3 5121.8 5133.8 5163.8 5593.5 5595.4 5598.0 5609.5 5611.8 5516.4 5564.8 5651.7 5691.4 5693.4 5270.1 5275.8 5278.2 5281.6 5289.2 5709.3 5710.9 5726.2 5727.5 5728.9 5418.5 5458.4 5501.7 5514.4 5545.8 5532.1 5544.0 5547.3 5552.9 5553.8 5477.3 5512.8 5523.9 5526.5 5571.6 5491.8 5525.4 5568.4 5606.0 5616.4 4233.0 4239.3 4240.2 4245.7 4281.4 3807.3 3839.3 3848.6 3870.6 3870.9 5201.5 5209.5 5214.3 5229.2 5247.7 5500.9 5541.0 5545.7 5546.1 5549.7 5161.7 5183.7 5213.9 5215.1 5257.9 4717.4 4740.5 4741.5 4753.5 4785.0 5781.0 5834.7 5837.7 5842.3 5892.6 5462.4 5555.7 5573.1 5574.1 5635.8 5794.2 5794.8 5804.6 5810.9 5859.9 5476.3 5484.8 5485.3 5494.0 5500.6 5465.7 5541.7 5563.1 5575.7 5641.3 5315.4 5324.5 5362.9 5384.0 5391.5 5378.9 5389.6 5392.5 5393.6 5432.2 5136.0 5233.5 5296.4 5309.5 5368.8 5421.9 5424.4 5424.8 5430.8 5481.5 5280.6 5324.8 5325.6 5325.9 5339.3 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#1] ext.html Cycles:180 Average:43237.52 Median:17707.67 stddev:68911.04 (389.2%) stddev-sans-first:69029.70 03:27:39 INFO - PROCESS | 8814 | Values: 516.3 536.8 574.4 578.3 611.0 31351.5 37426.3 38233.0 38254.2 38363.0 40295.8 40886.6 40915.6 40924.6 40958.4 7495.1 7610.6 8562.2 8761.6 10140.4 10220.7 10365.4 10369.9 10378.2 10384.9 10289.8 10382.9 10387.6 10400.5 10401.4 10234.9 10310.2 10316.7 10328.8 10333.0 10091.8 10592.0 10614.4 10626.0 10633.0 41740.4 42164.4 42164.8 42245.2 42283.4 3221.3 3239.3 3246.2 3258.6 3399.2 30218.0 30663.4 30704.5 30835.8 30848.4 3998.1 4014.5 4044.7 4066.4 4126.6 281098.0 281522.0 281921.0 282568.0 282877.0 60903.4 61465.7 61559.7 62134.4 62145.7 64552.2 64844.0 65007.3 65014.7 65057.7 14703.3 14842.0 14975.7 15003.0 15060.4 10757.8 10848.1 10860.2 11721.7 12207.9 17619.0 19419.8 20346.6 20353.4 20537.0 7490.1 7615.8 7624.1 7681.7 7714.1 949.2 954.8 996.4 1002.5 1093.0 28007.3 28817.1 29274.3 29369.0 29453.6 950.2 955.9 990.2 1000.4 1007.7 14651.9 15059.1 15088.9 15394.5 15414.2 317035.0 319685.0 320859.0 321567.0 321648.0 53537.5 53917.5 53925.2 53941.5 54009.5 1202.0 1219.3 1247.2 1382.6 1397.8 25992.5 27145.3 27370.2 27406.3 27530.3 38158.0 38633.4 38842.4 38884.4 39460.6 155022.0 158109.0 158794.0 164224.0 164571.2 27844.0 31572.2 31924.5 34029.0 34099.5 41714.2 42345.4 42548.4 43240.0 43404.8 35100.8 35277.8 36074.5 36339.5 36532.6 34798.8 34957.0 35284.6 35752.8 35915.6 35544.6 35642.1 35859.5 36212.6 36542.3 30871.4 32194.0 32281.4 32680.2 32804.3 24568.4 25009.7 25038.4 25171.9 25235.5 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#2] jquery.html Cycles:180 Average:25266.87 Median:421479.74 stddev:70723.33 (16.8%) stddev-sans-first:70896.99 03:27:39 INFO - PROCESS | 8814 | Values: 357.5 364.5 364.9 371.4 373.1 16100.2 16285.8 16939.7 17034.7 17071.3 15527.1 16124.4 16138.4 16149.8 16633.4 5298.5 5324.6 5413.4 6130.5 6135.3 5988.4 6004.6 6008.2 6019.7 6037.4 5886.1 5900.9 5917.9 5994.8 6003.0 5949.1 5960.6 5973.4 5976.4 5981.9 4926.0 5075.7 5124.9 5143.3 5269.1 12501.6 12513.9 15875.5 19832.8 19847.3 2082.4 2094.0 2156.6 2728.0 2810.0 12425.3 12545.0 12625.5 12975.9 13087.8 1876.7 1882.3 1906.6 1922.5 1928.6 60313.4 64801.4 66527.0 67596.7 67812.7 9799.0 10122.2 10270.5 10305.9 10324.8 13667.9 13813.2 13835.4 13845.9 13851.9 7513.5 7563.7 7657.3 7675.9 7769.5 7400.6 7460.9 7481.1 7558.3 7564.4 4295.8 4348.2 4365.5 4426.9 4606.1 1736.6 1750.6 1784.3 1825.0 1846.6 935.3 943.2 950.4 992.3 1073.6 16353.0 16555.4 16672.4 16752.7 16773.9 895.0 924.3 955.8 959.2 1005.8 8942.2 9181.4 9234.8 9308.5 9500.8 416758.0 426201.5 431251.0 433980.0 444325.0 75797.0 77442.0 78207.0 78375.0 78653.6 943.1 947.8 949.4 955.4 955.9 14509.2 14734.5 14756.6 14774.0 14979.3 32501.3 32572.0 32808.2 33315.8 33410.5 48098.0 48143.3 48245.5 48251.0 48422.8 7701.6 7774.5 7855.3 7933.6 7955.2 11508.1 12450.4 12457.1 12463.8 12654.3 10345.6 10618.1 10790.6 10953.5 11003.2 10456.8 10595.2 10918.5 10974.7 11037.4 10138.7 10458.8 10767.1 10945.7 11004.3 7816.5 7892.4 7975.0 8030.9 8062.4 9438.5 11033.9 11068.8 11078.3 11288.3 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#3] mootools.html Cycles:180 Average:5522.04 Median:6561.20 stddev:2939.70 (44.8%) stddev-sans-first:2931.09 03:27:39 INFO - PROCESS | 8814 | Values: 1333.4 1434.4 1448.0 1591.9 1775.8 7087.1 7718.7 7889.8 7906.4 7907.1 7560.3 7747.7 7752.7 7754.5 7754.6 2023.0 2282.7 2315.3 2342.8 2343.1 2324.4 2334.6 2335.6 2336.2 2338.1 2136.5 2205.0 2209.4 2209.9 2210.5 2272.7 2286.2 2303.5 2330.5 2333.7 2291.9 2296.6 2303.4 2308.1 2332.2 7668.8 7699.5 7722.1 7724.3 7739.0 4782.2 4916.9 4918.5 4921.8 4923.3 3155.1 3162.4 3204.0 3239.2 3292.1 986.1 1013.6 1036.7 1064.8 1095.0 11179.5 11192.4 11204.2 11212.6 11215.4 4432.6 4434.0 4457.8 4509.8 4511.1 9507.0 9556.0 9563.6 9569.2 9588.4 4351.2 4855.0 4914.1 4924.5 4925.5 3962.2 4004.0 4005.3 4262.1 4359.4 3680.0 3765.4 3777.6 3777.9 3830.4 1215.8 1218.3 1223.2 1223.8 1224.5 945.4 963.2 969.4 1049.9 1342.6 7488.1 7500.3 7527.5 7531.4 7550.0 477.2 480.7 483.7 486.1 486.7 5491.9 5493.2 5541.6 5554.2 5567.9 9354.5 9520.5 9614.8 9623.9 9816.4 9506.0 9554.3 9633.2 9700.5 9706.0 7570.6 7635.9 7675.4 7677.3 7697.9 7486.7 7598.2 7617.3 7631.8 7671.3 8562.2 8659.6 8894.6 8926.2 8934.1 8825.6 8913.9 9061.9 9068.2 9071.3 6144.9 6683.5 6821.6 7118.9 7227.5 7433.9 7456.9 7467.7 7484.5 7490.8 6580.7 6819.3 6819.7 6890.3 6948.9 6561.0 6604.6 6639.5 6715.3 6715.6 6762.5 6802.8 6812.8 6816.5 6817.4 6494.8 6500.4 6561.4 6571.9 6579.9 6512.8 6593.2 6596.7 6600.6 6609.1 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#4] prototype.html Cycles:180 Average:5255.24 Median:5919.09 stddev:1590.38 (26.9%) stddev-sans-first:1551.53 03:27:39 INFO - PROCESS | 8814 | Values: 344.0 346.5 350.8 351.2 361.6 5870.6 5880.5 5885.0 5936.6 5974.3 5855.5 5860.6 5864.8 5870.9 5872.9 4348.6 4415.6 4559.9 4563.5 4585.4 4539.1 4577.7 4581.7 4598.1 4609.1 4525.7 4559.4 4559.6 4559.9 4578.9 4350.2 4433.4 4532.3 4541.3 4563.9 4024.0 4026.8 4032.1 4036.1 4042.9 5628.1 5634.6 5637.0 5646.9 5654.0 5312.2 5313.8 5314.2 5314.4 5319.3 6214.8 6224.2 6225.6 6227.2 6227.3 4150.8 4266.0 4290.7 4473.6 4481.5 6432.7 6470.1 6486.3 6495.3 6503.7 4429.8 4461.5 4462.2 4467.4 4472.7 4523.8 4524.4 4525.3 4526.3 4529.5 5218.9 5223.1 5229.0 5229.3 5232.1 6064.5 6208.7 6268.7 6271.3 6279.7 1554.2 1559.4 1563.7 1565.2 1565.4 983.5 1030.9 1045.5 1051.5 1076.8 5913.6 5915.4 5917.6 5918.8 5919.4 6306.7 6373.2 6394.7 6401.6 6408.0 5969.6 5977.2 5981.3 5983.8 5986.1 3410.0 3430.0 3446.1 3453.1 3454.1 6646.0 6748.5 6748.9 6811.1 6886.3 6619.3 6654.0 6657.1 6660.2 6661.7 6804.4 6832.4 6844.6 6857.3 6857.5 6498.2 6512.3 6541.9 6589.4 6592.6 6243.1 6425.6 6445.4 6447.7 6461.0 6813.5 6849.5 6854.6 6862.3 6867.6 4389.2 4390.2 4391.7 4394.8 4408.1 6509.0 6516.2 6521.8 6524.2 6525.7 6302.6 6308.3 6313.2 6317.3 6319.0 6082.1 6274.6 6316.8 6317.1 6334.8 6164.4 6186.6 6198.8 6202.8 6204.5 6331.3 6334.3 6335.2 6342.1 6344.0 5939.4 6006.7 6187.0 6197.3 6197.6 03:27:39 INFO - PROCESS | 8814 | 03:27:39 INFO - PROCESS | 8814 | [#5] yui.html Cycles:180 Average:13342.73 Median:48014.00 stddev:15301.35 (31.9%) stddev-sans-first:15314.80 03:27:39 INFO - PROCESS | 8814 | Values: 695.0 699.9 719.6 825.9 846.0 12727.5 12862.7 12873.2 12891.7 12908.0 12639.1 12692.5 12697.5 12730.9 12731.7 815.3 826.7 827.4 828.9 830.8 826.7 829.1 831.4 832.8 833.1 712.0 866.1 868.7 870.8 870.8 857.9 860.3 861.5 862.4 868.3 530.8 640.2 641.5 642.5 644.7 10468.5 10480.9 12436.3 12602.7 12649.9 11865.1 12069.0 12222.3 12361.1 12520.9 9244.0 9367.2 9419.6 9465.3 9628.6 3527.4 3579.1 3607.2 3619.4 3723.1 49179.3 49348.8 49488.0 49834.5 49950.5 9731.3 9837.3 9885.1 10097.1 10174.5 18376.9 18411.4 18415.7 18429.6 18430.9 7392.9 7488.8 7578.5 7586.0 7667.2 4225.4 4333.1 4352.3 4364.3 4407.7 3004.8 3043.7 3045.9 3052.8 3054.4 560.1 560.3 561.1 573.9 578.1 514.8 651.0 656.7 667.3 695.1 8533.4 8725.1 8729.3 8781.2 8818.6 570.2 624.2 647.2 665.7 672.3 3488.3 3953.5 3993.4 4084.7 4171.5 53011.0 54501.0 55421.0 55601.0 55619.4 44051.0 45936.3 46174.8 46248.1 46511.8 41786.8 42160.4 42395.4 42663.4 42673.4 8379.2 8612.3 8645.4 8698.0 8739.8 33489.8 33570.0 34122.5 34784.7 35121.3 42429.2 43840.6 43950.6 47551.0 48477.0 10326.6 10725.7 10860.9 10942.6 11146.7 11289.2 11397.4 11428.3 12178.5 12438.9 10820.4 10862.6 11098.3 11203.6 11291.3 10845.8 10902.4 11022.6 11068.3 11197.3 10976.2 11359.7 11510.9 11739.5 11785.0 8871.6 9042.8 9202.9 9205.0 9615.5 8898.4 9364.9 9495.9 9543.8 9920.6 03:27:39 INFO - PROCESS | 8814 | -------- Summary: end -------- 03:27:39 INFO - PROCESS | 8814 | 03:27:40 INFO - TEST-INFO | 8814: exit 0 03:27:40 INFO - TEST-OK | dromaeo_css | took 1113092ms 03:27:40 INFO - TEST-START | kraken 03:27:40 INFO - operating with platform_type : linux_ 03:27:40 INFO - Initialising browser for kraken test... 03:27:40 INFO - TEST-INFO | started process 9001 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp4xMdsE/profile http://localhost:49663/getInfo.html) 03:27:44 INFO - PROCESS | 9001 | __metrics Screen width/height:1600/1200 03:27:44 INFO - PROCESS | 9001 | colorDepth:24 03:27:44 INFO - PROCESS | 9001 | Browser inner width/height: 1024/697 03:27:44 INFO - PROCESS | 9001 | __metrics 03:27:45 ERROR - PROCESS | 9001 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 03:27:45 INFO - PROCESS | 9001 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 03:27:46 INFO - TEST-INFO | 9001: exit 0 03:27:46 INFO - Browser initialized. 03:27:46 INFO - Running cycle 1/1 for kraken test... 03:27:46 INFO - TEST-INFO | started process 9084 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp4xMdsE/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:27:58 INFO - PROCESS | 9084 | RSS: Main: 155111424 03:27:58 INFO - PROCESS | 9084 | 03:28:00 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49663/tests/kraken/driver.html?testName=audio-beat-detection) 03:28:01 INFO - PROCESS | 9084 | RSS: Main: 194633728 03:28:01 INFO - PROCESS | 9084 | 03:28:03 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49663/tests/kraken/driver.html?testName=audio-dft) 03:28:04 INFO - PROCESS | 9084 | RSS: Main: 186052608 03:28:04 INFO - PROCESS | 9084 | 03:28:07 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49663/tests/kraken/driver.html?testName=audio-fft) 03:28:07 INFO - PROCESS | 9084 | RSS: Main: 171515904 03:28:07 INFO - PROCESS | 9084 | 03:28:09 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49663/tests/kraken/driver.html?testName=audio-oscillator) 03:28:10 INFO - PROCESS | 9084 | RSS: Main: 173322240 03:28:10 INFO - PROCESS | 9084 | 03:28:12 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49663/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:28:13 INFO - PROCESS | 9084 | RSS: Main: 174198784 03:28:13 INFO - PROCESS | 9084 | 03:28:16 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49663/tests/kraken/driver.html?testName=imaging-darkroom) 03:28:16 INFO - PROCESS | 9084 | RSS: Main: 175484928 03:28:16 INFO - PROCESS | 9084 | 03:28:20 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49663/tests/kraken/driver.html?testName=imaging-desaturate) 03:28:20 INFO - PROCESS | 9084 | RSS: Main: 175595520 03:28:20 INFO - PROCESS | 9084 | 03:28:23 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49663/tests/kraken/driver.html?testName=json-parse-financial) 03:28:24 INFO - PROCESS | 9084 | RSS: Main: 176644096 03:28:24 INFO - PROCESS | 9084 | 03:28:25 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49663/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:28:26 INFO - PROCESS | 9084 | RSS: Main: 183242752 03:28:26 INFO - PROCESS | 9084 | 03:28:28 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:28:28 INFO - PROCESS | 9084 | RSS: Main: 179957760 03:28:28 INFO - PROCESS | 9084 | 03:28:30 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:28:31 INFO - PROCESS | 9084 | RSS: Main: 191840256 03:28:31 INFO - PROCESS | 9084 | 03:28:33 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:28:34 INFO - PROCESS | 9084 | RSS: Main: 193662976 03:28:34 INFO - PROCESS | 9084 | 03:28:37 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:28:37 INFO - PROCESS | 9084 | RSS: Main: 196288512 03:28:37 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | Cycle 1(1): loaded http://localhost:49663/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49663/tests/kraken/driver.html?testName=ai-astar) 03:28:39 INFO - PROCESS | 9084 | RSS: Main: 255598592 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | __start_tp_report 03:28:39 INFO - PROCESS | 9084 | _x_x_mozilla_page_load 03:28:39 INFO - PROCESS | 9084 | _x_x_mozilla_page_load_details 03:28:39 INFO - PROCESS | 9084 | |i|pagename|runs| 03:28:39 INFO - PROCESS | 9084 | |0;ai-astar;110;112;105;110;110;111;101;115;110;110 03:28:39 INFO - PROCESS | 9084 | |1;audio-beat-detection;151;126;158;174;130;155;159;128;167;126 03:28:39 INFO - PROCESS | 9084 | |2;audio-dft;161;162;162;162;162;161;162;165;160;163 03:28:39 INFO - PROCESS | 9084 | |3;audio-fft;75;73;101;107;77;75;72;141;95;75 03:28:39 INFO - PROCESS | 9084 | |4;audio-oscillator;94;93;137;95;95;95;146;94;93;143 03:28:39 INFO - PROCESS | 9084 | |5;imaging-gaussian-blur;117;117;117;118;117;118;117;117;117;116 03:28:39 INFO - PROCESS | 9084 | |6;imaging-darkroom;145;146;145;144;146;145;145;145;145;145 03:28:39 INFO - PROCESS | 9084 | |7;imaging-desaturate;96;96;96;96;96;96;96;96;96;95 03:28:39 INFO - PROCESS | 9084 | |8;json-parse-financial;58;58;59;57;57;58;61;66;57;56 03:28:39 INFO - PROCESS | 9084 | |9;json-stringify-tinderbox;68;68;68;68;68;69;68;68;68;68 03:28:39 INFO - PROCESS | 9084 | |10;stanford-crypto-aes;81;82;81;81;80;81;83;82;81;81 03:28:39 INFO - PROCESS | 9084 | |11;stanford-crypto-ccm;115;118;117;131;116;117;116;128;115;120 03:28:39 INFO - PROCESS | 9084 | |12;stanford-crypto-pbkdf2;151;143;153;141;150;149;150;150;150;149 03:28:39 INFO - PROCESS | 9084 | |13;stanford-crypto-sha256-iterative;68;70;70;68;68;68;67;79;67;67 03:28:39 INFO - PROCESS | 9084 | __end_tp_report 03:28:39 INFO - PROCESS | 9084 | __start_cc_report 03:28:39 INFO - PROCESS | 9084 | _x_x_mozilla_cycle_collect,1059 03:28:39 INFO - PROCESS | 9084 | __end_cc_report 03:28:39 INFO - PROCESS | 9084 | __startTimestamp1458296919709__endTimestamp 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | ------- Summary: start ------- 03:28:39 INFO - PROCESS | 9084 | Number of tests: 14 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#0] ai-astar Cycles:10 Average:109.40 Median:110.00 stddev:3.84 (3.5%) stddev-sans-first:4.06 03:28:39 INFO - PROCESS | 9084 | Values: 110.0 112.0 105.0 110.0 110.0 111.0 101.0 115.0 110.0 110.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#1] audio-beat-detection Cycles:10 Average:147.40 Median:156.50 stddev:18.27 (11.7%) stddev-sans-first:19.33 03:28:39 INFO - PROCESS | 9084 | Values: 151.0 126.0 158.0 174.0 130.0 155.0 159.0 128.0 167.0 126.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#2] audio-dft Cycles:10 Average:162.00 Median:162.00 stddev:1.33 (0.8%) stddev-sans-first:1.36 03:28:39 INFO - PROCESS | 9084 | Values: 161.0 162.0 162.0 162.0 162.0 161.0 162.0 165.0 160.0 163.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#3] audio-fft Cycles:10 Average:89.10 Median:75.00 stddev:22.32 (29.8%) stddev-sans-first:23.09 03:28:39 INFO - PROCESS | 9084 | Values: 75.0 73.0 101.0 107.0 77.0 75.0 72.0 141.0 95.0 75.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#4] audio-oscillator Cycles:10 Average:108.50 Median:94.00 stddev:23.23 (24.7%) stddev-sans-first:24.04 03:28:39 INFO - PROCESS | 9084 | Values: 94.0 93.0 137.0 95.0 95.0 95.0 146.0 94.0 93.0 143.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 03:28:39 INFO - PROCESS | 9084 | Values: 117.0 117.0 117.0 118.0 117.0 118.0 117.0 117.0 117.0 116.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#6] imaging-darkroom Cycles:10 Average:145.10 Median:145.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 03:28:39 INFO - PROCESS | 9084 | Values: 145.0 146.0 145.0 144.0 146.0 145.0 145.0 145.0 145.0 145.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 03:28:39 INFO - PROCESS | 9084 | Values: 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#8] json-parse-financial Cycles:10 Average:58.70 Median:58.00 stddev:2.91 (5.0%) stddev-sans-first:3.07 03:28:39 INFO - PROCESS | 9084 | Values: 58.0 58.0 59.0 57.0 57.0 58.0 61.0 66.0 57.0 56.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:68.00 stddev:0.32 (0.5%) stddev-sans-first:0.33 03:28:39 INFO - PROCESS | 9084 | Values: 68.0 68.0 68.0 68.0 68.0 69.0 68.0 68.0 68.0 68.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#10] stanford-crypto-aes Cycles:10 Average:81.30 Median:81.00 stddev:0.82 (1.0%) stddev-sans-first:0.87 03:28:39 INFO - PROCESS | 9084 | Values: 81.0 82.0 81.0 81.0 80.0 81.0 83.0 82.0 81.0 81.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#11] stanford-crypto-ccm Cycles:10 Average:119.30 Median:117.50 stddev:5.62 (4.8%) stddev-sans-first:5.74 03:28:39 INFO - PROCESS | 9084 | Values: 115.0 118.0 117.0 131.0 116.0 117.0 116.0 128.0 115.0 120.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.60 Median:150.00 stddev:3.69 (2.5%) stddev-sans-first:3.81 03:28:39 INFO - PROCESS | 9084 | Values: 151.0 143.0 153.0 141.0 150.0 149.0 150.0 150.0 150.0 149.0 03:28:39 INFO - PROCESS | 9084 | 03:28:39 INFO - PROCESS | 9084 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.20 Median:68.00 stddev:3.61 (5.3%) stddev-sans-first:3.81 03:28:39 INFO - PROCESS | 9084 | Values: 68.0 70.0 70.0 68.0 68.0 68.0 67.0 79.0 67.0 67.0 03:28:39 INFO - PROCESS | 9084 | -------- Summary: end -------- 03:28:39 INFO - PROCESS | 9084 | 03:28:40 INFO - TEST-INFO | 9084: exit 0 03:28:40 INFO - TEST-OK | kraken | took 60354ms 03:28:40 INFO - SUITE-END | took 1173s 03:28:40 INFO - Completed test suite (00:19:33) 03:28:40 INFO - javascript benchmark 03:28:40 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3080.630324361077, 3176.3806057818733, 3209.454392753232, 3211.967880321196, 3239.5464634951104, 5078.64449488536, 5132.204508301214, 5161.071007218704, 5164.586833053356, 5174.948250517494, 5146.665466744659, 5195.908859139576, 5203.713795741232, 5212.113940630093, 5251.133562962116, 4660.720356778587, 4678.251479763238, 4721.362616046841, 4768.690035147722, 4791.520847915215, 4649.44206695197, 4731.243001119804, 4743.739094349809, 4759.048190361924, 4861.052094841507, 4763.880902977453, 4765.356676848615, 4778.593819525309, 4781.90436191276, 4797.664163508538, 4713.952860471386, 4734.573888350065, 4768.380110585602, 4770.928436073462, 4787.521247875219, 4627.514111018362, 4661.976690116561, 4742.881427964294, 4743.596794272491, 4763.976180119112, 5118.155504341779, 5118.2578526113875, 5121.820736274212, 5133.820316288912, 5163.7676304566385, 5593.496585307301, 5595.356533998602, 5598.0, 5609.49514543693, 5611.803586874481, 5516.448355164492, 5564.8330550083565, 5651.745671444794, 5691.4024027476935, 5693.402192769782, 5270.051390749702, 5275.788968441258, 5278.181881808326, 5281.551068159211, 5289.233061206142, 5709.25779648643, 5710.885782284331, 5726.226959360516, 5727.455891690282, 5728.856778580569, 5418.485243901823, 5458.399576046631, 5501.697406642593, 5514.420985796514, 5545.805896793673, 5532.087205611109, 5544.029794785896, 5547.278853748987, 5552.916706249329, 5553.77784888608, 5477.3427188737605, 5512.751926163332, 5523.917141242885, 5526.530244929226, 5571.582131340166, 5491.752871120809, 5525.364583072998, 5568.387477377485, 5606.046972014768, 5616.410276920865, 4232.957670423318, 4239.25812982733, 4240.151969606091, 4245.660347172219, 4281.422008028876, 3807.3146833569667, 3839.251345987506, 3848.634379733921, 3870.6129387061633, 3870.8838734838, 5201.479852014768, 5209.453007434241, 5214.32213812202, 5229.241759944863, 5247.658902171423, 5500.917486237709, 5541.002619528443, 5545.667259964415, 5546.084895992197, 5549.694766787866, 5161.716105614228, 5183.740812959337, 5213.869653258699, 5215.139501982207, 5257.868553286198, 4717.410323709536, 4740.525947405232, 4741.454732705714, 4753.500882407367, 4784.952150478451, 5781.046127389102, 5834.737436815353, 5837.67892765902, 5842.298924129047, 5892.616979896293, 5462.371827239759, 5555.666660000413, 5573.136163894603, 5574.108142697149, 5635.774569017193, 5794.159846822272, 5794.82615521535, 5804.564657650609, 5810.912836307374, 5859.853503662443, 5476.315460567429, 5484.8354549363585, 5485.259489968803, 5493.972530137324, 5500.642458240201, 5465.726713664221, 5541.722913854211, 5563.109902415594, 5575.693336866511, 5641.294838145232, 5315.3621565412395, 5324.547413469743, 5362.892742145057, 5383.973080134574, 5391.487808658171, 5378.946210537844, 5389.649672771257, 5392.460753924576, 5393.595480338912, 5432.158015507603, 5136.049830781318, 5233.528982391603, 5296.390915044819, 5309.548688361532, 5368.785248590013, 5421.945780542144, 5424.430434804289, 5424.810131645373, 5430.782768689208, 5481.506664400223, 5280.551153152025, 5324.840254792362, 5325.600579956596, 5325.946740532545, 5339.3058902342445], "unit": "score", "name": "dojo.html", "value": 5132.490642903428}, {"lowerIsBetter": false, "replicates": [516.3493997563072, 536.7960175133453, 574.3796699564471, 578.2540522725683, 610.9541784366171, 31351.529727054083, 37426.251474970486, 38233.0, 38254.23491530168, 38363.0, 40295.79852100735, 40886.59113408865, 40915.59084409155, 40924.59075409245, 40958.38562421566, 7495.100587929456, 7610.619469026554, 8562.18659227374, 8761.605727742235, 10140.391576505397, 10220.74448138795, 10365.429901355423, 10369.948150259239, 10378.221633377527, 10384.896151038507, 10289.845652315222, 10382.948085259563, 10387.636432724856, 10400.531976061058, 10401.427921464354, 10234.948825255864, 10310.226732995055, 10316.690499284996, 10328.793424131512, 10333.0, 10091.848622270672, 10592.046715795615, 10614.363138211733, 10625.990530899553, 10633.0, 41740.37389439161, 42164.367534487006, 42164.78917605423, 42245.1550968982, 42283.36574951378, 3221.3396253767924, 3239.2549713566013, 3246.2371342734436, 3258.5600943872746, 3399.1672040350027, 30218.0, 30663.38673226523, 30704.53943190854, 30835.845820770977, 30848.38303233923, 3998.108935280804, 4014.498187726534, 4044.676425885922, 4066.369712694537, 4126.649234815044, 281098.0, 281522.0, 281921.0, 282568.0, 282877.0, 60903.39096609066, 61465.692671537254, 61559.692201539605, 62134.37865621376, 62145.689271553354, 64552.22201668851, 64844.0, 65007.34992650013, 65014.67492662601, 65057.67471162614, 14703.338349774285, 14842.0, 14975.700485990437, 15003.0, 15060.397584096514, 10757.83863242052, 10848.077913377452, 10860.185486088574, 11721.706957325965, 12207.938960305319, 17619.004688063284, 19419.805801942082, 20346.593068138554, 20353.389398318075, 20537.0, 7490.101187857383, 7615.847683046419, 7624.08510978675, 7681.692732290758, 7714.112877019103, 949.188443880486, 954.8042651256476, 996.3822430093244, 1002.4536627538009, 1092.9726057506077, 28007.299817504725, 28817.135485935454, 29274.26814329616, 29369.0, 29453.55819662707, 950.1875896108866, 955.8852937647526, 990.2127808392345, 1000.364768372089, 1007.7379881230933, 14651.853481465048, 15059.096454212782, 15088.924555377373, 15394.461193858162, 15414.152221627694, 317035.0, 319685.0, 320859.0, 321567.0, 321648.0, 53537.46462535325, 53917.46082539203, 53925.1911221332, 53941.46058539443, 54009.45990540123, 1201.9819702704467, 1219.2562536852513, 1247.189326937498, 1382.5506710319187, 1397.76936805428, 25992.480150397263, 27145.321366965985, 27370.178894633194, 27406.314842129108, 27530.311742206606, 38158.0, 38633.42049869198, 38842.417363739, 38884.416733748454, 39460.60539394569, 155022.0, 158109.0, 158794.0, 164224.0, 164571.17714411352, 27844.0, 31572.210694732814, 31924.5211321835, 34029.0, 34099.488507672904, 41714.165716686104, 42345.364819527116, 42548.36177457279, 43240.0, 43404.78297608492, 35100.82449587736, 35277.82361088178, 36074.45888311625, 36339.45490817587, 36532.63467365292, 34798.82600587082, 34957.0, 35284.64715352814, 35752.82123589469, 35915.64084359123, 35544.644553554135, 35642.10894727652, 35859.46210806788, 36212.63787362093, 36542.269154617294, 30871.382572348877, 32194.0, 32281.35437291194, 32680.182995425304, 32804.34391312208, 24568.385790355384, 25009.74990250147, 25038.37404064913, 25171.87414062918, 25235.495290093728], "unit": "score", "name": "ext.html", "value": 18378.591084855212}, {"lowerIsBetter": false, "replicates": [357.4995006990213, 364.50427418710547, 364.9343118238716, 371.41687550545635, 373.0654709951571, 16100.194990250484, 16285.755713664304, 16939.74590381142, 17034.74447883283, 17071.317147314123, 15527.146006969611, 16124.355025798954, 16138.354465821352, 16149.83850161498, 16633.41783037594, 5298.523132918046, 5324.627276090675, 5413.377461591908, 6130.540209484284, 6135.263768347804, 5988.3712210217955, 6004.609700369484, 6008.1888944992525, 6019.72911218994, 6037.426444487766, 5886.058230683092, 5900.940990590082, 5917.9408205918035, 5994.820155395345, 6003.039513677791, 5949.107633854913, 5960.582759206857, 5973.432523910222, 5976.3724808895095, 5981.850453738648, 4925.950740492585, 5075.720835354054, 5124.897502049976, 5143.254228136937, 5269.130593452076, 12501.562445314461, 12513.874861251363, 15875.52373428799, 19832.80167198324, 19847.305344313023, 2082.3544701142696, 2093.9790602093935, 2156.611809874222, 2727.9789649814725, 2810.0024491305703, 12425.31660758658, 12545.0, 12625.494980200781, 12975.935120324433, 13087.803682944763, 1876.7278744581959, 1882.265916292647, 1906.5996140810446, 1922.4521011511652, 1928.6046360496064, 60313.39686603165, 64801.351986480004, 66527.0, 67596.6620166896, 67812.6609366955, 9799.0, 10122.190224782, 10270.486475676187, 10305.896941030494, 10324.793504129875, 13667.931660341636, 13813.240271784947, 13835.446582136803, 13845.930770346084, 13851.930740346234, 7513.511621744569, 7563.697452101855, 7657.272559106876, 7675.884861727079, 7769.456138070281, 7400.592967386845, 7460.925390746132, 7481.064866891638, 7558.281963213486, 7564.394848412114, 4295.785210739513, 4348.195583817004, 4365.454318210223, 4426.889327766831, 4606.055758569485, 1736.5658585353663, 1750.6323672029016, 1784.3308759215295, 1824.97262541062, 1846.5568263616904, 935.2751617496494, 943.217129782279, 950.3585080070925, 992.3450522655013, 1073.608133031438, 16353.0, 16555.420560280334, 16672.416465423652, 16752.664946701, 16773.91762728372, 894.9686760963335, 924.3021518753433, 955.7622878372524, 959.1607343574373, 1005.7837564923576, 8942.239909607757, 9181.357304988587, 9234.76913077165, 9308.48803315824, 9500.809983800285, 416758.0, 426201.4759704851, 431251.0, 433980.0, 444325.0, 75797.0, 77442.0, 78207.0, 78375.0, 78653.60673196598, 943.1181844974833, 947.8151760406655, 949.4208532794989, 955.3742298794301, 955.8900726416412, 14509.201993890438, 14734.484293049692, 14756.557303280919, 14774.0, 14979.251037447866, 32501.34997300088, 32572.0, 32808.17979550435, 33315.83342083274, 33410.49884251689, 48098.0, 48143.27785083157, 48245.5175448241, 48251.0, 48422.75788621175, 7701.614919254127, 7774.533527988338, 7855.33229675484, 7933.60331983387, 7955.204479551999, 11508.136889733136, 12450.377481126088, 12457.12800103984, 12463.750724985632, 12654.30401327899, 10345.586176552853, 10618.097461715532, 10790.568377265135, 10953.507092180711, 11003.22977391607, 10456.790864182825, 10595.205359597907, 10918.454077295944, 10974.670759877217, 11037.448127593427, 10138.746531336776, 10458.843117353093, 10767.138628909825, 10945.671629851116, 11004.339739615649, 7816.49192802466, 7892.4080693947035, 7975.0, 8030.919690803017, 8062.355011599176, 9438.480883551196, 11033.944830275797, 11068.778624427627, 11078.279911805706, 11288.322700637988], "unit": "score", "name": "jquery.html", "value": 8471.002885322625}, {"lowerIsBetter": false, "replicates": [1333.433290851388, 1434.3617090394773, 1448.0298200205864, 1591.880608954328, 1775.8224177582244, 7087.114110736158, 7718.691252349906, 7889.763307100782, 7906.407019473541, 7907.090684571276, 7560.281773231548, 7747.651355688993, 7752.651130699118, 7754.534727916329, 7754.612269386536, 2022.9696554551695, 2282.7488976212603, 2315.305408377488, 2342.7774361435722, 2343.1096183450263, 2324.3840382298704, 2334.6147885598857, 2335.602947498929, 2336.2056900653774, 2338.088145623208, 2136.4552039230052, 2204.9889750551224, 2209.359285807114, 2209.9116035358566, 2210.546837898235, 2272.7272727272752, 2286.1655495744017, 2303.527776805759, 2330.4989427273217, 2333.696619439462, 2291.9312420627407, 2296.609576372021, 2303.378087916253, 2308.1459859851793, 2332.195392589571, 7668.808279792994, 7699.538027718355, 7722.073351197836, 7724.30481256684, 7739.032620922385, 4782.163121453732, 4916.877078073041, 4918.483559226302, 4921.827736029258, 4923.310736496894, 3155.1481100103074, 3162.3991441626017, 3204.006757905057, 3239.2387788869596, 3292.1275861896615, 986.127277359542, 1013.6452241715415, 1036.730450082984, 1064.79236548873, 1094.9890501095047, 11179.4969226385, 11192.44037798115, 11204.21570490066, 11212.551497940072, 11215.38315392653, 4432.578905004019, 4433.977830110829, 4457.799399026987, 4509.7970591323465, 4511.142882852248, 9507.049295070576, 9555.952220238854, 9563.61745530185, 9569.186619137312, 9588.424694518351, 4351.151525452569, 4855.0, 4914.140025495524, 4924.532169443897, 4925.532074452921, 3962.167944731581, 4003.979980100081, 4005.319095753729, 4262.126264115849, 4359.38968544404, 3680.0, 3765.3975363941636, 3777.6033516480925, 3777.8866634001024, 3830.367989281737, 1215.805471124616, 1218.2994778002683, 1223.2232532342027, 1223.8103094020441, 1224.4795961716236, 945.4374647084974, 963.1957315641517, 969.4328817641617, 1049.9370037797758, 1342.6039318401095, 7488.138864030598, 7500.287472690195, 7527.473076884566, 7531.435142364345, 7550.0, 477.1840153337762, 480.6971607887079, 483.6662702735102, 486.14195944158587, 486.73716193255245, 5491.945080549223, 5493.176023596492, 5541.612087153861, 5554.1946417770005, 5567.860803479945, 9354.532273386303, 9520.476373799507, 9614.807703845883, 9623.941366449684, 9816.361936474106, 9506.0, 9554.331196816294, 9633.181179599673, 9700.466474343837, 9705.983708490772, 7570.583617900958, 7635.885461718079, 7675.385969122569, 7677.30904218623, 7697.923020769833, 7486.663100160397, 7598.240175982358, 7617.314441700273, 7631.771046868603, 7671.2712292332135, 8562.229399354088, 8659.6103175356, 8894.59974301171, 8926.152015558511, 8934.106589341014, 8825.646974120964, 8913.910860891308, 9061.864072038792, 9068.22920051803, 9071.319651026331, 6144.8771024580155, 6683.532152749261, 6821.590704557742, 7118.857622847618, 7227.494075414881, 7433.8884916727375, 7456.850862982601, 7467.6639551221415, 7484.513506622052, 7490.775276741707, 6580.7038683260325, 6819.318068193141, 6819.69311380999, 6890.345417185359, 6948.930510694829, 6560.967195164185, 6604.603723776589, 6639.535232533676, 6715.328467153246, 6715.597064176165, 6762.459003279628, 6802.82992925161, 6812.761553345609, 6816.522843400914, 6817.386435220854, 6494.7726829562625, 6500.447461965786, 6561.442277406283, 6571.868562628625, 6579.868402632016, 6512.804615861532, 6593.241777195684, 6596.736130554724, 6600.63696496678, 6609.107770450928], "unit": "score", "name": "mootools.html", "value": 4428.37251354209}, {"lowerIsBetter": false, "replicates": [343.9518467414564, 346.4958485403738, 350.7790092241887, 351.21853875127846, 361.5715377277926, 5870.64776113433, 5880.500157486614, 5885.028970219914, 5936.554758393117, 5974.283086029683, 5855.531557475402, 5860.589758716891, 5864.794732184374, 5870.941290587093, 5872.911906321408, 4348.565143485642, 4415.580519850609, 4559.886002849922, 4563.520830312811, 4585.403897493338, 4539.114872599845, 4577.679562430631, 4581.725096494221, 4598.126355992351, 4609.147307748078, 4525.728456292616, 4559.407277053979, 4559.566841150086, 4559.886002849922, 4578.885527861797, 4350.2387082260475, 4433.379326894237, 4532.297493888453, 4541.34150548172, 4563.908721825578, 4024.0, 4026.778527181004, 4032.1129351542613, 4036.091879327157, 4042.858499952517, 5628.099504079369, 5634.605577609569, 5637.0, 5646.887062258773, 5654.0, 5312.150055991062, 5313.760880760375, 5314.229436731691, 5314.441983591744, 5319.255304257407, 6214.751409943597, 6224.221972253468, 6225.62646241227, 6227.159333489966, 6227.314995350508, 4150.792460376969, 4266.040140968288, 4290.742555446684, 4473.575010374009, 4481.529439408848, 6432.71052802625, 6470.09418681385, 6486.254080780724, 6495.253045899734, 6503.674816259216, 4429.82280708768, 4461.464624245112, 4462.174497717868, 4467.352233926127, 4472.709273897186, 4523.77857978344, 4524.366588677588, 4525.343825145335, 4526.253168227206, 4529.5243999380245, 5218.947810521922, 5223.112070947948, 5228.9738551307, 5229.294045303835, 5232.136697444955, 6064.514838812885, 6208.658523781235, 6268.749250030039, 6271.3415091414745, 6279.7488100476385, 1554.2073542493183, 1559.3996311420185, 1563.73416519192, 1565.1939251285596, 1565.4286185542196, 983.4787562591838, 1030.9381437113648, 1045.4981608827652, 1051.5215576912487, 1076.7738774857369, 5913.58604897653, 5915.37888521699, 5917.615355001911, 5918.763249469973, 5919.408059194132, 6306.716197771111, 6373.1714877066615, 6394.744210231632, 6401.64790936503, 6408.0, 5969.641821490724, 5977.163197152402, 5981.252343457068, 5983.790567330123, 5986.102084687244, 3410.0451873475467, 3429.9657003430148, 3446.138465383654, 3453.1194545390763, 3454.1191996040848, 6645.966770166215, 6748.527603067738, 6748.898766518506, 6811.114555107804, 6886.345797149263, 6619.3380661933425, 6654.0, 6657.068010478537, 6660.167479065117, 6661.733530658719, 6804.421624161902, 6832.350926662059, 6844.623545705034, 6857.314268573103, 6857.485688573377, 6498.187726534184, 6512.34876512345, 6541.934580654132, 6589.374009469093, 6592.604443733391, 6243.063540468966, 6425.58233714807, 6445.4199122079235, 6447.709853056717, 6460.967695161494, 6813.454923606, 6849.48628852848, 6854.554453960476, 6862.348076932683, 6867.587944723333, 4389.23188442015, 4390.209762242827, 4391.670624703224, 4394.780260987001, 4408.074304396113, 6509.0, 6516.218053833571, 6521.771737989147, 6524.249711283073, 6525.706343214471, 6302.590331628429, 6308.306086330592, 6313.210848643919, 6317.273513545817, 6319.0, 6082.087686847009, 6274.592151510137, 6316.810495685137, 6317.115603815561, 6334.778282760081, 6164.445199932027, 6186.597871138361, 6198.752049917953, 6202.751889924352, 6204.503639708722, 6331.271903730945, 6334.334894835976, 6335.176427064452, 6342.143810585512, 6344.0, 5939.376365481562, 6006.729697163725, 6187.010078387437, 6197.349278325711, 6197.628142311476], "unit": "score", "name": "prototype.html", "value": 4740.922293896672}, {"lowerIsBetter": false, "replicates": [694.9583025018497, 699.9475039372048, 719.6150059718052, 825.8513467575834, 846.04385128694, 12727.490900363986, 12862.678433039155, 12873.227606343615, 12891.742165156691, 12908.0, 12639.115261931645, 12692.492300308, 12697.492100316, 12730.872691273085, 12731.745365092693, 815.2866242038217, 826.7147833997261, 827.4249396669318, 828.8715249136363, 830.8006078541137, 826.7395770332356, 829.1459796409707, 831.4304701279613, 832.8251067275849, 833.0544831616098, 712.0387476906161, 866.0992567729554, 868.674247157316, 870.7866572689668, 870.8301881133182, 857.9227869491745, 860.3375400941303, 861.4788053227801, 862.3704695572204, 868.3443999780188, 530.8460546441528, 640.2413140428607, 641.4996302883758, 642.5084810120262, 644.6518879804946, 10468.47657617116, 10480.895191048068, 12436.253824770543, 12602.684932876751, 12649.936750316281, 11865.110116741193, 12069.0, 12222.327771972537, 12361.134720569564, 12520.937395313056, 9244.0, 9367.156955874005, 9419.62321507139, 9465.290103242285, 9628.566714497865, 3527.3650742866275, 3579.069441945087, 3607.1703508193, 3619.438986957026, 3723.050622091376, 49179.262311065366, 49348.753256233846, 49488.0, 49834.50165498371, 49950.500494995315, 9731.318807683394, 9837.275892687914, 9885.110340069428, 10097.141742951784, 10174.542145603466, 18376.908115459337, 18411.355602553846, 18415.72376414355, 18429.631407371777, 18430.907845460955, 7392.889106663404, 7488.812779680552, 7578.545287282781, 7586.0, 7667.156612772591, 4225.429567008415, 4333.090051089306, 4352.325389564559, 4364.345348197796, 4407.735535867858, 3004.7596192304563, 3043.680413556545, 3045.8933937312086, 3052.8168309901475, 3054.419660264587, 560.0535095688274, 560.3276068717555, 561.0910325273084, 573.8651416917021, 578.0577658416838, 514.7837908078616, 650.9934900650933, 656.6847913001786, 667.2726727866649, 695.09984569982, 8533.445326053787, 8725.127487251224, 8729.258013068833, 8781.165789250012, 8818.647254109892, 570.1988705868262, 624.1636207481996, 647.1877793369385, 665.7037618259828, 672.2907332763883, 3488.267463832573, 3953.5453422856162, 3993.3610622300876, 4084.6528045116497, 4171.478565179353, 53011.0, 54501.0, 55421.0, 55601.0, 55619.44380556224, 44051.0, 45936.3109553357, 46174.769126154155, 46248.075038499715, 46511.767441163254, 41786.791066044476, 42160.36759448611, 42395.364069538366, 42663.36004959928, 42673.35989960153, 8379.245867871921, 8612.311015118901, 8645.351598630003, 8698.043215246444, 8739.781505462413, 33489.83255083709, 33570.0, 34122.48816267708, 34784.65215347814, 35121.297574048884, 42429.15141697087, 43840.561594384926, 43950.560494395926, 47551.0, 48477.0, 10326.638567650096, 10725.731856703333, 10860.891391085988, 10942.562297508011, 11146.72133196644, 11289.153313501685, 11397.373144477133, 11428.257163284692, 12178.503406801761, 12438.875611244133, 10820.393387592349, 10862.619808306672, 11098.334099954029, 11203.607873724706, 11291.266067705574, 10845.837312440477, 10902.400367979837, 11022.559097636005, 11068.293939333991, 11197.328160310408, 10976.23166378346, 11359.716007099558, 11510.884891150981, 11739.48296531382, 11785.0, 8871.600777964877, 9042.773930651787, 9202.861957070783, 9204.95397523008, 9615.51922403891, 8898.377113601986, 9364.906350936404, 9495.85756213671, 9543.76140596463, 9920.603175873173], "unit": "score", "name": "yui.html", "value": 6174.440636570112}], "name": "dromaeo_css", "value": 6853.091284557672}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 112.0, 105.0, 110.0, 110.0, 111.0, 101.0, 115.0, 110.0, 110.0], "unit": "score", "name": "ai-astar", "value": 109.4}, {"lowerIsBetter": true, "replicates": [151.0, 126.0, 158.0, 174.0, 130.0, 155.0, 159.0, 128.0, 167.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 147.4}, {"lowerIsBetter": true, "replicates": [161.0, 162.0, 162.0, 162.0, 162.0, 161.0, 162.0, 165.0, 160.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.0}, {"lowerIsBetter": true, "replicates": [75.0, 73.0, 101.0, 107.0, 77.0, 75.0, 72.0, 141.0, 95.0, 75.0], "unit": "score", "name": "audio-fft", "value": 89.1}, {"lowerIsBetter": true, "replicates": [94.0, 93.0, 137.0, 95.0, 95.0, 95.0, 146.0, 94.0, 93.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 108.5}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.1}, {"lowerIsBetter": true, "replicates": [145.0, 146.0, 145.0, 144.0, 146.0, 145.0, 145.0, 145.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.1}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.9}, {"lowerIsBetter": true, "replicates": [58.0, 58.0, 59.0, 57.0, 57.0, 58.0, 61.0, 66.0, 57.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 58.7}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 68.0, 68.0, 68.0, 69.0, 68.0, 68.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.1}, {"lowerIsBetter": true, "replicates": [81.0, 82.0, 81.0, 81.0, 80.0, 81.0, 83.0, 82.0, 81.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.3}, {"lowerIsBetter": true, "replicates": [115.0, 118.0, 117.0, 131.0, 116.0, 117.0, 116.0, 128.0, 115.0, 120.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.3}, {"lowerIsBetter": true, "replicates": [151.0, 143.0, 153.0, 141.0, 150.0, 149.0, 150.0, 150.0, 150.0, 149.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 148.6}, {"lowerIsBetter": true, "replicates": [68.0, 70.0, 70.0, 68.0, 68.0, 68.0, 67.0, 79.0, 67.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.2}], "name": "kraken", "value": 1519.6999999999998}]} 03:28:40 INFO - Return code: 0 03:28:40 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 03:28:40 ERROR - # TBPL SUCCESS # 03:28:40 INFO - Running post-action listener: _resource_record_post_action 03:28:40 INFO - Running post-run listener: _resource_record_post_run 03:28:42 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 0; Write bytes: 535961600; Read time: 0; Write time: 520996 03:28:42 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 246628352; Read time: 0; Write time: 345220 03:28:42 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 288731136; Read time: 0; Write time: 174868 03:28:42 INFO - Running post-run listener: _upload_blobber_files 03:28:42 INFO - Blob upload gear active. 03:28:42 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 03:28:42 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:28:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 03:28:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 03:28:42 INFO - (blobuploader) - INFO - Open directory for files ... 03:28:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:28:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:28:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:28:43 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:28:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:28:43 INFO - (blobuploader) - INFO - Done attempting. 03:28:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 03:28:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:28:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:28:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:28:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:28:44 INFO - (blobuploader) - INFO - Done attempting. 03:28:44 INFO - (blobuploader) - INFO - Iteration through files over. 03:28:44 INFO - Return code: 0 03:28:44 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 03:28:44 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 03:28:44 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/cd5b232738a3fcd5d3325f8b949ed4dc5b706c42b356cdb7e662d422fc5a12f737b7ce97877ad4c395eed6f97fd2243345bea6536bbe8506553768c74380859a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/672249200482aed2a6f3b8a544ece216dae1e8cd6c831f368405ae4cc267222a30bff7850511525451da82107fd9b0b7976070b688d0ceaf436ba91e6b73759b"} 03:28:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 03:28:44 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 03:28:44 INFO - Contents: 03:28:44 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/cd5b232738a3fcd5d3325f8b949ed4dc5b706c42b356cdb7e662d422fc5a12f737b7ce97877ad4c395eed6f97fd2243345bea6536bbe8506553768c74380859a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/672249200482aed2a6f3b8a544ece216dae1e8cd6c831f368405ae4cc267222a30bff7850511525451da82107fd9b0b7976070b688d0ceaf436ba91e6b73759b"} 03:28:44 INFO - Running post-run listener: copy_logs_to_upload_dir 03:28:44 INFO - Copying logs to upload dir... 03:28:44 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 03:28:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.776494 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-03-18 03:28:43.970042) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-18 03:28:43.973359) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/cd5b232738a3fcd5d3325f8b949ed4dc5b706c42b356cdb7e662d422fc5a12f737b7ce97877ad4c395eed6f97fd2243345bea6536bbe8506553768c74380859a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/672249200482aed2a6f3b8a544ece216dae1e8cd6c831f368405ae4cc267222a30bff7850511525451da82107fd9b0b7976070b688d0ceaf436ba91e6b73759b"} build_url:https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011491 build_url: 'https://queue.taskcluster.net/v1/task/RG-iqSbpSnSPERc-vncZ9w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/cd5b232738a3fcd5d3325f8b949ed4dc5b706c42b356cdb7e662d422fc5a12f737b7ce97877ad4c395eed6f97fd2243345bea6536bbe8506553768c74380859a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/672249200482aed2a6f3b8a544ece216dae1e8cd6c831f368405ae4cc267222a30bff7850511525451da82107fd9b0b7976070b688d0ceaf436ba91e6b73759b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-18 03:28:44.002578) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:28:44.003337) ========= 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=a0d2d2de893abaa8702a9954000001a7-1458295691.605836-595872422 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004511 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-18 03:28:44.084801) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-18 03:28:44.085545) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-18 03:28:44.086232) ========= ========= Total master_lag: 0.27 =========