builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-031 starttime: 1447836395.46 results: success (0) buildid: 20151117233007 builduid: 40e6cd78fd114a209473dd928bcccc2a revision: c699b2c839a9f8c2b964dd956de9084d3b93a13f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.458493) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.458956) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.459281) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006442 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.486634) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.486921) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.544795) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.545080) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004571 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.604221) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.604492) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.604817) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.605102) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-18 00:46:35-- 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% 223M=0s 2015-11-18 00:46:35 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.181914 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.809552) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.810109) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014772 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.862950) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:35.863269) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev c699b2c839a9f8c2b964dd956de9084d3b93a13f --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 c699b2c839a9f8c2b964dd956de9084d3b93a13f --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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-18 00:46:36,008 truncating revision to first 12 chars 2015-11-18 00:46:36,008 Setting DEBUG logging. 2015-11-18 00:46:36,008 attempt 1/10 2015-11-18 00:46:36,008 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/c699b2c839a9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-18 00:46:36,282 unpacking tar archive at: fx-team-c699b2c839a9/testing/mozharness/ program finished with exit code 0 elapsedTime=0.572805 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:36.448307) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:36.448575) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:36.456937) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:36.457192) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-18 00:46:36.457551) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2015-11-18 00:46:36.457821) ========= /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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 00:46:36 INFO - MultiFileLogger online at 20151118 00:46:36 in /builds/slave/test-pgo 00:46:36 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 00:46:36 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 00:46:36 INFO - {'append_to_log': False, 00:46:36 INFO - 'base_work_dir': '/builds/slave/test-pgo', 00:46:36 INFO - 'blob_upload_branch': 'Fx-Team', 00:46:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 00:46:36 INFO - 'branch': 'Fx-Team', 00:46:36 INFO - 'buildbot_json_path': 'buildprops.json', 00:46:36 INFO - 'config_files': ('talos/linux_config.py',), 00:46:36 INFO - 'default_actions': ('clobber', 00:46:36 INFO - 'read-buildbot-config', 00:46:36 INFO - 'download-and-extract', 00:46:36 INFO - 'populate-webroot', 00:46:36 INFO - 'create-virtualenv', 00:46:36 INFO - 'install', 00:46:36 INFO - 'run-tests'), 00:46:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 00:46:36 INFO - 'download_minidump_stackwalk': True, 00:46:36 INFO - 'download_symbols': 'ondemand', 00:46:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 00:46:36 INFO - 'tooltool.py': '/tools/tooltool.py', 00:46:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 00:46:36 INFO - '/tools/misc-python/virtualenv.py')}, 00:46:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 00:46:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 00:46:36 INFO - 'installer_path': 'installer.exe', 00:46:36 INFO - 'log_level': 'info', 00:46:36 INFO - 'log_name': 'talos', 00:46:36 INFO - 'log_to_console': True, 00:46:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 00:46:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 00:46:36 INFO - 'opt_config_files': (), 00:46:36 INFO - 'pip_index': False, 00:46:36 INFO - 'sps_profile': False, 00:46:36 INFO - 'sps_profile_interval': 0, 00:46:36 INFO - 'suite': 'dromaeojs', 00:46:36 INFO - 'system_bits': '64', 00:46:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 00:46:36 INFO - 'title': 'talos-linux64-ix-031', 00:46:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 00:46:36 INFO - 'use_talos_json': True, 00:46:36 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 00:46:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 00:46:36 INFO - 'work_dir': 'build'} 00:46:36 INFO - ##### 00:46:36 INFO - ##### Running clobber step. 00:46:36 INFO - ##### 00:46:36 INFO - Running pre-action listener: _resource_record_pre_action 00:46:36 INFO - Running main action method: clobber 00:46:36 INFO - rmtree: /builds/slave/test-pgo/build 00:46:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 00:46:37 INFO - Running post-action listener: _resource_record_post_action 00:46:37 INFO - ##### 00:46:37 INFO - ##### Running read-buildbot-config step. 00:46:37 INFO - ##### 00:46:37 INFO - Running pre-action listener: _resource_record_pre_action 00:46:37 INFO - Running main action method: read_buildbot_config 00:46:37 INFO - Using buildbot properties: 00:46:37 INFO - { 00:46:37 INFO - "properties": { 00:46:37 INFO - "buildnumber": 790, 00:46:37 INFO - "product": "firefox", 00:46:37 INFO - "script_repo_revision": "production", 00:46:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 00:46:37 INFO - "repository": "", 00:46:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 00:46:37 INFO - "buildid": "20151117233007", 00:46:37 INFO - "slavename": "talos-linux64-ix-031", 00:46:37 INFO - "pgo_build": "True", 00:46:37 INFO - "basedir": "/builds/slave/test-pgo", 00:46:37 INFO - "project": "", 00:46:37 INFO - "platform": "ubuntu64_hw", 00:46:37 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 00:46:37 INFO - "slavebuilddir": "test", 00:46:37 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 00:46:37 INFO - "branch": "fx-team", 00:46:37 INFO - "repo_path": "integration/fx-team", 00:46:37 INFO - "stage_platform": "linux64-pgo", 00:46:37 INFO - "builduid": "40e6cd78fd114a209473dd928bcccc2a", 00:46:37 INFO - "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f" 00:46:37 INFO - }, 00:46:37 INFO - "sourcestamp": { 00:46:37 INFO - "repository": "", 00:46:37 INFO - "hasPatch": false, 00:46:37 INFO - "project": "", 00:46:37 INFO - "branch": "fx-team-linux64-pgo-talos", 00:46:37 INFO - "changes": [ 00:46:37 INFO - { 00:46:37 INFO - "category": null, 00:46:37 INFO - "files": [ 00:46:37 INFO - { 00:46:37 INFO - "url": null, 00:46:37 INFO - "name": "https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 00:46:37 INFO - } 00:46:37 INFO - ], 00:46:37 INFO - "repository": "", 00:46:37 INFO - "rev": "c699b2c839a9f8c2b964dd956de9084d3b93a13f", 00:46:37 INFO - "who": "sendchange", 00:46:37 INFO - "when": 1447836371, 00:46:37 INFO - "number": 6676404, 00:46:37 INFO - "comments": "", 00:46:37 INFO - "project": "", 00:46:37 INFO - "at": "Wed 18 Nov 2015 00:46:11", 00:46:37 INFO - "branch": "fx-team-linux64-pgo-talos", 00:46:37 INFO - "revlink": "", 00:46:37 INFO - "properties": [ 00:46:37 INFO - [ 00:46:37 INFO - "buildid", 00:46:37 INFO - "20151117233007", 00:46:37 INFO - "Change" 00:46:37 INFO - ], 00:46:37 INFO - [ 00:46:37 INFO - "builduid", 00:46:37 INFO - "40e6cd78fd114a209473dd928bcccc2a", 00:46:37 INFO - "Change" 00:46:37 INFO - ], 00:46:37 INFO - [ 00:46:37 INFO - "pgo_build", 00:46:37 INFO - "True", 00:46:37 INFO - "Change" 00:46:37 INFO - ] 00:46:37 INFO - ], 00:46:37 INFO - "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f" 00:46:37 INFO - } 00:46:37 INFO - ], 00:46:37 INFO - "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f" 00:46:37 INFO - } 00:46:37 INFO - } 00:46:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 00:46:37 INFO - Running post-action listener: _resource_record_post_action 00:46:37 INFO - ##### 00:46:37 INFO - ##### Running download-and-extract step. 00:46:37 INFO - ##### 00:46:37 INFO - Running pre-action listener: _resource_record_pre_action 00:46:37 INFO - Running main action method: download_and_extract 00:46:37 INFO - mkdir: /builds/slave/test-pgo/build/tests 00:46:37 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')]} 00:46:37 INFO - https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 00:46:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/test_packages.json 00:46:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/test_packages.json 00:46:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 00:46:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 00:46:43 INFO - Downloaded 1302 bytes. 00:46:43 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 00:46:43 INFO - Using the following test package requirements: 00:46:43 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:46:43 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 00:46:43 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'jsshell-linux-x86_64.zip'], 00:46:43 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 00:46:43 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:46:43 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 00:46:43 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 00:46:43 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 00:46:43 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:46:43 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:46:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 00:46:43 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 00:46:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:46:43 INFO - https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 00:46:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:44 INFO - Downloaded 22461522 bytes. 00:46:44 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 00:46:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:44 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 00:46:45 INFO - Return code: 0 00:46:45 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 00:46:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:46:45 INFO - https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 00:46:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:52 INFO - Downloaded 22461522 bytes. 00:46:52 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 00:46:52 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:46:52 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 00:46:53 INFO - Return code: 0 00:46:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:46:53 INFO - https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 00:46:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:46:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:46:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:54 INFO - Downloaded 11131693 bytes. 00:46:54 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 00:46:54 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:46:54 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 00:46:54 INFO - Return code: 0 00:46: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')]} 00:46:54 INFO - https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 00:46:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:46:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:46:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/SIgO1HkfRvydRCvTsGSxOw/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 00:46:57 INFO - Downloaded 57197286 bytes. 00:46:57 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:46:57 INFO - mkdir: /builds/slave/test-pgo/properties 00:46:57 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 00:46:57 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 00:46:57 INFO - Contents: 00:46:57 INFO - build_url:https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:46:57 INFO - Running post-action listener: _resource_record_post_action 00:46:57 INFO - Running post-action listener: set_extra_try_arguments 00:46:57 INFO - ##### 00:46:57 INFO - ##### Running populate-webroot step. 00:46:57 INFO - ##### 00:46:57 INFO - Running pre-action listener: _resource_record_pre_action 00:46:57 INFO - Running main action method: populate_webroot 00:46:57 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 00:46:57 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 00:46:57 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 00:46:57 INFO - '../fennec_ids.txt'], 00:46:57 INFO - 'tests': ['tcheck2']}, 00:46:57 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 00:46:57 INFO - '--tppagecycles', 00:46:57 INFO - '7'], 00:46:57 INFO - 'tests': ['tsvgm']}}, 00:46:57 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 00:46:57 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['tresize', 'tcanvasmark']}, 00:46:57 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 00:46:57 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 00:46:57 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:46:57 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:46:57 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'tests': ['damp', 'tps']}, 00:46:57 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['damp', 'tps']}, 00:46:57 INFO - 'g3': {'tests': ['dromaeo_dom']}, 00:46:57 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 00:46:57 INFO - 'other': {'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'other-e10s': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'other_l64': {'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'other_nol64': {'tests': ['a11yr', 00:46:57 INFO - 'ts_paint', 00:46:57 INFO - 'tpaint', 00:46:57 INFO - 'sessionrestore', 00:46:57 INFO - 'sessionrestore_no_auto_restore']}, 00:46:57 INFO - 'svgr': {'tests': ['tsvgx', 00:46:57 INFO - 'tsvgr_opacity', 00:46:57 INFO - 'tart', 00:46:57 INFO - 'tscrollx', 00:46:57 INFO - 'cart']}, 00:46:57 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['tsvgx', 00:46:57 INFO - 'tsvgr_opacity', 00:46:57 INFO - 'tart', 00:46:57 INFO - 'tscrollx', 00:46:57 INFO - 'cart']}, 00:46:57 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'tests': ['tp5o']}, 00:46:57 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'talos_options': ['--e10s'], 00:46:57 INFO - 'tests': ['tp5o']}, 00:46:57 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'talos_options': ['--xperf_path', 00:46:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:46:57 INFO - 'tests': ['tp5n']}, 00:46:57 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:46:57 INFO - 'talos_options': ['--e10s', 00:46:57 INFO - '--xperf_path', 00:46:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:46:57 INFO - 'tests': ['tp5n']}}, 00:46:57 INFO - 'talos.zip': {'path': '', 00:46:57 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 00:46:57 INFO - Running post-action listener: _resource_record_post_action 00:46:57 INFO - ##### 00:46:57 INFO - ##### Running create-virtualenv step. 00:46:57 INFO - ##### 00:46:57 INFO - Running pre-action listener: _resource_record_pre_action 00:46:57 INFO - Running main action method: create_virtualenv 00:46:57 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 00:46:57 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 00:46:57 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 00:46:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 00:46:58 INFO - Using real prefix '/usr' 00:46:58 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 00:46:58 INFO - Installing distribute.............................................................................................................................................................................................done. 00:47:00 INFO - Installing pip.................done. 00:47:00 INFO - Return code: 0 00:47:00 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 00:47: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')]} 00:47:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47: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')]} 00:47:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 00:47:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 00:47:00 INFO - Using env: {'DISPLAY': ':0', 00:47:00 INFO - 'HOME': '/home/cltbld', 00:47:00 INFO - 'LANG': 'en_US.UTF-8', 00:47:00 INFO - 'LANGUAGE': 'en_US:en', 00:47:00 INFO - 'LOGNAME': 'cltbld', 00:47:00 INFO - 'MAIL': '/var/mail/cltbld', 00:47:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:00 INFO - 'MOZ_NO_REMOTE': '1', 00:47:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:00 INFO - 'NO_EM_RESTART': '1', 00:47:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:00 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:00 INFO - 'SHELL': '/bin/bash', 00:47:00 INFO - 'SHLVL': '1', 00:47:00 INFO - 'TERM': 'linux', 00:47:00 INFO - 'TMOUT': '86400', 00:47:00 INFO - 'USER': 'cltbld', 00:47:00 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:00 INFO - '_': '/tools/buildbot/bin/python'} 00:47:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:00 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 00:47:00 INFO - Cleaning up... 00:47:00 INFO - Return code: 0 00:47:00 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 00:47: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')]} 00:47:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47: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')]} 00:47:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 00:47:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 00:47:00 INFO - Using env: {'DISPLAY': ':0', 00:47:00 INFO - 'HOME': '/home/cltbld', 00:47:00 INFO - 'LANG': 'en_US.UTF-8', 00:47:00 INFO - 'LANGUAGE': 'en_US:en', 00:47:00 INFO - 'LOGNAME': 'cltbld', 00:47:00 INFO - 'MAIL': '/var/mail/cltbld', 00:47:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:00 INFO - 'MOZ_NO_REMOTE': '1', 00:47:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:00 INFO - 'NO_EM_RESTART': '1', 00:47:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:00 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:00 INFO - 'SHELL': '/bin/bash', 00:47:00 INFO - 'SHLVL': '1', 00:47:00 INFO - 'TERM': 'linux', 00:47:00 INFO - 'TMOUT': '86400', 00:47:00 INFO - 'USER': 'cltbld', 00:47:00 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:00 INFO - '_': '/tools/buildbot/bin/python'} 00:47:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:00 INFO - Downloading/unpacking psutil>=0.7.1 00:47:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:02 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 00:47:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 00:47:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 00:47:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:47:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:47:02 INFO - Installing collected packages: psutil 00:47:02 INFO - Running setup.py install for psutil 00:47:02 INFO - building 'psutil._psutil_linux' extension 00:47:02 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 00:47:02 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 00:47:03 INFO - building 'psutil._psutil_posix' extension 00:47:03 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 00:47:03 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 00:47:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:47:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:47:03 INFO - Successfully installed psutil 00:47:03 INFO - Cleaning up... 00:47:03 INFO - Return code: 0 00:47:03 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 00:47: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')]} 00:47:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47: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')]} 00:47:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47: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', '--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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:03 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 00:47:03 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 00:47:03 INFO - Using env: {'DISPLAY': ':0', 00:47:03 INFO - 'HOME': '/home/cltbld', 00:47:03 INFO - 'LANG': 'en_US.UTF-8', 00:47:03 INFO - 'LANGUAGE': 'en_US:en', 00:47:03 INFO - 'LOGNAME': 'cltbld', 00:47:03 INFO - 'MAIL': '/var/mail/cltbld', 00:47:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:03 INFO - 'MOZ_NO_REMOTE': '1', 00:47:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:03 INFO - 'NO_EM_RESTART': '1', 00:47:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:03 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:03 INFO - 'SHELL': '/bin/bash', 00:47:03 INFO - 'SHLVL': '1', 00:47:03 INFO - 'TERM': 'linux', 00:47:03 INFO - 'TMOUT': '86400', 00:47:03 INFO - 'USER': 'cltbld', 00:47:03 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:03 INFO - '_': '/tools/buildbot/bin/python'} 00:47:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:03 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 00:47:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:05 INFO - Downloading mozsystemmonitor-0.0.tar.gz 00:47:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 00:47:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 00:47:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 00:47:05 INFO - Installing collected packages: mozsystemmonitor 00:47:05 INFO - Running setup.py install for mozsystemmonitor 00:47:05 INFO - Successfully installed mozsystemmonitor 00:47:05 INFO - Cleaning up... 00:47:05 INFO - Return code: 0 00:47:05 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 00:47:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:47:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:47:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:05 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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:05 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 00:47:05 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 00:47:05 INFO - Using env: {'DISPLAY': ':0', 00:47:05 INFO - 'HOME': '/home/cltbld', 00:47:05 INFO - 'LANG': 'en_US.UTF-8', 00:47:05 INFO - 'LANGUAGE': 'en_US:en', 00:47:05 INFO - 'LOGNAME': 'cltbld', 00:47:05 INFO - 'MAIL': '/var/mail/cltbld', 00:47:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:05 INFO - 'MOZ_NO_REMOTE': '1', 00:47:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:05 INFO - 'NO_EM_RESTART': '1', 00:47:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:05 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:05 INFO - 'SHELL': '/bin/bash', 00:47:05 INFO - 'SHLVL': '1', 00:47:05 INFO - 'TERM': 'linux', 00:47:05 INFO - 'TMOUT': '86400', 00:47:05 INFO - 'USER': 'cltbld', 00:47:05 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:05 INFO - '_': '/tools/buildbot/bin/python'} 00:47:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:05 INFO - Downloading/unpacking blobuploader==1.2.4 00:47: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 00:47: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 00:47: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 00:47: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 00:47: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 00:47: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 00:47:07 INFO - Downloading blobuploader-1.2.4.tar.gz 00:47:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 00:47:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 00:47:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 00:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 00:47:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 00:47:07 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 00:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:47:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:47:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:47:07 INFO - Downloading docopt-0.6.1.tar.gz 00:47:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 00:47:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 00:47:07 INFO - Installing collected packages: blobuploader, requests, docopt 00:47:07 INFO - Running setup.py install for blobuploader 00:47:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 00:47:08 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 00:47:08 INFO - Running setup.py install for requests 00:47:08 INFO - Running setup.py install for docopt 00:47:08 INFO - Successfully installed blobuploader requests docopt 00:47:08 INFO - Cleaning up... 00:47:08 INFO - Return code: 0 00:47:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 00:47:08 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')]} 00:47:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:08 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')]} 00:47:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:08 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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:08 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 00:47:08 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 00:47:08 INFO - Using env: {'DISPLAY': ':0', 00:47:08 INFO - 'HOME': '/home/cltbld', 00:47:08 INFO - 'LANG': 'en_US.UTF-8', 00:47:08 INFO - 'LANGUAGE': 'en_US:en', 00:47:08 INFO - 'LOGNAME': 'cltbld', 00:47:08 INFO - 'MAIL': '/var/mail/cltbld', 00:47:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:08 INFO - 'MOZ_NO_REMOTE': '1', 00:47:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:08 INFO - 'NO_EM_RESTART': '1', 00:47:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:08 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:08 INFO - 'SHELL': '/bin/bash', 00:47:08 INFO - 'SHLVL': '1', 00:47:08 INFO - 'TERM': 'linux', 00:47:08 INFO - 'TMOUT': '86400', 00:47:08 INFO - 'USER': 'cltbld', 00:47:08 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:08 INFO - '_': '/tools/buildbot/bin/python'} 00:47:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 00:47:08 INFO - Running setup.py (path:/tmp/pip-9upcrA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 00:47:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 00:47:08 INFO - Running setup.py (path:/tmp/pip-EBHI0J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 00:47:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 00:47:08 INFO - Running setup.py (path:/tmp/pip-wN1F2b-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 00:47:08 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 00:47:08 INFO - Running setup.py (path:/tmp/pip-KIWWK5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 00:47:09 INFO - Running setup.py (path:/tmp/pip-Ww9JM1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 00:47:09 INFO - Running setup.py (path:/tmp/pip-qJ5BYU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 00:47:09 INFO - Running setup.py (path:/tmp/pip-zze7Kg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 00:47:09 INFO - Running setup.py (path:/tmp/pip-ICJ_1u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 00:47:09 INFO - Running setup.py (path:/tmp/pip-yKT5JO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 00:47:09 INFO - Running setup.py (path:/tmp/pip-2lQphx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 00:47:09 INFO - Running setup.py (path:/tmp/pip-65dvps-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 00:47:09 INFO - Running setup.py (path:/tmp/pip-HEJVsj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 00:47:09 INFO - Running setup.py (path:/tmp/pip-2nVALq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 00:47:09 INFO - Running setup.py (path:/tmp/pip-c8CDeh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 00:47:09 INFO - Running setup.py (path:/tmp/pip-5hNfHS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 00:47:09 INFO - Running setup.py (path:/tmp/pip-Ks54Kq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 00:47:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 00:47:09 INFO - Running setup.py (path:/tmp/pip-o4jfFd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 00:47:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 00:47:09 INFO - Running setup.py install for manifestparser 00:47:10 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for mozcrash 00:47:10 INFO - Running setup.py install for mozdebug 00:47:10 INFO - Running setup.py install for mozdevice 00:47:10 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for mozfile 00:47:10 INFO - Running setup.py install for mozhttpd 00:47:10 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for mozinfo 00:47:10 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for mozInstall 00:47:10 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for mozleak 00:47:10 INFO - Running setup.py install for mozlog 00:47:10 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 00:47:10 INFO - Running setup.py install for moznetwork 00:47:11 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Running setup.py install for mozprocess 00:47:11 INFO - Running setup.py install for mozprofile 00:47:11 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Running setup.py install for mozrunner 00:47:11 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Running setup.py install for mozscreenshot 00:47:11 INFO - Running setup.py install for moztest 00:47:11 INFO - Running setup.py install for mozversion 00:47:11 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 00:47:11 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 00:47:11 INFO - Cleaning up... 00:47:11 INFO - Return code: 0 00:47:11 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 00:47:11 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')]} 00:47:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:11 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')]} 00:47:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:11 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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:11 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 00:47:11 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 00:47:11 INFO - Using env: {'DISPLAY': ':0', 00:47:11 INFO - 'HOME': '/home/cltbld', 00:47:11 INFO - 'LANG': 'en_US.UTF-8', 00:47:11 INFO - 'LANGUAGE': 'en_US:en', 00:47:11 INFO - 'LOGNAME': 'cltbld', 00:47:11 INFO - 'MAIL': '/var/mail/cltbld', 00:47:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:11 INFO - 'MOZ_NO_REMOTE': '1', 00:47:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:11 INFO - 'NO_EM_RESTART': '1', 00:47:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:11 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:11 INFO - 'SHELL': '/bin/bash', 00:47:11 INFO - 'SHLVL': '1', 00:47:11 INFO - 'TERM': 'linux', 00:47:11 INFO - 'TMOUT': '86400', 00:47:11 INFO - 'USER': 'cltbld', 00:47:11 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:11 INFO - '_': '/tools/buildbot/bin/python'} 00:47:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:11 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 00:47:11 INFO - Running setup.py (path:/tmp/pip-dqtguJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 00:47:12 INFO - Running setup.py (path:/tmp/pip-S9Nttg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 00:47:12 INFO - Running setup.py (path:/tmp/pip-aFjW2e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 00:47:12 INFO - Running setup.py (path:/tmp/pip-k9Nzhg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 00:47:12 INFO - Running setup.py (path:/tmp/pip-vFXRi7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 00:47:12 INFO - Running setup.py (path:/tmp/pip-ddDaJO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 00:47:12 INFO - Running setup.py (path:/tmp/pip-YjQ6pN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 00:47:12 INFO - Running setup.py (path:/tmp/pip-eDVG0H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 00:47:12 INFO - Running setup.py (path:/tmp/pip-WeaEjp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 00:47:12 INFO - Running setup.py (path:/tmp/pip-Px0H92-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 00:47:12 INFO - Running setup.py (path:/tmp/pip-IsZLqE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 00:47:12 INFO - Running setup.py (path:/tmp/pip-OD3kxa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 00:47:12 INFO - Running setup.py (path:/tmp/pip-8Qs5I4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 00:47:12 INFO - Running setup.py (path:/tmp/pip-HAopZT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 00:47:12 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)) 00:47:12 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 00:47:12 INFO - Running setup.py (path:/tmp/pip-mwuAa2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 00:47:13 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)) 00:47:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 00:47:13 INFO - Running setup.py (path:/tmp/pip-n3gbw2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 00:47:13 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)) 00:47:13 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 00:47:13 INFO - Running setup.py (path:/tmp/pip-yIHhbT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 00:47:13 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)) 00:47:13 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)) 00:47:13 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)) 00:47:13 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)) 00:47:13 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)) 00:47:13 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)) 00:47:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 00:47:13 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 00:47:13 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 00:47:13 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 00:47:13 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 00:47:13 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 00:47:13 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 00:47:14 INFO - Downloading blessings-1.5.1.tar.gz 00:47:14 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 00:47:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 00:47:14 INFO - Installing collected packages: blessings 00:47:14 INFO - Running setup.py install for blessings 00:47:15 INFO - Successfully installed blessings 00:47:15 INFO - Cleaning up... 00:47:15 INFO - Return code: 0 00:47:15 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 00:47:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 00:47:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 00:47:15 INFO - Reading from file tmpfile_stdout 00:47:15 INFO - Current package versions: 00:47:15 INFO - argparse == 1.2.1 00:47:15 INFO - blessings == 1.5.1 00:47:15 INFO - blobuploader == 1.2.4 00:47:15 INFO - docopt == 0.6.1 00:47:15 INFO - manifestparser == 1.1 00:47:15 INFO - mozInstall == 1.12 00:47:15 INFO - mozcrash == 0.16 00:47:15 INFO - mozdebug == 0.1 00:47:15 INFO - mozdevice == 0.47 00:47:15 INFO - mozfile == 1.2 00:47:15 INFO - mozhttpd == 0.7 00:47:15 INFO - mozinfo == 0.9 00:47:15 INFO - mozleak == 0.1 00:47:15 INFO - mozlog == 3.0 00:47:15 INFO - moznetwork == 0.27 00:47:15 INFO - mozprocess == 0.22 00:47:15 INFO - mozprofile == 0.27 00:47:15 INFO - mozrunner == 6.11 00:47:15 INFO - mozscreenshot == 0.1 00:47:15 INFO - mozsystemmonitor == 0.0 00:47:15 INFO - moztest == 0.7 00:47:15 INFO - mozversion == 1.4 00:47:15 INFO - psutil == 3.1.1 00:47:15 INFO - requests == 1.2.3 00:47:15 INFO - wsgiref == 0.1.2 00:47:15 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 00:47:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:47:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:47:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:47:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:47:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:47:15 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 0x7fee69125c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc836c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd443d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, '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': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', '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 00:47:15 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 00:47:15 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 00:47:15 INFO - Using env: {'DISPLAY': ':0', 00:47:15 INFO - 'HOME': '/home/cltbld', 00:47:15 INFO - 'LANG': 'en_US.UTF-8', 00:47:15 INFO - 'LANGUAGE': 'en_US:en', 00:47:15 INFO - 'LOGNAME': 'cltbld', 00:47:15 INFO - 'MAIL': '/var/mail/cltbld', 00:47:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:15 INFO - 'MOZ_NO_REMOTE': '1', 00:47:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:15 INFO - 'NO_EM_RESTART': '1', 00:47:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:15 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:15 INFO - 'SHELL': '/bin/bash', 00:47:15 INFO - 'SHLVL': '1', 00:47:15 INFO - 'TERM': 'linux', 00:47:15 INFO - 'TMOUT': '86400', 00:47:15 INFO - 'USER': 'cltbld', 00:47:15 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:15 INFO - '_': '/tools/buildbot/bin/python'} 00:47:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 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)) 00:47:15 INFO - Cleaning up... 00:47:15 INFO - Return code: 0 00:47:15 INFO - Running post-action listener: _resource_record_post_action 00:47:15 INFO - Running post-action listener: _start_resource_monitoring 00:47:15 INFO - Starting resource monitoring. 00:47:15 INFO - ##### 00:47:15 INFO - ##### Running install step. 00:47:15 INFO - ##### 00:47:15 INFO - Running pre-action listener: _resource_record_pre_action 00:47:15 INFO - Running main action method: install 00:47:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 00:47:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 00:47:15 INFO - Reading from file tmpfile_stdout 00:47:15 INFO - Detecting whether we're running mozinstall >=1.0... 00:47:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 00:47:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 00:47:15 INFO - Reading from file tmpfile_stdout 00:47:15 INFO - Output received: 00:47:15 INFO - Usage: mozinstall [options] installer 00:47:15 INFO - Options: 00:47:15 INFO - -h, --help show this help message and exit 00:47:15 INFO - -d DEST, --destination=DEST 00:47:15 INFO - Directory to install application into. [default: 00:47:15 INFO - "/builds/slave/test-pgo"] 00:47:15 INFO - --app=APP Application being installed. [default: firefox] 00:47:15 INFO - mkdir: /builds/slave/test-pgo/build/application 00:47:15 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'] 00:47:15 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 00:47:30 INFO - Reading from file tmpfile_stdout 00:47:30 INFO - Output received: 00:47:30 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 00:47:30 INFO - Running post-action listener: _resource_record_post_action 00:47:30 INFO - ##### 00:47:30 INFO - ##### Running run-tests step. 00:47:30 INFO - ##### 00:47:30 INFO - Running pre-action listener: _resource_record_pre_action 00:47:30 INFO - Running main action method: run_tests 00:47:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 00:47:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 00:47:30 INFO - Python 2.7.3 00:47:30 INFO - Return code: 0 00:47:30 INFO - grabbing minidump binary from tooltool 00:47:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 00:47:30 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 0xdcd8c0>, '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 0xd7a420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7a8b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 00:47:30 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 00:47:30 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 00:47:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 00:47:30 INFO - Return code: 0 00:47:30 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 00:47:30 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 00:47:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 00:47:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 00:47:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 00:47:30 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/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 00:47:30 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/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-031 --webServer localhost 00:47:30 INFO - Using env: {'DISPLAY': ':0', 00:47:30 INFO - 'HOME': '/home/cltbld', 00:47:30 INFO - 'LANG': 'en_US.UTF-8', 00:47:30 INFO - 'LANGUAGE': 'en_US:en', 00:47:30 INFO - 'LOGNAME': 'cltbld', 00:47:30 INFO - 'MAIL': '/var/mail/cltbld', 00:47:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 00:47:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 00:47:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:47:30 INFO - 'MOZ_NO_REMOTE': '1', 00:47:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 00:47:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:47:30 INFO - 'NO_EM_RESTART': '1', 00:47:30 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:47:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 00:47:30 INFO - 'PWD': '/builds/slave/test-pgo', 00:47:30 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 00:47:30 INFO - 'SHELL': '/bin/bash', 00:47:30 INFO - 'SHLVL': '1', 00:47:30 INFO - 'TERM': 'linux', 00:47:30 INFO - 'TMOUT': '86400', 00:47:30 INFO - 'USER': 'cltbld', 00:47:30 INFO - 'XDG_SESSION_COOKIE': 'a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201', 00:47:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:47:30 INFO - '_': '/tools/buildbot/bin/python'} 00:47:30 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/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--webServer', 'localhost'] with output_timeout 3600 00:47:30 INFO - mozversion INFO | application_buildid: 20151117233007 00:47:30 INFO - mozversion INFO | application_changeset: c699b2c839a9f8c2b964dd956de9084d3b93a13f 00:47:30 INFO - mozversion INFO | application_display_name: Nightly 00:47:30 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 00:47:30 INFO - mozversion INFO | application_name: Firefox 00:47:30 INFO - mozversion INFO | application_remotingname: firefox 00:47:30 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 00:47:30 INFO - mozversion INFO | application_vendor: Mozilla 00:47:30 INFO - mozversion INFO | application_version: 45.0a1 00:47:30 INFO - mozversion INFO | platform_buildid: 20151117233007 00:47:30 INFO - mozversion INFO | platform_changeset: c699b2c839a9f8c2b964dd956de9084d3b93a13f 00:47:30 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 00:47:30 INFO - mozversion INFO | platform_version: 45.0a1 00:47:30 INFO - 2015-11-18 00:47:30,472 DEBUG : using testdate: 1447836450 00:47:30 INFO - 2015-11-18 00:47:30,472 DEBUG : actual date: 1447836450 00:47:30 INFO - 2015-11-18 00:47:30,520 INFO : starting webserver on 'localhost:47083' 00:47:30 INFO - 2015-11-18 00:47:30,522 INFO : Starting test suite talos-linux64-ix-031 00:47:30 INFO - 2015-11-18 00:47:30,522 INFO : Starting test dromaeo_css 00:47:30 INFO - 2015-11-18 00:47:30,522 DEBUG : operating with platform_type : linux_ 00:47:30 INFO - 2015-11-18 00:47:30,523 INFO : Initialising browser for dromaeo_css test... 00:47:30 INFO - 2015-11-18 00:47:30,539 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpMW7LnS/profile http://localhost:47083/getInfo.html 00:47:34 INFO - 2015-11-18 00:47:34,637 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 00:47:34 INFO - 2015-11-18 00:47:34,637 DEBUG : BROWSER_OUTPUT: colorDepth:24 00:47:34 INFO - 2015-11-18 00:47:34,638 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 00:47:34 INFO - 2015-11-18 00:47:34,638 DEBUG : BROWSER_OUTPUT: __metrics 00:47:34 INFO - 2015-11-18 00:47:34,815 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 00:47:36 INFO - 2015-11-18 00:47:36,059 INFO : Browser initialized. 00:47:36 INFO - 2015-11-18 00:47:36,060 INFO : Running cycle 1/1 for dromaeo_css test... 00:47:36 INFO - 2015-11-18 00:47:36,060 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpMW7LnS/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 00:47:47 INFO - 2015-11-18 00:47:47,793 DEBUG : BROWSER_OUTPUT: RSS: Main: 141565952 00:47:47 INFO - 2015-11-18 00:47:47,793 DEBUG : BROWSER_OUTPUT: 00:48:39 INFO - 2015-11-18 00:48:39,245 DEBUG : BROWSER_OUTPUT: 1447836519243 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] 00:50:47 INFO - 2015-11-18 00:50:47,550 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47083/tests/dromaeo/cssquery-ext.html) 00:50:48 INFO - 2015-11-18 00:50:48,722 DEBUG : BROWSER_OUTPUT: RSS: Main: 256290816 00:50:48 INFO - 2015-11-18 00:50:48,722 DEBUG : BROWSER_OUTPUT: 00:53:51 INFO - 2015-11-18 00:53:51,112 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-ext.html (next: http://localhost:47083/tests/dromaeo/cssquery-jquery.html) 00:53:51 INFO - 2015-11-18 00:53:51,673 DEBUG : BROWSER_OUTPUT: RSS: Main: 216403968 00:53:51 INFO - 2015-11-18 00:53:51,673 DEBUG : BROWSER_OUTPUT: 00:56:53 INFO - 2015-11-18 00:56:53,600 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47083/tests/dromaeo/cssquery-mootools.html) 00:56:54 INFO - 2015-11-18 00:56:54,162 DEBUG : BROWSER_OUTPUT: RSS: Main: 207859712 00:56:54 INFO - 2015-11-18 00:56:54,162 DEBUG : BROWSER_OUTPUT: 00:59:55 INFO - 2015-11-18 00:59:55,944 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47083/tests/dromaeo/cssquery-prototype.html) 00:59:56 INFO - 2015-11-18 00:59:56,525 DEBUG : BROWSER_OUTPUT: RSS: Main: 199737344 00:59:56 INFO - 2015-11-18 00:59:56,526 DEBUG : BROWSER_OUTPUT: 01:02:58 INFO - 2015-11-18 01:02:58,967 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47083/tests/dromaeo/cssquery-yui.html) 01:02:59 INFO - 2015-11-18 01:02:59,549 DEBUG : BROWSER_OUTPUT: RSS: Main: 200155136 01:02:59 INFO - 2015-11-18 01:02:59,549 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,082 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/dromaeo/cssquery-yui.html (next: http://localhost:47083/tests/dromaeo/cssquery-dojo.html) 01:06:02 INFO - 2015-11-18 01:06:02,340 DEBUG : BROWSER_OUTPUT: RSS: Main: 246591488 01:06:02 INFO - 2015-11-18 01:06:02,341 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,341 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:06:02 INFO - 2015-11-18 01:06:02,341 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:06:02 INFO - 2015-11-18 01:06:02,341 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:06:02 INFO - 2015-11-18 01:06:02,342 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:06:02 INFO - 2015-11-18 01:06:02,342 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3140.5760222369977;3199.13623321703;3235.2235463488755;3250.5124231365294;3255.2350197703545;5159.793608255674;5310.893782124364;5330.946690533094;5376.462353764627;5402.35171779386;5326.174442961347;5381.300430943972;5398.865028374293;5416.83749487516;5457;4792.448868380128;4877.170880950247;4981.576565991895;5001.974990125044;5050.84847454577;4947.802087916479;4981.203007518798;5030.019146266462;5030.245463180516;5082.288479612857;4826.565609095181;4834;4919.72941488218;4933.333999910038;4935.210366341386;5007.799688012475;5024.221245706921;5030.119729047402;5039.521245481674;5053.722045287508;4965.106280869442;4974.328465657162;4993.750312484398;5010.123228435045;5076.314697515862;5066.721330326831;5175.353080864892;5182.481751824825;5184.766685499124;5196.558292545138;5751.712414379264;5780.53755699543;5786.045302525078;5867.530597552186;5911.408859114097;5782.392848750905;5787.652740835563;5790.507806836424;5794.536437085023;5805.4194580542035;5223.2948551945765;5395.973020134914;5402.945970540283;5409.188621706736;5425.077736784717;5747.224124743189;5786.826395208151;5897.587168898136;5905.232319798484;5935.169076329317;5794.739236734273;5816.447437493432;5817.854553636108;5819.388964158787;5826.126081087871;5710.2862142232225;5823.126531020381;5890.381509941394;5920.615160014585;5921.940780592225;5653;5750.453706897838;5757.251557297524;5760.798372056958;5797.623154494944;5828.271466066742;5835.94164058354;5861.9413805861395;5866.2373891393845;5874.706264686749;4360.629346505582;4368.497622773358;4456.821727130879;4512.571305725951;4528.7509186994375;3987.222491614107;4015.31739604268;4047.6761859051207;4071.1043570414463;4087.4073259377224;5536.141898005815;5569.248151499577;5572.414896435897;5575.916361254584;5579.860503487364;5711.143328500675;5715.5713321500225;5826.82519524415;5860.062390017577;5886.117082437669;5546.91679624806;5603.523700485504;5632.352279487829;5633.774649014075;5636.464535869086;5197.272381866542;5215.947840521546;5217.8173763918085;5220.582353411718;5270.288511051036;5862.560307976919;5954.047352423591;5999.610025348338;6041.305249896318;6091.8477038073515;5673.943260567342;5674.517665998271;5682.943170568242;5700.657960522382;5851.561132914963;5688.459596338341;5858.882822343444;5862.736176872137;5866.735996880236;5888.087346461305;5488.807891723771;5566.081596536688;5569.832905012856;5602.411746766531;5744.0522313817755;5733.827985160452;5768;5768.192453056491;5771.4517120875125;5775.94224057754;5466.781328746805;5599.992001439617;5600.85997850057;5614.887702246014;5616.971915140398;5550.111982082847;5612.382637909908;5615.747291371817;5622;5670.574706896917;5472.20653005304;5472.425395333592;5474.288342515448;5474.42518535564;5491.7254137292175;5512.972435137799;5591.664500130005;5619.634723742944;5623.2127502148915;5669.971650141888;5450.754716037709;5472.726363681721;5474.890502190014;5484.451554844483;5512.751926163252 01:06:02 INFO - 2015-11-18 01:06:02,342 DEBUG : BROWSER_OUTPUT: |1;ext.html;552.1800126811684;593.9346671866094;601.1463721515447;603.9154518367429;607.857228410588;32499.512507312378;40926;41433.58566414342;41535.37696934548;41697.583024169784;42077.158456830846;42556.36165457513;42556.57443425565;42633.57366426335;42743;7718.8456230875345;7867.645955931968;7881.290683838453;8777.16616921393;8983.011868694439;7825;7927.484713493604;10236.692899212998;10238.590456381773;10327.380357178594;10527.105196058345;10637.255392122555;10637.361758294488;10637.680869573926;10649.467526623677;7880.527168369858;10504.05463508284;10602.734931626694;10623.787524249472;10623.78752424951;7779.72770953014;10589.470526473646;10751.78496430067;10796.51415686296;10809.621663241827;39207.60792392068;39777;39811.8009409954;39824.60175398238;39835.60164398377;3263.1515805890403;3321.717653999413;3472.878449254264;3552.3960926642535;3807.0292075520842;29874.85062574673;30049.399012019854;30213.338266395338;30242.54636180459;31524;3335.8665653373837;3338.4658454647383;3372.3086767212662;3395.6604339566093;3462.186386199241;266609;266816;268195.999999998;268377;269277;57163.42836571581;58311.70844145752;59631.70184149052;59934.70032649896;65582;61240.387596123466;61248.08127878085;61480.69259653763;61540.69229653823;61545.692271538355;14214.076085054437;14387.568372948828;14389.496367627293;14396.928015359856;14402.927985360006;10755.623553175601;10785.730356741144;10806.837897431387;10810.783784324427;10813.945930270298;19468.513287167934;19602.313919012766;19744.70382944257;19747.605047899247;19770.50573735668;7568.129665088585;7694.923050769421;7818.257265559762;7827.217278272127;7851.646675899598;815.7185770909027;831.2643310670101;994.2294721590825;1024.472396715692;1046.7173863057085;28752.71247287542;28814.855925720658;29036.564451533242;29193.416131677248;29344.41311173807;970.45169479244;1053.9420331881668;1083.5394957143183;1083.6207327435334;1100.4332768624165;14927;15179.924100379649;15207.239638018054;15383.384664613513;15498.84501154974;315593;320526;320955;321121;322399;52020.47979520232;52916;52942.20586691203;52961;52983.470165298626;1248.294713486877;1253.0476837603487;1285.1068507387463;1285.845698516184;1290.0775945199227;23979.279256842994;28642.85678571594;28892.42215155643;28913.42173156567;29265.268368290963;42267.7886610565;42946;42986.57013429826;43036;43059.354109689004;283792;284141;284556;284781;285179;27926.720732793226;28139.0454002335;28566.71433285724;30476.84761576178;31996.5200521997;38571.80714096524;38809.2238155241;39159.80420097881;39668;39815.60184398119;35350;35624.109397265274;35751.64248357483;36185;36775.08062298464;29425.411491770472;35138.648613513535;35263.82368088143;35696.28607427889;36229.818850905576;32856;33347.1663208412;33448.33103337968;34206.14484637904;34218;31502.369952600362;31888;32693.836530818146;33181.17047073843;33266.66733332635;23511.177108801796;23561.29316120519;23615.64576531319;23626.17308394198;23685.17101901425 01:06:02 INFO - 2015-11-18 01:06:02,342 DEBUG : BROWSER_OUTPUT: |2;jquery.html;345.41452238455827;348.8116417134747;349.90027842065;356.5400633183195;359.72660777808863;14300.856991430082;14383.712325753479;17444.91277543612;17912.104394780275;18619.06904654767;14797.482088126917;15373.231338433061;15562.221888905566;15597.610059748513;16375.263113159906;5339.5728341732665;5466.480684334982;5467.097928841737;5482.835514934558;5485.725713714318;4029.858954936578;4114.053767633446;5421.376541697696;5454.945450545483;5837.708114594275;5953.613015154001;5967.850803729898;5974.5220382369525;5980.222571065777;6007.098935159739;4698.812047518095;4795.952040479586;4798.376211092571;4806.110869489121;6045.939540604603;4058.8782336529953;4112.835486580533;4158.563350848148;4166.687498437599;4172.666186705056;13208.33958302081;13212.86787132126;13313.400896959563;13406.46374145033;13433.32833358338;1805.6117934643983;1846.759921210234;1892.280933245358;1952.5509132899372;1979.9505012374661;9446.85829712555;9687.079727425884;9755.902440975571;9891;10048.246381521416;1659.6846599146245;1662.185529090749;1663.3180396037567;1757.1038770227276;1764.153206460906;58752.11871821926;60365.39634603642;63105;63352;63535.36464635341;6813.659317034228;6939.930600693929;6980.162380514371;6986.9650651746415;7076.92923070773;8341.582920854054;8394.370422218235;8408.033076196194;8416.410851240355;8420.663173472993;5421.2139239810795;5436.695193153615;5459.945400545944;5495.862603434946;5498.202760599691;5459.672419654833;5466.726663666801;5471.343438787291;5535.059039963216;5547.057000309957;3244.059222825354;3283.4254005548933;3287.7369810415107;3300.884469043572;3315.535824984504;1051.4007016000805;1090.231386872253;1124.746931940307;1162.0819552553558;1184.0468422919632;440.0385158428843;450.3267614915722;456.8743595511194;461.79680940386123;474;10360.792784144274;10987.945060274647;11463.254888432391;11625.535998080888;12068.215565988183;465.14407514019496;473.15305602970983;483.68077069134904;501.1005245584185;518.7665550502289;6152.200213972155;6498.707558159894;6566.146400967939;6566.376194261537;6655.43428808547;481247.6117217963;511890;532304;542193;543791;71127.64436177786;71264.28735712577;71528.64235678893;72225.27774722186;72891;550.82098318046;559.4489427913502;562.7355143082744;563.715323761506;563.8562166647479;10896.836547451636;10908.6727398175;11003.559857605926;11059.170562207706;11161.720956975816;35008;35068;35355.82322088373;35973.82013089918;36394.63605363912;46326.30510542412;46675.53324466712;47658.761706191246;48203.51796482131;48359.5164048355;6518.2504012037325;6586.045023471665;6608.603483790988;6639.236487803964;6661.233958094881;11757.823632645346;11891.167618266638;12031.819522706992;12207.267563946192;12241.143119981516;10745.570177192825;10949.616763413242;11035.337879727242;11047;11075.72310692239;10231.897681023094;10293.330933489298;10359;10709.785804284027;10850;10237.692869213935;10449.164066874784;10464.267501274837;10529.684109476728;10559.736006599896;6540.934590654223;6900.171979362308;6902.033715279966;6902.723891044302;6914.896276555956;9052.456852588866;10686.8931310689;10843.403612801372;11033.889661103607;11110.777784444428 01:06:02 INFO - 2015-11-18 01:06:02,343 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1326.2109045118152;1630.5597488678056;1711.02471591193;1727.4299481171215;1761.4803632928276;6921.688524016418;7264.527805692633;7365.189829118793;7377.225391333906;7394.593297368642;7498.88751668724;7607.505512141721;7610.505317154395;7611.657475413605;7611.847763044736;2254.120892851789;2276.35123989663;2276.84062115652;2281.1445707859552;2282.4179834142356;2298.092253559843;2303.67748515208;2353.470469144437;2356.5404746074523;2357.54027964547;2277.52172043871;2292.3695983604557;2303.7120359955006;2303.8156947444163;2305.296884450242;2274.72703275608;2287.2680742162515;2292.1175347491253;2293.552757212344;2298.321995011476;2289.496310811619;2300.0799680127916;2303.055747143663;2303.8272129590346;2303.8387312888103;6742.190937087532;6872.587644741331;7668.923310766877;7710.845783084307;7714.961425192838;4289.206496798102;4368.759718215497;4371.453568303962;4396.648268138541;4398.032432864797;2927.575501552284;2970.55441683747;3001.9399612007637;3007.6992300769966;3036.2712948892326;1010.5907107621425;1013.381837079381;1023.7798873242214;1025.8409946458312;1035.3891204189565;10559.683209503728;10593.364398136137;10612.469376531142;10615.150787936947;10623.150147988143;4175.144095460423;4184.205001049791;4236.216299984513;4309.332053531645;4321.762303073361;9034.909650903539;9057.04900985387;9065.59204835784;9066.274698024143;9070.183683468387;4648.1865673507;4649.67452278344;4649.744264065441;4655.231886738718;4655.837045703384;4214.473190851144;4220.451341325608;4220.556841531657;4222.662187025031;4226.429432026698;3588.8564457421935;3621.6378362163573;3639.872604458831;3661.908452288661;3678.4482327651067;1196.8144937534696;1200.1359021504502;1204.235310577772;1209.7640960012889;1220.2556440571245;1042.7705904700954;1060.5121644043672;1066.184368957748;1173.8650055243586;1295.1581472043247;7186.209516953236;7232.276772322725;7282.599457029808;7285.453590980697;7290.234525374865;415.17380412977957;416.35257175092414;416.36296466406446;418.8827128404052;431.1248166222573;5298.046351656739;5670.206171136044;5723.599348045597;5735.082386818089;5744.253247077937;8550.957245213734;8681.652733890574;8716.12838716136;8935.821283574292;8937.150970657776;8776.956115219384;8782.297416206817;8800.251978581764;8830.470171789584;8901.243394311427;7151.570905745672;7171.49799514029;7233.421326293989;7244.166920804069;7260.23767504415;6831.214410342675;6966.303369663196;7007.544509606859;7019.894701579583;7027.4729395294535;8073.717419890276;8083.474574152661;8160.18398160203;8339.082700902774;8343.707970221014;8202.917970820215;8302.875456868273;8494.74515764528;8499.95750021246;8500.404971651926;6905.965470172617;7022.964885175541;7037.507374483942;7045.154581450054;7049.541779784297;7475.962620186864;7517.511361761468;7542.170361260147;7545.660445279866;7563.281488258606;6989.825254368681;7000.579965202104;7104.254053324326;7128.465365097535;7159.928400715926;6932.556061868857;6937.791866244021;6961.686724097529;7031.156261248683;7062.435005199469;6792.694328755119;6825.692843822139;6829.453643708591;6837.897431538431;6853.314668533107;6360.618362898241;6418.679066046772;6443.130177426175;6454.870902581828;6457.61254324742;6507.902381464187;6544.6727663615675;6558.770443034471;6565.376289252514;6565.540412171103 01:06:02 INFO - 2015-11-18 01:06:02,343 DEBUG : BROWSER_OUTPUT: |4;prototype.html;320.0941336019065;323.374270786029;332.43983887150154;337.04111801923517;346.69490848053726;6045.576809623328;6147.446729794317;6175.598586091906;6178.752849886005;6179.81460556184;5805.506531944779;5889.322727886294;5953.940460595392;6026.969865150668;6035.7283922223605;4640.187967105743;4663.277192035223;4669.112868554972;4673.597920623816;4677.4854765975715;4432.800523976429;4646.4191976003;4678.90642187156;4680.25115981443;4681.672282940195;4480.395146655209;4537.886552836172;4612.469565999902;4614.769261536927;4625.098105869357;4605.102005109005;4615.653825963066;4615.676902616819;4623;4634.374359461463;4024.2353952748886;4026.074002979302;4034.668559375399;4040.3535434330365;4042.5957404259634;5663.207150998864;5766.855828604276;5776.422357764232;5783.537317014629;5784.913226301609;5397.649152805095;5406;5419.024575576394;5420.783168673248;5424.783008679648;6506.869862602769;6508.57694249877;6509.609423434562;6515.218173819172;6527.804165875032;4471.061077173765;4479.619232365253;4484.1928452878465;4489.147062058231;4499.055198408339;6559.180102487189;6639.136912201383;6680.5991640501725;6714.362135597111;6729.596224226513;4546.931796023062;4551.7724113794175;4560.4527456704745;4560.771961401983;4562.24722920721;4609.147307748078;4610.677252592286;4613.861584152481;4617.422822147231;4623.630109591225;5361.463853614685;5368.543673787772;5369.892602147936;5373.731313434313;5377.704226267515;6344.39728225827;6492.902606460907;6506.642134682638;6515.4787616990525;6520.054592084121;1602.3590563774583;1628.0882705684855;1629.902205867628;1630.6494103767748;1633.4283000949572;1051.374432212832;1060.4750648429076;1073.2219141122623;1074.0172741941192;1080.573173596425;6224.782132625336;6268.341824108403;6287.685615719196;6301.086342480315;6303.117563541108;6453.451456626145;6720.395164435225;6724.9327506725285;6725.428338591275;6734.56225345351;6133.202683651097;6217.720202590895;6333.809985700436;6341.4609758170145;6346.2067241594805;3612.6026137124895;3664.358737220976;3664.8167591620845;3667.651573100551;3676.5771936227143;6823.829404264933;6995.090638217;7003.194632617314;7005.439564834801;7010.474214433938;6937.479689023243;6958.547694399847;6994.790156295319;7043.36609705129;7056.435485161175;7004.089468369079;7007.423329750867;7010.439164866901;7011.859762804817;7013.438924885997;6612.520304885667;6762.087118238975;6766.763163289262;6774.153230846145;6775.559588626724;6692.933070669231;6694.757256319188;6694.765683201064;6700.798976030727;6701.899471507833;6985.965070174617;6994.685239164148;6996.160460744743;7007.8248043797275;7007.929920700932;4386.780660967002;4579.793909274024;4583.106294272585;4583.977080114578;4591.242444996672;6703.095082163845;6737.292584278776;6755.2231493378895;6756;6761.256261811099;6552.6723663815665;6555.246146693191;6559.311272316338;6564.343565643398;6580;6393.424591786761;6520.152380190734;6524.575902566318;6527.2167339919515;6531.934680653133;6408;6411.358864113738;6414.262359828493;6414.61512309263;6417.03744438338;6554.31179726141;6555.541112122106;6561.671916404065;6562.245341785756;6564.146660934048;6293.150424692608;6402.167718196604;6411.134496842867;6411.455026322628;6416.294207637249 01:06:02 INFO - 2015-11-18 01:06:02,344 DEBUG : BROWSER_OUTPUT: |5;yui.html;835.5738573327601;854.9016863060748;856.8243510080434;857.0529564830862;866.4411454611779;12981.870181298184;13112.213267203975;13319.7336053279;13338.133021353606;13854.030217884752;13648.727025459484;13748.450061997508;13775.242361670103;13785.103968242058;13786.241756703377;683.2313647146959;692.3215249055928;819.7049062337554;829.1915382502042;834.586879494651;817.2726273616486;820.4052062254877;821.4496287487368;821.9301359384459;826.1903334731966;857.6826574167567;859.7420773767844;861.6682577207757;865.4288169807928;865.9177378149097;706.0503622627558;716.8422946951662;851.2381418630322;855.9272461840688;864.0797550608581;635.4058954877205;636.6689321552767;636.8567072408671;637.6174295422755;638.1512588257606;13472;13765.311734413239;13799.310034498336;13803.723925521434;13826.585202443943;12000.639980800503;12118.757624847454;12220.144589878711;12740.426680799386;12905.999999999905;10133.898661013369;10222.131118854832;10257.025582569644;10384;10499.055085042306;3549.290141971616;3572.5534308211472;3582.158192824684;3605.1888325126897;3724.422714479233;47967.520324797006;48723.512764872256;48785.268220976715;49004.26493602599;50448.74775626135;7774.922250777533;7820.061592608923;10184.439855808001;10217.642382516577;10239.18086553074;12329.321887296284;12437.564685235973;12444.875551244371;12449.75100497985;12455.190412623151;6293.465055470245;6863.965680171567;6907.13660792401;6978.79063628092;7136.0723105995885;4220.472440944882;4230.576942305806;4240.406343111967;4241.830326786894;4297.011687311936;2791.6510436195476;2796.7622752066304;2808.0312292259546;2809.143211320526;2816.6197563329097;433.2829167727416;439.3651174053462;443.9289713645866;444.91546606144726;445.0653627382471;575.6776205325032;627.297426881886;643.9935600644027;645.6707079389545;672.2235817630644;8279.586020699062;8316.750497485085;8363.665453381796;8420.957895210608;8547.444416112932;568.4372471253512;571.6855729348924;663.1279866974912;668.2348710726192;684.1584850633649;3730.4963829882618;3835.328817456934;3866.5553461352306;4029.7783621901076;4157.584241575879;57133;58037;58066.709666451396;58413.70793146092;58525.70737146287;47375;47506.5249347509;47933.52066479361;48265;48367.75816120897;44436.3334549982;45602.54397455983;45674.31488527675;47240.291395629094;47395.289070663275;8746.69386571467;8769.298456123368;9125.315601329794;9146.645896990203;9248.398854074463;35129.47305790364;35367;35527.28945421025;35762.92711218668;36238.4564231542;42782.57217427911;45076;47881.281780774014;48011;48297.27554086621;7619.009528761226;7769.184235655401;7952.244536768998;8090.797730056795;8127.106018338096;11994;12220.144589878622;12455.813162802746;12672;12679.366031698562;11155;11304.152188585724;11368.772624547628;11420.143489238506;11584.884151158381;11159.743962990497;11183.543386933243;11713.355765432983;11724.062075034148;12111.878881211074;7816.88274675869;11164.274322169033;11893.821592675944;11944.402779861146;12343.876561234272;10355;10371.325863818827;10463.215258855464;10496.475176241005;10587.735306617396;10050.64822731201;10196.796064078826;10298.845517317097;10344.844827327446;10371.896281037394 01:06:02 INFO - 2015-11-18 01:06:02,344 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:06:02 INFO - 2015-11-18 01:06:02,345 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:06:02 INFO - 2015-11-18 01:06:02,345 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,933 01:06:02 INFO - 2015-11-18 01:06:02,345 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:06:02 INFO - 2015-11-18 01:06:02,345 DEBUG : BROWSER_OUTPUT: __startTimestamp1447837562338__endTimestamp 01:06:02 INFO - 2015-11-18 01:06:02,345 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,348 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:06:02 INFO - 2015-11-18 01:06:02,348 DEBUG : BROWSER_OUTPUT: Number of tests: 6 01:06:02 INFO - 2015-11-18 01:06:02,349 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,349 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5376.12 Median:5569.25 stddev:579.61 (10.4%) stddev-sans-first:554.22 01:06:02 INFO - 2015-11-18 01:06:02,349 DEBUG : BROWSER_OUTPUT: Values: 3140.6 3199.1 3235.2 3250.5 3255.2 5159.8 5310.9 5330.9 5376.5 5402.4 5326.2 5381.3 5398.9 5416.8 5457.0 4792.4 4877.2 4981.6 5002.0 5050.8 4947.8 4981.2 5030.0 5030.2 5082.3 4826.6 4834.0 4919.7 4933.3 4935.2 5007.8 5024.2 5030.1 5039.5 5053.7 4965.1 4974.3 4993.8 5010.1 5076.3 5066.7 5175.4 5182.5 5184.8 5196.6 5751.7 5780.5 5786.0 5867.5 5911.4 5782.4 5787.7 5790.5 5794.5 5805.4 5223.3 5396.0 5402.9 5409.2 5425.1 5747.2 5786.8 5897.6 5905.2 5935.2 5794.7 5816.4 5817.9 5819.4 5826.1 5710.3 5823.1 5890.4 5920.6 5921.9 5653.0 5750.5 5757.3 5760.8 5797.6 5828.3 5835.9 5861.9 5866.2 5874.7 4360.6 4368.5 4456.8 4512.6 4528.8 3987.2 4015.3 4047.7 4071.1 4087.4 5536.1 5569.2 5572.4 5575.9 5579.9 5711.1 5715.6 5826.8 5860.1 5886.1 5546.9 5603.5 5632.4 5633.8 5636.5 5197.3 5215.9 5217.8 5220.6 5270.3 5862.6 5954.0 5999.6 6041.3 6091.8 5673.9 5674.5 5682.9 5700.7 5851.6 5688.5 5858.9 5862.7 5866.7 5888.1 5488.8 5566.1 5569.8 5602.4 5744.1 5733.8 5768.0 5768.2 5771.5 5775.9 5466.8 5600.0 5600.9 5614.9 5617.0 5550.1 5612.4 5615.7 5622.0 5670.6 5472.2 5472.4 5474.3 5474.4 5491.7 5513.0 5591.7 5619.6 5623.2 5670.0 5450.8 5472.7 5474.9 5484.5 5512.8 01:06:02 INFO - 2015-11-18 01:06:02,349 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,349 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:45953.80 Median:17881.33 stddev:76187.96 (426.1%) stddev-sans-first:76325.43 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: Values: 552.2 593.9 601.1 603.9 607.9 32499.5 40926.0 41433.6 41535.4 41697.6 42077.2 42556.4 42556.6 42633.6 42743.0 7718.8 7867.6 7881.3 8777.2 8983.0 7825.0 7927.5 10236.7 10238.6 10327.4 10527.1 10637.3 10637.4 10637.7 10649.5 7880.5 10504.1 10602.7 10623.8 10623.8 7779.7 10589.5 10751.8 10796.5 10809.6 39207.6 39777.0 39811.8 39824.6 39835.6 3263.2 3321.7 3472.9 3552.4 3807.0 29874.9 30049.4 30213.3 30242.5 31524.0 3335.9 3338.5 3372.3 3395.7 3462.2 266609.0 266816.0 268196.0 268377.0 269277.0 57163.4 58311.7 59631.7 59934.7 65582.0 61240.4 61248.1 61480.7 61540.7 61545.7 14214.1 14387.6 14389.5 14396.9 14402.9 10755.6 10785.7 10806.8 10810.8 10813.9 19468.5 19602.3 19744.7 19747.6 19770.5 7568.1 7694.9 7818.3 7827.2 7851.6 815.7 831.3 994.2 1024.5 1046.7 28752.7 28814.9 29036.6 29193.4 29344.4 970.5 1053.9 1083.5 1083.6 1100.4 14927.0 15179.9 15207.2 15383.4 15498.8 315593.0 320526.0 320955.0 321121.0 322399.0 52020.5 52916.0 52942.2 52961.0 52983.5 1248.3 1253.0 1285.1 1285.8 1290.1 23979.3 28642.9 28892.4 28913.4 29265.3 42267.8 42946.0 42986.6 43036.0 43059.4 283792.0 284141.0 284556.0 284781.0 285179.0 27926.7 28139.0 28566.7 30476.8 31996.5 38571.8 38809.2 39159.8 39668.0 39815.6 35350.0 35624.1 35751.6 36185.0 36775.1 29425.4 35138.6 35263.8 35696.3 36229.8 32856.0 33347.2 33448.3 34206.1 34218.0 31502.4 31888.0 32693.8 33181.2 33266.7 23511.2 23561.3 23615.6 23626.2 23685.2 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26458.84 Median:23394.05 stddev:85666.78 (366.2%) stddev-sans-first:85884.65 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: Values: 345.4 348.8 349.9 356.5 359.7 14300.9 14383.7 17444.9 17912.1 18619.1 14797.5 15373.2 15562.2 15597.6 16375.3 5339.6 5466.5 5467.1 5482.8 5485.7 4029.9 4114.1 5421.4 5454.9 5837.7 5953.6 5967.9 5974.5 5980.2 6007.1 4698.8 4796.0 4798.4 4806.1 6045.9 4058.9 4112.8 4158.6 4166.7 4172.7 13208.3 13212.9 13313.4 13406.5 13433.3 1805.6 1846.8 1892.3 1952.6 1980.0 9446.9 9687.1 9755.9 9891.0 10048.2 1659.7 1662.2 1663.3 1757.1 1764.2 58752.1 60365.4 63105.0 63352.0 63535.4 6813.7 6939.9 6980.2 6987.0 7076.9 8341.6 8394.4 8408.0 8416.4 8420.7 5421.2 5436.7 5459.9 5495.9 5498.2 5459.7 5466.7 5471.3 5535.1 5547.1 3244.1 3283.4 3287.7 3300.9 3315.5 1051.4 1090.2 1124.7 1162.1 1184.0 440.0 450.3 456.9 461.8 474.0 10360.8 10987.9 11463.3 11625.5 12068.2 465.1 473.2 483.7 501.1 518.8 6152.2 6498.7 6566.1 6566.4 6655.4 481247.6 511890.0 532304.0 542193.0 543791.0 71127.6 71264.3 71528.6 72225.3 72891.0 550.8 559.4 562.7 563.7 563.9 10896.8 10908.7 11003.6 11059.2 11161.7 35008.0 35068.0 35355.8 35973.8 36394.6 46326.3 46675.5 47658.8 48203.5 48359.5 6518.3 6586.0 6608.6 6639.2 6661.2 11757.8 11891.2 12031.8 12207.3 12241.1 10745.6 10949.6 11035.3 11047.0 11075.7 10231.9 10293.3 10359.0 10709.8 10850.0 10237.7 10449.2 10464.3 10529.7 10559.7 6540.9 6900.2 6902.0 6902.7 6914.9 9052.5 10686.9 10843.4 11033.9 11110.8 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5347.93 Median:6389.65 stddev:2766.96 (43.3%) stddev-sans-first:2758.21 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: Values: 1326.2 1630.6 1711.0 1727.4 1761.5 6921.7 7264.5 7365.2 7377.2 7394.6 7498.9 7607.5 7610.5 7611.7 7611.8 2254.1 2276.4 2276.8 2281.1 2282.4 2298.1 2303.7 2353.5 2356.5 2357.5 2277.5 2292.4 2303.7 2303.8 2305.3 2274.7 2287.3 2292.1 2293.6 2298.3 2289.5 2300.1 2303.1 2303.8 2303.8 6742.2 6872.6 7668.9 7710.8 7715.0 4289.2 4368.8 4371.5 4396.6 4398.0 2927.6 2970.6 3001.9 3007.7 3036.3 1010.6 1013.4 1023.8 1025.8 1035.4 10559.7 10593.4 10612.5 10615.2 10623.2 4175.1 4184.2 4236.2 4309.3 4321.8 9034.9 9057.0 9065.6 9066.3 9070.2 4648.2 4649.7 4649.7 4655.2 4655.8 4214.5 4220.5 4220.6 4222.7 4226.4 3588.9 3621.6 3639.9 3661.9 3678.4 1196.8 1200.1 1204.2 1209.8 1220.3 1042.8 1060.5 1066.2 1173.9 1295.2 7186.2 7232.3 7282.6 7285.5 7290.2 415.2 416.4 416.4 418.9 431.1 5298.0 5670.2 5723.6 5735.1 5744.3 8551.0 8681.7 8716.1 8935.8 8937.2 8777.0 8782.3 8800.3 8830.5 8901.2 7151.6 7171.5 7233.4 7244.2 7260.2 6831.2 6966.3 7007.5 7019.9 7027.5 8073.7 8083.5 8160.2 8339.1 8343.7 8202.9 8302.9 8494.7 8500.0 8500.4 6906.0 7023.0 7037.5 7045.2 7049.5 7476.0 7517.5 7542.2 7545.7 7563.3 6989.8 7000.6 7104.3 7128.5 7159.9 6932.6 6937.8 6961.7 7031.2 7062.4 6792.7 6825.7 6829.5 6837.9 6853.3 6360.6 6418.7 6443.1 6454.9 6457.6 6507.9 6544.7 6558.8 6565.4 6565.5 01:06:02 INFO - 2015-11-18 01:06:02,351 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,352 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5429.86 Median:6198.77 stddev:1658.29 (26.8%) stddev-sans-first:1617.99 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: Values: 320.1 323.4 332.4 337.0 346.7 6045.6 6147.4 6175.6 6178.8 6179.8 5805.5 5889.3 5953.9 6027.0 6035.7 4640.2 4663.3 4669.1 4673.6 4677.5 4432.8 4646.4 4678.9 4680.3 4681.7 4480.4 4537.9 4612.5 4614.8 4625.1 4605.1 4615.7 4615.7 4623.0 4634.4 4024.2 4026.1 4034.7 4040.4 4042.6 5663.2 5766.9 5776.4 5783.5 5784.9 5397.6 5406.0 5419.0 5420.8 5424.8 6506.9 6508.6 6509.6 6515.2 6527.8 4471.1 4479.6 4484.2 4489.1 4499.1 6559.2 6639.1 6680.6 6714.4 6729.6 4546.9 4551.8 4560.5 4560.8 4562.2 4609.1 4610.7 4613.9 4617.4 4623.6 5361.5 5368.5 5369.9 5373.7 5377.7 6344.4 6492.9 6506.6 6515.5 6520.1 1602.4 1628.1 1629.9 1630.6 1633.4 1051.4 1060.5 1073.2 1074.0 1080.6 6224.8 6268.3 6287.7 6301.1 6303.1 6453.5 6720.4 6724.9 6725.4 6734.6 6133.2 6217.7 6333.8 6341.5 6346.2 3612.6 3664.4 3664.8 3667.7 3676.6 6823.8 6995.1 7003.2 7005.4 7010.5 6937.5 6958.5 6994.8 7043.4 7056.4 7004.1 7007.4 7010.4 7011.9 7013.4 6612.5 6762.1 6766.8 6774.2 6775.6 6692.9 6694.8 6694.8 6700.8 6701.9 6986.0 6994.7 6996.2 7007.8 7007.9 4386.8 4579.8 4583.1 4584.0 4591.2 6703.1 6737.3 6755.2 6756.0 6761.3 6552.7 6555.2 6559.3 6564.3 6580.0 6393.4 6520.2 6524.6 6527.2 6531.9 6408.0 6411.4 6414.3 6414.6 6417.0 6554.3 6555.5 6561.7 6562.2 6564.1 6293.2 6402.2 6411.1 6411.5 6416.3 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13567.42 Median:444.42 stddev:15959.23 (3591.0%) stddev-sans-first:15975.36 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: Values: 835.6 854.9 856.8 857.1 866.4 12981.9 13112.2 13319.7 13338.1 13854.0 13648.7 13748.5 13775.2 13785.1 13786.2 683.2 692.3 819.7 829.2 834.6 817.3 820.4 821.4 821.9 826.2 857.7 859.7 861.7 865.4 865.9 706.1 716.8 851.2 855.9 864.1 635.4 636.7 636.9 637.6 638.2 13472.0 13765.3 13799.3 13803.7 13826.6 12000.6 12118.8 12220.1 12740.4 12906.0 10133.9 10222.1 10257.0 10384.0 10499.1 3549.3 3572.6 3582.2 3605.2 3724.4 47967.5 48723.5 48785.3 49004.3 50448.7 7774.9 7820.1 10184.4 10217.6 10239.2 12329.3 12437.6 12444.9 12449.8 12455.2 6293.5 6864.0 6907.1 6978.8 7136.1 4220.5 4230.6 4240.4 4241.8 4297.0 2791.7 2796.8 2808.0 2809.1 2816.6 433.3 439.4 443.9 444.9 445.1 575.7 627.3 644.0 645.7 672.2 8279.6 8316.8 8363.7 8421.0 8547.4 568.4 571.7 663.1 668.2 684.2 3730.5 3835.3 3866.6 4029.8 4157.6 57133.0 58037.0 58066.7 58413.7 58525.7 47375.0 47506.5 47933.5 48265.0 48367.8 44436.3 45602.5 45674.3 47240.3 47395.3 8746.7 8769.3 9125.3 9146.6 9248.4 35129.5 35367.0 35527.3 35762.9 36238.5 42782.6 45076.0 47881.3 48011.0 48297.3 7619.0 7769.2 7952.2 8090.8 8127.1 11994.0 12220.1 12455.8 12672.0 12679.4 11155.0 11304.2 11368.8 11420.1 11584.9 11159.7 11183.5 11713.4 11724.1 12111.9 7816.9 11164.3 11893.8 11944.4 12343.9 10355.0 10371.3 10463.2 10496.5 10587.7 10050.6 10196.8 10298.8 10344.8 10371.9 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:06:02 INFO - 2015-11-18 01:06:02,353 DEBUG : BROWSER_OUTPUT: 01:06:03 INFO - 2015-11-18 01:06:03,009 INFO : Browser exited with error code: 0 01:06:03 INFO - 2015-11-18 01:06:03,028 INFO : Completed test dromaeo_css (00:18:32) 01:06:03 INFO - 2015-11-18 01:06:03,028 INFO : Starting test kraken 01:06:03 INFO - 2015-11-18 01:06:03,028 DEBUG : operating with platform_type : linux_ 01:06:03 INFO - 2015-11-18 01:06:03,028 INFO : Initialising browser for kraken test... 01:06:03 INFO - 2015-11-18 01:06:03,035 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeYkCbV/profile http://localhost:47083/getInfo.html 01:06:06 INFO - 2015-11-18 01:06:06,628 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:06:06 INFO - 2015-11-18 01:06:06,629 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:06:06 INFO - 2015-11-18 01:06:06,629 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:06:06 INFO - 2015-11-18 01:06:06,629 DEBUG : BROWSER_OUTPUT: __metrics 01:06:06 INFO - 2015-11-18 01:06:06,693 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:06:07 INFO - 2015-11-18 01:06:07,955 INFO : Browser initialized. 01:06:07 INFO - 2015-11-18 01:06:07,956 INFO : Running cycle 1/1 for kraken test... 01:06:07 INFO - 2015-11-18 01:06:07,956 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeYkCbV/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:06:19 INFO - 2015-11-18 01:06:19,717 DEBUG : BROWSER_OUTPUT: RSS: Main: 141914112 01:06:19 INFO - 2015-11-18 01:06:19,717 DEBUG : BROWSER_OUTPUT: 01:06:22 INFO - 2015-11-18 01:06:22,201 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47083/tests/kraken/driver.html?testName=audio-beat-detection) 01:06:22 INFO - 2015-11-18 01:06:22,782 DEBUG : BROWSER_OUTPUT: RSS: Main: 180203520 01:06:22 INFO - 2015-11-18 01:06:22,783 DEBUG : BROWSER_OUTPUT: 01:06:25 INFO - 2015-11-18 01:06:25,363 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47083/tests/kraken/driver.html?testName=audio-dft) 01:06:25 INFO - 2015-11-18 01:06:25,928 DEBUG : BROWSER_OUTPUT: RSS: Main: 167522304 01:06:25 INFO - 2015-11-18 01:06:25,929 DEBUG : BROWSER_OUTPUT: 01:06:28 INFO - 2015-11-18 01:06:28,798 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47083/tests/kraken/driver.html?testName=audio-fft) 01:06:29 INFO - 2015-11-18 01:06:29,359 DEBUG : BROWSER_OUTPUT: RSS: Main: 152023040 01:06:29 INFO - 2015-11-18 01:06:29,360 DEBUG : BROWSER_OUTPUT: 01:06:31 INFO - 2015-11-18 01:06:31,343 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47083/tests/kraken/driver.html?testName=audio-oscillator) 01:06:31 INFO - 2015-11-18 01:06:31,908 DEBUG : BROWSER_OUTPUT: RSS: Main: 153604096 01:06:31 INFO - 2015-11-18 01:06:31,908 DEBUG : BROWSER_OUTPUT: 01:06:34 INFO - 2015-11-18 01:06:34,065 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47083/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:06:34 INFO - 2015-11-18 01:06:34,631 DEBUG : BROWSER_OUTPUT: RSS: Main: 155017216 01:06:34 INFO - 2015-11-18 01:06:34,631 DEBUG : BROWSER_OUTPUT: 01:06:37 INFO - 2015-11-18 01:06:37,549 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47083/tests/kraken/driver.html?testName=imaging-darkroom) 01:06:38 INFO - 2015-11-18 01:06:38,122 DEBUG : BROWSER_OUTPUT: RSS: Main: 154734592 01:06:38 INFO - 2015-11-18 01:06:38,122 DEBUG : BROWSER_OUTPUT: 01:06:41 INFO - 2015-11-18 01:06:41,535 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47083/tests/kraken/driver.html?testName=imaging-desaturate) 01:06:42 INFO - 2015-11-18 01:06:42,105 DEBUG : BROWSER_OUTPUT: RSS: Main: 155648000 01:06:42 INFO - 2015-11-18 01:06:42,105 DEBUG : BROWSER_OUTPUT: 01:06:44 INFO - 2015-11-18 01:06:44,861 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47083/tests/kraken/driver.html?testName=json-parse-financial) 01:06:45 INFO - 2015-11-18 01:06:45,442 DEBUG : BROWSER_OUTPUT: RSS: Main: 155914240 01:06:45 INFO - 2015-11-18 01:06:45,443 DEBUG : BROWSER_OUTPUT: 01:06:47 INFO - 2015-11-18 01:06:47,011 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47083/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:06:47 INFO - 2015-11-18 01:06:47,572 DEBUG : BROWSER_OUTPUT: RSS: Main: 165396480 01:06:47 INFO - 2015-11-18 01:06:47,572 DEBUG : BROWSER_OUTPUT: 01:06:49 INFO - 2015-11-18 01:06:49,361 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:06:49 INFO - 2015-11-18 01:06:49,955 DEBUG : BROWSER_OUTPUT: RSS: Main: 165208064 01:06:49 INFO - 2015-11-18 01:06:49,955 DEBUG : BROWSER_OUTPUT: 01:06:52 INFO - 2015-11-18 01:06:52,006 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:06:52 INFO - 2015-11-18 01:06:52,572 DEBUG : BROWSER_OUTPUT: RSS: Main: 171028480 01:06:52 INFO - 2015-11-18 01:06:52,572 DEBUG : BROWSER_OUTPUT: 01:06:54 INFO - 2015-11-18 01:06:54,946 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:06:55 INFO - 2015-11-18 01:06:55,519 DEBUG : BROWSER_OUTPUT: RSS: Main: 183283712 01:06:55 INFO - 2015-11-18 01:06:55,520 DEBUG : BROWSER_OUTPUT: 01:06:58 INFO - 2015-11-18 01:06:58,079 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:06:58 INFO - 2015-11-18 01:06:58,652 DEBUG : BROWSER_OUTPUT: RSS: Main: 180682752 01:06:58 INFO - 2015-11-18 01:06:58,652 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,321 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47083/tests/kraken/driver.html?testName=ai-astar) 01:07:00 INFO - 2015-11-18 01:07:00,570 DEBUG : BROWSER_OUTPUT: RSS: Main: 240631808 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;113;105;111;112;114;100;110;110;108 01:07:00 INFO - 2015-11-18 01:07:00,571 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;153;125;152;166;126;153;149;129;166;127 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |2;audio-dft;159;160;162;161;160;162;160;161;160;161 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;72;98;73;73;72;105;90;72 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;92;137;90;90;91;134;91;92;134 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;109;110;109;109;110;109;109;109 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;145;145;146;146;145;145;145;146;145;145 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;95;95;96;95;95;96;95 01:07:00 INFO - 2015-11-18 01:07:00,572 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;65;57;57;57;58;56;57;72;55;56 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;67;67;69;67;69;67;67;68 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;86;84;85;85;85;85;86;86;86;94 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;115;117;113;113;117;122;116;122;116;123 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;140;149;152;150;151;140;153;152;150;143 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;67;67;67;68;65;66;68;69;66;66 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,906 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: __startTimestamp1447837620569__endTimestamp 01:07:00 INFO - 2015-11-18 01:07:00,573 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: Number of tests: 14 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:109.30 Median:110.50 stddev:4.14 (3.7%) stddev-sans-first:4.38 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: Values: 110.0 113.0 105.0 111.0 112.0 114.0 100.0 110.0 110.0 108.0 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:144.60 Median:152.50 stddev:16.38 (10.7%) stddev-sans-first:17.09 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: Values: 153.0 125.0 152.0 166.0 126.0 153.0 149.0 129.0 166.0 127.0 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:160.60 Median:161.00 stddev:0.97 (0.6%) stddev-sans-first:0.83 01:07:00 INFO - 2015-11-18 01:07:00,575 DEBUG : BROWSER_OUTPUT: Values: 159.0 160.0 162.0 161.0 160.0 162.0 160.0 161.0 160.0 161.0 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.80 Median:72.50 stddev:12.84 (17.7%) stddev-sans-first:13.30 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 72.0 98.0 73.0 73.0 72.0 105.0 90.0 72.0 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:104.30 Median:91.00 stddev:21.21 (23.3%) stddev-sans-first:22.03 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: Values: 92.0 92.0 137.0 90.0 90.0 91.0 134.0 91.0 92.0 134.0 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.30 Median:109.00 stddev:0.48 (0.4%) stddev-sans-first:0.44 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 109.0 110.0 109.0 109.0 110.0 109.0 109.0 109.0 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 01:07:00 INFO - 2015-11-18 01:07:00,576 DEBUG : BROWSER_OUTPUT: Values: 145.0 145.0 146.0 146.0 145.0 145.0 145.0 146.0 145.0 145.0 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 95.0 95.0 96.0 95.0 95.0 96.0 95.0 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.00 Median:57.00 stddev:5.33 (9.4%) stddev-sans-first:5.20 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: Values: 65.0 57.0 57.0 57.0 58.0 56.0 57.0 72.0 55.0 56.0 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.70 Median:68.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 67.0 67.0 69.0 67.0 69.0 67.0 67.0 68.0 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:86.20 Median:86.00 stddev:2.82 (3.3%) stddev-sans-first:2.99 01:07:00 INFO - 2015-11-18 01:07:00,577 DEBUG : BROWSER_OUTPUT: Values: 86.0 84.0 85.0 85.0 85.0 85.0 86.0 86.0 86.0 94.0 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:117.40 Median:117.00 stddev:3.69 (3.2%) stddev-sans-first:3.81 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: Values: 115.0 117.0 113.0 113.0 117.0 122.0 116.0 122.0 116.0 123.0 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.00 Median:150.50 stddev:5.03 (3.3%) stddev-sans-first:4.43 01:07:00 INFO - 2015-11-18 01:07:00,578 DEBUG : BROWSER_OUTPUT: Values: 140.0 149.0 152.0 150.0 151.0 140.0 153.0 152.0 150.0 143.0 01:07:00 INFO - 2015-11-18 01:07:00,579 DEBUG : BROWSER_OUTPUT: 01:07:00 INFO - 2015-11-18 01:07:00,579 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.90 Median:67.00 stddev:1.20 (1.8%) stddev-sans-first:1.27 01:07:00 INFO - 2015-11-18 01:07:00,579 DEBUG : BROWSER_OUTPUT: Values: 67.0 67.0 67.0 68.0 65.0 66.0 68.0 69.0 66.0 66.0 01:07:00 INFO - 2015-11-18 01:07:00,579 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:07:00 INFO - 2015-11-18 01:07:00,579 DEBUG : BROWSER_OUTPUT: 01:07:01 INFO - 2015-11-18 01:07:01,417 INFO : Browser exited with error code: 0 01:07:01 INFO - 2015-11-18 01:07:01,468 INFO : Completed test kraken (00:00:58) 01:07:01 INFO - 2015-11-18 01:07:01,468 INFO : Starting test v8_7 01:07:01 INFO - 2015-11-18 01:07:01,468 DEBUG : operating with platform_type : linux_ 01:07:01 INFO - 2015-11-18 01:07:01,468 INFO : Initialising browser for v8_7 test... 01:07:01 INFO - 2015-11-18 01:07:01,474 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUMkZk5/profile http://localhost:47083/getInfo.html 01:07:05 INFO - 2015-11-18 01:07:05,113 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:07:05 INFO - 2015-11-18 01:07:05,114 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:07:05 INFO - 2015-11-18 01:07:05,114 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:07:05 INFO - 2015-11-18 01:07:05,114 DEBUG : BROWSER_OUTPUT: __metrics 01:07:05 INFO - 2015-11-18 01:07:05,275 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:07:06 INFO - 2015-11-18 01:07:06,479 INFO : Browser initialized. 01:07:06 INFO - 2015-11-18 01:07:06,480 INFO : Running cycle 1/1 for v8_7 test... 01:07:06 INFO - 2015-11-18 01:07:06,480 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpUMkZk5/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:07:18 INFO - 2015-11-18 01:07:18,250 DEBUG : BROWSER_OUTPUT: RSS: Main: 141889536 01:07:18 INFO - 2015-11-18 01:07:18,250 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,665 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:47083/tests/v8_7/run.html (next: http://localhost:47083/tests/v8_7/run.html) 01:07:39 INFO - 2015-11-18 01:07:39,915 DEBUG : BROWSER_OUTPUT: RSS: Main: 606162944 01:07:39 INFO - 2015-11-18 01:07:39,915 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: |0;Richards;162.813415825464 01:07:39 INFO - 2015-11-18 01:07:39,916 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;193.4984520123839 01:07:39 INFO - 2015-11-18 01:07:39,917 DEBUG : BROWSER_OUTPUT: |2;Encrypt;283.84899233607723 01:07:39 INFO - 2015-11-18 01:07:39,917 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5055.555555555556 01:07:39 INFO - 2015-11-18 01:07:39,917 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1117.31843575419 01:07:39 INFO - 2015-11-18 01:07:39,917 DEBUG : BROWSER_OUTPUT: |5;Earley;777.000777000777 01:07:39 INFO - 2015-11-18 01:07:39,917 DEBUG : BROWSER_OUTPUT: |6;Boyer;11916.666666666666 01:07:39 INFO - 2015-11-18 01:07:39,918 DEBUG : BROWSER_OUTPUT: |7;RegExp;25150 01:07:39 INFO - 2015-11-18 01:07:39,918 DEBUG : BROWSER_OUTPUT: |8;Splay;668.8963210702341 01:07:39 INFO - 2015-11-18 01:07:39,918 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4845.410628019324 01:07:39 INFO - 2015-11-18 01:07:39,918 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:07:39 INFO - 2015-11-18 01:07:39,918 DEBUG : BROWSER_OUTPUT: __startTimestamp1447837659912__endTimestamp 01:07:39 INFO - 2015-11-18 01:07:39,919 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,919 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:07:39 INFO - 2015-11-18 01:07:39,919 DEBUG : BROWSER_OUTPUT: Number of tests: 10 01:07:39 INFO - 2015-11-18 01:07:39,919 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,919 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.81 Median:162.81 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,920 DEBUG : BROWSER_OUTPUT: Values: 162.8 01:07:39 INFO - 2015-11-18 01:07:39,920 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,920 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:193.50 Median:193.50 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,920 DEBUG : BROWSER_OUTPUT: Values: 193.5 01:07:39 INFO - 2015-11-18 01:07:39,920 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:283.85 Median:283.85 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: Values: 283.8 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5055.56 Median:5055.56 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: Values: 5055.6 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1117.32 Median:1117.32 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,921 DEBUG : BROWSER_OUTPUT: Values: 1117.3 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:777.00 Median:777.00 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: Values: 777.0 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11916.67 Median:11916.67 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: Values: 11916.7 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25150.00 Median:25150.00 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: Values: 25150.0 01:07:39 INFO - 2015-11-18 01:07:39,922 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:668.90 Median:668.90 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: Values: 668.9 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4845.41 Median:4845.41 stddev:0.00 (0.0%) 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: Values: 4845.4 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:07:39 INFO - 2015-11-18 01:07:39,923 DEBUG : BROWSER_OUTPUT: 01:07:40 INFO - 2015-11-18 01:07:40,741 INFO : Browser exited with error code: 0 01:07:40 INFO - 2015-11-18 01:07:40,753 INFO : Completed test v8_7 (00:00:39) 01:07:40 INFO - 2015-11-18 01:07:40,906 INFO : Completed test suite (00:20:10) 01:07:40 INFO - 2015-11-18 01:07:40,906 DEBUG : Working with test: dromaeo_css 01:07:40 INFO - 2015-11-18 01:07:40,906 DEBUG : Generating results file: dromaeo_css 01:07:40 INFO - 2015-11-18 01:07:40,907 DEBUG : Working with test: kraken 01:07:40 INFO - 2015-11-18 01:07:40,907 DEBUG : Generating results file: kraken 01:07:40 INFO - 2015-11-18 01:07:40,908 INFO : javascript benchmark 01:07:40 INFO - 2015-11-18 01:07:40,908 DEBUG : Working with test: v8_7 01:07:40 INFO - 2015-11-18 01:07:40,908 DEBUG : Generating results file: v8_7 01:07:40 INFO - 2015-11-18 01:07:40,908 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:07:40 INFO - 2015-11-18 01:07:40,945 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 01:07:40 INFO - 2015-11-18 01:07:40,945 DEBUG : process_Request line: dromaeo_css 6674.75 graph.html#tests=[[72,64,35]] 01:07:40 INFO - 2015-11-18 01:07:40,946 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:07:41 INFO - 2015-11-18 01:07:41,066 DEBUG : process_Request line: kraken 1493.70 graph.html#tests=[[232,64,35]] 01:07:41 INFO - 2015-11-18 01:07:41,066 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:07:41 INFO - 2015-11-18 01:07:41,094 DEBUG : process_Request line: v8_7 20955.49 graph.html#tests=[[230,64,35]] 01:07:41 INFO - 2015-11-18 01:07:41,096 INFO : javascript benchmark 01:07:41 INFO - 2015-11-18 01:07:41,100 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [345.41452238455827, 348.8116417134747, 349.90027842065, 356.5400633183195, 359.72660777808863, 14300.856991430082, 14383.712325753479, 17444.91277543612, 17912.104394780275, 18619.06904654767, 14797.482088126917, 15373.231338433061, 15562.221888905566, 15597.610059748513, 16375.263113159906, 5339.5728341732665, 5466.480684334982, 5467.097928841737, 5482.835514934558, 5485.725713714318, 4029.858954936578, 4114.053767633446, 5421.376541697696, 5454.945450545483, 5837.708114594275, 5953.613015154001, 5967.850803729898, 5974.5220382369525, 5980.222571065777, 6007.098935159739, 4698.812047518095, 4795.952040479586, 4798.376211092571, 4806.110869489121, 6045.939540604603, 4058.8782336529953, 4112.835486580533, 4158.563350848148, 4166.687498437599, 4172.666186705056, 13208.33958302081, 13212.86787132126, 13313.400896959563, 13406.46374145033, 13433.32833358338, 1805.6117934643983, 1846.759921210234, 1892.280933245358, 1952.5509132899372, 1979.9505012374661, 9446.85829712555, 9687.079727425884, 9755.902440975571, 9891.0, 10048.246381521416, 1659.6846599146245, 1662.185529090749, 1663.3180396037567, 1757.1038770227276, 1764.153206460906, 58752.11871821926, 60365.39634603642, 63105.0, 63352.0, 63535.36464635341, 6813.659317034228, 6939.930600693929, 6980.162380514371, 6986.9650651746415, 7076.92923070773, 8341.582920854054, 8394.370422218235, 8408.033076196194, 8416.410851240355, 8420.663173472993, 5421.2139239810795, 5436.695193153615, 5459.945400545944, 5495.862603434946, 5498.202760599691, 5459.672419654833, 5466.726663666801, 5471.343438787291, 5535.059039963216, 5547.057000309957, 3244.059222825354, 3283.4254005548933, 3287.7369810415107, 3300.884469043572, 3315.535824984504, 1051.4007016000805, 1090.231386872253, 1124.746931940307, 1162.0819552553558, 1184.0468422919632, 440.0385158428843, 450.3267614915722, 456.8743595511194, 461.79680940386123, 474.0, 10360.792784144274, 10987.945060274647, 11463.254888432391, 11625.535998080888, 12068.215565988183, 465.14407514019496, 473.15305602970983, 483.68077069134904, 501.1005245584185, 518.7665550502289, 6152.200213972155, 6498.707558159894, 6566.146400967939, 6566.376194261537, 6655.43428808547, 481247.6117217963, 511890.0, 532304.0, 542193.0, 543791.0, 71127.64436177786, 71264.28735712577, 71528.64235678893, 72225.27774722186, 72891.0, 550.82098318046, 559.4489427913502, 562.7355143082744, 563.715323761506, 563.8562166647479, 10896.836547451636, 10908.6727398175, 11003.559857605926, 11059.170562207706, 11161.720956975816, 35008.0, 35068.0, 35355.82322088373, 35973.82013089918, 36394.63605363912, 46326.30510542412, 46675.53324466712, 47658.761706191246, 48203.51796482131, 48359.5164048355, 6518.2504012037325, 6586.045023471665, 6608.603483790988, 6639.236487803964, 6661.233958094881, 11757.823632645346, 11891.167618266638, 12031.819522706992, 12207.267563946192, 12241.143119981516, 10745.570177192825, 10949.616763413242, 11035.337879727242, 11047.0, 11075.72310692239, 10231.897681023094, 10293.330933489298, 10359.0, 10709.785804284027, 10850.0, 10237.692869213935, 10449.164066874784, 10464.267501274837, 10529.684109476728, 10559.736006599896, 6540.934590654223, 6900.171979362308, 6902.033715279966, 6902.723891044302, 6914.896276555956, 9052.456852588866, 10686.8931310689, 10843.403612801372, 11033.889661103607, 11110.777784444428], "dojo.html": [3140.5760222369977, 3199.13623321703, 3235.2235463488755, 3250.5124231365294, 3255.2350197703545, 5159.793608255674, 5310.893782124364, 5330.946690533094, 5376.462353764627, 5402.35171779386, 5326.174442961347, 5381.300430943972, 5398.865028374293, 5416.83749487516, 5457.0, 4792.448868380128, 4877.170880950247, 4981.576565991895, 5001.974990125044, 5050.84847454577, 4947.802087916479, 4981.203007518798, 5030.019146266462, 5030.245463180516, 5082.288479612857, 4826.565609095181, 4834.0, 4919.72941488218, 4933.333999910038, 4935.210366341386, 5007.799688012475, 5024.221245706921, 5030.119729047402, 5039.521245481674, 5053.722045287508, 4965.106280869442, 4974.328465657162, 4993.750312484398, 5010.123228435045, 5076.314697515862, 5066.721330326831, 5175.353080864892, 5182.481751824825, 5184.766685499124, 5196.558292545138, 5751.712414379264, 5780.53755699543, 5786.045302525078, 5867.530597552186, 5911.408859114097, 5782.392848750905, 5787.652740835563, 5790.507806836424, 5794.536437085023, 5805.4194580542035, 5223.2948551945765, 5395.973020134914, 5402.945970540283, 5409.188621706736, 5425.077736784717, 5747.224124743189, 5786.826395208151, 5897.587168898136, 5905.232319798484, 5935.169076329317, 5794.739236734273, 5816.447437493432, 5817.854553636108, 5819.388964158787, 5826.126081087871, 5710.2862142232225, 5823.126531020381, 5890.381509941394, 5920.615160014585, 5921.940780592225, 5653.0, 5750.453706897838, 5757.251557297524, 5760.798372056958, 5797.623154494944, 5828.271466066742, 5835.94164058354, 5861.9413805861395, 5866.2373891393845, 5874.706264686749, 4360.629346505582, 4368.497622773358, 4456.821727130879, 4512.571305725951, 4528.7509186994375, 3987.222491614107, 4015.31739604268, 4047.6761859051207, 4071.1043570414463, 4087.4073259377224, 5536.141898005815, 5569.248151499577, 5572.414896435897, 5575.916361254584, 5579.860503487364, 5711.143328500675, 5715.5713321500225, 5826.82519524415, 5860.062390017577, 5886.117082437669, 5546.91679624806, 5603.523700485504, 5632.352279487829, 5633.774649014075, 5636.464535869086, 5197.272381866542, 5215.947840521546, 5217.8173763918085, 5220.582353411718, 5270.288511051036, 5862.560307976919, 5954.047352423591, 5999.610025348338, 6041.305249896318, 6091.8477038073515, 5673.943260567342, 5674.517665998271, 5682.943170568242, 5700.657960522382, 5851.561132914963, 5688.459596338341, 5858.882822343444, 5862.736176872137, 5866.735996880236, 5888.087346461305, 5488.807891723771, 5566.081596536688, 5569.832905012856, 5602.411746766531, 5744.0522313817755, 5733.827985160452, 5768.0, 5768.192453056491, 5771.4517120875125, 5775.94224057754, 5466.781328746805, 5599.992001439617, 5600.85997850057, 5614.887702246014, 5616.971915140398, 5550.111982082847, 5612.382637909908, 5615.747291371817, 5622.0, 5670.574706896917, 5472.20653005304, 5472.425395333592, 5474.288342515448, 5474.42518535564, 5491.7254137292175, 5512.972435137799, 5591.664500130005, 5619.634723742944, 5623.2127502148915, 5669.971650141888, 5450.754716037709, 5472.726363681721, 5474.890502190014, 5484.451554844483, 5512.751926163252], "mootools.html": [1326.2109045118152, 1630.5597488678056, 1711.02471591193, 1727.4299481171215, 1761.4803632928276, 6921.688524016418, 7264.527805692633, 7365.189829118793, 7377.225391333906, 7394.593297368642, 7498.88751668724, 7607.505512141721, 7610.505317154395, 7611.657475413605, 7611.847763044736, 2254.120892851789, 2276.35123989663, 2276.84062115652, 2281.1445707859552, 2282.4179834142356, 2298.092253559843, 2303.67748515208, 2353.470469144437, 2356.5404746074523, 2357.54027964547, 2277.52172043871, 2292.3695983604557, 2303.7120359955006, 2303.8156947444163, 2305.296884450242, 2274.72703275608, 2287.2680742162515, 2292.1175347491253, 2293.552757212344, 2298.321995011476, 2289.496310811619, 2300.0799680127916, 2303.055747143663, 2303.8272129590346, 2303.8387312888103, 6742.190937087532, 6872.587644741331, 7668.923310766877, 7710.845783084307, 7714.961425192838, 4289.206496798102, 4368.759718215497, 4371.453568303962, 4396.648268138541, 4398.032432864797, 2927.575501552284, 2970.55441683747, 3001.9399612007637, 3007.6992300769966, 3036.2712948892326, 1010.5907107621425, 1013.381837079381, 1023.7798873242214, 1025.8409946458312, 1035.3891204189565, 10559.683209503728, 10593.364398136137, 10612.469376531142, 10615.150787936947, 10623.150147988143, 4175.144095460423, 4184.205001049791, 4236.216299984513, 4309.332053531645, 4321.762303073361, 9034.909650903539, 9057.04900985387, 9065.59204835784, 9066.274698024143, 9070.183683468387, 4648.1865673507, 4649.67452278344, 4649.744264065441, 4655.231886738718, 4655.837045703384, 4214.473190851144, 4220.451341325608, 4220.556841531657, 4222.662187025031, 4226.429432026698, 3588.8564457421935, 3621.6378362163573, 3639.872604458831, 3661.908452288661, 3678.4482327651067, 1196.8144937534696, 1200.1359021504502, 1204.235310577772, 1209.7640960012889, 1220.2556440571245, 1042.7705904700954, 1060.5121644043672, 1066.184368957748, 1173.8650055243586, 1295.1581472043247, 7186.209516953236, 7232.276772322725, 7282.599457029808, 7285.453590980697, 7290.234525374865, 415.17380412977957, 416.35257175092414, 416.36296466406446, 418.8827128404052, 431.1248166222573, 5298.046351656739, 5670.206171136044, 5723.599348045597, 5735.082386818089, 5744.253247077937, 8550.957245213734, 8681.652733890574, 8716.12838716136, 8935.821283574292, 8937.150970657776, 8776.956115219384, 8782.297416206817, 8800.251978581764, 8830.470171789584, 8901.243394311427, 7151.570905745672, 7171.49799514029, 7233.421326293989, 7244.166920804069, 7260.23767504415, 6831.214410342675, 6966.303369663196, 7007.544509606859, 7019.894701579583, 7027.4729395294535, 8073.717419890276, 8083.474574152661, 8160.18398160203, 8339.082700902774, 8343.707970221014, 8202.917970820215, 8302.875456868273, 8494.74515764528, 8499.95750021246, 8500.404971651926, 6905.965470172617, 7022.964885175541, 7037.507374483942, 7045.154581450054, 7049.541779784297, 7475.962620186864, 7517.511361761468, 7542.170361260147, 7545.660445279866, 7563.281488258606, 6989.825254368681, 7000.579965202104, 7104.254053324326, 7128.465365097535, 7159.928400715926, 6932.556061868857, 6937.791866244021, 6961.686724097529, 7031.156261248683, 7062.435005199469, 6792.694328755119, 6825.692843822139, 6829.453643708591, 6837.897431538431, 6853.314668533107, 6360.618362898241, 6418.679066046772, 6443.130177426175, 6454.870902581828, 6457.61254324742, 6507.902381464187, 6544.6727663615675, 6558.770443034471, 6565.376289252514, 6565.540412171103], "ext.html": [552.1800126811684, 593.9346671866094, 601.1463721515447, 603.9154518367429, 607.857228410588, 32499.512507312378, 40926.0, 41433.58566414342, 41535.37696934548, 41697.583024169784, 42077.158456830846, 42556.36165457513, 42556.57443425565, 42633.57366426335, 42743.0, 7718.8456230875345, 7867.645955931968, 7881.290683838453, 8777.16616921393, 8983.011868694439, 7825.0, 7927.484713493604, 10236.692899212998, 10238.590456381773, 10327.380357178594, 10527.105196058345, 10637.255392122555, 10637.361758294488, 10637.680869573926, 10649.467526623677, 7880.527168369858, 10504.05463508284, 10602.734931626694, 10623.787524249472, 10623.78752424951, 7779.72770953014, 10589.470526473646, 10751.78496430067, 10796.51415686296, 10809.621663241827, 39207.60792392068, 39777.0, 39811.8009409954, 39824.60175398238, 39835.60164398377, 3263.1515805890403, 3321.717653999413, 3472.878449254264, 3552.3960926642535, 3807.0292075520842, 29874.85062574673, 30049.399012019854, 30213.338266395338, 30242.54636180459, 31524.0, 3335.8665653373837, 3338.4658454647383, 3372.3086767212662, 3395.6604339566093, 3462.186386199241, 266609.0, 266816.0, 268195.999999998, 268377.0, 269277.0, 57163.42836571581, 58311.70844145752, 59631.70184149052, 59934.70032649896, 65582.0, 61240.387596123466, 61248.08127878085, 61480.69259653763, 61540.69229653823, 61545.692271538355, 14214.076085054437, 14387.568372948828, 14389.496367627293, 14396.928015359856, 14402.927985360006, 10755.623553175601, 10785.730356741144, 10806.837897431387, 10810.783784324427, 10813.945930270298, 19468.513287167934, 19602.313919012766, 19744.70382944257, 19747.605047899247, 19770.50573735668, 7568.129665088585, 7694.923050769421, 7818.257265559762, 7827.217278272127, 7851.646675899598, 815.7185770909027, 831.2643310670101, 994.2294721590825, 1024.472396715692, 1046.7173863057085, 28752.71247287542, 28814.855925720658, 29036.564451533242, 29193.416131677248, 29344.41311173807, 970.45169479244, 1053.9420331881668, 1083.5394957143183, 1083.6207327435334, 1100.4332768624165, 14927.0, 15179.924100379649, 15207.239638018054, 15383.384664613513, 15498.84501154974, 315593.0, 320526.0, 320955.0, 321121.0, 322399.0, 52020.47979520232, 52916.0, 52942.20586691203, 52961.0, 52983.470165298626, 1248.294713486877, 1253.0476837603487, 1285.1068507387463, 1285.845698516184, 1290.0775945199227, 23979.279256842994, 28642.85678571594, 28892.42215155643, 28913.42173156567, 29265.268368290963, 42267.7886610565, 42946.0, 42986.57013429826, 43036.0, 43059.354109689004, 283792.0, 284141.0, 284556.0, 284781.0, 285179.0, 27926.720732793226, 28139.0454002335, 28566.71433285724, 30476.84761576178, 31996.5200521997, 38571.80714096524, 38809.2238155241, 39159.80420097881, 39668.0, 39815.60184398119, 35350.0, 35624.109397265274, 35751.64248357483, 36185.0, 36775.08062298464, 29425.411491770472, 35138.648613513535, 35263.82368088143, 35696.28607427889, 36229.818850905576, 32856.0, 33347.1663208412, 33448.33103337968, 34206.14484637904, 34218.0, 31502.369952600362, 31888.0, 32693.836530818146, 33181.17047073843, 33266.66733332635, 23511.177108801796, 23561.29316120519, 23615.64576531319, 23626.17308394198, 23685.17101901425], "prototype.html": [320.0941336019065, 323.374270786029, 332.43983887150154, 337.04111801923517, 346.69490848053726, 6045.576809623328, 6147.446729794317, 6175.598586091906, 6178.752849886005, 6179.81460556184, 5805.506531944779, 5889.322727886294, 5953.940460595392, 6026.969865150668, 6035.7283922223605, 4640.187967105743, 4663.277192035223, 4669.112868554972, 4673.597920623816, 4677.4854765975715, 4432.800523976429, 4646.4191976003, 4678.90642187156, 4680.25115981443, 4681.672282940195, 4480.395146655209, 4537.886552836172, 4612.469565999902, 4614.769261536927, 4625.098105869357, 4605.102005109005, 4615.653825963066, 4615.676902616819, 4623.0, 4634.374359461463, 4024.2353952748886, 4026.074002979302, 4034.668559375399, 4040.3535434330365, 4042.5957404259634, 5663.207150998864, 5766.855828604276, 5776.422357764232, 5783.537317014629, 5784.913226301609, 5397.649152805095, 5406.0, 5419.024575576394, 5420.783168673248, 5424.783008679648, 6506.869862602769, 6508.57694249877, 6509.609423434562, 6515.218173819172, 6527.804165875032, 4471.061077173765, 4479.619232365253, 4484.1928452878465, 4489.147062058231, 4499.055198408339, 6559.180102487189, 6639.136912201383, 6680.5991640501725, 6714.362135597111, 6729.596224226513, 4546.931796023062, 4551.7724113794175, 4560.4527456704745, 4560.771961401983, 4562.24722920721, 4609.147307748078, 4610.677252592286, 4613.861584152481, 4617.422822147231, 4623.630109591225, 5361.463853614685, 5368.543673787772, 5369.892602147936, 5373.731313434313, 5377.704226267515, 6344.39728225827, 6492.902606460907, 6506.642134682638, 6515.4787616990525, 6520.054592084121, 1602.3590563774583, 1628.0882705684855, 1629.902205867628, 1630.6494103767748, 1633.4283000949572, 1051.374432212832, 1060.4750648429076, 1073.2219141122623, 1074.0172741941192, 1080.573173596425, 6224.782132625336, 6268.341824108403, 6287.685615719196, 6301.086342480315, 6303.117563541108, 6453.451456626145, 6720.395164435225, 6724.9327506725285, 6725.428338591275, 6734.56225345351, 6133.202683651097, 6217.720202590895, 6333.809985700436, 6341.4609758170145, 6346.2067241594805, 3612.6026137124895, 3664.358737220976, 3664.8167591620845, 3667.651573100551, 3676.5771936227143, 6823.829404264933, 6995.090638217, 7003.194632617314, 7005.439564834801, 7010.474214433938, 6937.479689023243, 6958.547694399847, 6994.790156295319, 7043.36609705129, 7056.435485161175, 7004.089468369079, 7007.423329750867, 7010.439164866901, 7011.859762804817, 7013.438924885997, 6612.520304885667, 6762.087118238975, 6766.763163289262, 6774.153230846145, 6775.559588626724, 6692.933070669231, 6694.757256319188, 6694.765683201064, 6700.798976030727, 6701.899471507833, 6985.965070174617, 6994.685239164148, 6996.160460744743, 7007.8248043797275, 7007.929920700932, 4386.780660967002, 4579.793909274024, 4583.106294272585, 4583.977080114578, 4591.242444996672, 6703.095082163845, 6737.292584278776, 6755.2231493378895, 6756.0, 6761.256261811099, 6552.6723663815665, 6555.246146693191, 6559.311272316338, 6564.343565643398, 6580.0, 6393.424591786761, 6520.152380190734, 6524.575902566318, 6527.2167339919515, 6531.934680653133, 6408.0, 6411.358864113738, 6414.262359828493, 6414.61512309263, 6417.03744438338, 6554.31179726141, 6555.541112122106, 6561.671916404065, 6562.245341785756, 6564.146660934048, 6293.150424692608, 6402.167718196604, 6411.134496842867, 6411.455026322628, 6416.294207637249], "yui.html": [835.5738573327601, 854.9016863060748, 856.8243510080434, 857.0529564830862, 866.4411454611779, 12981.870181298184, 13112.213267203975, 13319.7336053279, 13338.133021353606, 13854.030217884752, 13648.727025459484, 13748.450061997508, 13775.242361670103, 13785.103968242058, 13786.241756703377, 683.2313647146959, 692.3215249055928, 819.7049062337554, 829.1915382502042, 834.586879494651, 817.2726273616486, 820.4052062254877, 821.4496287487368, 821.9301359384459, 826.1903334731966, 857.6826574167567, 859.7420773767844, 861.6682577207757, 865.4288169807928, 865.9177378149097, 706.0503622627558, 716.8422946951662, 851.2381418630322, 855.9272461840688, 864.0797550608581, 635.4058954877205, 636.6689321552767, 636.8567072408671, 637.6174295422755, 638.1512588257606, 13472.0, 13765.311734413239, 13799.310034498336, 13803.723925521434, 13826.585202443943, 12000.639980800503, 12118.757624847454, 12220.144589878711, 12740.426680799386, 12905.999999999905, 10133.898661013369, 10222.131118854832, 10257.025582569644, 10384.0, 10499.055085042306, 3549.290141971616, 3572.5534308211472, 3582.158192824684, 3605.1888325126897, 3724.422714479233, 47967.520324797006, 48723.512764872256, 48785.268220976715, 49004.26493602599, 50448.74775626135, 7774.922250777533, 7820.061592608923, 10184.439855808001, 10217.642382516577, 10239.18086553074, 12329.321887296284, 12437.564685235973, 12444.875551244371, 12449.75100497985, 12455.190412623151, 6293.465055470245, 6863.965680171567, 6907.13660792401, 6978.79063628092, 7136.0723105995885, 4220.472440944882, 4230.576942305806, 4240.406343111967, 4241.830326786894, 4297.011687311936, 2791.6510436195476, 2796.7622752066304, 2808.0312292259546, 2809.143211320526, 2816.6197563329097, 433.2829167727416, 439.3651174053462, 443.9289713645866, 444.91546606144726, 445.0653627382471, 575.6776205325032, 627.297426881886, 643.9935600644027, 645.6707079389545, 672.2235817630644, 8279.586020699062, 8316.750497485085, 8363.665453381796, 8420.957895210608, 8547.444416112932, 568.4372471253512, 571.6855729348924, 663.1279866974912, 668.2348710726192, 684.1584850633649, 3730.4963829882618, 3835.328817456934, 3866.5553461352306, 4029.7783621901076, 4157.584241575879, 57133.0, 58037.0, 58066.709666451396, 58413.70793146092, 58525.70737146287, 47375.0, 47506.5249347509, 47933.52066479361, 48265.0, 48367.75816120897, 44436.3334549982, 45602.54397455983, 45674.31488527675, 47240.291395629094, 47395.289070663275, 8746.69386571467, 8769.298456123368, 9125.315601329794, 9146.645896990203, 9248.398854074463, 35129.47305790364, 35367.0, 35527.28945421025, 35762.92711218668, 36238.4564231542, 42782.57217427911, 45076.0, 47881.281780774014, 48011.0, 48297.27554086621, 7619.009528761226, 7769.184235655401, 7952.244536768998, 8090.797730056795, 8127.106018338096, 11994.0, 12220.144589878622, 12455.813162802746, 12672.0, 12679.366031698562, 11155.0, 11304.152188585724, 11368.772624547628, 11420.143489238506, 11584.884151158381, 11159.743962990497, 11183.543386933243, 11713.355765432983, 11724.062075034148, 12111.878881211074, 7816.88274675869, 11164.274322169033, 11893.821592675944, 11944.402779861146, 12343.876561234272, 10355.0, 10371.325863818827, 10463.215258855464, 10496.475176241005, 10587.735306617396, 10050.64822731201, 10196.796064078826, 10298.845517317097, 10344.844827327446, 10371.896281037394]}, "summary": {"lowerIsBetter": false, "suite": 6674.74721560882, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 6969.04066900106, "unit": "ms", "value": 6969.04066900106}, "dojo.html": {"lowerIsBetter": false, "filtered": 5339.281392591595, "unit": "ms", "value": 5339.281392591595}, "mootools.html": {"lowerIsBetter": false, "filtered": 4322.9977756303, "unit": "ms", "value": 4322.9977756303}, "ext.html": {"lowerIsBetter": false, "filtered": 18378.698489013637, "unit": "ms", "value": 18378.698489013637}, "prototype.html": {"lowerIsBetter": false, "filtered": 4884.328183345252, "unit": "ms", "value": 4884.328183345252}, "yui.html": {"lowerIsBetter": false, "filtered": 6123.663849584209, "unit": "ms", "value": 6123.663849584209}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-031"}, "testrun": {"date": 1447836450, "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": "20151117233007", "branch": "Fx-Team", "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f"}}, {"talos_counters": {}, "results": {"audio-dft": [159.0, 160.0, 162.0, 161.0, 160.0, 162.0, 160.0, 161.0, 160.0, 161.0], "ai-astar": [110.0, 113.0, 105.0, 111.0, 112.0, 114.0, 100.0, 110.0, 110.0, 108.0], "imaging-gaussian-blur": [110.0, 109.0, 109.0, 110.0, 109.0, 109.0, 110.0, 109.0, 109.0, 109.0], "audio-beat-detection": [153.0, 125.0, 152.0, 166.0, 126.0, 153.0, 149.0, 129.0, 166.0, 127.0], "json-stringify-tinderbox": [68.0, 68.0, 67.0, 67.0, 69.0, 67.0, 69.0, 67.0, 67.0, 68.0], "stanford-crypto-pbkdf2": [140.0, 149.0, 152.0, 150.0, 151.0, 140.0, 153.0, 152.0, 150.0, 143.0], "json-parse-financial": [65.0, 57.0, 57.0, 57.0, 58.0, 56.0, 57.0, 72.0, 55.0, 56.0], "stanford-crypto-sha256-iterative": [67.0, 67.0, 67.0, 68.0, 65.0, 66.0, 68.0, 69.0, 66.0, 66.0], "audio-fft": [72.0, 71.0, 72.0, 98.0, 73.0, 73.0, 72.0, 105.0, 90.0, 72.0], "imaging-darkroom": [145.0, 145.0, 146.0, 146.0, 145.0, 145.0, 145.0, 146.0, 145.0, 145.0], "stanford-crypto-ccm": [115.0, 117.0, 113.0, 113.0, 117.0, 122.0, 116.0, 122.0, 116.0, 123.0], "audio-oscillator": [92.0, 92.0, 137.0, 90.0, 90.0, 91.0, 134.0, 91.0, 92.0, 134.0], "stanford-crypto-aes": [86.0, 84.0, 85.0, 85.0, 85.0, 85.0, 86.0, 86.0, 86.0, 94.0], "imaging-desaturate": [95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0]}, "summary": {"lowerIsBetter": true, "suite": 1493.7000000000003, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 79.8, "unit": "ms", "value": 79.8}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 148.0, "unit": "ms", "value": 148.0}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 144.6, "unit": "ms", "value": 144.6}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 117.4, "unit": "ms", "value": 117.4}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 145.3, "unit": "ms", "value": 145.3}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 59.0, "unit": "ms", "value": 59.0}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 104.3, "unit": "ms", "value": 104.3}, "ai-astar": {"lowerIsBetter": true, "filtered": 109.3, "unit": "ms", "value": 109.3}, "audio-dft": {"lowerIsBetter": true, "filtered": 160.6, "unit": "ms", "value": 160.6}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 66.9, "unit": "ms", "value": 66.9}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 67.7, "unit": "ms", "value": 67.7}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 109.3, "unit": "ms", "value": 109.3}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 86.2, "unit": "ms", "value": 86.2}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 95.3, "unit": "ms", "value": 95.3}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-031"}, "testrun": {"date": 1447836450, "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": "20151117233007", "branch": "Fx-Team", "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f"}}, {"talos_counters": {}, "results": {"DeltaBlue": [193.4984520123839], "Encrypt": [283.84899233607723], "NavierStokes": [4845.410628019324], "Decrypt": [5055.555555555556], "Splay": [668.8963210702341], "Richards": [162.813415825464], "RegExp": [25150.0], "Earley": [777.000777000777], "Boyer": [11916.666666666666], "RayTrace": [1117.31843575419]}, "summary": {"lowerIsBetter": false, "suite": 20955.490025416755, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 341.6978240000001, "unit": "score", "value": 341.6978240000001}, "Encrypt": {"lowerIsBetter": false, "filtered": 937.7556629999997, "unit": "score", "value": 937.7556629999997}, "NavierStokes": {"lowerIsBetter": false, "filtered": 306.26919242273203, "unit": "score", "value": 306.26919242273203}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.65118681318681, "unit": "score", "value": 52.65118681318681}, "Splay": {"lowerIsBetter": false, "filtered": 121.82904500000001, "unit": "score", "value": 121.82904500000001}, "RegExp": {"lowerIsBetter": false, "filtered": 36.22206759443341, "unit": "score", "value": 36.22206759443341}, "Richards": {"lowerIsBetter": false, "filtered": 216.82488399999997, "unit": "score", "value": 216.82488399999997}, "Earley": {"lowerIsBetter": false, "filtered": 857.737881, "unit": "score", "value": 857.737881}, "Boyer": {"lowerIsBetter": false, "filtered": 55.926965034964994, "unit": "score", "value": 55.926965034964994}, "RayTrace": {"lowerIsBetter": false, "filtered": 662.290155, "unit": "score", "value": 662.290155}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-031"}, "testrun": {"date": 1447836450, "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": "20151117233007", "branch": "Fx-Team", "revision": "c699b2c839a9f8c2b964dd956de9084d3b93a13f"}}] 01:07:41 INFO - RETURN: dromaeo_css: 6674.75 01:07:41 INFO - RETURN: kraken: 1493.70 01:07:41 INFO - RETURN: v8_7: 20955.49 01:07:41 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,35]]", "result": "20955.49"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1493.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6674.75"}}} 01:07:41 INFO - Return code: 0 01:07:41 INFO - # TBPL SUCCESS # 01:07:41 INFO - Running post-action listener: _resource_record_post_action 01:07:41 INFO - Running post-run listener: _resource_record_post_run 01:07:42 INFO - Total resource usage - Wall time: 1225s; CPU: 13.0%; Read bytes: 4096; Write bytes: 511528960; Read time: 8; Write time: 514704 01:07:42 INFO - install - Wall time: 15s; CPU: 15.0%; Read bytes: 0; Write bytes: 221388800; Read time: 0; Write time: 270548 01:07:42 INFO - run-tests - Wall time: 1211s; CPU: 13.0%; Read bytes: 4096; Write bytes: 274784256; Read time: 8; Write time: 236812 01:07:42 INFO - Running post-run listener: _upload_blobber_files 01:07:42 INFO - Blob upload gear active. 01:07:42 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 01:07:42 INFO - Copying logs to upload dir... 01:07:42 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1265.721670 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2015-11-18 01:07:42.200258) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-18 01:07:42.203498) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010092 build_url: 'https://queue.taskcluster.net/v1/task/SIgO1HkfRvydRCvTsGSxOw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-18 01:07:42.254941) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 01:07:42.255295) ========= 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=a9e534cca236dfa67d42a089000001c1-1447834593.656309-1893423201 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004522 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-18 01:07:42.304956) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-18 01:07:42.305275) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-18 01:07:42.305562) ========= ========= Total master_lag: 0.26 =========