builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-026 starttime: 1447384712.72 results: success (0) buildid: 20151112173006 builduid: 1cc0c6b078da43e3804230546373901b revision: 0c648a1efbe06b5ec866ba058d18256b80808b46 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.715984) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.716372) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.716648) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.009028 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.740270) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.740544) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.763972) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.764264) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004623 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.819742) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.819996) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.820335) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:32.820601) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-12 19:18:34-- 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% 222M=0s 2015-11-12 19:18:34 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.186001 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.018275) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.018599) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018323 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.068010) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.068326) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 0c648a1efbe06b5ec866ba058d18256b80808b46 --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/fx-team --rev 0c648a1efbe06b5ec866ba058d18256b80808b46 --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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-12 19:18:34,506 truncating revision to first 12 chars 2015-11-12 19:18:34,506 Setting DEBUG logging. 2015-11-12 19:18:34,506 attempt 1/10 2015-11-12 19:18:34,506 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/0c648a1efbe0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-12 19:18:34,734 unpacking tar archive at: fx-team-0c648a1efbe0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.497492 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.578427) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.578712) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.585943) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.586210) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-12 19:18:33.586573) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2015-11-12 19:18:33.586852) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:18:35 INFO - MultiFileLogger online at 20151112 19:18:35 in /builds/slave/test-pgo 19:18:35 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 19:18:35 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 19:18:35 INFO - {'append_to_log': False, 19:18:35 INFO - 'base_work_dir': '/builds/slave/test-pgo', 19:18:35 INFO - 'blob_upload_branch': 'Fx-Team', 19:18:35 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 19:18:35 INFO - 'branch': 'Fx-Team', 19:18:35 INFO - 'buildbot_json_path': 'buildprops.json', 19:18:35 INFO - 'config_files': ('talos/linux_config.py',), 19:18:35 INFO - 'default_actions': ('clobber', 19:18:35 INFO - 'read-buildbot-config', 19:18:35 INFO - 'download-and-extract', 19:18:35 INFO - 'populate-webroot', 19:18:35 INFO - 'create-virtualenv', 19:18:35 INFO - 'install', 19:18:35 INFO - 'run-tests'), 19:18:35 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:18:35 INFO - 'download_minidump_stackwalk': True, 19:18:35 INFO - 'download_symbols': 'ondemand', 19:18:35 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:18:35 INFO - 'tooltool.py': '/tools/tooltool.py', 19:18:35 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:18:35 INFO - '/tools/misc-python/virtualenv.py')}, 19:18:35 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:18:35 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:18:35 INFO - 'installer_path': 'installer.exe', 19:18:35 INFO - 'log_level': 'info', 19:18:35 INFO - 'log_name': 'talos', 19:18:35 INFO - 'log_to_console': True, 19:18:35 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:18:35 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:18:35 INFO - 'opt_config_files': (), 19:18:35 INFO - 'pip_index': False, 19:18:35 INFO - 'sps_profile': False, 19:18:35 INFO - 'sps_profile_interval': 0, 19:18:35 INFO - 'suite': 'dromaeojs', 19:18:35 INFO - 'system_bits': '64', 19:18:35 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:18:35 INFO - 'title': 'talos-linux64-ix-026', 19:18:35 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:18:35 INFO - 'use_talos_json': True, 19:18:35 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 19:18:35 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:18:35 INFO - 'work_dir': 'build'} 19:18:35 INFO - ##### 19:18:35 INFO - ##### Running clobber step. 19:18:35 INFO - ##### 19:18:35 INFO - Running pre-action listener: _resource_record_pre_action 19:18:35 INFO - Running main action method: clobber 19:18:35 INFO - rmtree: /builds/slave/test-pgo/build 19:18:35 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 19:18:35 INFO - Running post-action listener: _resource_record_post_action 19:18:35 INFO - ##### 19:18:35 INFO - ##### Running read-buildbot-config step. 19:18:35 INFO - ##### 19:18:35 INFO - Running pre-action listener: _resource_record_pre_action 19:18:35 INFO - Running main action method: read_buildbot_config 19:18:35 INFO - Using buildbot properties: 19:18:35 INFO - { 19:18:35 INFO - "properties": { 19:18:35 INFO - "buildnumber": 482, 19:18:35 INFO - "product": "firefox", 19:18:35 INFO - "script_repo_revision": "production", 19:18:35 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 19:18:35 INFO - "repository": "", 19:18:35 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 19:18:35 INFO - "buildid": "20151112173006", 19:18:35 INFO - "slavename": "talos-linux64-ix-026", 19:18:35 INFO - "pgo_build": "True", 19:18:35 INFO - "basedir": "/builds/slave/test-pgo", 19:18:35 INFO - "project": "", 19:18:35 INFO - "platform": "ubuntu64_hw", 19:18:35 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 19:18:35 INFO - "slavebuilddir": "test", 19:18:35 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 19:18:35 INFO - "branch": "fx-team", 19:18:35 INFO - "repo_path": "integration/fx-team", 19:18:35 INFO - "stage_platform": "linux64-pgo", 19:18:35 INFO - "builduid": "1cc0c6b078da43e3804230546373901b", 19:18:35 INFO - "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46" 19:18:35 INFO - }, 19:18:35 INFO - "sourcestamp": { 19:18:35 INFO - "repository": "", 19:18:35 INFO - "hasPatch": false, 19:18:35 INFO - "project": "", 19:18:35 INFO - "branch": "fx-team-linux64-pgo-talos", 19:18:35 INFO - "changes": [ 19:18:35 INFO - { 19:18:35 INFO - "category": null, 19:18:35 INFO - "files": [ 19:18:35 INFO - { 19:18:35 INFO - "url": null, 19:18:35 INFO - "name": "https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 19:18:35 INFO - } 19:18:35 INFO - ], 19:18:35 INFO - "repository": "", 19:18:35 INFO - "rev": "0c648a1efbe06b5ec866ba058d18256b80808b46", 19:18:35 INFO - "who": "sendchange", 19:18:35 INFO - "when": 1447384687, 19:18:35 INFO - "number": 6656087, 19:18:35 INFO - "comments": "", 19:18:35 INFO - "project": "", 19:18:35 INFO - "at": "Thu 12 Nov 2015 19:18:07", 19:18:35 INFO - "branch": "fx-team-linux64-pgo-talos", 19:18:35 INFO - "revlink": "", 19:18:35 INFO - "properties": [ 19:18:35 INFO - [ 19:18:35 INFO - "buildid", 19:18:35 INFO - "20151112173006", 19:18:35 INFO - "Change" 19:18:35 INFO - ], 19:18:35 INFO - [ 19:18:35 INFO - "builduid", 19:18:35 INFO - "1cc0c6b078da43e3804230546373901b", 19:18:35 INFO - "Change" 19:18:35 INFO - ], 19:18:35 INFO - [ 19:18:35 INFO - "pgo_build", 19:18:35 INFO - "True", 19:18:35 INFO - "Change" 19:18:35 INFO - ] 19:18:35 INFO - ], 19:18:35 INFO - "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46" 19:18:35 INFO - } 19:18:35 INFO - ], 19:18:35 INFO - "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46" 19:18:35 INFO - } 19:18:35 INFO - } 19:18:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 19:18:35 INFO - Running post-action listener: _resource_record_post_action 19:18:35 INFO - ##### 19:18:35 INFO - ##### Running download-and-extract step. 19:18:35 INFO - ##### 19:18:35 INFO - Running pre-action listener: _resource_record_pre_action 19:18:35 INFO - Running main action method: download_and_extract 19:18:35 INFO - mkdir: /builds/slave/test-pgo/build/tests 19:18:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:35 INFO - https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:18:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/test_packages.json 19:18:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/test_packages.json 19:18:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 19:18:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 19:18:38 INFO - Downloaded 1302 bytes. 19:18:38 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 19:18:38 INFO - Using the following test package requirements: 19:18:38 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:18:38 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:18:38 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'jsshell-linux-x86_64.zip'], 19:18:38 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:18:38 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:18:38 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:18:38 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:18:38 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:18:38 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:18:38 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:18:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:18:38 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:18:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:38 INFO - https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:18:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:18:40 INFO - Downloaded 22443766 bytes. 19:18:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:18:40 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:40 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:18:41 INFO - Return code: 0 19:18:41 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 19:18:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:41 INFO - https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:18:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:18:45 INFO - Downloaded 22443766 bytes. 19:18:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:18:45 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:18:45 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:18:47 INFO - Return code: 0 19:18:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:47 INFO - https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:18:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:18:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:18:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:18:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:18:47 INFO - Downloaded 11131693 bytes. 19:18:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 19:18:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:18:47 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 19:18:48 INFO - Return code: 0 19:18:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:48 INFO - https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:18:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:18:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:18:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:18:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:18:49 INFO - Downloaded 57158325 bytes. 19:18:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:18:49 INFO - mkdir: /builds/slave/test-pgo/properties 19:18:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 19:18:49 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 19:18:49 INFO - Contents: 19:18:49 INFO - build_url:https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:18:49 INFO - Running post-action listener: _resource_record_post_action 19:18:49 INFO - Running post-action listener: set_extra_try_arguments 19:18:49 INFO - ##### 19:18:49 INFO - ##### Running populate-webroot step. 19:18:49 INFO - ##### 19:18:49 INFO - Running pre-action listener: _resource_record_pre_action 19:18:49 INFO - Running main action method: populate_webroot 19:18:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:18:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:18:49 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 19:18:49 INFO - '../fennec_ids.txt'], 19:18:49 INFO - 'tests': ['tcheck2']}, 19:18:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:18:49 INFO - '--tppagecycles', 19:18:49 INFO - '7'], 19:18:49 INFO - 'tests': ['tsvgm']}}, 19:18:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:18:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:18:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:18:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:18:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:18:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:18:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'tests': ['damp', 'tps']}, 19:18:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['damp', 'tps']}, 19:18:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:18:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:18:49 INFO - 'other': {'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'other_l64': {'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'other_nol64': {'tests': ['a11yr', 19:18:49 INFO - 'ts_paint', 19:18:49 INFO - 'tpaint', 19:18:49 INFO - 'sessionrestore', 19:18:49 INFO - 'sessionrestore_no_auto_restore']}, 19:18:49 INFO - 'svgr': {'tests': ['tsvgx', 19:18:49 INFO - 'tsvgr_opacity', 19:18:49 INFO - 'tart', 19:18:49 INFO - 'tscrollx', 19:18:49 INFO - 'cart']}, 19:18:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['tsvgx', 19:18:49 INFO - 'tsvgr_opacity', 19:18:49 INFO - 'tart', 19:18:49 INFO - 'tscrollx', 19:18:49 INFO - 'cart']}, 19:18:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'tests': ['tp5o']}, 19:18:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'talos_options': ['--e10s'], 19:18:49 INFO - 'tests': ['tp5o']}, 19:18:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'talos_options': ['--xperf_path', 19:18:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:18:49 INFO - 'tests': ['tp5n']}, 19:18:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:18:49 INFO - 'talos_options': ['--e10s', 19:18:49 INFO - '--xperf_path', 19:18:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:18:49 INFO - 'tests': ['tp5n']}}, 19:18:49 INFO - 'talos.zip': {'path': '', 19:18:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:18:49 INFO - Running post-action listener: _resource_record_post_action 19:18:49 INFO - ##### 19:18:49 INFO - ##### Running create-virtualenv step. 19:18:49 INFO - ##### 19:18:49 INFO - Running pre-action listener: _resource_record_pre_action 19:18:49 INFO - Running main action method: create_virtualenv 19:18:49 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 19:18:49 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 19:18:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 19:18:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:18:49 INFO - Using real prefix '/usr' 19:18:49 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 19:18:50 INFO - Installing distribute.............................................................................................................................................................................................done. 19:18:52 INFO - Installing pip.................done. 19:18:52 INFO - Return code: 0 19:18:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 19:18:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:18:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 19:18:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:18:52 INFO - Using env: {'DISPLAY': ':0', 19:18:52 INFO - 'HOME': '/home/cltbld', 19:18:52 INFO - 'LANG': 'en_US.UTF-8', 19:18:52 INFO - 'LANGUAGE': 'en_US:en', 19:18:52 INFO - 'LOGNAME': 'cltbld', 19:18:52 INFO - 'MAIL': '/var/mail/cltbld', 19:18:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:52 INFO - 'MOZ_NO_REMOTE': '1', 19:18:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:52 INFO - 'NO_EM_RESTART': '1', 19:18:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:18:52 INFO - 'PWD': '/builds/slave/test-pgo', 19:18:52 INFO - 'SHELL': '/bin/bash', 19:18:52 INFO - 'SHLVL': '1', 19:18:52 INFO - 'TERM': 'linux', 19:18:52 INFO - 'TMOUT': '86400', 19:18:52 INFO - 'USER': 'cltbld', 19:18:52 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:18:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:52 INFO - '_': '/tools/buildbot/bin/python'} 19:18:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:52 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 19:18:52 INFO - Cleaning up... 19:18:52 INFO - Return code: 0 19:18:52 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 19:18:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:18:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 19:18:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 19:18:52 INFO - Using env: {'DISPLAY': ':0', 19:18:52 INFO - 'HOME': '/home/cltbld', 19:18:52 INFO - 'LANG': 'en_US.UTF-8', 19:18:52 INFO - 'LANGUAGE': 'en_US:en', 19:18:52 INFO - 'LOGNAME': 'cltbld', 19:18:52 INFO - 'MAIL': '/var/mail/cltbld', 19:18:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:52 INFO - 'MOZ_NO_REMOTE': '1', 19:18:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:52 INFO - 'NO_EM_RESTART': '1', 19:18:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:18:52 INFO - 'PWD': '/builds/slave/test-pgo', 19:18:52 INFO - 'SHELL': '/bin/bash', 19:18:52 INFO - 'SHLVL': '1', 19:18:52 INFO - 'TERM': 'linux', 19:18:52 INFO - 'TMOUT': '86400', 19:18:52 INFO - 'USER': 'cltbld', 19:18:52 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:18:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:52 INFO - '_': '/tools/buildbot/bin/python'} 19:18:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:52 INFO - Downloading/unpacking psutil>=0.7.1 19:18:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:54 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 19:18:54 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:18:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 19:18:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:18:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:18:54 INFO - Installing collected packages: psutil 19:18:54 INFO - Running setup.py install for psutil 19:18:54 INFO - building 'psutil._psutil_linux' extension 19:18:54 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 19:18:54 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 19:18:54 INFO - building 'psutil._psutil_posix' extension 19:18:54 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 19:18:54 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 19:18:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:18:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:18:54 INFO - Successfully installed psutil 19:18:54 INFO - Cleaning up... 19:18:54 INFO - Return code: 0 19:18:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 19:18:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:18:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 19:18:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 19:18:54 INFO - Using env: {'DISPLAY': ':0', 19:18:54 INFO - 'HOME': '/home/cltbld', 19:18:54 INFO - 'LANG': 'en_US.UTF-8', 19:18:54 INFO - 'LANGUAGE': 'en_US:en', 19:18:54 INFO - 'LOGNAME': 'cltbld', 19:18:54 INFO - 'MAIL': '/var/mail/cltbld', 19:18:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:54 INFO - 'MOZ_NO_REMOTE': '1', 19:18:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:54 INFO - 'NO_EM_RESTART': '1', 19:18:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:18:54 INFO - 'PWD': '/builds/slave/test-pgo', 19:18:54 INFO - 'SHELL': '/bin/bash', 19:18:54 INFO - 'SHLVL': '1', 19:18:54 INFO - 'TERM': 'linux', 19:18:54 INFO - 'TMOUT': '86400', 19:18:54 INFO - 'USER': 'cltbld', 19:18:54 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:18:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:54 INFO - '_': '/tools/buildbot/bin/python'} 19:18:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:55 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:18:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:18:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:18:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:18:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:18:57 INFO - Installing collected packages: mozsystemmonitor 19:18:57 INFO - Running setup.py install for mozsystemmonitor 19:18:57 INFO - Successfully installed mozsystemmonitor 19:18:57 INFO - Cleaning up... 19:18:57 INFO - Return code: 0 19:18:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 19:18:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:18:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:18:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 19:18:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 19:18:57 INFO - Using env: {'DISPLAY': ':0', 19:18:57 INFO - 'HOME': '/home/cltbld', 19:18:57 INFO - 'LANG': 'en_US.UTF-8', 19:18:57 INFO - 'LANGUAGE': 'en_US:en', 19:18:57 INFO - 'LOGNAME': 'cltbld', 19:18:57 INFO - 'MAIL': '/var/mail/cltbld', 19:18:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:57 INFO - 'MOZ_NO_REMOTE': '1', 19:18:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:57 INFO - 'NO_EM_RESTART': '1', 19:18:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:18:57 INFO - 'PWD': '/builds/slave/test-pgo', 19:18:57 INFO - 'SHELL': '/bin/bash', 19:18:57 INFO - 'SHLVL': '1', 19:18:57 INFO - 'TERM': 'linux', 19:18:57 INFO - 'TMOUT': '86400', 19:18:57 INFO - 'USER': 'cltbld', 19:18:57 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:18:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:57 INFO - '_': '/tools/buildbot/bin/python'} 19:18:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:57 INFO - Downloading/unpacking blobuploader==1.2.4 19:18:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:59 INFO - Downloading blobuploader-1.2.4.tar.gz 19:18:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:18:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:18:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:18:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:18:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 19:18:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:18:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:59 INFO - Downloading docopt-0.6.1.tar.gz 19:18:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:18:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 19:18:59 INFO - Installing collected packages: blobuploader, requests, docopt 19:18:59 INFO - Running setup.py install for blobuploader 19:18:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:18:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 19:18:59 INFO - Running setup.py install for requests 19:19:00 INFO - Running setup.py install for docopt 19:19:00 INFO - Successfully installed blobuploader requests docopt 19:19:00 INFO - Cleaning up... 19:19:00 INFO - Return code: 0 19:19:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:19:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:19:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:19:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:19:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 19:19:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:19:00 INFO - Using env: {'DISPLAY': ':0', 19:19:00 INFO - 'HOME': '/home/cltbld', 19:19:00 INFO - 'LANG': 'en_US.UTF-8', 19:19:00 INFO - 'LANGUAGE': 'en_US:en', 19:19:00 INFO - 'LOGNAME': 'cltbld', 19:19:00 INFO - 'MAIL': '/var/mail/cltbld', 19:19:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:19:00 INFO - 'MOZ_NO_REMOTE': '1', 19:19:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:19:00 INFO - 'NO_EM_RESTART': '1', 19:19:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:19:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:19:00 INFO - 'PWD': '/builds/slave/test-pgo', 19:19:00 INFO - 'SHELL': '/bin/bash', 19:19:00 INFO - 'SHLVL': '1', 19:19:00 INFO - 'TERM': 'linux', 19:19:00 INFO - 'TMOUT': '86400', 19:19:00 INFO - 'USER': 'cltbld', 19:19:00 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:19:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:19:00 INFO - '_': '/tools/buildbot/bin/python'} 19:19:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:19:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:19:00 INFO - Running setup.py (path:/tmp/pip-7S0bmc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:19:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:19:00 INFO - Running setup.py (path:/tmp/pip-cd1wCw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:19:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:19:00 INFO - Running setup.py (path:/tmp/pip-Z4Pnys-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:19:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:19:00 INFO - Running setup.py (path:/tmp/pip-_8xRwT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:19:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:19:00 INFO - Running setup.py (path:/tmp/pip-HVktje-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:19:01 INFO - Running setup.py (path:/tmp/pip-HLoqpv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:19:01 INFO - Running setup.py (path:/tmp/pip-NDh1GI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:19:01 INFO - Running setup.py (path:/tmp/pip-3hqufQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:19:01 INFO - Running setup.py (path:/tmp/pip-zq9SjT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:19:01 INFO - Running setup.py (path:/tmp/pip-TKZddD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:19:01 INFO - Running setup.py (path:/tmp/pip-WHFqfK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:19:01 INFO - Running setup.py (path:/tmp/pip-SF5Lij-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:19:01 INFO - Running setup.py (path:/tmp/pip-wH7_Wu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:19:01 INFO - Running setup.py (path:/tmp/pip-GbTFlq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:19:01 INFO - Running setup.py (path:/tmp/pip-7nW4PU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:19:01 INFO - Running setup.py (path:/tmp/pip-FcboX2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:19:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:19:01 INFO - Running setup.py (path:/tmp/pip-r6Wpmr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:19:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:19:01 INFO - Running setup.py install for manifestparser 19:19:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 19:19:01 INFO - Running setup.py install for mozcrash 19:19:02 INFO - Running setup.py install for mozdebug 19:19:02 INFO - Running setup.py install for mozdevice 19:19:02 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Running setup.py install for mozfile 19:19:02 INFO - Running setup.py install for mozhttpd 19:19:02 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Running setup.py install for mozinfo 19:19:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Running setup.py install for mozInstall 19:19:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Running setup.py install for mozleak 19:19:02 INFO - Running setup.py install for mozlog 19:19:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 19:19:02 INFO - Running setup.py install for moznetwork 19:19:03 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Running setup.py install for mozprocess 19:19:03 INFO - Running setup.py install for mozprofile 19:19:03 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Running setup.py install for mozrunner 19:19:03 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Running setup.py install for mozscreenshot 19:19:03 INFO - Running setup.py install for moztest 19:19:03 INFO - Running setup.py install for mozversion 19:19:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 19:19:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:19:03 INFO - Cleaning up... 19:19:03 INFO - Return code: 0 19:19:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:19:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:19:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:03 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:19:03 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 19:19:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:19:03 INFO - Using env: {'DISPLAY': ':0', 19:19:03 INFO - 'HOME': '/home/cltbld', 19:19:03 INFO - 'LANG': 'en_US.UTF-8', 19:19:03 INFO - 'LANGUAGE': 'en_US:en', 19:19:03 INFO - 'LOGNAME': 'cltbld', 19:19:03 INFO - 'MAIL': '/var/mail/cltbld', 19:19:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:19:03 INFO - 'MOZ_NO_REMOTE': '1', 19:19:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:19:03 INFO - 'NO_EM_RESTART': '1', 19:19:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:19:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:19:03 INFO - 'PWD': '/builds/slave/test-pgo', 19:19:03 INFO - 'SHELL': '/bin/bash', 19:19:03 INFO - 'SHLVL': '1', 19:19:03 INFO - 'TERM': 'linux', 19:19:03 INFO - 'TMOUT': '86400', 19:19:03 INFO - 'USER': 'cltbld', 19:19:03 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:19:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:19:03 INFO - '_': '/tools/buildbot/bin/python'} 19:19:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:19:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:19:03 INFO - Running setup.py (path:/tmp/pip-NZepBL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:19:03 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 19:19:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:19:03 INFO - Running setup.py (path:/tmp/pip-BpWgYU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:19:04 INFO - Running setup.py (path:/tmp/pip-hLpsCF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:19:04 INFO - Running setup.py (path:/tmp/pip-amtLcv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:19:04 INFO - Running setup.py (path:/tmp/pip-tYicqJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:19:04 INFO - Running setup.py (path:/tmp/pip-Biv80l-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:19:04 INFO - Running setup.py (path:/tmp/pip-3nSdoL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:19:04 INFO - Running setup.py (path:/tmp/pip-gLjH01-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:19:04 INFO - Running setup.py (path:/tmp/pip-8uhCOV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:19:04 INFO - Running setup.py (path:/tmp/pip-UQtIWF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:19:04 INFO - Running setup.py (path:/tmp/pip-bXhUs4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:19:04 INFO - Running setup.py (path:/tmp/pip-D8PPup-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:19:04 INFO - Running setup.py (path:/tmp/pip-NTzPu3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:19:04 INFO - Running setup.py (path:/tmp/pip-lDB1GD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:19:04 INFO - Running setup.py (path:/tmp/pip-lv8LhV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:19:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 19:19:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:19:04 INFO - Running setup.py (path:/tmp/pip-Vce26O-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 19:19:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:19:05 INFO - Running setup.py (path:/tmp/pip-pWEySZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:19:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:19:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:19:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:19:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:19:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:19:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:19:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:19:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:19:06 INFO - Downloading blessings-1.5.1.tar.gz 19:19:06 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 19:19:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 19:19:06 INFO - Installing collected packages: blessings 19:19:06 INFO - Running setup.py install for blessings 19:19:06 INFO - Successfully installed blessings 19:19:06 INFO - Cleaning up... 19:19:07 INFO - Return code: 0 19:19:07 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 19:19:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:19:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:19:07 INFO - Reading from file tmpfile_stdout 19:19:07 INFO - Current package versions: 19:19:07 INFO - argparse == 1.2.1 19:19:07 INFO - blessings == 1.5.1 19:19:07 INFO - blobuploader == 1.2.4 19:19:07 INFO - docopt == 0.6.1 19:19:07 INFO - manifestparser == 1.1 19:19:07 INFO - mozInstall == 1.12 19:19:07 INFO - mozcrash == 0.16 19:19:07 INFO - mozdebug == 0.1 19:19:07 INFO - mozdevice == 0.47 19:19:07 INFO - mozfile == 1.2 19:19:07 INFO - mozhttpd == 0.7 19:19:07 INFO - mozinfo == 0.9 19:19:07 INFO - mozleak == 0.1 19:19:07 INFO - mozlog == 3.0 19:19:07 INFO - moznetwork == 0.27 19:19:07 INFO - mozprocess == 0.22 19:19:07 INFO - mozprofile == 0.27 19:19:07 INFO - mozrunner == 6.11 19:19:07 INFO - mozscreenshot == 0.1 19:19:07 INFO - mozsystemmonitor == 0.0 19:19:07 INFO - moztest == 0.7 19:19:07 INFO - mozversion == 1.4 19:19:07 INFO - psutil == 3.1.1 19:19:07 INFO - requests == 1.2.3 19:19:07 INFO - wsgiref == 0.1.2 19:19:07 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:19:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:19:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:19:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:19:07 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/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 0x7fa512eb7c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aac6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b6d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, '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': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:19:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 19:19:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:19:07 INFO - Using env: {'DISPLAY': ':0', 19:19:07 INFO - 'HOME': '/home/cltbld', 19:19:07 INFO - 'LANG': 'en_US.UTF-8', 19:19:07 INFO - 'LANGUAGE': 'en_US:en', 19:19:07 INFO - 'LOGNAME': 'cltbld', 19:19:07 INFO - 'MAIL': '/var/mail/cltbld', 19:19:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:19:07 INFO - 'MOZ_NO_REMOTE': '1', 19:19:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:19:07 INFO - 'NO_EM_RESTART': '1', 19:19:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:19:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:19:07 INFO - 'PWD': '/builds/slave/test-pgo', 19:19:07 INFO - 'SHELL': '/bin/bash', 19:19:07 INFO - 'SHLVL': '1', 19:19:07 INFO - 'TERM': 'linux', 19:19:07 INFO - 'TMOUT': '86400', 19:19:07 INFO - 'USER': 'cltbld', 19:19:07 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:19:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:19:07 INFO - '_': '/tools/buildbot/bin/python'} 19:19:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 19:19:07 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:19:07 INFO - Cleaning up... 19:19:07 INFO - Return code: 0 19:19:07 INFO - Running post-action listener: _resource_record_post_action 19:19:07 INFO - Running post-action listener: _start_resource_monitoring 19:19:07 INFO - Starting resource monitoring. 19:19:07 INFO - ##### 19:19:07 INFO - ##### Running install step. 19:19:07 INFO - ##### 19:19:07 INFO - Running pre-action listener: _resource_record_pre_action 19:19:07 INFO - Running main action method: install 19:19:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:19:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:19:07 INFO - Reading from file tmpfile_stdout 19:19:07 INFO - Detecting whether we're running mozinstall >=1.0... 19:19:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 19:19:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 19:19:07 INFO - Reading from file tmpfile_stdout 19:19:07 INFO - Output received: 19:19:07 INFO - Usage: mozinstall [options] installer 19:19:07 INFO - Options: 19:19:07 INFO - -h, --help show this help message and exit 19:19:07 INFO - -d DEST, --destination=DEST 19:19:07 INFO - Directory to install application into. [default: 19:19:07 INFO - "/builds/slave/test-pgo"] 19:19:07 INFO - --app=APP Application being installed. [default: firefox] 19:19:07 INFO - mkdir: /builds/slave/test-pgo/build/application 19:19:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 19:19:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 19:19:22 INFO - Reading from file tmpfile_stdout 19:19:22 INFO - Output received: 19:19:22 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 19:19:22 INFO - Running post-action listener: _resource_record_post_action 19:19:22 INFO - ##### 19:19:22 INFO - ##### Running run-tests step. 19:19:22 INFO - ##### 19:19:22 INFO - Running pre-action listener: _resource_record_pre_action 19:19:22 INFO - Running main action method: run_tests 19:19:22 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 19:19:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 19:19:22 INFO - Python 2.7.3 19:19:22 INFO - Return code: 0 19:19:22 INFO - grabbing minidump binary from tooltool 19:19:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:19:22 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 0x1bf68c0>, '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 0x1ba3420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ba38b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 19:19:22 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 19:19:22 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 19:19:22 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:19:22 INFO - Return code: 0 19:19:22 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 19:19:22 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 19:19:22 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 19:19:22 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 19:19:22 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 19:19:22 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-026', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 19:19:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-026 --webServer localhost 19:19:22 INFO - Using env: {'DISPLAY': ':0', 19:19:22 INFO - 'HOME': '/home/cltbld', 19:19:22 INFO - 'LANG': 'en_US.UTF-8', 19:19:22 INFO - 'LANGUAGE': 'en_US:en', 19:19:22 INFO - 'LOGNAME': 'cltbld', 19:19:22 INFO - 'MAIL': '/var/mail/cltbld', 19:19:22 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:19:22 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 19:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:19:22 INFO - 'MOZ_NO_REMOTE': '1', 19:19:22 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:19:22 INFO - 'NO_EM_RESTART': '1', 19:19:22 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:19:22 INFO - 'PWD': '/builds/slave/test-pgo', 19:19:22 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 19:19:22 INFO - 'SHELL': '/bin/bash', 19:19:22 INFO - 'SHLVL': '1', 19:19:22 INFO - 'TERM': 'linux', 19:19:22 INFO - 'TMOUT': '86400', 19:19:22 INFO - 'USER': 'cltbld', 19:19:22 INFO - 'XDG_SESSION_COOKIE': 'a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481', 19:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:19:22 INFO - '_': '/tools/buildbot/bin/python'} 19:19:22 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-026', '--webServer', 'localhost'] with output_timeout 3600 19:19:22 INFO - mozversion INFO | application_buildid: 20151112173006 19:19:22 INFO - mozversion INFO | application_changeset: 0c648a1efbe06b5ec866ba058d18256b80808b46 19:19:22 INFO - mozversion INFO | application_display_name: Nightly 19:19:22 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:19:22 INFO - mozversion INFO | application_name: Firefox 19:19:22 INFO - mozversion INFO | application_remotingname: firefox 19:19:22 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 19:19:22 INFO - mozversion INFO | application_vendor: Mozilla 19:19:22 INFO - mozversion INFO | application_version: 45.0a1 19:19:22 INFO - mozversion INFO | platform_buildid: 20151112173006 19:19:22 INFO - mozversion INFO | platform_changeset: 0c648a1efbe06b5ec866ba058d18256b80808b46 19:19:22 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 19:19:22 INFO - mozversion INFO | platform_version: 45.0a1 19:19:22 INFO - 2015-11-12 19:19:22,499 DEBUG : using testdate: 1447384762 19:19:22 INFO - 2015-11-12 19:19:22,499 DEBUG : actual date: 1447384762 19:19:22 INFO - 2015-11-12 19:19:22,509 INFO : starting webserver on 'localhost:51877' 19:19:22 INFO - 2015-11-12 19:19:22,510 INFO : Starting test suite talos-linux64-ix-026 19:19:22 INFO - 2015-11-12 19:19:22,510 INFO : Starting test dromaeo_css 19:19:22 INFO - 2015-11-12 19:19:22,510 DEBUG : operating with platform_type : linux_ 19:19:22 INFO - 2015-11-12 19:19:22,511 INFO : Initialising browser for dromaeo_css test... 19:19:22 INFO - 2015-11-12 19:19:22,524 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpNCf8vY/profile http://localhost:51877/getInfo.html 19:19:27 INFO - 2015-11-12 19:19:27,114 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:19:27 INFO - 2015-11-12 19:19:27,114 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:19:27 INFO - 2015-11-12 19:19:27,115 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 19:19:27 INFO - 2015-11-12 19:19:27,115 DEBUG : BROWSER_OUTPUT: __metrics 19:19:27 INFO - 2015-11-12 19:19:27,292 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:19:28 INFO - 2015-11-12 19:19:28,545 INFO : Browser initialized. 19:19:28 INFO - 2015-11-12 19:19:28,546 INFO : Running cycle 1/1 for dromaeo_css test... 19:19:28 INFO - 2015-11-12 19:19:28,546 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpNCf8vY/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:19:40 INFO - 2015-11-12 19:19:40,304 DEBUG : BROWSER_OUTPUT: RSS: Main: 141398016 19:19:40 INFO - 2015-11-12 19:19:40,304 DEBUG : BROWSER_OUTPUT: 19:20:31 INFO - 2015-11-12 19:20:31,892 DEBUG : BROWSER_OUTPUT: 1447384831885 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 19:22:40 INFO - 2015-11-12 19:22:40,486 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51877/tests/dromaeo/cssquery-ext.html) 19:22:41 INFO - 2015-11-12 19:22:41,575 DEBUG : BROWSER_OUTPUT: RSS: Main: 237465600 19:22:41 INFO - 2015-11-12 19:22:41,576 DEBUG : BROWSER_OUTPUT: 19:25:44 INFO - 2015-11-12 19:25:44,016 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-ext.html (next: http://localhost:51877/tests/dromaeo/cssquery-jquery.html) 19:25:44 INFO - 2015-11-12 19:25:44,585 DEBUG : BROWSER_OUTPUT: RSS: Main: 218341376 19:25:44 INFO - 2015-11-12 19:25:44,585 DEBUG : BROWSER_OUTPUT: 19:28:46 INFO - 2015-11-12 19:28:46,522 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51877/tests/dromaeo/cssquery-mootools.html) 19:28:47 INFO - 2015-11-12 19:28:47,092 DEBUG : BROWSER_OUTPUT: RSS: Main: 218767360 19:28:47 INFO - 2015-11-12 19:28:47,092 DEBUG : BROWSER_OUTPUT: 19:31:48 INFO - 2015-11-12 19:31:48,917 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51877/tests/dromaeo/cssquery-prototype.html) 19:31:49 INFO - 2015-11-12 19:31:49,519 DEBUG : BROWSER_OUTPUT: RSS: Main: 198709248 19:31:49 INFO - 2015-11-12 19:31:49,519 DEBUG : BROWSER_OUTPUT: 19:34:51 INFO - 2015-11-12 19:34:51,880 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51877/tests/dromaeo/cssquery-yui.html) 19:34:52 INFO - 2015-11-12 19:34:52,481 DEBUG : BROWSER_OUTPUT: RSS: Main: 203624448 19:34:52 INFO - 2015-11-12 19:34:52,481 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,041 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/dromaeo/cssquery-yui.html (next: http://localhost:51877/tests/dromaeo/cssquery-dojo.html) 19:37:55 INFO - 2015-11-12 19:37:55,291 DEBUG : BROWSER_OUTPUT: RSS: Main: 246296576 19:37:55 INFO - 2015-11-12 19:37:55,291 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,291 DEBUG : BROWSER_OUTPUT: __start_tp_report 19:37:55 INFO - 2015-11-12 19:37:55,291 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 19:37:55 INFO - 2015-11-12 19:37:55,291 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 19:37:55 INFO - 2015-11-12 19:37:55,292 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 19:37:55 INFO - 2015-11-12 19:37:55,292 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3188.442022646037;3263.265765202831;3301.9763873199295;3309.5863017122842;3324.8836290729823;5310.973445132779;5409.188621706746;5479.835604931854;5496.038193316169;5496.148097044959;5411.431799661038;5445.128779395298;5502.284702988606;5507.4767897049815;5516.531094856942;5005.199168133099;5040.143175660138;5092.719900405476;5193.844184674465;5210.010098081371;4959.429665588467;5145;5178.974105129469;5185.662931909433;5217.295665085203;4922.261660750898;4985.401751789772;5019.121653710623;5034.924476132861;5063.291139240509;5024.62315326352;5050.141475949097;5054.3176671149295;5090.236464530313;5138.794448222066;4915.090708218955;5041.773120209599;5050.924236136461;5080.1363768159135;5098.566621837112;5239.109351410231;5279.208118782213;5294.232336311252;5299.33758280215;5344.305240318772;5995.940040599626;5999;6002.909956350658;6005.279366476007;6005.369436209179;5848.210491583624;5990.520758339322;6052.818415447544;6054.545909056838;6075.696215189267;5524.419935906712;5600.60795744294;5601.29983752031;5603.2435621191435;5642.943570564283;6095.3892705671915;6099.237595300588;6103.450689437972;6106.053561697944;6107.206063211843;5781.335146458127;5839.854003649858;5912.201852749824;5968.582199246098;5971.731272092767;5962.284525856839;5963.5825492216;5971.4327138921735;5981.700914954235;6075.605085669417;5928.258967629046;5934.525237980951;5935.52515798735;5945;5954.434328738763;5734.569907256972;5820.708964551755;5862.560307976919;5935.881282374328;5956;4530.343100250445;4542.477615074309;4542.84100056503;4548.977255113703;4573.382593349856;4033.495813023372;4044.6966477513715;4045.0089728016824;4079.7756123412905;4097;5419.376771671229;5470.699111548824;5538.141588053858;5550.056490396642;5589.580781441408;6015.699215039318;6051.939480605226;6056.394360563909;6057.545684073712;6065.969670151621;5445.59158063139;5647.29408823897;5649.887002259932;5658.066419040894;5658.207850900877;4923.679960802537;4958.206686930074;5029.673071250357;5049.015441988777;5086.847394578169;6300.747970081237;6310.432061114522;6312.936870631327;6315.210598675074;6316.842078948063;5823.679697616502;5930.377310382521;6079.452849243589;6095.786647467317;6100.176476175837;6080.665563394055;6160.845978850564;6169.2288463942;6171.9074213887725;6174.876502469836;5924.555658325729;5974.2233509643465;5981.1327357532045;5985.850353741192;6022.277326720821;5743.971280143573;5837.708114594168;5924.733386997682;6068.969655151873;6075.969620152047;5896.852578685567;5918.970405147947;5919.319278283053;5919.437653422918;5930.258717660293;5893.2044174035955;5900.0264956281735;5903.2325797646035;5904.675242861684;5904.763809447574;5577.191307260506;5699.629524080921;5703.486686198262;5730.054541000688;5820.912686309794;5861.560382971379;5876.471117599436;5894.528437724886;5896.056630939029;5908.852278693067;5751.7411716472025;5756.107803290497;5758.798442054675;5772.797952071657;5799.681017544076 19:37:55 INFO - 2015-11-12 19:37:55,293 DEBUG : BROWSER_OUTPUT: |1;ext.html;577.566824881339;622.2004723929751;623.7941479311826;624.2446639566125;669.3373560175424;30243.848780756092;30849.92025279113;30878.691213087863;30879.38241235174;41159.38260926089;42733.145337093316;42887.35668964968;42902;43018.78490607542;43023;8631.697890573816;8751.212390884819;8813.515256660881;8822.161894620032;8832.02847686754;7849.0973538043;8025.077116131662;8586.96956365234;10604.522796474139;10800.081993030602;10612.628558000471;10674.839877401846;10697.679069627924;10702.518386672618;10718.78562428751;7991.520508769434;10553.894461055368;10621;10671.413072281022;10677.1992100592;7851;10693.304935179189;10950.671479855617;10952.561897524089;10958.342499449978;40398.79800600978;40572;40816.183676326305;40862;40897.79551102255;3059.892903748358;3081.0910781319562;3095.5047192449324;3123.031860123369;3155.6844315568487;30472.84763576168;30692.232694182825;31338.37323253522;31934.6806531934;32165;3041.8250950570377;3088.0005569340638;3090.9690903090905;3118.844057797101;3201.119692084672;278729;280125;280163;280342;280408;52600.21099683508;53818;59748.402515975155;60153.097703534484;60185.39814601798;69371.3062869375;70463.64768176126;70841;71000.64499677469;71081.28918710747;15483.303251353716;15501;15510.844891551165;15514.456994005155;15547.533573992798;12723;12755.93622031884;12782.169159004636;12790.29653369055;12813.231206127475;19669.803301967084;19734.210631574577;19898.303559375352;20000.399988000383;20085.196592136443;7852.528848269122;8001.719939802196;8002.159773223728;8033.55815430157;8065;899.8380291547453;964.8745663063756;1012.4330374990029;1030.294248439821;1041.8437234414898;28179.745620350324;28678.13965581036;28712.806953531614;28986.42027159445;29160.70839291622;935.9532023398802;1014.0113389445232;1028.1569113327;1064.8722153341648;1068.3056013591229;13887;14185.361658725382;14365.92817035908;14419.42322307096;14586;345378;350717;351450;351757;351870;51221;51387.22919156215;51403.48596513987;51461.2280815788;51476.22785658218;1322.6693326668333;1327.2700014991715;1327.6415367850818;1332.420397127272;1332.7950316750666;27022.72977270202;27496.58755118715;28168.85915570409;28287.2928176789;28852.42295154127;44672.10655786931;44732;44935.77532112318;44967.32549011833;45083;281868;282441;282471;283798;284250;28854.711452886044;28977.11648742825;29199.416011680074;33004.33991320208;33438.164045899044;37646.42358975893;41938.580614193466;42087.36868947029;42666.5733342675;42960;35657;36023.639763603074;36077.76872353547;36258.093547660465;37143.8142809295;29666;33536;33900.32199356049;34926;35247.647523524436;35232.471512926815;35836.641633584375;36177.819110904275;36419.63580364163;36882.44676329911;29767.702322976493;30700;31927.840360798047;32897.671023290415;33529.49705754367;23744.88127559351;23887;24023.879880600485;24221.51556968886;25539.872300638377 19:37:55 INFO - 2015-11-12 19:37:55,294 DEBUG : BROWSER_OUTPUT: |2;jquery.html;332.8685169358102;334.83593039410664;353.6269235956067;357.25512306840244;358.1368900948713;14405.711885762279;14828.481003164892;16620.750688739678;17255.654886902255;17987.730184047232;15475.922620386882;15562.53312400627;15591.1424871632;15783.368665253376;16227.107509086996;5086.440491545927;5354.625176237665;5359.062164121263;5363.517283444489;5363.54409875161;3968.226195891802;4042.2117687051036;5307.150855863063;5807.41925807418;5972.163897054415;5885.08781138922;5912.083627037816;5917.349091599921;5935.614185077978;5941.108833674962;5669.8582535436535;5754.4533269339345;5762.510186634099;5763.164341170507;5764.510016648569;5145.536901678829;5161.251618515332;5163.8192663256605;5164.431912489623;5168.870778230536;13496.527621533298;13582.660433489144;13825.239611821346;13875.722485550334;13876.167429954134;1943.067327682706;1955.2081407030175;1967.9409617711492;2051.497383141125;2080.3966849613594;9848.409095454224;9904.702858914245;10059.245556583212;10065.446400447972;10304.381737095799;1606.2129556517339;1637.7952755905512;1652.3308060235624;1669.090345761563;1742.5295170303948;60485.39514604885;60579;61603.69198154025;61862;63479;6926.792196234121;6940.201876784134;7029.789106326818;7099.538529995534;7102.360787529044;8530.10433904431;8553.101924297858;8555.288942211582;8557.400981931329;8567.828643427221;5723.942760572424;5753.8561535961935;5775.48020678141;5817.621854579439;5824.068149096209;6095.024796032613;6099.664518451439;6106.847328816726;6125.081237814364;6151.446369826737;3279.9180020499202;3306.553615261957;3306.966930330714;3311.0563489405404;3334;1116.1405717597404;1147.718808891827;1152.2970987697497;1152.8847115288404;1208.8065909454444;403.2720938705606;405.3838165987741;448.6343629941587;450.37398016756737;494.7674592941312;10078.647247346307;10496.73758156037;10546.947265263778;10744.086752625957;11042.116630669527;435.6427729261975;437.8642620787566;454.3752340531769;467.19894805524893;505.8027369325966;6301.40136687014;6566.3105373936005;6578.927652773288;6611.86776264472;6757.459403247728;383574;385476;392451;538194;546562;62865.37134628687;71184.2881571188;77529.2247077522;78441.21558784453;78631;574.718387989882;579.1457600039907;586.5190543754165;586.5835256967515;588.2470437839658;10905.182111341523;11132.666020019413;11144.60993865211;11295.943520282346;11343.546258149912;33209.83395083009;33472.66527334695;33691.66308336984;33741.325173495905;34069.65930340764;40780.79609601933;44623.33065004092;45571;46943.29585056158;47177.292340615604;6832.385085342343;6944.340287672663;6950.235474097946;6954.860902782018;6986.54587451814;10330.121939635215;12365.381730913597;12865.67835804075;12997.740045198854;13029.674258143243;9363.719088427359;10829.945850270698;10851;11034.393108378796;11075.390853503135;10425.972001558908;10701.090407315465;10703.518341674488;10779.89220107789;11119;10836.241463097507;11060.391678457761;11071.446427678746;11216.327020378803;11216.495257713586;6911.412529935012;6930.61881596517;6939;6998.6150761708595;7003.124609423822;10174.49127543605;10185.949070254897;10302.201218753886;11094.944525277322;11313.886861131612 19:37:55 INFO - 2015-11-12 19:37:55,298 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1351.1892864281426;1714.7256438969766;1759.243525284128;1786.5712229065027;1814.1201517264124;7021.403180729638;7536.284053014969;7755.340796032337;7765.223477652232;7768.106667733213;7581.128170260422;7690.038745156856;7700.422468314885;7706.922930770691;7708.498947568418;1963.7054441833768;2017.8688385254984;2243.910243590263;2245.6070187717164;2260.7626199249007;2290.919817806377;2297.1500544798446;2298.0348253733387;2298.2645553422913;2298.425393651587;2212.048819007834;2265.014718597407;2268.7164104486938;2268.8411811173223;2272.988635056822;1955.2960934063726;1992.1234656750983;2237.2281562860867;2288.0618946231966;2289.301762962296;2222.555488902226;2237.038073628339;2262.3326118794994;2266.172846910882;2266.603344414721;7558.168601453835;7569.205233450519;7588.013558237449;7594.506357086827;7598.0502437195355;4599.494055653875;4656.254999200146;4671.089137618166;4690.038542098861;4698.741569213692;3008.127642983532;3074.1853408846673;3111.502159654467;3133.85897634607;3144.4497212987635;948.3172116076414;973.5181085362719;1022.3048327137543;1034.75165960169;1036.6682661548307;10469.267151299413;10591.099756520705;10607.204459665556;10608;10613.787724245472;4082.897927551835;4183.5398106208295;4195.181939521825;4238.554951730086;4302.505211900609;8639.438436501607;8681.739547813575;8690.348223883235;8693.261072808755;8695.565221739014;4689.484156742756;4722.811087556528;4725.054989002213;4732.384789977281;4733.100710864994;4343.109662519176;4345.391645169679;4356.455443069616;4356.869293921188;4359.934600980988;3353.5975682918206;3391.8304084795664;3417.128632198773;3419.4870769384293;3431.4509678451327;1066.0405634928472;1072.8819829818713;1077.8059949209062;1081.7457897394106;1082.5832054658856;1223.7674841780033;1233.6114124050896;1238.9626919099421;1251.7997120460682;1261.3314943080181;7019.613921234279;7158.427325813923;7172.677229524684;7193.172785129673;7203.315685009916;473.7773246574105;478.90661321042757;479.3265462025859;484.55905126334864;487.8707142607212;5433.864153396196;5441.5102640762525;5455.918161227585;5456.236126942231;5472.151816468454;8757.912420875837;9158.771030724152;9211.585478653476;9220.124088211609;9220.5850736717;9024.729258122266;9034.32242581809;9040.367174297737;9087.500187489619;9103.772405689779;6938.375546200866;7068.893966590505;7156.391706704884;7169.354758071799;7182.066331376992;6830.7609233676585;6853.897191542231;6862.759803406857;6869.484788640772;6873.553219040747;7794.727184548514;7948.364130869632;7965.880511792444;8069.5965201740855;8080.0707918590115;8085.716999904975;8120.675172993014;8144.83710325802;8156;8229.629666664894;6354.52341074412;6824.249332573314;6949.791506254821;6951.16586009682;6963.512554121163;7342.412606991535;7370.852582948204;7384.96307518459;7387.482876198615;7392.371648409945;6941.409980151744;6994.090768200102;7092.716291348288;7170.605616691132;7229.349358557755;6222.408871157233;6341.175647165839;6579.17760279965;6694.330566943267;6784.93215067843;6793.830154246183;6807.591544507345;6825.317468253334;6836.145481814773;6840.3501667341525;6260.718267678057;6261.686915654108;6283.366324755505;6296.527760418078;6310;6299.779507717208;6317.336679648571;6324.968375158095;6330;6338.176037115146 19:37:55 INFO - 2015-11-12 19:37:55,298 DEBUG : BROWSER_OUTPUT: |4;prototype.html;316.8970084722465;319.8528676808668;320.83637344954064;339.4128158286163;340.3686162169175;6061.090836374546;6084.452399284063;6096.298925623549;6100.816975490737;6166.630002199871;6002.699865006754;6012.068129439933;6016.428439298271;6022.735225602629;6023.427774361439;4650.65120115991;4652.418447694038;4657.743824089682;4659.114768194049;4660.091282199973;4556.453225612914;4632.768361581924;4637.860864174063;4654.930176047362;4663.300504924255;4594.931076033862;4596.862094137181;4601.12578610063;4603.4015577974815;4609.907801843961;4398.142362239332;4592.380028696133;4596.6322694184555;4599.609033232179;4608.585227329523;3897.883063508071;3909.2963266612;3953.2686453006286;3957.960420395788;3968.0476685595536;5656.519195868356;5657.745401456944;5662.37713851476;5667.149927510865;5680.517156041741;5055.51972562606;5162.457941916082;5176.818811341585;5276.841694749163;5277.182036784305;6318.74725010999;6325.240971083454;6355.491560675135;6362.491000719931;6372.299047104815;4386.649068074578;4388.49532303786;4390.560943905616;4392.319190525442;4400.075984043355;6459.5478316517865;6535.607863528156;6552.475801935833;6561.967190164019;6610.93389066108;4482.193205223026;4491.8427855025575;4492.483364413069;4493.887652808706;4504.527024662363;4548.727076375428;4551.7724113794175;4562.452505699337;4563.748993805306;4567.223571992769;5256.868578285574;5269.0252303324005;5270.894582108336;5276.076686579833;5276.314079169683;6298.968505157445;6409.1668083149825;6432.678366081771;6438.935610643927;6449.5485316027425;1623.310093210381;1641.1876121320024;1652.793400824897;1657.3536320834885;1659.8838081334432;1073.3291692692067;1080.5785743560018;1091.5033659684982;1092.5902786455079;1099.3074363151163;6214.40963108504;6215.968920155461;6216.906746398808;6217.502599792097;6226.875462490725;6639.43564796988;6642.83392915181;6643.269240383554;6652.70062847173;6656.167979002625;6062.090686397076;6193.38066193377;6203.720832562545;6205.875882482325;6216.502679785606;3571.3571557119967;3578.4095624221713;3590.4973303737497;3597.4244120940525;3599.532060832075;6833.692483838239;6865.9313406866295;6880.346367095118;6882.414994725505;6916.3429474200875;6421.2615549211505;6679.76620818269;6681.031250468752;6681.398674119353;6692.196936367667;6447.226332839996;6888.655567221619;6968.128983877015;6989.650517474106;6994.61529615876;6673.1992160941;6706;6706.396424321834;6709;6716.597004179765;6613.603183808987;6617.338266173344;6617.867642647024;6619.768308109193;6629.105070815571;6803.557768745214;6949.826254343682;6968.965155174192;6970.895436568557;6971.721131154697;4470.351798989063;4508.301213311942;4511.413516242867;4512.165249428866;4520.683552151318;6671.266160722414;6680.365365290289;6681.365270299314;6681.46548276127;6681.766138185335;6363.363663633785;6481.736061467968;6484.513661475503;6485.221773387224;6487.902681459687;6447.742090316335;6462;6469.8706025880165;6471.838204044937;6481.319461456667;6226.346233645402;6350.428461438492;6378.170837791057;6389.52078594098;6400.103985441949;6512.706928188148;6514.120593719787;6527.184101987252;6534.281229064894;6543.149390579194;6384.329645387167;6386.137871387489;6389.361063893573;6395.264544577433;6395.552311338161 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: |5;yui.html;725.7858931615173;732.1470486882782;745.8955746195531;818.8116733151375;865.7402779166249;12759.744805103892;12959.28723920184;13017.869821301783;13041.60875173745;13083.215007099569;13093.148945318548;13165.40755665995;13237.867621323783;13270.137441066325;13276.668083297922;678.976235831746;697.7662483068153;826.983460330793;828.9792755181123;845.4166625028711;834.9540775257359;842.418731075559;845.0197770586121;849.2950850793826;849.4945507423105;861.336770686571;873.5326600268858;873.7509809704236;874.1651722604897;874.5714599846093;712.6864179760888;728.6866647341641;861.96983105591;882.0606054551881;882.3514716683233;650.339904996429;650.5316172355896;650.8047585724264;650.9544331896769;651.3063587279579;13482.595522134254;13581.320933953262;13581.524646637321;13629.386677599532;13630.318484075757;11905.940470297593;12444.502219911192;12655.557055503104;12749.808752868714;12954.546590869275;9777.168940640055;9881.011898810133;10099.646512372105;10120.797584048278;10176.898231017669;3258.3483303339426;3289.5559099521497;3291.2759192977746;3393.7624366294367;3396.847141878621;41396.79301603503;42023;42353.788231058956;42684.146317073486;42821.35767963483;7369.484136110528;7397.9630101850225;7523.623818809147;7621.428392870557;7699.961500192463;12098.274103553638;12250.387480626112;12256.448459819152;12271.38643067843;12295.815562766566;6712.530122891449;6765.560238584476;6822.556533825285;6822.658867056627;7002.439804815603;4339.696221264544;4345.521992580813;4375.737455752601;4381.123775244963;4407.735535867858;2728.822626529269;2773.3898542320658;2774.056820680978;2776.3475583237923;2778.7638050765913;433.4711651784817;442.8848499390182;457.0721435485969;457.23641518663914;457.4761897627198;610.6336198280995;631.782035197856;641.5893827950116;647.4464332995316;656.7931101702949;8311.127331630212;8447.584950070317;8635.266002389742;8748.431351962103;8997.881619937694;589.3134498309507;655.5181941273161;675.2470994840816;678.1218322272571;696.3593493985545;4313.396124542566;4424.491183513873;4443.622292105143;4516.36770852081;4521.84173553924;57996;58085.419145808;58992.41007589869;59203.70398147982;59357;50675.746621266655;51513;52558;52859.735701321246;53012.674683132456;45716.77141614271;45832.7708361456;46948.5305146951;47121.293180601635;49289.26066108939;7940.364770818436;7948;8139.314026371165;8142.307903828004;8350.79123021905;34452.48321275133;35387.82306088453;35517.644823552466;35645.499784180036;35650.46524302189;44886.77556612196;45357.319640206086;46545;46819.53180468288;47187.29219061785;8016.078151012708;8128.878066828884;8143.022837259567;8156.538624312233;8265.380096492907;11583.6524904253;11842.111841612086;11855.940720296689;11978.138380668583;12149.939250303692;10238.129758970274;10722.571097156026;10896.291741036806;10908.781824363627;10927.180461465263;10758.784824303626;11005.889941100486;11080.224384293022;11166.385848778395;11345.149113816331;10782.838257425989;10866.076383507174;10916.12670986335;11029;11342.60300889465;9707.951460242653;9841.655542055994;9915.702528924145;10013.799724005625;10294.691159264934;8848.380613357003;9405.576749046173;9545.540787489606;9800.411975281506;10085.29402941787 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: __end_tp_report 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: __start_cc_report 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,866 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: __end_cc_report 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: __startTimestamp1447385875289__endTimestamp 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,302 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: Number of tests: 6 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5532.78 Median:5756.11 stddev:640.93 (11.1%) stddev-sans-first:615.94 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: Values: 3188.4 3263.3 3302.0 3309.6 3324.9 5311.0 5409.2 5479.8 5496.0 5496.1 5411.4 5445.1 5502.3 5507.5 5516.5 5005.2 5040.1 5092.7 5193.8 5210.0 4959.4 5145.0 5179.0 5185.7 5217.3 4922.3 4985.4 5019.1 5034.9 5063.3 5024.6 5050.1 5054.3 5090.2 5138.8 4915.1 5041.8 5050.9 5080.1 5098.6 5239.1 5279.2 5294.2 5299.3 5344.3 5995.9 5999.0 6002.9 6005.3 6005.4 5848.2 5990.5 6052.8 6054.5 6075.7 5524.4 5600.6 5601.3 5603.2 5642.9 6095.4 6099.2 6103.5 6106.1 6107.2 5781.3 5839.9 5912.2 5968.6 5971.7 5962.3 5963.6 5971.4 5981.7 6075.6 5928.3 5934.5 5935.5 5945.0 5954.4 5734.6 5820.7 5862.6 5935.9 5956.0 4530.3 4542.5 4542.8 4549.0 4573.4 4033.5 4044.7 4045.0 4079.8 4097.0 5419.4 5470.7 5538.1 5550.1 5589.6 6015.7 6051.9 6056.4 6057.5 6066.0 5445.6 5647.3 5649.9 5658.1 5658.2 4923.7 4958.2 5029.7 5049.0 5086.8 6300.7 6310.4 6312.9 6315.2 6316.8 5823.7 5930.4 6079.5 6095.8 6100.2 6080.7 6160.8 6169.2 6171.9 6174.9 5924.6 5974.2 5981.1 5985.9 6022.3 5744.0 5837.7 5924.7 6069.0 6076.0 5896.9 5919.0 5919.3 5919.4 5930.3 5893.2 5900.0 5903.2 5904.7 5904.8 5577.2 5699.6 5703.5 5730.1 5820.9 5861.6 5876.5 5894.5 5896.1 5908.9 5751.7 5756.1 5758.8 5772.8 5799.7 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:47370.93 Median:3120.94 stddev:80158.55 (2568.4%) stddev-sans-first:80306.42 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: Values: 577.6 622.2 623.8 624.2 669.3 30243.8 30849.9 30878.7 30879.4 41159.4 42733.1 42887.4 42902.0 43018.8 43023.0 8631.7 8751.2 8813.5 8822.2 8832.0 7849.1 8025.1 8587.0 10604.5 10800.1 10612.6 10674.8 10697.7 10702.5 10718.8 7991.5 10553.9 10621.0 10671.4 10677.2 7851.0 10693.3 10950.7 10952.6 10958.3 40398.8 40572.0 40816.2 40862.0 40897.8 3059.9 3081.1 3095.5 3123.0 3155.7 30472.8 30692.2 31338.4 31934.7 32165.0 3041.8 3088.0 3091.0 3118.8 3201.1 278729.0 280125.0 280163.0 280342.0 280408.0 52600.2 53818.0 59748.4 60153.1 60185.4 69371.3 70463.6 70841.0 71000.6 71081.3 15483.3 15501.0 15510.8 15514.5 15547.5 12723.0 12755.9 12782.2 12790.3 12813.2 19669.8 19734.2 19898.3 20000.4 20085.2 7852.5 8001.7 8002.2 8033.6 8065.0 899.8 964.9 1012.4 1030.3 1041.8 28179.7 28678.1 28712.8 28986.4 29160.7 936.0 1014.0 1028.2 1064.9 1068.3 13887.0 14185.4 14365.9 14419.4 14586.0 345378.0 350717.0 351450.0 351757.0 351870.0 51221.0 51387.2 51403.5 51461.2 51476.2 1322.7 1327.3 1327.6 1332.4 1332.8 27022.7 27496.6 28168.9 28287.3 28852.4 44672.1 44732.0 44935.8 44967.3 45083.0 281868.0 282441.0 282471.0 283798.0 284250.0 28854.7 28977.1 29199.4 33004.3 33438.2 37646.4 41938.6 42087.4 42666.6 42960.0 35657.0 36023.6 36077.8 36258.1 37143.8 29666.0 33536.0 33900.3 34926.0 35247.6 35232.5 35836.6 36177.8 36419.6 36882.4 29767.7 30700.0 31927.8 32897.7 33529.5 23744.9 23887.0 24023.9 24221.5 25539.9 19:37:55 INFO - 2015-11-12 19:37:55,303 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,304 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:24475.36 Median:436.75 stddev:74864.65 (17141.2%) stddev-sans-first:75052.72 19:37:55 INFO - 2015-11-12 19:37:55,305 DEBUG : BROWSER_OUTPUT: Values: 332.9 334.8 353.6 357.3 358.1 14405.7 14828.5 16620.8 17255.7 17987.7 15475.9 15562.5 15591.1 15783.4 16227.1 5086.4 5354.6 5359.1 5363.5 5363.5 3968.2 4042.2 5307.2 5807.4 5972.2 5885.1 5912.1 5917.3 5935.6 5941.1 5669.9 5754.5 5762.5 5763.2 5764.5 5145.5 5161.3 5163.8 5164.4 5168.9 13496.5 13582.7 13825.2 13875.7 13876.2 1943.1 1955.2 1967.9 2051.5 2080.4 9848.4 9904.7 10059.2 10065.4 10304.4 1606.2 1637.8 1652.3 1669.1 1742.5 60485.4 60579.0 61603.7 61862.0 63479.0 6926.8 6940.2 7029.8 7099.5 7102.4 8530.1 8553.1 8555.3 8557.4 8567.8 5723.9 5753.9 5775.5 5817.6 5824.1 6095.0 6099.7 6106.8 6125.1 6151.4 3279.9 3306.6 3307.0 3311.1 3334.0 1116.1 1147.7 1152.3 1152.9 1208.8 403.3 405.4 448.6 450.4 494.8 10078.6 10496.7 10546.9 10744.1 11042.1 435.6 437.9 454.4 467.2 505.8 6301.4 6566.3 6578.9 6611.9 6757.5 383574.0 385476.0 392451.0 538194.0 546562.0 62865.4 71184.3 77529.2 78441.2 78631.0 574.7 579.1 586.5 586.6 588.2 10905.2 11132.7 11144.6 11295.9 11343.5 33209.8 33472.7 33691.7 33741.3 34069.7 40780.8 44623.3 45571.0 46943.3 47177.3 6832.4 6944.3 6950.2 6954.9 6986.5 10330.1 12365.4 12865.7 12997.7 13029.7 9363.7 10829.9 10851.0 11034.4 11075.4 10426.0 10701.1 10703.5 10779.9 11119.0 10836.2 11060.4 11071.4 11216.3 11216.5 6911.4 6930.6 6939.0 6998.6 7003.1 10174.5 10185.9 10302.2 11094.9 11313.9 19:37:55 INFO - 2015-11-12 19:37:55,305 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,305 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5310.67 Median:6272.53 stddev:2756.69 (43.9%) stddev-sans-first:2748.35 19:37:55 INFO - 2015-11-12 19:37:55,306 DEBUG : BROWSER_OUTPUT: Values: 1351.2 1714.7 1759.2 1786.6 1814.1 7021.4 7536.3 7755.3 7765.2 7768.1 7581.1 7690.0 7700.4 7706.9 7708.5 1963.7 2017.9 2243.9 2245.6 2260.8 2290.9 2297.2 2298.0 2298.3 2298.4 2212.0 2265.0 2268.7 2268.8 2273.0 1955.3 1992.1 2237.2 2288.1 2289.3 2222.6 2237.0 2262.3 2266.2 2266.6 7558.2 7569.2 7588.0 7594.5 7598.1 4599.5 4656.3 4671.1 4690.0 4698.7 3008.1 3074.2 3111.5 3133.9 3144.4 948.3 973.5 1022.3 1034.8 1036.7 10469.3 10591.1 10607.2 10608.0 10613.8 4082.9 4183.5 4195.2 4238.6 4302.5 8639.4 8681.7 8690.3 8693.3 8695.6 4689.5 4722.8 4725.1 4732.4 4733.1 4343.1 4345.4 4356.5 4356.9 4359.9 3353.6 3391.8 3417.1 3419.5 3431.5 1066.0 1072.9 1077.8 1081.7 1082.6 1223.8 1233.6 1239.0 1251.8 1261.3 7019.6 7158.4 7172.7 7193.2 7203.3 473.8 478.9 479.3 484.6 487.9 5433.9 5441.5 5455.9 5456.2 5472.2 8757.9 9158.8 9211.6 9220.1 9220.6 9024.7 9034.3 9040.4 9087.5 9103.8 6938.4 7068.9 7156.4 7169.4 7182.1 6830.8 6853.9 6862.8 6869.5 6873.6 7794.7 7948.4 7965.9 8069.6 8080.1 8085.7 8120.7 8144.8 8156.0 8229.6 6354.5 6824.2 6949.8 6951.2 6963.5 7342.4 7370.9 7385.0 7387.5 7392.4 6941.4 6994.1 7092.7 7170.6 7229.3 6222.4 6341.2 6579.2 6694.3 6784.9 6793.8 6807.6 6825.3 6836.1 6840.4 6260.7 6261.7 6283.4 6296.5 6310.0 6299.8 6317.3 6325.0 6330.0 6338.2 19:37:55 INFO - 2015-11-12 19:37:55,306 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,306 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5362.53 Median:6180.01 stddev:1630.46 (26.4%) stddev-sans-first:1590.44 19:37:55 INFO - 2015-11-12 19:37:55,306 DEBUG : BROWSER_OUTPUT: Values: 316.9 319.9 320.8 339.4 340.4 6061.1 6084.5 6096.3 6100.8 6166.6 6002.7 6012.1 6016.4 6022.7 6023.4 4650.7 4652.4 4657.7 4659.1 4660.1 4556.5 4632.8 4637.9 4654.9 4663.3 4594.9 4596.9 4601.1 4603.4 4609.9 4398.1 4592.4 4596.6 4599.6 4608.6 3897.9 3909.3 3953.3 3958.0 3968.0 5656.5 5657.7 5662.4 5667.1 5680.5 5055.5 5162.5 5176.8 5276.8 5277.2 6318.7 6325.2 6355.5 6362.5 6372.3 4386.6 4388.5 4390.6 4392.3 4400.1 6459.5 6535.6 6552.5 6562.0 6610.9 4482.2 4491.8 4492.5 4493.9 4504.5 4548.7 4551.8 4562.5 4563.7 4567.2 5256.9 5269.0 5270.9 5276.1 5276.3 6299.0 6409.2 6432.7 6438.9 6449.5 1623.3 1641.2 1652.8 1657.4 1659.9 1073.3 1080.6 1091.5 1092.6 1099.3 6214.4 6216.0 6216.9 6217.5 6226.9 6639.4 6642.8 6643.3 6652.7 6656.2 6062.1 6193.4 6203.7 6205.9 6216.5 3571.4 3578.4 3590.5 3597.4 3599.5 6833.7 6865.9 6880.3 6882.4 6916.3 6421.3 6679.8 6681.0 6681.4 6692.2 6447.2 6888.7 6968.1 6989.7 6994.6 6673.2 6706.0 6706.4 6709.0 6716.6 6613.6 6617.3 6617.9 6619.8 6629.1 6803.6 6949.8 6969.0 6970.9 6971.7 4470.4 4508.3 4511.4 4512.2 4520.7 6671.3 6680.4 6681.4 6681.5 6681.8 6363.4 6481.7 6484.5 6485.2 6487.9 6447.7 6462.0 6469.9 6471.8 6481.3 6226.3 6350.4 6378.2 6389.5 6400.1 6512.7 6514.1 6527.2 6534.3 6543.1 6384.3 6386.1 6389.4 6395.3 6395.6 19:37:55 INFO - 2015-11-12 19:37:55,307 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,307 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13358.51 Median:46682.27 stddev:15955.81 (34.2%) stddev-sans-first:15972.37 19:37:55 INFO - 2015-11-12 19:37:55,307 DEBUG : BROWSER_OUTPUT: Values: 725.8 732.1 745.9 818.8 865.7 12759.7 12959.3 13017.9 13041.6 13083.2 13093.1 13165.4 13237.9 13270.1 13276.7 679.0 697.8 827.0 829.0 845.4 835.0 842.4 845.0 849.3 849.5 861.3 873.5 873.8 874.2 874.6 712.7 728.7 862.0 882.1 882.4 650.3 650.5 650.8 651.0 651.3 13482.6 13581.3 13581.5 13629.4 13630.3 11905.9 12444.5 12655.6 12749.8 12954.5 9777.2 9881.0 10099.6 10120.8 10176.9 3258.3 3289.6 3291.3 3393.8 3396.8 41396.8 42023.0 42353.8 42684.1 42821.4 7369.5 7398.0 7523.6 7621.4 7700.0 12098.3 12250.4 12256.4 12271.4 12295.8 6712.5 6765.6 6822.6 6822.7 7002.4 4339.7 4345.5 4375.7 4381.1 4407.7 2728.8 2773.4 2774.1 2776.3 2778.8 433.5 442.9 457.1 457.2 457.5 610.6 631.8 641.6 647.4 656.8 8311.1 8447.6 8635.3 8748.4 8997.9 589.3 655.5 675.2 678.1 696.4 4313.4 4424.5 4443.6 4516.4 4521.8 57996.0 58085.4 58992.4 59203.7 59357.0 50675.7 51513.0 52558.0 52859.7 53012.7 45716.8 45832.8 46948.5 47121.3 49289.3 7940.4 7948.0 8139.3 8142.3 8350.8 34452.5 35387.8 35517.6 35645.5 35650.5 44886.8 45357.3 46545.0 46819.5 47187.3 8016.1 8128.9 8143.0 8156.5 8265.4 11583.7 11842.1 11855.9 11978.1 12149.9 10238.1 10722.6 10896.3 10908.8 10927.2 10758.8 11005.9 11080.2 11166.4 11345.1 10782.8 10866.1 10916.1 11029.0 11342.6 9708.0 9841.7 9915.7 10013.8 10294.7 8848.4 9405.6 9545.5 9800.4 10085.3 19:37:55 INFO - 2015-11-12 19:37:55,307 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 19:37:55 INFO - 2015-11-12 19:37:55,307 DEBUG : BROWSER_OUTPUT: 19:37:55 INFO - 2015-11-12 19:37:55,979 INFO : Browser exited with error code: 0 19:37:55 INFO - 2015-11-12 19:37:55,995 INFO : Completed test dromaeo_css (00:18:33) 19:37:55 INFO - 2015-11-12 19:37:55,995 INFO : Starting test kraken 19:37:55 INFO - 2015-11-12 19:37:55,995 DEBUG : operating with platform_type : linux_ 19:37:55 INFO - 2015-11-12 19:37:55,995 INFO : Initialising browser for kraken test... 19:37:56 INFO - 2015-11-12 19:37:56,001 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_MQIJK/profile http://localhost:51877/getInfo.html 19:37:59 INFO - 2015-11-12 19:37:59,788 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:37:59 INFO - 2015-11-12 19:37:59,788 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:37:59 INFO - 2015-11-12 19:37:59,788 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 19:37:59 INFO - 2015-11-12 19:37:59,788 DEBUG : BROWSER_OUTPUT: __metrics 19:37:59 INFO - 2015-11-12 19:37:59,930 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:38:01 INFO - 2015-11-12 19:38:01,120 INFO : Browser initialized. 19:38:01 INFO - 2015-11-12 19:38:01,120 INFO : Running cycle 1/1 for kraken test... 19:38:01 INFO - 2015-11-12 19:38:01,120 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_MQIJK/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:38:12 INFO - 2015-11-12 19:38:12,894 DEBUG : BROWSER_OUTPUT: RSS: Main: 140779520 19:38:12 INFO - 2015-11-12 19:38:12,895 DEBUG : BROWSER_OUTPUT: 19:38:15 INFO - 2015-11-12 19:38:15,389 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51877/tests/kraken/driver.html?testName=audio-beat-detection) 19:38:15 INFO - 2015-11-12 19:38:15,970 DEBUG : BROWSER_OUTPUT: RSS: Main: 181346304 19:38:15 INFO - 2015-11-12 19:38:15,970 DEBUG : BROWSER_OUTPUT: 19:38:18 INFO - 2015-11-12 19:38:18,567 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51877/tests/kraken/driver.html?testName=audio-dft) 19:38:19 INFO - 2015-11-12 19:38:19,133 DEBUG : BROWSER_OUTPUT: RSS: Main: 169414656 19:38:19 INFO - 2015-11-12 19:38:19,133 DEBUG : BROWSER_OUTPUT: 19:38:22 INFO - 2015-11-12 19:38:22,012 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51877/tests/kraken/driver.html?testName=audio-fft) 19:38:22 INFO - 2015-11-12 19:38:22,564 DEBUG : BROWSER_OUTPUT: RSS: Main: 149835776 19:38:22 INFO - 2015-11-12 19:38:22,564 DEBUG : BROWSER_OUTPUT: 19:38:24 INFO - 2015-11-12 19:38:24,556 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51877/tests/kraken/driver.html?testName=audio-oscillator) 19:38:25 INFO - 2015-11-12 19:38:25,117 DEBUG : BROWSER_OUTPUT: RSS: Main: 154587136 19:38:25 INFO - 2015-11-12 19:38:25,117 DEBUG : BROWSER_OUTPUT: 19:38:27 INFO - 2015-11-12 19:38:27,291 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51877/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:38:27 INFO - 2015-11-12 19:38:27,857 DEBUG : BROWSER_OUTPUT: RSS: Main: 155242496 19:38:27 INFO - 2015-11-12 19:38:27,857 DEBUG : BROWSER_OUTPUT: 19:38:30 INFO - 2015-11-12 19:38:30,797 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51877/tests/kraken/driver.html?testName=imaging-darkroom) 19:38:31 INFO - 2015-11-12 19:38:31,371 DEBUG : BROWSER_OUTPUT: RSS: Main: 155885568 19:38:31 INFO - 2015-11-12 19:38:31,371 DEBUG : BROWSER_OUTPUT: 19:38:34 INFO - 2015-11-12 19:38:34,745 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51877/tests/kraken/driver.html?testName=imaging-desaturate) 19:38:35 INFO - 2015-11-12 19:38:35,332 DEBUG : BROWSER_OUTPUT: RSS: Main: 156090368 19:38:35 INFO - 2015-11-12 19:38:35,332 DEBUG : BROWSER_OUTPUT: 19:38:38 INFO - 2015-11-12 19:38:38,122 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51877/tests/kraken/driver.html?testName=json-parse-financial) 19:38:38 INFO - 2015-11-12 19:38:38,691 DEBUG : BROWSER_OUTPUT: RSS: Main: 156311552 19:38:38 INFO - 2015-11-12 19:38:38,691 DEBUG : BROWSER_OUTPUT: 19:38:40 INFO - 2015-11-12 19:38:40,219 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51877/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:38:40 INFO - 2015-11-12 19:38:40,772 DEBUG : BROWSER_OUTPUT: RSS: Main: 167616512 19:38:40 INFO - 2015-11-12 19:38:40,772 DEBUG : BROWSER_OUTPUT: 19:38:42 INFO - 2015-11-12 19:38:42,583 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:38:43 INFO - 2015-11-12 19:38:43,170 DEBUG : BROWSER_OUTPUT: RSS: Main: 165212160 19:38:43 INFO - 2015-11-12 19:38:43,170 DEBUG : BROWSER_OUTPUT: 19:38:45 INFO - 2015-11-12 19:38:45,222 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:38:45 INFO - 2015-11-12 19:38:45,795 DEBUG : BROWSER_OUTPUT: RSS: Main: 180002816 19:38:45 INFO - 2015-11-12 19:38:45,795 DEBUG : BROWSER_OUTPUT: 19:38:48 INFO - 2015-11-12 19:38:48,202 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:38:48 INFO - 2015-11-12 19:38:48,785 DEBUG : BROWSER_OUTPUT: RSS: Main: 183259136 19:38:48 INFO - 2015-11-12 19:38:48,785 DEBUG : BROWSER_OUTPUT: 19:38:51 INFO - 2015-11-12 19:38:51,320 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:38:51 INFO - 2015-11-12 19:38:51,890 DEBUG : BROWSER_OUTPUT: RSS: Main: 183001088 19:38:51 INFO - 2015-11-12 19:38:51,890 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,538 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51877/tests/kraken/driver.html?testName=ai-astar) 19:38:53 INFO - 2015-11-12 19:38:53,795 DEBUG : BROWSER_OUTPUT: RSS: Main: 242126848 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: __start_tp_report 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 19:38:53 INFO - 2015-11-12 19:38:53,796 DEBUG : BROWSER_OUTPUT: |0;ai-astar;113;111;105;112;112;111;100;110;114;111 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;149;126;151;164;126;149;158;131;167;123 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;160;162;161;162;163;161;164;163;162 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;73;81;92;72;73;73;106;91;72 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;90;91;144;89;91;90;131;90;91;138 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;109;110;110;109;110;109;110;111 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;145;145;145;145;146;146;145;146;145 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;95;95;95;95;95;96;95 19:38:53 INFO - 2015-11-12 19:38:53,797 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;58;57;59;58;58;57;57;64;55;55 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;67;68;67;67;67;68;67;68;68 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;83;85;84;84;84;85;85;93;86;85 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;115;129;125;122;121;118;116;116;124;123 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;137;146;152;146;147;140;147;149;140;148 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;66;66;67;67;66;68;67;67;65;66 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: __end_tp_report 19:38:53 INFO - 2015-11-12 19:38:53,798 DEBUG : BROWSER_OUTPUT: __start_cc_report 19:38:53 INFO - 2015-11-12 19:38:53,799 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,928 19:38:53 INFO - 2015-11-12 19:38:53,799 DEBUG : BROWSER_OUTPUT: __end_cc_report 19:38:53 INFO - 2015-11-12 19:38:53,799 DEBUG : BROWSER_OUTPUT: __startTimestamp1447385933791__endTimestamp 19:38:53 INFO - 2015-11-12 19:38:53,799 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,800 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: Number of tests: 14 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:109.90 Median:111.50 stddev:4.23 (3.8%) stddev-sans-first:4.33 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: Values: 113.0 111.0 105.0 112.0 112.0 111.0 100.0 110.0 114.0 111.0 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:144.40 Median:150.00 stddev:16.60 (11.1%) stddev-sans-first:17.52 19:38:53 INFO - 2015-11-12 19:38:53,801 DEBUG : BROWSER_OUTPUT: Values: 149.0 126.0 151.0 164.0 126.0 149.0 158.0 131.0 167.0 123.0 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.00 Median:162.00 stddev:1.15 (0.7%) stddev-sans-first:1.22 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: Values: 162.0 160.0 162.0 161.0 162.0 163.0 161.0 164.0 163.0 162.0 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.60 Median:73.00 stddev:11.84 (16.2%) stddev-sans-first:12.24 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: Values: 73.0 73.0 81.0 92.0 72.0 73.0 73.0 106.0 91.0 72.0 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,802 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:104.50 Median:90.00 stddev:23.10 (25.7%) stddev-sans-first:23.90 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: Values: 90.0 91.0 144.0 89.0 91.0 90.0 131.0 90.0 91.0 138.0 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.60 Median:110.00 stddev:0.70 (0.6%) stddev-sans-first:0.71 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 109.0 110.0 110.0 109.0 110.0 109.0 110.0 111.0 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:145.40 Median:145.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: Values: 146.0 145.0 145.0 145.0 145.0 146.0 146.0 145.0 146.0 145.0 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 19:38:53 INFO - 2015-11-12 19:38:53,803 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,804 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:57.80 Median:58.00 stddev:2.53 (4.4%) stddev-sans-first:2.68 19:38:53 INFO - 2015-11-12 19:38:53,804 DEBUG : BROWSER_OUTPUT: Values: 58.0 57.0 59.0 58.0 58.0 57.0 57.0 64.0 55.0 55.0 19:38:53 INFO - 2015-11-12 19:38:53,804 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.30 Median:67.50 stddev:0.67 (1.0%) stddev-sans-first:0.53 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: Values: 66.0 67.0 68.0 67.0 67.0 67.0 68.0 67.0 68.0 68.0 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.40 Median:85.00 stddev:2.80 (3.3%) stddev-sans-first:2.83 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: Values: 83.0 85.0 84.0 84.0 84.0 85.0 85.0 93.0 86.0 85.0 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:120.90 Median:122.50 stddev:4.58 (3.7%) stddev-sans-first:4.33 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: Values: 115.0 129.0 125.0 122.0 121.0 118.0 116.0 116.0 124.0 123.0 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,805 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.20 Median:147.00 stddev:4.69 (3.2%) stddev-sans-first:3.92 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: Values: 137.0 146.0 152.0 146.0 147.0 140.0 147.0 149.0 140.0 148.0 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:67.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: Values: 66.0 66.0 67.0 67.0 66.0 68.0 67.0 67.0 65.0 66.0 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 19:38:53 INFO - 2015-11-12 19:38:53,806 DEBUG : BROWSER_OUTPUT: 19:38:54 INFO - 2015-11-12 19:38:54,627 INFO : Browser exited with error code: 0 19:38:54 INFO - 2015-11-12 19:38:54,683 INFO : Completed test kraken (00:00:58) 19:38:54 INFO - 2015-11-12 19:38:54,683 INFO : Starting test v8_7 19:38:54 INFO - 2015-11-12 19:38:54,683 DEBUG : operating with platform_type : linux_ 19:38:54 INFO - 2015-11-12 19:38:54,684 INFO : Initialising browser for v8_7 test... 19:38:54 INFO - 2015-11-12 19:38:54,689 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpg4zEGy/profile http://localhost:51877/getInfo.html 19:38:58 INFO - 2015-11-12 19:38:58,644 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:38:58 INFO - 2015-11-12 19:38:58,645 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:38:58 INFO - 2015-11-12 19:38:58,645 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 19:38:58 INFO - 2015-11-12 19:38:58,645 DEBUG : BROWSER_OUTPUT: __metrics 19:38:58 INFO - 2015-11-12 19:38:58,808 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:39:00 INFO - 2015-11-12 19:39:00,059 INFO : Browser initialized. 19:39:00 INFO - 2015-11-12 19:39:00,059 INFO : Running cycle 1/1 for v8_7 test... 19:39:00 INFO - 2015-11-12 19:39:00,059 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpg4zEGy/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:39:11 INFO - 2015-11-12 19:39:11,775 DEBUG : BROWSER_OUTPUT: RSS: Main: 141201408 19:39:11 INFO - 2015-11-12 19:39:11,775 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,161 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51877/tests/v8_7/run.html (next: http://localhost:51877/tests/v8_7/run.html) 19:39:33 INFO - 2015-11-12 19:39:33,419 DEBUG : BROWSER_OUTPUT: RSS: Main: 566669312 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: __start_tp_report 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: |0;Richards;170.2127659574468 19:39:33 INFO - 2015-11-12 19:39:33,420 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;194.09937888198758 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |2;Encrypt;284.9814762040467 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5055.555555555556 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1100.1100110011 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |5;Earley;800.640512409928 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |6;Boyer;11811.764705882353 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |7;RegExp;26230.76923076923 19:39:33 INFO - 2015-11-12 19:39:33,421 DEBUG : BROWSER_OUTPUT: |8;Splay;594.1770647653001 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4826.923076923077 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: __end_tp_report 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: __startTimestamp1447385973412__endTimestamp 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: Number of tests: 10 19:39:33 INFO - 2015-11-12 19:39:33,422 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:170.21 Median:170.21 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: Values: 170.2 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:194.10 Median:194.10 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: Values: 194.1 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,423 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:284.98 Median:284.98 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: Values: 285.0 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5055.56 Median:5055.56 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: Values: 5055.6 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1100.11 Median:1100.11 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: Values: 1100.1 19:39:33 INFO - 2015-11-12 19:39:33,424 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:800.64 Median:800.64 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: Values: 800.6 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11811.76 Median:11811.76 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: Values: 11811.8 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,425 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26230.77 Median:26230.77 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: Values: 26230.8 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:594.18 Median:594.18 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: Values: 594.2 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: Values: 4826.9 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 19:39:33 INFO - 2015-11-12 19:39:33,426 DEBUG : BROWSER_OUTPUT: 19:39:34 INFO - 2015-11-12 19:39:34,290 INFO : Browser exited with error code: 0 19:39:34 INFO - 2015-11-12 19:39:34,305 INFO : Completed test v8_7 (00:00:39) 19:39:34 INFO - 2015-11-12 19:39:34,423 INFO : Completed test suite (00:20:11) 19:39:34 INFO - 2015-11-12 19:39:34,423 DEBUG : Working with test: dromaeo_css 19:39:34 INFO - 2015-11-12 19:39:34,423 DEBUG : Generating results file: dromaeo_css 19:39:34 INFO - 2015-11-12 19:39:34,424 DEBUG : Working with test: kraken 19:39:34 INFO - 2015-11-12 19:39:34,424 DEBUG : Generating results file: kraken 19:39:34 INFO - 2015-11-12 19:39:34,424 INFO : javascript benchmark 19:39:34 INFO - 2015-11-12 19:39:34,424 DEBUG : Working with test: v8_7 19:39:34 INFO - 2015-11-12 19:39:34,425 DEBUG : Generating results file: v8_7 19:39:34 INFO - 2015-11-12 19:39:34,425 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:39:34 INFO - 2015-11-12 19:39:34,474 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 19:39:34 INFO - 2015-11-12 19:39:34,474 DEBUG : process_Request line: dromaeo_css 6698.08 graph.html#tests=[[72,64,35]] 19:39:34 INFO - 2015-11-12 19:39:34,475 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:39:34 INFO - 2015-11-12 19:39:34,503 DEBUG : process_Request line: kraken 1494.70 graph.html#tests=[[232,64,35]] 19:39:34 INFO - 2015-11-12 19:39:34,503 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:39:34 INFO - 2015-11-12 19:39:34,529 DEBUG : process_Request line: v8_7 21004.77 graph.html#tests=[[230,64,35]] 19:39:34 INFO - 2015-11-12 19:39:34,531 INFO : javascript benchmark 19:39:34 INFO - 2015-11-12 19:39:34,535 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [332.8685169358102, 334.83593039410664, 353.6269235956067, 357.25512306840244, 358.1368900948713, 14405.711885762279, 14828.481003164892, 16620.750688739678, 17255.654886902255, 17987.730184047232, 15475.922620386882, 15562.53312400627, 15591.1424871632, 15783.368665253376, 16227.107509086996, 5086.440491545927, 5354.625176237665, 5359.062164121263, 5363.517283444489, 5363.54409875161, 3968.226195891802, 4042.2117687051036, 5307.150855863063, 5807.41925807418, 5972.163897054415, 5885.08781138922, 5912.083627037816, 5917.349091599921, 5935.614185077978, 5941.108833674962, 5669.8582535436535, 5754.4533269339345, 5762.510186634099, 5763.164341170507, 5764.510016648569, 5145.536901678829, 5161.251618515332, 5163.8192663256605, 5164.431912489623, 5168.870778230536, 13496.527621533298, 13582.660433489144, 13825.239611821346, 13875.722485550334, 13876.167429954134, 1943.067327682706, 1955.2081407030175, 1967.9409617711492, 2051.497383141125, 2080.3966849613594, 9848.409095454224, 9904.702858914245, 10059.245556583212, 10065.446400447972, 10304.381737095799, 1606.2129556517339, 1637.7952755905512, 1652.3308060235624, 1669.090345761563, 1742.5295170303948, 60485.39514604885, 60579.0, 61603.69198154025, 61862.0, 63479.0, 6926.792196234121, 6940.201876784134, 7029.789106326818, 7099.538529995534, 7102.360787529044, 8530.10433904431, 8553.101924297858, 8555.288942211582, 8557.400981931329, 8567.828643427221, 5723.942760572424, 5753.8561535961935, 5775.48020678141, 5817.621854579439, 5824.068149096209, 6095.024796032613, 6099.664518451439, 6106.847328816726, 6125.081237814364, 6151.446369826737, 3279.9180020499202, 3306.553615261957, 3306.966930330714, 3311.0563489405404, 3334.0, 1116.1405717597404, 1147.718808891827, 1152.2970987697497, 1152.8847115288404, 1208.8065909454444, 403.2720938705606, 405.3838165987741, 448.6343629941587, 450.37398016756737, 494.7674592941312, 10078.647247346307, 10496.73758156037, 10546.947265263778, 10744.086752625957, 11042.116630669527, 435.6427729261975, 437.8642620787566, 454.3752340531769, 467.19894805524893, 505.8027369325966, 6301.40136687014, 6566.3105373936005, 6578.927652773288, 6611.86776264472, 6757.459403247728, 383574.0, 385476.0, 392451.0, 538194.0, 546562.0, 62865.37134628687, 71184.2881571188, 77529.2247077522, 78441.21558784453, 78631.0, 574.718387989882, 579.1457600039907, 586.5190543754165, 586.5835256967515, 588.2470437839658, 10905.182111341523, 11132.666020019413, 11144.60993865211, 11295.943520282346, 11343.546258149912, 33209.83395083009, 33472.66527334695, 33691.66308336984, 33741.325173495905, 34069.65930340764, 40780.79609601933, 44623.33065004092, 45571.0, 46943.29585056158, 47177.292340615604, 6832.385085342343, 6944.340287672663, 6950.235474097946, 6954.860902782018, 6986.54587451814, 10330.121939635215, 12365.381730913597, 12865.67835804075, 12997.740045198854, 13029.674258143243, 9363.719088427359, 10829.945850270698, 10851.0, 11034.393108378796, 11075.390853503135, 10425.972001558908, 10701.090407315465, 10703.518341674488, 10779.89220107789, 11119.0, 10836.241463097507, 11060.391678457761, 11071.446427678746, 11216.327020378803, 11216.495257713586, 6911.412529935012, 6930.61881596517, 6939.0, 6998.6150761708595, 7003.124609423822, 10174.49127543605, 10185.949070254897, 10302.201218753886, 11094.944525277322, 11313.886861131612], "dojo.html": [3188.442022646037, 3263.265765202831, 3301.9763873199295, 3309.5863017122842, 3324.8836290729823, 5310.973445132779, 5409.188621706746, 5479.835604931854, 5496.038193316169, 5496.148097044959, 5411.431799661038, 5445.128779395298, 5502.284702988606, 5507.4767897049815, 5516.531094856942, 5005.199168133099, 5040.143175660138, 5092.719900405476, 5193.844184674465, 5210.010098081371, 4959.429665588467, 5145.0, 5178.974105129469, 5185.662931909433, 5217.295665085203, 4922.261660750898, 4985.401751789772, 5019.121653710623, 5034.924476132861, 5063.291139240509, 5024.62315326352, 5050.141475949097, 5054.3176671149295, 5090.236464530313, 5138.794448222066, 4915.090708218955, 5041.773120209599, 5050.924236136461, 5080.1363768159135, 5098.566621837112, 5239.109351410231, 5279.208118782213, 5294.232336311252, 5299.33758280215, 5344.305240318772, 5995.940040599626, 5999.0, 6002.909956350658, 6005.279366476007, 6005.369436209179, 5848.210491583624, 5990.520758339322, 6052.818415447544, 6054.545909056838, 6075.696215189267, 5524.419935906712, 5600.60795744294, 5601.29983752031, 5603.2435621191435, 5642.943570564283, 6095.3892705671915, 6099.237595300588, 6103.450689437972, 6106.053561697944, 6107.206063211843, 5781.335146458127, 5839.854003649858, 5912.201852749824, 5968.582199246098, 5971.731272092767, 5962.284525856839, 5963.5825492216, 5971.4327138921735, 5981.700914954235, 6075.605085669417, 5928.258967629046, 5934.525237980951, 5935.52515798735, 5945.0, 5954.434328738763, 5734.569907256972, 5820.708964551755, 5862.560307976919, 5935.881282374328, 5956.0, 4530.343100250445, 4542.477615074309, 4542.84100056503, 4548.977255113703, 4573.382593349856, 4033.495813023372, 4044.6966477513715, 4045.0089728016824, 4079.7756123412905, 4097.0, 5419.376771671229, 5470.699111548824, 5538.141588053858, 5550.056490396642, 5589.580781441408, 6015.699215039318, 6051.939480605226, 6056.394360563909, 6057.545684073712, 6065.969670151621, 5445.59158063139, 5647.29408823897, 5649.887002259932, 5658.066419040894, 5658.207850900877, 4923.679960802537, 4958.206686930074, 5029.673071250357, 5049.015441988777, 5086.847394578169, 6300.747970081237, 6310.432061114522, 6312.936870631327, 6315.210598675074, 6316.842078948063, 5823.679697616502, 5930.377310382521, 6079.452849243589, 6095.786647467317, 6100.176476175837, 6080.665563394055, 6160.845978850564, 6169.2288463942, 6171.9074213887725, 6174.876502469836, 5924.555658325729, 5974.2233509643465, 5981.1327357532045, 5985.850353741192, 6022.277326720821, 5743.971280143573, 5837.708114594168, 5924.733386997682, 6068.969655151873, 6075.969620152047, 5896.852578685567, 5918.970405147947, 5919.319278283053, 5919.437653422918, 5930.258717660293, 5893.2044174035955, 5900.0264956281735, 5903.2325797646035, 5904.675242861684, 5904.763809447574, 5577.191307260506, 5699.629524080921, 5703.486686198262, 5730.054541000688, 5820.912686309794, 5861.560382971379, 5876.471117599436, 5894.528437724886, 5896.056630939029, 5908.852278693067, 5751.7411716472025, 5756.107803290497, 5758.798442054675, 5772.797952071657, 5799.681017544076], "mootools.html": [1351.1892864281426, 1714.7256438969766, 1759.243525284128, 1786.5712229065027, 1814.1201517264124, 7021.403180729638, 7536.284053014969, 7755.340796032337, 7765.223477652232, 7768.106667733213, 7581.128170260422, 7690.038745156856, 7700.422468314885, 7706.922930770691, 7708.498947568418, 1963.7054441833768, 2017.8688385254984, 2243.910243590263, 2245.6070187717164, 2260.7626199249007, 2290.919817806377, 2297.1500544798446, 2298.0348253733387, 2298.2645553422913, 2298.425393651587, 2212.048819007834, 2265.014718597407, 2268.7164104486938, 2268.8411811173223, 2272.988635056822, 1955.2960934063726, 1992.1234656750983, 2237.2281562860867, 2288.0618946231966, 2289.301762962296, 2222.555488902226, 2237.038073628339, 2262.3326118794994, 2266.172846910882, 2266.603344414721, 7558.168601453835, 7569.205233450519, 7588.013558237449, 7594.506357086827, 7598.0502437195355, 4599.494055653875, 4656.254999200146, 4671.089137618166, 4690.038542098861, 4698.741569213692, 3008.127642983532, 3074.1853408846673, 3111.502159654467, 3133.85897634607, 3144.4497212987635, 948.3172116076414, 973.5181085362719, 1022.3048327137543, 1034.75165960169, 1036.6682661548307, 10469.267151299413, 10591.099756520705, 10607.204459665556, 10608.0, 10613.787724245472, 4082.897927551835, 4183.5398106208295, 4195.181939521825, 4238.554951730086, 4302.505211900609, 8639.438436501607, 8681.739547813575, 8690.348223883235, 8693.261072808755, 8695.565221739014, 4689.484156742756, 4722.811087556528, 4725.054989002213, 4732.384789977281, 4733.100710864994, 4343.109662519176, 4345.391645169679, 4356.455443069616, 4356.869293921188, 4359.934600980988, 3353.5975682918206, 3391.8304084795664, 3417.128632198773, 3419.4870769384293, 3431.4509678451327, 1066.0405634928472, 1072.8819829818713, 1077.8059949209062, 1081.7457897394106, 1082.5832054658856, 1223.7674841780033, 1233.6114124050896, 1238.9626919099421, 1251.7997120460682, 1261.3314943080181, 7019.613921234279, 7158.427325813923, 7172.677229524684, 7193.172785129673, 7203.315685009916, 473.7773246574105, 478.90661321042757, 479.3265462025859, 484.55905126334864, 487.8707142607212, 5433.864153396196, 5441.5102640762525, 5455.918161227585, 5456.236126942231, 5472.151816468454, 8757.912420875837, 9158.771030724152, 9211.585478653476, 9220.124088211609, 9220.5850736717, 9024.729258122266, 9034.32242581809, 9040.367174297737, 9087.500187489619, 9103.772405689779, 6938.375546200866, 7068.893966590505, 7156.391706704884, 7169.354758071799, 7182.066331376992, 6830.7609233676585, 6853.897191542231, 6862.759803406857, 6869.484788640772, 6873.553219040747, 7794.727184548514, 7948.364130869632, 7965.880511792444, 8069.5965201740855, 8080.0707918590115, 8085.716999904975, 8120.675172993014, 8144.83710325802, 8156.0, 8229.629666664894, 6354.52341074412, 6824.249332573314, 6949.791506254821, 6951.16586009682, 6963.512554121163, 7342.412606991535, 7370.852582948204, 7384.96307518459, 7387.482876198615, 7392.371648409945, 6941.409980151744, 6994.090768200102, 7092.716291348288, 7170.605616691132, 7229.349358557755, 6222.408871157233, 6341.175647165839, 6579.17760279965, 6694.330566943267, 6784.93215067843, 6793.830154246183, 6807.591544507345, 6825.317468253334, 6836.145481814773, 6840.3501667341525, 6260.718267678057, 6261.686915654108, 6283.366324755505, 6296.527760418078, 6310.0, 6299.779507717208, 6317.336679648571, 6324.968375158095, 6330.0, 6338.176037115146], "ext.html": [577.566824881339, 622.2004723929751, 623.7941479311826, 624.2446639566125, 669.3373560175424, 30243.848780756092, 30849.92025279113, 30878.691213087863, 30879.38241235174, 41159.38260926089, 42733.145337093316, 42887.35668964968, 42902.0, 43018.78490607542, 43023.0, 8631.697890573816, 8751.212390884819, 8813.515256660881, 8822.161894620032, 8832.02847686754, 7849.0973538043, 8025.077116131662, 8586.96956365234, 10604.522796474139, 10800.081993030602, 10612.628558000471, 10674.839877401846, 10697.679069627924, 10702.518386672618, 10718.78562428751, 7991.520508769434, 10553.894461055368, 10621.0, 10671.413072281022, 10677.1992100592, 7851.0, 10693.304935179189, 10950.671479855617, 10952.561897524089, 10958.342499449978, 40398.79800600978, 40572.0, 40816.183676326305, 40862.0, 40897.79551102255, 3059.892903748358, 3081.0910781319562, 3095.5047192449324, 3123.031860123369, 3155.6844315568487, 30472.84763576168, 30692.232694182825, 31338.37323253522, 31934.6806531934, 32165.0, 3041.8250950570377, 3088.0005569340638, 3090.9690903090905, 3118.844057797101, 3201.119692084672, 278729.0, 280125.0, 280163.0, 280342.0, 280408.0, 52600.21099683508, 53818.0, 59748.402515975155, 60153.097703534484, 60185.39814601798, 69371.3062869375, 70463.64768176126, 70841.0, 71000.64499677469, 71081.28918710747, 15483.303251353716, 15501.0, 15510.844891551165, 15514.456994005155, 15547.533573992798, 12723.0, 12755.93622031884, 12782.169159004636, 12790.29653369055, 12813.231206127475, 19669.803301967084, 19734.210631574577, 19898.303559375352, 20000.399988000383, 20085.196592136443, 7852.528848269122, 8001.719939802196, 8002.159773223728, 8033.55815430157, 8065.0, 899.8380291547453, 964.8745663063756, 1012.4330374990029, 1030.294248439821, 1041.8437234414898, 28179.745620350324, 28678.13965581036, 28712.806953531614, 28986.42027159445, 29160.70839291622, 935.9532023398802, 1014.0113389445232, 1028.1569113327, 1064.8722153341648, 1068.3056013591229, 13887.0, 14185.361658725382, 14365.92817035908, 14419.42322307096, 14586.0, 345378.0, 350717.0, 351450.0, 351757.0, 351870.0, 51221.0, 51387.22919156215, 51403.48596513987, 51461.2280815788, 51476.22785658218, 1322.6693326668333, 1327.2700014991715, 1327.6415367850818, 1332.420397127272, 1332.7950316750666, 27022.72977270202, 27496.58755118715, 28168.85915570409, 28287.2928176789, 28852.42295154127, 44672.10655786931, 44732.0, 44935.77532112318, 44967.32549011833, 45083.0, 281868.0, 282441.0, 282471.0, 283798.0, 284250.0, 28854.711452886044, 28977.11648742825, 29199.416011680074, 33004.33991320208, 33438.164045899044, 37646.42358975893, 41938.580614193466, 42087.36868947029, 42666.5733342675, 42960.0, 35657.0, 36023.639763603074, 36077.76872353547, 36258.093547660465, 37143.8142809295, 29666.0, 33536.0, 33900.32199356049, 34926.0, 35247.647523524436, 35232.471512926815, 35836.641633584375, 36177.819110904275, 36419.63580364163, 36882.44676329911, 29767.702322976493, 30700.0, 31927.840360798047, 32897.671023290415, 33529.49705754367, 23744.88127559351, 23887.0, 24023.879880600485, 24221.51556968886, 25539.872300638377], "prototype.html": [316.8970084722465, 319.8528676808668, 320.83637344954064, 339.4128158286163, 340.3686162169175, 6061.090836374546, 6084.452399284063, 6096.298925623549, 6100.816975490737, 6166.630002199871, 6002.699865006754, 6012.068129439933, 6016.428439298271, 6022.735225602629, 6023.427774361439, 4650.65120115991, 4652.418447694038, 4657.743824089682, 4659.114768194049, 4660.091282199973, 4556.453225612914, 4632.768361581924, 4637.860864174063, 4654.930176047362, 4663.300504924255, 4594.931076033862, 4596.862094137181, 4601.12578610063, 4603.4015577974815, 4609.907801843961, 4398.142362239332, 4592.380028696133, 4596.6322694184555, 4599.609033232179, 4608.585227329523, 3897.883063508071, 3909.2963266612, 3953.2686453006286, 3957.960420395788, 3968.0476685595536, 5656.519195868356, 5657.745401456944, 5662.37713851476, 5667.149927510865, 5680.517156041741, 5055.51972562606, 5162.457941916082, 5176.818811341585, 5276.841694749163, 5277.182036784305, 6318.74725010999, 6325.240971083454, 6355.491560675135, 6362.491000719931, 6372.299047104815, 4386.649068074578, 4388.49532303786, 4390.560943905616, 4392.319190525442, 4400.075984043355, 6459.5478316517865, 6535.607863528156, 6552.475801935833, 6561.967190164019, 6610.93389066108, 4482.193205223026, 4491.8427855025575, 4492.483364413069, 4493.887652808706, 4504.527024662363, 4548.727076375428, 4551.7724113794175, 4562.452505699337, 4563.748993805306, 4567.223571992769, 5256.868578285574, 5269.0252303324005, 5270.894582108336, 5276.076686579833, 5276.314079169683, 6298.968505157445, 6409.1668083149825, 6432.678366081771, 6438.935610643927, 6449.5485316027425, 1623.310093210381, 1641.1876121320024, 1652.793400824897, 1657.3536320834885, 1659.8838081334432, 1073.3291692692067, 1080.5785743560018, 1091.5033659684982, 1092.5902786455079, 1099.3074363151163, 6214.40963108504, 6215.968920155461, 6216.906746398808, 6217.502599792097, 6226.875462490725, 6639.43564796988, 6642.83392915181, 6643.269240383554, 6652.70062847173, 6656.167979002625, 6062.090686397076, 6193.38066193377, 6203.720832562545, 6205.875882482325, 6216.502679785606, 3571.3571557119967, 3578.4095624221713, 3590.4973303737497, 3597.4244120940525, 3599.532060832075, 6833.692483838239, 6865.9313406866295, 6880.346367095118, 6882.414994725505, 6916.3429474200875, 6421.2615549211505, 6679.76620818269, 6681.031250468752, 6681.398674119353, 6692.196936367667, 6447.226332839996, 6888.655567221619, 6968.128983877015, 6989.650517474106, 6994.61529615876, 6673.1992160941, 6706.0, 6706.396424321834, 6709.0, 6716.597004179765, 6613.603183808987, 6617.338266173344, 6617.867642647024, 6619.768308109193, 6629.105070815571, 6803.557768745214, 6949.826254343682, 6968.965155174192, 6970.895436568557, 6971.721131154697, 4470.351798989063, 4508.301213311942, 4511.413516242867, 4512.165249428866, 4520.683552151318, 6671.266160722414, 6680.365365290289, 6681.365270299314, 6681.46548276127, 6681.766138185335, 6363.363663633785, 6481.736061467968, 6484.513661475503, 6485.221773387224, 6487.902681459687, 6447.742090316335, 6462.0, 6469.8706025880165, 6471.838204044937, 6481.319461456667, 6226.346233645402, 6350.428461438492, 6378.170837791057, 6389.52078594098, 6400.103985441949, 6512.706928188148, 6514.120593719787, 6527.184101987252, 6534.281229064894, 6543.149390579194, 6384.329645387167, 6386.137871387489, 6389.361063893573, 6395.264544577433, 6395.552311338161], "yui.html": [725.7858931615173, 732.1470486882782, 745.8955746195531, 818.8116733151375, 865.7402779166249, 12759.744805103892, 12959.28723920184, 13017.869821301783, 13041.60875173745, 13083.215007099569, 13093.148945318548, 13165.40755665995, 13237.867621323783, 13270.137441066325, 13276.668083297922, 678.976235831746, 697.7662483068153, 826.983460330793, 828.9792755181123, 845.4166625028711, 834.9540775257359, 842.418731075559, 845.0197770586121, 849.2950850793826, 849.4945507423105, 861.336770686571, 873.5326600268858, 873.7509809704236, 874.1651722604897, 874.5714599846093, 712.6864179760888, 728.6866647341641, 861.96983105591, 882.0606054551881, 882.3514716683233, 650.339904996429, 650.5316172355896, 650.8047585724264, 650.9544331896769, 651.3063587279579, 13482.595522134254, 13581.320933953262, 13581.524646637321, 13629.386677599532, 13630.318484075757, 11905.940470297593, 12444.502219911192, 12655.557055503104, 12749.808752868714, 12954.546590869275, 9777.168940640055, 9881.011898810133, 10099.646512372105, 10120.797584048278, 10176.898231017669, 3258.3483303339426, 3289.5559099521497, 3291.2759192977746, 3393.7624366294367, 3396.847141878621, 41396.79301603503, 42023.0, 42353.788231058956, 42684.146317073486, 42821.35767963483, 7369.484136110528, 7397.9630101850225, 7523.623818809147, 7621.428392870557, 7699.961500192463, 12098.274103553638, 12250.387480626112, 12256.448459819152, 12271.38643067843, 12295.815562766566, 6712.530122891449, 6765.560238584476, 6822.556533825285, 6822.658867056627, 7002.439804815603, 4339.696221264544, 4345.521992580813, 4375.737455752601, 4381.123775244963, 4407.735535867858, 2728.822626529269, 2773.3898542320658, 2774.056820680978, 2776.3475583237923, 2778.7638050765913, 433.4711651784817, 442.8848499390182, 457.0721435485969, 457.23641518663914, 457.4761897627198, 610.6336198280995, 631.782035197856, 641.5893827950116, 647.4464332995316, 656.7931101702949, 8311.127331630212, 8447.584950070317, 8635.266002389742, 8748.431351962103, 8997.881619937694, 589.3134498309507, 655.5181941273161, 675.2470994840816, 678.1218322272571, 696.3593493985545, 4313.396124542566, 4424.491183513873, 4443.622292105143, 4516.36770852081, 4521.84173553924, 57996.0, 58085.419145808, 58992.41007589869, 59203.70398147982, 59357.0, 50675.746621266655, 51513.0, 52558.0, 52859.735701321246, 53012.674683132456, 45716.77141614271, 45832.7708361456, 46948.5305146951, 47121.293180601635, 49289.26066108939, 7940.364770818436, 7948.0, 8139.314026371165, 8142.307903828004, 8350.79123021905, 34452.48321275133, 35387.82306088453, 35517.644823552466, 35645.499784180036, 35650.46524302189, 44886.77556612196, 45357.319640206086, 46545.0, 46819.53180468288, 47187.29219061785, 8016.078151012708, 8128.878066828884, 8143.022837259567, 8156.538624312233, 8265.380096492907, 11583.6524904253, 11842.111841612086, 11855.940720296689, 11978.138380668583, 12149.939250303692, 10238.129758970274, 10722.571097156026, 10896.291741036806, 10908.781824363627, 10927.180461465263, 10758.784824303626, 11005.889941100486, 11080.224384293022, 11166.385848778395, 11345.149113816331, 10782.838257425989, 10866.076383507174, 10916.12670986335, 11029.0, 11342.60300889465, 9707.951460242653, 9841.655542055994, 9915.702528924145, 10013.799724005625, 10294.691159264934, 8848.380613357003, 9405.576749046173, 9545.540787489606, 9800.411975281506, 10085.29402941787]}, "summary": {"lowerIsBetter": false, "suite": 6698.083047342444, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7054.517630222194, "unit": "ms", "value": 7054.517630222194}, "dojo.html": {"lowerIsBetter": false, "filtered": 5489.5073697361995, "unit": "ms", "value": 5489.5073697361995}, "mootools.html": {"lowerIsBetter": false, "filtered": 4301.322507864163, "unit": "ms", "value": 4301.322507864163}, "ext.html": {"lowerIsBetter": false, "filtered": 18618.634904434504, "unit": "ms", "value": 18618.634904434504}, "prototype.html": {"lowerIsBetter": false, "filtered": 4829.648752503444, "unit": "ms", "value": 4829.648752503444}, "yui.html": {"lowerIsBetter": false, "filtered": 6028.360150296692, "unit": "ms", "value": 6028.360150296692}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-026"}, "testrun": {"date": 1447384762, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151112173006", "branch": "Fx-Team", "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46"}}, {"talos_counters": {}, "results": {"audio-dft": [162.0, 160.0, 162.0, 161.0, 162.0, 163.0, 161.0, 164.0, 163.0, 162.0], "ai-astar": [113.0, 111.0, 105.0, 112.0, 112.0, 111.0, 100.0, 110.0, 114.0, 111.0], "imaging-gaussian-blur": [109.0, 109.0, 109.0, 110.0, 110.0, 109.0, 110.0, 109.0, 110.0, 111.0], "audio-beat-detection": [149.0, 126.0, 151.0, 164.0, 126.0, 149.0, 158.0, 131.0, 167.0, 123.0], "json-stringify-tinderbox": [66.0, 67.0, 68.0, 67.0, 67.0, 67.0, 68.0, 67.0, 68.0, 68.0], "stanford-crypto-pbkdf2": [137.0, 146.0, 152.0, 146.0, 147.0, 140.0, 147.0, 149.0, 140.0, 148.0], "json-parse-financial": [58.0, 57.0, 59.0, 58.0, 58.0, 57.0, 57.0, 64.0, 55.0, 55.0], "stanford-crypto-sha256-iterative": [66.0, 66.0, 67.0, 67.0, 66.0, 68.0, 67.0, 67.0, 65.0, 66.0], "audio-fft": [73.0, 73.0, 81.0, 92.0, 72.0, 73.0, 73.0, 106.0, 91.0, 72.0], "imaging-darkroom": [146.0, 145.0, 145.0, 145.0, 145.0, 146.0, 146.0, 145.0, 146.0, 145.0], "stanford-crypto-ccm": [115.0, 129.0, 125.0, 122.0, 121.0, 118.0, 116.0, 116.0, 124.0, 123.0], "audio-oscillator": [90.0, 91.0, 144.0, 89.0, 91.0, 90.0, 131.0, 90.0, 91.0, 138.0], "stanford-crypto-aes": [83.0, 85.0, 84.0, 84.0, 84.0, 85.0, 85.0, 93.0, 86.0, 85.0], "imaging-desaturate": [95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0]}, "summary": {"lowerIsBetter": true, "suite": 1494.7000000000003, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 80.6, "unit": "ms", "value": 80.6}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 145.2, "unit": "ms", "value": 145.2}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 144.4, "unit": "ms", "value": 144.4}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 120.9, "unit": "ms", "value": 120.9}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 145.4, "unit": "ms", "value": 145.4}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 57.8, "unit": "ms", "value": 57.8}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 104.5, "unit": "ms", "value": 104.5}, "ai-astar": {"lowerIsBetter": true, "filtered": 109.9, "unit": "ms", "value": 109.9}, "audio-dft": {"lowerIsBetter": true, "filtered": 162.0, "unit": "ms", "value": 162.0}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 66.5, "unit": "ms", "value": 66.5}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 67.3, "unit": "ms", "value": 67.3}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 109.6, "unit": "ms", "value": 109.6}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 85.4, "unit": "ms", "value": 85.4}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 95.2, "unit": "ms", "value": 95.2}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-026"}, "testrun": {"date": 1447384762, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151112173006", "branch": "Fx-Team", "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46"}}, {"talos_counters": {}, "results": {"DeltaBlue": [194.09937888198758], "Encrypt": [284.9814762040467], "NavierStokes": [4826.923076923077], "Decrypt": [5055.555555555556], "Splay": [594.1770647653001], "Richards": [170.2127659574468], "RegExp": [26230.76923076923], "Earley": [800.640512409928], "Boyer": [11811.764705882353], "RayTrace": [1100.1100110011]}, "summary": {"lowerIsBetter": false, "suite": 21004.766888226077, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 340.63993600000003, "unit": "score", "value": 340.63993600000003}, "Encrypt": {"lowerIsBetter": false, "filtered": 934.0291290000002, "unit": "score", "value": 934.0291290000002}, "NavierStokes": {"lowerIsBetter": false, "filtered": 307.4422310756973, "unit": "score", "value": 307.4422310756973}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.65118681318681, "unit": "score", "value": 52.65118681318681}, "Splay": {"lowerIsBetter": false, "filtered": 137.14935300000005, "unit": "score", "value": 137.14935300000005}, "RegExp": {"lowerIsBetter": false, "filtered": 34.729633431085055, "unit": "score", "value": 34.729633431085055}, "Richards": {"lowerIsBetter": false, "filtered": 207.39925000000005, "unit": "score", "value": 207.39925000000005}, "Earley": {"lowerIsBetter": false, "filtered": 832.4122870000002, "unit": "score", "value": 832.4122870000002}, "Boyer": {"lowerIsBetter": false, "filtered": 56.42366035856573, "unit": "score", "value": 56.42366035856573}, "RayTrace": {"lowerIsBetter": false, "filtered": 672.6500009999999, "unit": "score", "value": 672.6500009999999}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-026"}, "testrun": {"date": 1447384762, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151112173006", "branch": "Fx-Team", "revision": "0c648a1efbe06b5ec866ba058d18256b80808b46"}}] 19:39:34 INFO - RETURN: dromaeo_css: 6698.08 19:39:34 INFO - RETURN: kraken: 1494.70 19:39:34 INFO - RETURN: v8_7: 21004.77 19:39:34 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,35]]", "result": "21004.77"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1494.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6698.08"}}} 19:39:34 INFO - Return code: 0 19:39:34 INFO - # TBPL SUCCESS # 19:39:34 INFO - Running post-action listener: _resource_record_post_action 19:39:34 INFO - Running post-run listener: _resource_record_post_run 19:39:35 INFO - Total resource usage - Wall time: 1227s; CPU: 13.0%; Read bytes: 0; Write bytes: 514125824; Read time: 0; Write time: 750592 19:39:35 INFO - install - Wall time: 15s; CPU: 15.0%; Read bytes: 0; Write bytes: 140484608; Read time: 0; Write time: 197500 19:39:35 INFO - run-tests - Wall time: 1212s; CPU: 13.0%; Read bytes: 0; Write bytes: 296062976; Read time: 0; Write time: 353824 19:39:35 INFO - Running post-run listener: _upload_blobber_files 19:39:35 INFO - Blob upload gear active. 19:39:35 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 19:39:35 INFO - Copying logs to upload dir... 19:39:35 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1260.768572 ========= master_lag: 0.32 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2015-11-12 19:39:34.671523) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-12 19:39:34.680515) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010011 build_url: 'https://queue.taskcluster.net/v1/task/N6MQTYYWTS6LMdXpnzw-WQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.01 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-12 19:39:34.703036) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:39:34.706364) ========= 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=a65b340e283ce644d68cb24e000001c9-1447380485.335121-1041809481 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004534 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 19:39:34.758321) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-12 19:39:34.758642) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-12 19:39:34.758925) ========= ========= Total master_lag: 0.50 =========