builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-001 starttime: 1447773575.2 results: success (0) buildid: 20151117043002 builduid: 55015811a8a44e209dd7bb4b215c73aa revision: f8b569906e4c257687664227f470e416872d5802 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.204623) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.205090) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.205378) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006541 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.04 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.247167) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.247509) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.283579) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.284103) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.038649 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.334708) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.335076) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.335450) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.335748) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-17 07:19: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.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 15.8M=0.001s 2015-11-17 07:19:35 (15.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.206745 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.555997) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.556324) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.205124 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.775150) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:35.775543) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f8b569906e4c257687664227f470e416872d5802 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev f8b569906e4c257687664227f470e416872d5802 --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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-17 07:19:35,831 truncating revision to first 12 chars 2015-11-17 07:19:35,831 Setting DEBUG logging. 2015-11-17 07:19:35,831 attempt 1/10 2015-11-17 07:19:35,831 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f8b569906e4c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-17 07:19:36,070 unpacking tar archive at: mozilla-central-f8b569906e4c/testing/mozharness/ program finished with exit code 0 elapsedTime=0.522740 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:36.311260) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:36.311595) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:36.321028) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:36.321399) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 07:19:36.321882) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2015-11-17 07:19:36.322188) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:19:36 INFO - MultiFileLogger online at 20151117 07:19:36 in /builds/slave/test-pgo 07:19:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 07:19:36 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:19:36 INFO - {'append_to_log': False, 07:19:36 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:19:36 INFO - 'blob_upload_branch': 'Firefox', 07:19:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:19:36 INFO - 'branch': 'Firefox', 07:19:36 INFO - 'buildbot_json_path': 'buildprops.json', 07:19:36 INFO - 'config_files': ('talos/linux_config.py',), 07:19:36 INFO - 'default_actions': ('clobber', 07:19:36 INFO - 'read-buildbot-config', 07:19:36 INFO - 'download-and-extract', 07:19:36 INFO - 'populate-webroot', 07:19:36 INFO - 'create-virtualenv', 07:19:36 INFO - 'install', 07:19:36 INFO - 'run-tests'), 07:19:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:19:36 INFO - 'download_minidump_stackwalk': True, 07:19:36 INFO - 'download_symbols': 'ondemand', 07:19:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:19:36 INFO - 'tooltool.py': '/tools/tooltool.py', 07:19:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:19:36 INFO - '/tools/misc-python/virtualenv.py')}, 07:19:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:19:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:19:36 INFO - 'installer_path': 'installer.exe', 07:19:36 INFO - 'log_level': 'info', 07:19:36 INFO - 'log_name': 'talos', 07:19:36 INFO - 'log_to_console': True, 07:19:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:19:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:19:36 INFO - 'opt_config_files': (), 07:19:36 INFO - 'pip_index': False, 07:19:36 INFO - 'sps_profile': False, 07:19:36 INFO - 'sps_profile_interval': 0, 07:19:36 INFO - 'suite': 'dromaeojs', 07:19:36 INFO - 'system_bits': '64', 07:19:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:19:36 INFO - 'title': 'talos-linux64-ix-001', 07:19:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:19:36 INFO - 'use_talos_json': True, 07:19:36 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:19:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:19:36 INFO - 'work_dir': 'build'} 07:19:36 INFO - ##### 07:19:36 INFO - ##### Running clobber step. 07:19:36 INFO - ##### 07:19:36 INFO - Running pre-action listener: _resource_record_pre_action 07:19:36 INFO - Running main action method: clobber 07:19:36 INFO - rmtree: /builds/slave/test-pgo/build 07:19:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:19:37 INFO - Running post-action listener: _resource_record_post_action 07:19:37 INFO - ##### 07:19:37 INFO - ##### Running read-buildbot-config step. 07:19:37 INFO - ##### 07:19:37 INFO - Running pre-action listener: _resource_record_pre_action 07:19:37 INFO - Running main action method: read_buildbot_config 07:19:37 INFO - Using buildbot properties: 07:19:37 INFO - { 07:19:37 INFO - "properties": { 07:19:37 INFO - "buildnumber": 563, 07:19:37 INFO - "product": "firefox", 07:19:37 INFO - "script_repo_revision": "production", 07:19:37 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 07:19:37 INFO - "repository": "", 07:19:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 07:19:37 INFO - "buildid": "20151117043002", 07:19:37 INFO - "slavename": "talos-linux64-ix-001", 07:19:37 INFO - "pgo_build": "True", 07:19:37 INFO - "basedir": "/builds/slave/test-pgo", 07:19:37 INFO - "project": "", 07:19:37 INFO - "platform": "ubuntu64_hw", 07:19:37 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:19:37 INFO - "slavebuilddir": "test", 07:19:37 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 07:19:37 INFO - "branch": "mozilla-central", 07:19:37 INFO - "repo_path": "mozilla-central", 07:19:37 INFO - "stage_platform": "linux64-pgo", 07:19:37 INFO - "builduid": "55015811a8a44e209dd7bb4b215c73aa", 07:19:37 INFO - "revision": "f8b569906e4c257687664227f470e416872d5802" 07:19:37 INFO - }, 07:19:37 INFO - "sourcestamp": { 07:19:37 INFO - "repository": "", 07:19:37 INFO - "hasPatch": false, 07:19:37 INFO - "project": "", 07:19:37 INFO - "branch": "mozilla-central-linux64-pgo-talos", 07:19:37 INFO - "changes": [ 07:19:37 INFO - { 07:19:37 INFO - "category": null, 07:19:37 INFO - "files": [ 07:19:37 INFO - { 07:19:37 INFO - "url": null, 07:19:37 INFO - "name": "https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 07:19:37 INFO - } 07:19:37 INFO - ], 07:19:37 INFO - "repository": "", 07:19:37 INFO - "rev": "f8b569906e4c257687664227f470e416872d5802", 07:19:37 INFO - "who": "sendchange", 07:19:37 INFO - "when": 1447773556, 07:19:37 INFO - "number": 6672175, 07:19:37 INFO - "comments": "", 07:19:37 INFO - "project": "", 07:19:37 INFO - "at": "Tue 17 Nov 2015 07:19:16", 07:19:37 INFO - "branch": "mozilla-central-linux64-pgo-talos", 07:19:37 INFO - "revlink": "", 07:19:37 INFO - "properties": [ 07:19:37 INFO - [ 07:19:37 INFO - "buildid", 07:19:37 INFO - "20151117043002", 07:19:37 INFO - "Change" 07:19:37 INFO - ], 07:19:37 INFO - [ 07:19:37 INFO - "builduid", 07:19:37 INFO - "55015811a8a44e209dd7bb4b215c73aa", 07:19:37 INFO - "Change" 07:19:37 INFO - ], 07:19:37 INFO - [ 07:19:37 INFO - "pgo_build", 07:19:37 INFO - "True", 07:19:37 INFO - "Change" 07:19:37 INFO - ] 07:19:37 INFO - ], 07:19:37 INFO - "revision": "f8b569906e4c257687664227f470e416872d5802" 07:19:37 INFO - } 07:19:37 INFO - ], 07:19:37 INFO - "revision": "f8b569906e4c257687664227f470e416872d5802" 07:19:37 INFO - } 07:19:37 INFO - } 07:19:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 07:19:37 INFO - Running post-action listener: _resource_record_post_action 07:19:37 INFO - ##### 07:19:37 INFO - ##### Running download-and-extract step. 07:19:37 INFO - ##### 07:19:37 INFO - Running pre-action listener: _resource_record_pre_action 07:19:37 INFO - Running main action method: download_and_extract 07:19:37 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:19: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')]} 07:19:37 INFO - https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 07:19:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/test_packages.json 07:19:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/test_packages.json 07:19:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 07:19:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 07:19:38 INFO - Downloaded 1302 bytes. 07:19:38 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 07:19:38 INFO - Using the following test package requirements: 07:19:38 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 07:19:38 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:19:38 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'jsshell-linux-x86_64.zip'], 07:19:38 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:19:38 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 07:19:38 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:19:38 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:19:38 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:19:38 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 07:19:38 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 07:19:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:19:38 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:19:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:38 INFO - https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:19:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:39 INFO - Downloaded 22459236 bytes. 07:19:39 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 07:19:39 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19:39 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 07:19:40 INFO - Return code: 0 07:19:40 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 07:19:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:40 INFO - https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:19:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:44 INFO - Downloaded 22459236 bytes. 07:19: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 07:19:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 07:19: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 07:19:46 INFO - Return code: 0 07:19:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:46 INFO - https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:19:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 07:19:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 07:19:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:47 INFO - Downloaded 11131693 bytes. 07:19:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 07:19:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 07:19:47 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 07:19:47 INFO - Return code: 0 07:19:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:47 INFO - https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:19:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 07:19:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 07:19:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/xBa88q1XSVu-8vsnc2_T_A/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 07:19:48 INFO - Downloaded 57180541 bytes. 07:19:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 07:19:48 INFO - mkdir: /builds/slave/test-pgo/properties 07:19:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:19:48 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:19:48 INFO - Contents: 07:19:48 INFO - build_url:https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 07:19:48 INFO - Running post-action listener: _resource_record_post_action 07:19:48 INFO - Running post-action listener: set_extra_try_arguments 07:19:48 INFO - ##### 07:19:48 INFO - ##### Running populate-webroot step. 07:19:48 INFO - ##### 07:19:48 INFO - Running pre-action listener: _resource_record_pre_action 07:19:48 INFO - Running main action method: populate_webroot 07:19:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:19:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:19:48 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 07:19:48 INFO - '../fennec_ids.txt'], 07:19:48 INFO - 'tests': ['tcheck2']}, 07:19:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:19:48 INFO - '--tppagecycles', 07:19:48 INFO - '7'], 07:19:48 INFO - 'tests': ['tsvgm']}}, 07:19:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:19:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:19:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:19:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 07:19:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:19:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:19:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'tests': ['damp', 'tps']}, 07:19:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['damp', 'tps']}, 07:19:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:19:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:19:48 INFO - 'other': {'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'other_l64': {'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'other_nol64': {'tests': ['a11yr', 07:19:48 INFO - 'ts_paint', 07:19:48 INFO - 'tpaint', 07:19:48 INFO - 'sessionrestore', 07:19:48 INFO - 'sessionrestore_no_auto_restore']}, 07:19:48 INFO - 'svgr': {'tests': ['tsvgx', 07:19:48 INFO - 'tsvgr_opacity', 07:19:48 INFO - 'tart', 07:19:48 INFO - 'tscrollx', 07:19:48 INFO - 'cart']}, 07:19:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['tsvgx', 07:19:48 INFO - 'tsvgr_opacity', 07:19:48 INFO - 'tart', 07:19:48 INFO - 'tscrollx', 07:19:48 INFO - 'cart']}, 07:19:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'tests': ['tp5o']}, 07:19:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'talos_options': ['--e10s'], 07:19:48 INFO - 'tests': ['tp5o']}, 07:19:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'talos_options': ['--xperf_path', 07:19:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:19:48 INFO - 'tests': ['tp5n']}, 07:19:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:19:48 INFO - 'talos_options': ['--e10s', 07:19:48 INFO - '--xperf_path', 07:19:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:19:48 INFO - 'tests': ['tp5n']}}, 07:19:48 INFO - 'talos.zip': {'path': '', 07:19:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:19:48 INFO - Running post-action listener: _resource_record_post_action 07:19:48 INFO - ##### 07:19:48 INFO - ##### Running create-virtualenv step. 07:19:48 INFO - ##### 07:19:48 INFO - Running pre-action listener: _resource_record_pre_action 07:19:48 INFO - Running main action method: create_virtualenv 07:19:48 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:19:48 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 07:19:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:19:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:19:48 INFO - Using real prefix '/usr' 07:19:48 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:19:49 INFO - Installing distribute.............................................................................................................................................................................................done. 07:19:51 INFO - Installing pip.................done. 07:19:51 INFO - Return code: 0 07:19:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:19:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:19:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:19:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:19:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 07:19:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:19:51 INFO - Using env: {'DISPLAY': ':0', 07:19:51 INFO - 'HOME': '/home/cltbld', 07:19:51 INFO - 'LANG': 'en_US.UTF-8', 07:19:51 INFO - 'LANGUAGE': 'en_US:en', 07:19:51 INFO - 'LOGNAME': 'cltbld', 07:19:51 INFO - 'MAIL': '/var/mail/cltbld', 07:19:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:19:51 INFO - 'MOZ_NO_REMOTE': '1', 07:19:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:19:51 INFO - 'NO_EM_RESTART': '1', 07:19:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:19:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:19:51 INFO - 'PWD': '/builds/slave/test-pgo', 07:19:51 INFO - 'SHELL': '/bin/bash', 07:19:51 INFO - 'SHLVL': '1', 07:19:51 INFO - 'TERM': 'linux', 07:19:51 INFO - 'TMOUT': '86400', 07:19:51 INFO - 'USER': 'cltbld', 07:19:51 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:19:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:19:51 INFO - '_': '/tools/buildbot/bin/python'} 07:19:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:19:52 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:19:52 INFO - Cleaning up... 07:19:52 INFO - Return code: 0 07:19:52 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:19:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:19:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:19:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:19:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 07:19:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 07:19:52 INFO - Using env: {'DISPLAY': ':0', 07:19:52 INFO - 'HOME': '/home/cltbld', 07:19:52 INFO - 'LANG': 'en_US.UTF-8', 07:19:52 INFO - 'LANGUAGE': 'en_US:en', 07:19:52 INFO - 'LOGNAME': 'cltbld', 07:19:52 INFO - 'MAIL': '/var/mail/cltbld', 07:19:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:19:52 INFO - 'MOZ_NO_REMOTE': '1', 07:19:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:19:52 INFO - 'NO_EM_RESTART': '1', 07:19:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:19:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:19:52 INFO - 'PWD': '/builds/slave/test-pgo', 07:19:52 INFO - 'SHELL': '/bin/bash', 07:19:52 INFO - 'SHLVL': '1', 07:19:52 INFO - 'TERM': 'linux', 07:19:52 INFO - 'TMOUT': '86400', 07:19:52 INFO - 'USER': 'cltbld', 07:19:52 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:19:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:19:52 INFO - '_': '/tools/buildbot/bin/python'} 07:19:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:19:52 INFO - Downloading/unpacking psutil>=0.7.1 07:19:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:19:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:19:54 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 07:19:54 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 07:19:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:19:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:19:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:19:54 INFO - Installing collected packages: psutil 07:19:54 INFO - Running setup.py install for psutil 07:19:54 INFO - building 'psutil._psutil_linux' extension 07:19:54 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 07:19:55 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 07:19:55 INFO - building 'psutil._psutil_posix' extension 07:19:55 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 07:19:55 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 07:19:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:19:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:19:55 INFO - Successfully installed psutil 07:19:55 INFO - Cleaning up... 07:19:56 INFO - Return code: 0 07:19:56 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:19:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:19:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:19:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:19:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 07:19:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 07:19:56 INFO - Using env: {'DISPLAY': ':0', 07:19:56 INFO - 'HOME': '/home/cltbld', 07:19:56 INFO - 'LANG': 'en_US.UTF-8', 07:19:56 INFO - 'LANGUAGE': 'en_US:en', 07:19:56 INFO - 'LOGNAME': 'cltbld', 07:19:56 INFO - 'MAIL': '/var/mail/cltbld', 07:19:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:19:56 INFO - 'MOZ_NO_REMOTE': '1', 07:19:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:19:56 INFO - 'NO_EM_RESTART': '1', 07:19:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:19:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:19:56 INFO - 'PWD': '/builds/slave/test-pgo', 07:19:56 INFO - 'SHELL': '/bin/bash', 07:19:56 INFO - 'SHLVL': '1', 07:19:56 INFO - 'TERM': 'linux', 07:19:56 INFO - 'TMOUT': '86400', 07:19:56 INFO - 'USER': 'cltbld', 07:19:56 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:19:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:19:56 INFO - '_': '/tools/buildbot/bin/python'} 07:19:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:19:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:19:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:19:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:19:57 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:19:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 07:19:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:19:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:19:57 INFO - Installing collected packages: mozsystemmonitor 07:19:57 INFO - Running setup.py install for mozsystemmonitor 07:19:58 INFO - Successfully installed mozsystemmonitor 07:19:58 INFO - Cleaning up... 07:19:58 INFO - Return code: 0 07:19:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:19:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:19:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:19:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:19:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:19:58 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 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:19:58 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 07:19:58 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 07:19:58 INFO - Using env: {'DISPLAY': ':0', 07:19:58 INFO - 'HOME': '/home/cltbld', 07:19:58 INFO - 'LANG': 'en_US.UTF-8', 07:19:58 INFO - 'LANGUAGE': 'en_US:en', 07:19:58 INFO - 'LOGNAME': 'cltbld', 07:19:58 INFO - 'MAIL': '/var/mail/cltbld', 07:19:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:19:58 INFO - 'MOZ_NO_REMOTE': '1', 07:19:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:19:58 INFO - 'NO_EM_RESTART': '1', 07:19:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:19:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:19:58 INFO - 'PWD': '/builds/slave/test-pgo', 07:19:58 INFO - 'SHELL': '/bin/bash', 07:19:58 INFO - 'SHLVL': '1', 07:19:58 INFO - 'TERM': 'linux', 07:19:58 INFO - 'TMOUT': '86400', 07:19:58 INFO - 'USER': 'cltbld', 07:19:58 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:19:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:19:58 INFO - '_': '/tools/buildbot/bin/python'} 07:19:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:19:58 INFO - Downloading/unpacking blobuploader==1.2.4 07:19:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:19:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:19:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:19:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:00 INFO - Downloading blobuploader-1.2.4.tar.gz 07:20:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 07:20:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:20:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:20: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 07:20: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 07:20: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 07:20: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 07:20: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 07:20: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 07:20:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 07:20:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:20:01 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:20:01 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 07:20:01 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 07:20:01 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 07:20:01 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 07:20:01 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 07:20:01 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 07:20:01 INFO - Downloading docopt-0.6.1.tar.gz 07:20:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 07:20:01 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:20:01 INFO - Installing collected packages: blobuploader, requests, docopt 07:20:01 INFO - Running setup.py install for blobuploader 07:20:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:20:01 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:20:01 INFO - Running setup.py install for requests 07:20:01 INFO - Running setup.py install for docopt 07:20:01 INFO - Successfully installed blobuploader requests docopt 07:20:01 INFO - Cleaning up... 07:20:01 INFO - Return code: 0 07:20:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:20:01 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')]} 07:20:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:01 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')]} 07:20:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:01 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 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:20:01 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 07:20:01 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 07:20:01 INFO - Using env: {'DISPLAY': ':0', 07:20:01 INFO - 'HOME': '/home/cltbld', 07:20:01 INFO - 'LANG': 'en_US.UTF-8', 07:20:01 INFO - 'LANGUAGE': 'en_US:en', 07:20:01 INFO - 'LOGNAME': 'cltbld', 07:20:01 INFO - 'MAIL': '/var/mail/cltbld', 07:20:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:01 INFO - 'MOZ_NO_REMOTE': '1', 07:20:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:01 INFO - 'NO_EM_RESTART': '1', 07:20:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:01 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:01 INFO - 'SHELL': '/bin/bash', 07:20:01 INFO - 'SHLVL': '1', 07:20:01 INFO - 'TERM': 'linux', 07:20:01 INFO - 'TMOUT': '86400', 07:20:01 INFO - 'USER': 'cltbld', 07:20:01 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:20:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:01 INFO - '_': '/tools/buildbot/bin/python'} 07:20:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:20:02 INFO - Running setup.py (path:/tmp/pip-oC4Ya5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:20:02 INFO - Running setup.py (path:/tmp/pip-zP124h-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:20:02 INFO - Running setup.py (path:/tmp/pip-JGBqtN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:20:02 INFO - Running setup.py (path:/tmp/pip-T9Lba_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:20:02 INFO - Running setup.py (path:/tmp/pip-_BD8OM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:20:02 INFO - Running setup.py (path:/tmp/pip-2ZkmSW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:20:02 INFO - Running setup.py (path:/tmp/pip-8WeuQe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:20:02 INFO - Running setup.py (path:/tmp/pip-_UJ8ag-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:20:02 INFO - Running setup.py (path:/tmp/pip-tRwBw4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:20:02 INFO - Running setup.py (path:/tmp/pip-HA0YMz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:20:02 INFO - Running setup.py (path:/tmp/pip-bWN48l-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:20:02 INFO - Running setup.py (path:/tmp/pip-WLJ2xd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:20:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:20:02 INFO - Running setup.py (path:/tmp/pip-Ife77k-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:20:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:20:03 INFO - Running setup.py (path:/tmp/pip-Gf0Y1v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:20:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:20:03 INFO - Running setup.py (path:/tmp/pip-IJMAEA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:20:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:20:03 INFO - Running setup.py (path:/tmp/pip-otMzle-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:20:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:20:03 INFO - Running setup.py (path:/tmp/pip-STJ9KB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:20:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:20:03 INFO - Running setup.py install for manifestparser 07:20:03 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:20:03 INFO - Running setup.py install for mozcrash 07:20:03 INFO - Running setup.py install for mozdebug 07:20:03 INFO - Running setup.py install for mozdevice 07:20:03 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:20:03 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:20:03 INFO - Running setup.py install for mozfile 07:20:03 INFO - Running setup.py install for mozhttpd 07:20:03 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:20:03 INFO - Running setup.py install for mozinfo 07:20:03 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:20:03 INFO - Running setup.py install for mozInstall 07:20:04 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Running setup.py install for mozleak 07:20:04 INFO - Running setup.py install for mozlog 07:20:04 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Running setup.py install for moznetwork 07:20:04 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Running setup.py install for mozprocess 07:20:04 INFO - Running setup.py install for mozprofile 07:20:04 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Running setup.py install for mozrunner 07:20:04 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:20:04 INFO - Running setup.py install for mozscreenshot 07:20:04 INFO - Running setup.py install for moztest 07:20:04 INFO - Running setup.py install for mozversion 07:20:05 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:20:05 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:20:05 INFO - Cleaning up... 07:20:05 INFO - Return code: 0 07:20:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:20: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')]} 07:20:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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', '-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 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:20:05 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 07:20:05 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 07:20:05 INFO - Using env: {'DISPLAY': ':0', 07:20:05 INFO - 'HOME': '/home/cltbld', 07:20:05 INFO - 'LANG': 'en_US.UTF-8', 07:20:05 INFO - 'LANGUAGE': 'en_US:en', 07:20:05 INFO - 'LOGNAME': 'cltbld', 07:20:05 INFO - 'MAIL': '/var/mail/cltbld', 07:20:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:05 INFO - 'MOZ_NO_REMOTE': '1', 07:20:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:05 INFO - 'NO_EM_RESTART': '1', 07:20:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:05 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:05 INFO - 'SHELL': '/bin/bash', 07:20:05 INFO - 'SHLVL': '1', 07:20:05 INFO - 'TERM': 'linux', 07:20:05 INFO - 'TMOUT': '86400', 07:20:05 INFO - 'USER': 'cltbld', 07:20:05 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:20:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:05 INFO - '_': '/tools/buildbot/bin/python'} 07:20:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:20:05 INFO - Running setup.py (path:/tmp/pip-bjUErQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:20:05 INFO - Running setup.py (path:/tmp/pip-gM8hNa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:20:05 INFO - Running setup.py (path:/tmp/pip-G63nxF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:20:05 INFO - Running setup.py (path:/tmp/pip-vGnxl4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:20:05 INFO - Running setup.py (path:/tmp/pip-O2Oef2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:20:05 INFO - Running setup.py (path:/tmp/pip-WAINEA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:20:05 INFO - Running setup.py (path:/tmp/pip-6rLhrA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:20:05 INFO - Running setup.py (path:/tmp/pip-XamArc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:20:05 INFO - Running setup.py (path:/tmp/pip-vohA4d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:20:05 INFO - Running setup.py (path:/tmp/pip-ew5qjf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:20:05 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)) 07:20:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:20:05 INFO - Running setup.py (path:/tmp/pip-aB8Mi5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:20:06 INFO - Running setup.py (path:/tmp/pip-sGSEva-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:20:06 INFO - Running setup.py (path:/tmp/pip-BQ0ngG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:20:06 INFO - Running setup.py (path:/tmp/pip-zLA5GN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:20:06 INFO - Running setup.py (path:/tmp/pip-D4udPq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:20:06 INFO - Running setup.py (path:/tmp/pip-rwHr6v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:20:06 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)) 07:20:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:20:06 INFO - Running setup.py (path:/tmp/pip-xKUVML-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:20:06 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)) 07:20:06 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)) 07:20:06 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)) 07:20:06 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)) 07:20:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:20:06 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)) 07:20:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:20:06 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 07:20:06 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 07:20:06 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 07:20:06 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 07:20:06 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 07:20:06 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 07:20:08 INFO - Downloading blessings-1.5.1.tar.gz 07:20:08 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 07:20:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:20:08 INFO - Installing collected packages: blessings 07:20:08 INFO - Running setup.py install for blessings 07:20:08 INFO - Successfully installed blessings 07:20:08 INFO - Cleaning up... 07:20:08 INFO - Return code: 0 07:20:08 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:20:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:20:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:20:08 INFO - Reading from file tmpfile_stdout 07:20:08 INFO - Current package versions: 07:20:08 INFO - argparse == 1.2.1 07:20:08 INFO - blessings == 1.5.1 07:20:08 INFO - blobuploader == 1.2.4 07:20:08 INFO - docopt == 0.6.1 07:20:08 INFO - manifestparser == 1.1 07:20:08 INFO - mozInstall == 1.12 07:20:08 INFO - mozcrash == 0.16 07:20:08 INFO - mozdebug == 0.1 07:20:08 INFO - mozdevice == 0.47 07:20:08 INFO - mozfile == 1.2 07:20:08 INFO - mozhttpd == 0.7 07:20:08 INFO - mozinfo == 0.9 07:20:08 INFO - mozleak == 0.1 07:20:08 INFO - mozlog == 3.0 07:20:08 INFO - moznetwork == 0.27 07:20:08 INFO - mozprocess == 0.22 07:20:08 INFO - mozprofile == 0.27 07:20:08 INFO - mozrunner == 6.11 07:20:08 INFO - mozscreenshot == 0.1 07:20:08 INFO - mozsystemmonitor == 0.0 07:20:08 INFO - moztest == 0.7 07:20:08 INFO - mozversion == 1.4 07:20:08 INFO - psutil == 3.1.1 07:20:08 INFO - requests == 1.2.3 07:20:08 INFO - wsgiref == 0.1.2 07:20:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:20: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')]} 07:20:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:08 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 0x7f3ceb92dc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0a6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcb3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, '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': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', '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 07:20:08 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 07:20:08 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 07:20:08 INFO - Using env: {'DISPLAY': ':0', 07:20:08 INFO - 'HOME': '/home/cltbld', 07:20:08 INFO - 'LANG': 'en_US.UTF-8', 07:20:08 INFO - 'LANGUAGE': 'en_US:en', 07:20:08 INFO - 'LOGNAME': 'cltbld', 07:20:08 INFO - 'MAIL': '/var/mail/cltbld', 07:20:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:08 INFO - 'MOZ_NO_REMOTE': '1', 07:20:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:08 INFO - 'NO_EM_RESTART': '1', 07:20:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:08 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:08 INFO - 'SHELL': '/bin/bash', 07:20:08 INFO - 'SHLVL': '1', 07:20:08 INFO - 'TERM': 'linux', 07:20:08 INFO - 'TMOUT': '86400', 07:20:08 INFO - 'USER': 'cltbld', 07:20:08 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:20:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:08 INFO - '_': '/tools/buildbot/bin/python'} 07:20:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 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)) 07:20:08 INFO - Cleaning up... 07:20:08 INFO - Return code: 0 07:20:08 INFO - Running post-action listener: _resource_record_post_action 07:20:08 INFO - Running post-action listener: _start_resource_monitoring 07:20:08 INFO - Starting resource monitoring. 07:20:08 INFO - ##### 07:20:08 INFO - ##### Running install step. 07:20:08 INFO - ##### 07:20:08 INFO - Running pre-action listener: _resource_record_pre_action 07:20:08 INFO - Running main action method: install 07:20:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:20:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:20:09 INFO - Reading from file tmpfile_stdout 07:20:09 INFO - Detecting whether we're running mozinstall >=1.0... 07:20:09 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:20:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:20:09 INFO - Reading from file tmpfile_stdout 07:20:09 INFO - Output received: 07:20:09 INFO - Usage: mozinstall [options] installer 07:20:09 INFO - Options: 07:20:09 INFO - -h, --help show this help message and exit 07:20:09 INFO - -d DEST, --destination=DEST 07:20:09 INFO - Directory to install application into. [default: 07:20:09 INFO - "/builds/slave/test-pgo"] 07:20:09 INFO - --app=APP Application being installed. [default: firefox] 07:20:09 INFO - mkdir: /builds/slave/test-pgo/build/application 07:20:09 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'] 07:20:09 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 07:20:23 INFO - Reading from file tmpfile_stdout 07:20:23 INFO - Output received: 07:20:23 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:20:23 INFO - Running post-action listener: _resource_record_post_action 07:20:23 INFO - ##### 07:20:23 INFO - ##### Running run-tests step. 07:20:23 INFO - ##### 07:20:23 INFO - Running pre-action listener: _resource_record_pre_action 07:20:23 INFO - Running main action method: run_tests 07:20:23 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:20:23 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:20:23 INFO - Python 2.7.3 07:20:23 INFO - Return code: 0 07:20:23 INFO - grabbing minidump binary from tooltool 07:20:23 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')]} 07:20:23 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 0x1c548c0>, '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 0x1c01420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c018b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:20:23 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 07:20:23 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 07:20:23 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:20:23 INFO - Return code: 0 07:20:23 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:20:23 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:20:23 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:20:23 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:20:23 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:20:23 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 07:20:23 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-001 --webServer localhost 07:20:23 INFO - Using env: {'DISPLAY': ':0', 07:20:23 INFO - 'HOME': '/home/cltbld', 07:20:23 INFO - 'LANG': 'en_US.UTF-8', 07:20:23 INFO - 'LANGUAGE': 'en_US:en', 07:20:23 INFO - 'LOGNAME': 'cltbld', 07:20:23 INFO - 'MAIL': '/var/mail/cltbld', 07:20:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:20:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:20:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:23 INFO - 'MOZ_NO_REMOTE': '1', 07:20:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:20:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:23 INFO - 'NO_EM_RESTART': '1', 07:20:23 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:20:23 INFO - 'PWD': '/builds/slave/test-pgo', 07:20:23 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:20:23 INFO - 'SHELL': '/bin/bash', 07:20:23 INFO - 'SHLVL': '1', 07:20:23 INFO - 'TERM': 'linux', 07:20:23 INFO - 'TMOUT': '86400', 07:20:23 INFO - 'USER': 'cltbld', 07:20:23 INFO - 'XDG_SESSION_COOKIE': 'b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757', 07:20:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:23 INFO - '_': '/tools/buildbot/bin/python'} 07:20:23 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--webServer', 'localhost'] with output_timeout 3600 07:20:23 INFO - mozversion INFO | application_buildid: 20151117043002 07:20:23 INFO - mozversion INFO | application_changeset: f8b569906e4c257687664227f470e416872d5802 07:20:23 INFO - mozversion INFO | application_display_name: Nightly 07:20:23 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:20:23 INFO - mozversion INFO | application_name: Firefox 07:20:23 INFO - mozversion INFO | application_remotingname: firefox 07:20:23 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 07:20:23 INFO - mozversion INFO | application_vendor: Mozilla 07:20:23 INFO - mozversion INFO | application_version: 45.0a1 07:20:23 INFO - mozversion INFO | platform_buildid: 20151117043002 07:20:23 INFO - mozversion INFO | platform_changeset: f8b569906e4c257687664227f470e416872d5802 07:20:23 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 07:20:23 INFO - mozversion INFO | platform_version: 45.0a1 07:20:23 INFO - 2015-11-17 07:20:23,931 DEBUG : using testdate: 1447773623 07:20:23 INFO - 2015-11-17 07:20:23,931 DEBUG : actual date: 1447773623 07:20:24 INFO - 2015-11-17 07:20:24,006 INFO : starting webserver on 'localhost:52806' 07:20:24 INFO - 2015-11-17 07:20:24,007 INFO : Starting test suite talos-linux64-ix-001 07:20:24 INFO - 2015-11-17 07:20:24,008 INFO : Starting test dromaeo_css 07:20:24 INFO - 2015-11-17 07:20:24,008 DEBUG : operating with platform_type : linux_ 07:20:24 INFO - 2015-11-17 07:20:24,008 INFO : Initialising browser for dromaeo_css test... 07:20:24 INFO - 2015-11-17 07:20:24,033 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5_4pdW/profile http://localhost:52806/getInfo.html 07:20:31 INFO - 2015-11-17 07:20:31,201 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:20:31 INFO - 2015-11-17 07:20:31,202 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:20:31 INFO - 2015-11-17 07:20:31,202 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 07:20:31 INFO - 2015-11-17 07:20:31,202 DEBUG : BROWSER_OUTPUT: __metrics 07:20:31 INFO - 2015-11-17 07:20:31,298 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:20:32 INFO - 2015-11-17 07:20:32,704 INFO : Browser initialized. 07:20:32 INFO - 2015-11-17 07:20:32,704 INFO : Running cycle 1/1 for dromaeo_css test... 07:20:32 INFO - 2015-11-17 07:20:32,705 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5_4pdW/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:20:44 INFO - 2015-11-17 07:20:44,476 DEBUG : BROWSER_OUTPUT: RSS: Main: 141524992 07:20:44 INFO - 2015-11-17 07:20:44,476 DEBUG : BROWSER_OUTPUT: 07:21:36 INFO - 2015-11-17 07:21:36,104 DEBUG : BROWSER_OUTPUT: 1447773696099 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] 07:23:44 INFO - 2015-11-17 07:23:44,884 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52806/tests/dromaeo/cssquery-ext.html) 07:23:45 INFO - 2015-11-17 07:23:45,872 DEBUG : BROWSER_OUTPUT: RSS: Main: 229998592 07:23:45 INFO - 2015-11-17 07:23:45,873 DEBUG : BROWSER_OUTPUT: 07:26:48 INFO - 2015-11-17 07:26:48,187 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-ext.html (next: http://localhost:52806/tests/dromaeo/cssquery-jquery.html) 07:26:48 INFO - 2015-11-17 07:26:48,752 DEBUG : BROWSER_OUTPUT: RSS: Main: 219021312 07:26:48 INFO - 2015-11-17 07:26:48,753 DEBUG : BROWSER_OUTPUT: 07:29:50 INFO - 2015-11-17 07:29:50,696 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52806/tests/dromaeo/cssquery-mootools.html) 07:29:51 INFO - 2015-11-17 07:29:51,258 DEBUG : BROWSER_OUTPUT: RSS: Main: 208384000 07:29:51 INFO - 2015-11-17 07:29:51,258 DEBUG : BROWSER_OUTPUT: 07:32:53 INFO - 2015-11-17 07:32:53,068 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52806/tests/dromaeo/cssquery-prototype.html) 07:32:53 INFO - 2015-11-17 07:32:53,654 DEBUG : BROWSER_OUTPUT: RSS: Main: 196075520 07:32:53 INFO - 2015-11-17 07:32:53,654 DEBUG : BROWSER_OUTPUT: 07:35:56 INFO - 2015-11-17 07:35:56,291 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52806/tests/dromaeo/cssquery-yui.html) 07:35:56 INFO - 2015-11-17 07:35:56,856 DEBUG : BROWSER_OUTPUT: RSS: Main: 201719808 07:35:56 INFO - 2015-11-17 07:35:56,856 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,355 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/dromaeo/cssquery-yui.html (next: http://localhost:52806/tests/dromaeo/cssquery-dojo.html) 07:38:59 INFO - 2015-11-17 07:38:59,605 DEBUG : BROWSER_OUTPUT: RSS: Main: 264036352 07:38:59 INFO - 2015-11-17 07:38:59,605 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,607 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:38:59 INFO - 2015-11-17 07:38:59,607 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:38:59 INFO - 2015-11-17 07:38:59,607 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:38:59 INFO - 2015-11-17 07:38:59,607 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:38:59 INFO - 2015-11-17 07:38:59,608 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3187.2987942652617;3216.726578240852;3261.0216934919517;3270.068030611275;3282.688144626261;5173.9482605174035;5278.551323137528;5316.441773613768;5340.198970154479;5375.48932851379;5276.314079169712;5307.73461326934;5332.466753324666;5344.625876188668;5347.518723314901;4777.737224452654;4833.879153021167;4847.1032858921035;4939.185034469308;4973.776180071905;4800.351952486404;4912.361393018902;4940.011997600476;4983.800647974077;5045.899082018357;4776.0686666099955;4850.951490485085;4867.634927380461;4882.3408839806525;4922.55696987271;4900.6569540132205;4925.4335751388335;4928.531789479994;4936.703797772145;4941.579965702884;4751.952480475185;4839.588634966032;4901.289313049623;4912.901741965141;4940.40715114185;5152.407473140562;5190.636655434121;5199.584033277329;5214.061468935628;5229.084910140748;5741.425857414267;5747.051736463479;5753.510951569122;5758.452946970031;5775.768969241225;5562.221289019541;5724.284464441945;5779.248697669318;5791.565632577532;5792.275965504312;5358.732063396815;5409.107497262986;5414.998225328288;5421.593380496479;5446.400895901487;5913.763449461973;5953.791617293374;5956.970215148896;5969.910451343233;5977.760889564369;5614.326280846243;5649.6327738696855;5728.942710572925;5764.596478246483;5804.593678442468;5816.1566572846705;5832.650040997469;5857.326407463196;5876.236089308448;5890.4698577128265;5779.624324418899;5788.18965344852;5790;5790.189373487715;5800.680962547016;5582.385937546866;5705.71471426427;5707.4577915098;5723.59934804568;5794.246747922827;4389.539098394686;4391.67062470316;4393.450818647669;4420.557944205618;4425.845095421645;3913.8043097844993;3926.332523471017;3937.645611894943;3956;3968.8610898618986;5340.546053585411;5358.169483730028;5433.891322173614;5479.835604931858;5507.201455788968;5788.9290481261105;5831.912521312183;5844.064949608127;5852.151438041546;5854.707264636836;5515.503604675519;5527.889442211133;5530.529904958124;5535.308086489189;5548.9722551387795;4802.543758342952;4811.663183577186;4867.172580661296;4904.8038078477175;4923.77842997066;6047.697615119227;6068.484178844759;6073.331933487313;6088.6042407243385;6091.269047714302;5588.050031494575;5821.417858214314;5830.7959221427045;5839.854003649943;5848.210491583582;5906.1140828874295;5915.349311575809;5963.761449541969;5964.194833697396;6007.759689612367;5757.165211044291;5809.883802323845;5811.62224455426;5813.3605303417435;5813.593048486566;5676.403977582295;5755.798547050833;5890.705464726832;5896.027155519463;5898.882022359615;5683.403242659627;5724.599278050497;5739.713014349182;5774.335951365647;5788.681622510802;5700.828975130753;5709.371969083314;5716.714164291852;5725.6850873202375;5739.139129130664;5452.045891968969;5529.30883639545;5618.213450116905;5626.156076588544;5635.351934527418;5619.241402410622;5659.405762395054;5684.8294551163535;5718;5719.656820590778;5572.275604171432;5626.63426877268;5632.746526406403;5636.1545768133465;5638.633488823213 07:38:59 INFO - 2015-11-17 07:38:59,610 DEBUG : BROWSER_OUTPUT: |1;ext.html;562.5391321100033;580.3616022375386;594.5332913662772;597.5488506177835;600.1597763131613;31337.373252534937;31876.20309492264;32160.517592236134;39300;39701.60298397015;43591.78204108983;44073.77963110188;44131.55868441315;44156.779216103954;44213.7789311053;8677.869831952527;8880.289576833839;8892.644294228223;8907.465552066864;8911.821763564725;7658.9617051914665;7931.325837303836;10153.644622438216;10358.223133265035;10365.740856478611;10010.299279050469;10071.64749233777;10089.697309080739;10104.595816167344;10104.797904041914;7787.493812902143;7968.482048666818;10033.347832390871;10034.046765557297;10083.344582602107;10155.39067655943;10330.793384132276;10338.069573738325;10340.793184136275;10346.741331466697;39805.800970995246;40155.59844401548;40502.594974050175;40552.18895622071;40586.79706601478;3343.882964096245;3371.612264589579;3618.3848745713294;4024.2555127301544;4053.250148722496;30581;30717.692823071706;30922.381552368828;31755.364892702248;31759.52360714591;3503.789772613651;3545.2732189901267;3547.4324108142573;3550.8757193498363;3605.387084195693;287242;287589;287694;287978;288027;54656.45343546593;56160.71919640457;59057;63851.68074159599;65897.67051164714;60613.393866061655;60825.39174608286;60929.39070609326;60989.39010609837;61031.69484152551;15041;15079.321430535652;15085.24573771329;15137.772933406008;15315.770263446057;11404.087672986141;11435.428228588704;11445.08439324852;11549.307041577533;11732.589359372381;19540.72985255954;19755.901220493804;19835;19842.50393740168;19842.70235946462;7476.102867655916;7566.772996810105;7588.62056897153;7608.923910760932;7686.3082322591235;953.4994128082812;957.3107362698846;959.1271942532262;1013.4729940430934;1077.0683358894657;28228;28242.15273541797;28660.283492912844;28693.56959645607;28835.56746648802;1010.8685870836745;1060.984085238722;1103.2167161315394;1113.8916777805973;1145.381493993251;15391.692166156838;15747.842521574867;15835.841641583436;15855.920720396554;16112.113833739022;317742;324811;325182;326321;326415;51999.74000129975;52325;52459.47540524622;52471.73764131155;52804.73597631987;1326.2042774335514;1341.8054382114733;1357.7691792395317;1362.291608363665;1371.6502291915497;22620.547589048456;28298.434031318848;28372.85813570919;28807.855960720062;30053.69946300509;47953.52046479491;48568;48624;48632.27051594158;48685.756571216916;269953;271941;273725;274029;274047;27637.170884873485;28043.719562804927;30743.538846917763;32064.67935320617;32085.518717218794;37338.25323493461;37621.62378376181;37631.81184094062;37738.811305943294;38267.6173238264;31818.522722158723;32033.359332813678;32109.518357225126;32335.644345629655;32602.83698581492;34057.48913766246;34813.65186348205;35020.47469288014;35082;35121;34640.653593464755;34946.30107397787;34985.65014349824;35004.299914002084;36671.266574667825;28572.285692857844;30066.24834379158;30846.69153308438;30945.381092378477;30949.381012380076;23094.191703290304;23396.88301558481;24636;24706.876465618276;24926.252212433657 07:38:59 INFO - 2015-11-17 07:38:59,611 DEBUG : BROWSER_OUTPUT: |2;jquery.html;336.971357434618;347.1010083882744;349.45485043332394;350.59156083163117;354.0970525160841;14422;14876.181810000446;16780.496585102435;17003.659926801472;17862.999999999985;12013.159078864483;12437.813432798494;16249.431269905555;17743.46769596911;17750.822491775078;4556.179887620227;4658.091672123937;4658.720476771387;4659.650526210531;4660.16117098922;3468.4623883298127;3533.505309256706;4626.30605409188;4658.021815418766;4894.951050489485;4894.632902532307;4906.705597664134;4919.385076865392;4931.3835770528685;4968.975155124219;4825.420949486067;4889.804407823683;4897.1674815281485;4908.386451693538;4919.483454237289;4239.6396306314;4248.915021699549;4252.064545799919;4258.531561528261;4271.145770845843;13517.32413379327;13785.310734463337;14083.084599501;14087.43650253999;14106;1870.3827736846945;1906.9332573359866;1920.1359388275193;1923.85571082168;1940.8544359173118;10185.89814101857;10247.077763001365;10325.9483702581;10489.527971241312;10517.894821051768;1721.8880772749856;1745.301879248298;1767.9027653479054;1777.3779177287975;1810.0497238949656;55576.44423555753;58346.70826645882;59049.70475147597;59810.40189598092;62240.37759622391;6930.549514281555;7113.039739635083;7135.357817796319;7172.605506697182;7207.243239459886;8440.409171357946;8543.700970466129;8559.700410485602;8563.314934805201;8590;5678.346990096192;5700.087985922232;5701.885962280731;5724.341700704389;5767.798127065533;5908.231929849092;5931.08068249422;5933.6736479493175;5945.940540594625;5949.3455719871645;3324.3185147044796;3350.195952971318;3375.3586818504405;3392.456432323287;3399.133221028622;1136.732867776072;1172.0740614914293;1185.3184418959133;1189.084405008139;1216.9087318451152;486.5888324365905;488.4334172360045;506.5820697924227;516.7752027867889;523.7904838064804;11437.485313160927;11994.10044246685;12317.568885088978;12319.322437265857;12357.814632780515;492.3894370979959;500.21423518040973;507.4240736763726;510.47676131965034;522.146290814521;5241.580673546107;6810.761623343258;6858.451323894076;6934.514583979174;7005.159380874327;480744;487429;539715;564638;573590;72649;75749.24250757422;76100;76849.23150768533;77201;527.2934268080791;530.8248278068228;534.4842227250722;535.8660334916271;538.3808620086932;10797.190210734383;10968.122550196125;11073;11259.49332280033;11354.659360219206;34048.65951340455;34315;34490.31019379648;34879;35962.820185898905;42281.154376911676;42980;43206.783966079965;47358.76320618375;49097.26354104763;6658;6839.760608378683;6910.101686780888;6948;6950.374466298057;11708.297502149557;11709.180357374902;11957.521699131938;12104.394780261127;12159.392030398622;10344.689659310232;10349.120324772479;10455.208261003107;10719.946400267949;10760.677179684622;10375.27373083877;10670.57317707283;10834.566617335218;10846.132309415385;11004.229703920648;10856.13150947938;10937.726556836144;11092.556297748;11156.776864462503;11239.04468120219;6907.102076730194;6959.478039147186;6967.09427774386;6968.895466567904;6975.058367120374;10617.362958222531;10817.513211905325;10874.78250434971;10912.290701104403;10939.835902461311 07:38:59 INFO - 2015-11-17 07:38:59,612 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1341.9867999660255;1675.3466148202203;1726.0765490462604;1727.2486468386253;1747.6242607839313;6549.67251637418;7297.452691048173;7708.961455192716;7723.3049025587825;7740.92259077409;7516;7576.469647124703;7588.58262795546;7603.961980190105;7611.619419029054;1940.3014914630792;1992.1234656751055;1993.1927569334443;2231.4979129695853;2257.1310045632385;2226.8552544084664;2268.2854900706225;2268.5803126421665;2268.8638681679067;2269.217120093565;2201.273579718689;2230.643097104464;2259.1076524772707;2260.050778672953;2265.3543740034092;1934.6904495280758;1994.1026538057931;1994.68085106383;1997.4806550297028;2254.9887250563725;2228.053077442081;2277.954440911189;2281.885905704708;2281.954360912789;2282.54349130173;7380.335769780745;7529.811754706121;7540;7546.169921308651;7576.0908690956885;4579.038401935598;4656.115338085787;4684.3910291662205;4689.835855745033;4689.9765501172615;3052.526858336961;3062.632484101922;3114.7352475039647;3194.4409728297455;3196.840157992091;1013.2451323763843;1023.8720159980003;1031.0771859185986;1042.4266653340633;1080.9783804323947;10545.630902918438;10607.469626518721;10620.734481637943;10633.202509811717;10633.415162166155;4133.111381053028;4210.957890421057;4241.91516169681;4263.040815816416;4266.274733295285;9033.954830225806;9039.954800226089;9052.728418147335;9055.23030542398;9063.912330520248;4706.105839890478;4708.270218116198;4708.529147085264;4711.175544279738;4713.6464765142755;4272;4275;4277.636400905895;4279.97860010698;4280.122574872144;3592.9820350898076;3601.603823579404;3611.566612006576;3625.619309972468;3637.908627411766;1211.1340391620033;1228.588422878328;1234.6234398508361;1239.9566015189605;1242.167747609104;1030.2221822523945;1047.638564695179;1051.994740026295;1152.9711757206137;1284.7045179608742;7213.422926165894;7278.818029549304;7317.597532135677;7326.120865496175;7340.376068034277;480.6179087625346;480.8557432770155;483.5068230405038;485.4150748348232;493.3832709113608;5157.535821776059;5261.13191323435;5679.176519404663;5726.99777538929;5787.450192231731;8825.470471771714;8969.775755606031;9001.684941027033;9022.458652480873;9065.41074830134;8620.439671421464;8876;8889.955550222337;9008.234300084436;9016.549172541347;6937.826554336081;7013.158420989514;7024.929750702529;7062.752803651848;7084;6856.040154378291;6884.242733299233;6930.306969303029;6938.06336144614;6957.8956315654295;8066.475679081076;8088.029436467662;8168.1015088339045;8207.876881846658;8310.459820111673;8349.165083491846;8423.4945903246;8428.24145826854;8572.614232359434;8579.828403431771;6752.932470675427;6881.793546193622;6884.724611015704;6894.896576551456;6897.379235868796;7447.441441891771;7465.813354666177;7513.361364283878;7573.2805383488485;7581.810454738455;6964.303569642995;7101.680424380812;7160.283971603007;7224.602646854263;7233.132024157135;6828.487863410363;6858.074159988338;6936;7003.404710599656;7030;6907.585544867324;6966.512344135862;6969.686364113526;6972.372486476242;6987.860242795217;6292.4651404629285;6318.210223722035;6370.203724534434;6374.617522948638;6377.043443483514;6479.8056058318325;6507.023946408077;6517.967410162919;6520.608763474207;6531.673416329259 07:38:59 INFO - 2015-11-17 07:38:59,614 DEBUG : BROWSER_OUTPUT: |4;prototype.html;326.5265365220431;329.1721320877992;332.62579597952305;336.18978262387645;338.48550203690394;5857.794977175799;6005.129256257851;6026.578139530235;6047.092936059593;6054.788082417116;5813.476787089161;5923.14114453404;5953.553483488734;5969.552283578738;5976.462118409342;4555.04344087742;4594.793234304448;4596.954030459703;4615.838445654403;4617.838375656853;4370.868873933787;4450.532694067125;4453.176162409948;4457.821687132511;4622.306654001893;4442.666799990014;4516.593506584407;4543.772811359436;4545.659075569329;4558.498565157846;4520.208963431386;4530.116627257686;4530.433695788027;4539.114872599845;4551.590356867881;3918.941215881764;3919.1181984053646;3919.8236079376497;3923.7253392262555;3929.1945151243926;5638.492535671769;5688.971555142198;5720.513756330717;5800.7679692812235;5814.127880817869;5405.108157154064;5407.513323800877;5407.972960135174;5412.188171774265;5415.296011518478;6080.391960803929;6439.83900402489;6447.871042579169;6448.838779030515;6449.580777249464;4416.536263692298;4417.955820441819;4512.661550383735;4518.683692141552;4523.389342438762;6544.836379090513;6570.310117437648;6594.340565943367;6594.8351291218105;6596.241432235306;4521.3896124023495;4536.591706746409;4536.841210557614;4548.476925153584;4551.4765801932535;4546.499885012646;4604.677672562889;4612.285095810154;4651.418572678415;4674.298855171752;5371.355437347544;5372.462753724596;5375.838724838261;5380.91928621071;5382.434844341366;6447.645379504079;6452.0967064610995;6454.386833250834;6460.224773027173;6462.127612772216;1630.0627139394896;1630.070859610011;1631.1599526243995;1633.4038076102138;1634.9264283107289;1112.065864673678;1113.7661091170783;1131.6887855839545;1134.489479734123;1163.96508104757;6031;6113.541484388688;6119.265688117454;6123.938760612336;6129.785457508966;6501.382368674968;6506.219253689587;6507.804765857032;6512.381323774234;6519.4132528072705;5927.940720592739;6050.455459008623;6112.419320164666;6115.785947491905;6118.1128736332985;3511.841967111486;3542.6103128655827;3547.8935631931085;3550.627184145679;3553.8400771965325;6762.661866906733;6780.38976492118;6782.491313151435;6782.898256526156;6786.3892249697765;6703.564268322543;6707.932920670828;6708.664566771642;6709.127813384326;6710.0941372915;6757.8648427031185;6898.172219333712;6904.102466679299;6924.6537673117155;6971.407430368476;6384.361563843579;6564.212294524687;6581.552058547112;6705.262421133769;6705.899411508929;6538.084668146558;6569.37590928861;6580.80257592273;6586.70359833799;6587.209534855848;6906.240313565403;6913.896291555731;6914.343137401939;6921.169459664872;6924.792256232321;4351.477822661301;4379.255526560429;4381.014271788822;4486.528914464065;4491.528389519053;6564.048213009182;6566.9343306568235;6568.6058836469965;6570.277269500256;6580.1116849224745;6460.4508616766225;6463.935360646334;6466.7066586683795;6471.25580558223;6473.870522589427;6345.1434056401795;6439.098526206241;6441.420272175526;6480.222373315232;6494.4804415645685;6383.2978372378075;6384.170057892445;6384.585001974857;6386.201724784402;6386.425221730066;6517.902231466626;6518.478521718156;6526.510511711545;6527.086207930988;6535.085088087577;6178.165947597017;6336.20797400325;6342.39747224013;6343.11196432509;6366.936330636634 07:38:59 INFO - 2015-11-17 07:38:59,617 DEBUG : BROWSER_OUTPUT: |5;yui.html;785.9056913170419;794.9721759738406;807.442864423548;862.9697960571381;891.8483857744183;13058;13109.016823738222;13153.868461315384;13178.802317965237;13408.664783380409;11523.711907202323;13381.063325567215;13528.864711352884;13531.323433828318;13541.729165416711;662.8707402056601;797.079373323812;820.1306614988102;822.5434883639577;822.5434883639577;796.6136423834436;801.3428988229654;804.4127786715701;804.5615139748851;807.446898874273;695.4297476069625;706.833894034904;845.1506236232577;851.9616617252238;852.2925971443686;822.7326119011345;845.8477474054667;846.4413487098516;846.6655671009978;846.7713717296326;625.2684359299631;626.0546574672278;628.0892705576932;628.3339659960457;628.5160426471591;13392.933035334858;13618.523351682743;13631.045826792128;13635.181889086687;13635.522756703567;12400.13199076065;12412;12524.874751252462;12549.372531373394;12687.936560317232;10577.100946419563;10663.786724265548;10674.35953842772;10684.305520141166;10745.83881241782;3477;3491.8603255869734;3576.213233088716;3589.5333606631234;3656.2687462507606;41254;42016.3697544534;48216.758916205545;48252.758736206444;48330.27504587434;7236.493445458873;7308.6345682715655;7323.963380183065;7395.297446742551;7399.371053460516;11386.373749443694;11391.145664075228;11393.145514086476;11417.42912854354;11430.828537571942;6662.766803161866;6666.566673166229;6711.0940023096255;6730.596164230162;6738.865222695518;4322.481302243751;4462.776861156929;4525.366448697185;4662.813487460531;4708.717476951394;2697.7572018518426;2715.158300926719;2719.3881376690088;2720.9455810883674;2720.9932325039863;447.33347312504134;448.4372112998166;457.858064000161;459.12078369921227;463.74725774453003;621.9813405597839;692.5602242576;699.1505321034865;699.9335063168991;711.5943911970231;7884.172161922916;8105.392095592736;8479.95760021196;8629.70297029703;8720.345974051972;575.890580789657;582.6795262605634;656.6815094679076;720.9783706488814;727.5670975769409;3959.5248570171766;4362.258416069276;4362.389265502832;4392.05570802279;4454.1982443159895;52734.472655272955;53666;54196.45803541993;54344;56780.148297775566;51121.233181502306;51885;52352;52813.47186528086;53444.73277633587;47938.52061479341;48182.27726584104;49493.257601136014;50234;50440.747796261516;8940.284777217677;9101.954490227772;9148.862767058366;9262.259019278306;9413.670521531987;31283.530747038356;32562.837185813918;33633.49549756707;33718.15704607405;33857.66142338545;45679.314810278534;46338.30492542547;46660.53339466562;46727;47389.76305118452;7575.659095340613;7611.3530349918665;7619.847603048019;7799.103103143211;7802.258785415376;12088.214266072677;12319.384030798245;12370.44333004999;12388.194767340094;12463.875361246271;10588;10678.46607669629;10840.891591083988;10961.890381096087;11183.105351571692;10847.945760271148;11104.777904442028;11179.60871369498;11209;11538.59614913474;10722.912568170057;11272.887271127183;11278.154138439486;11315.151363647925;11717.941410292893;9934.304598678023;10192.286539942133;10237.23220758461;10494.68515944523;10516.789664206826;9542.332036757638;9549.809003820024;9690.660826871026;10022.849657255292;10095.949520252645 07:38:59 INFO - 2015-11-17 07:38:59,617 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:38:59 INFO - 2015-11-17 07:38:59,617 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:38:59 INFO - 2015-11-17 07:38:59,617 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,743 07:38:59 INFO - 2015-11-17 07:38:59,617 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: __startTimestamp1447774739605__endTimestamp 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: Number of tests: 6 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5369.75 Median:5618.21 stddev:614.37 (10.9%) stddev-sans-first:591.91 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: Values: 3187.3 3216.7 3261.0 3270.1 3282.7 5173.9 5278.6 5316.4 5340.2 5375.5 5276.3 5307.7 5332.5 5344.6 5347.5 4777.7 4833.9 4847.1 4939.2 4973.8 4800.4 4912.4 4940.0 4983.8 5045.9 4776.1 4851.0 4867.6 4882.3 4922.6 4900.7 4925.4 4928.5 4936.7 4941.6 4752.0 4839.6 4901.3 4912.9 4940.4 5152.4 5190.6 5199.6 5214.1 5229.1 5741.4 5747.1 5753.5 5758.5 5775.8 5562.2 5724.3 5779.2 5791.6 5792.3 5358.7 5409.1 5415.0 5421.6 5446.4 5913.8 5953.8 5957.0 5969.9 5977.8 5614.3 5649.6 5728.9 5764.6 5804.6 5816.2 5832.7 5857.3 5876.2 5890.5 5779.6 5788.2 5790.0 5790.2 5800.7 5582.4 5705.7 5707.5 5723.6 5794.2 4389.5 4391.7 4393.5 4420.6 4425.8 3913.8 3926.3 3937.6 3956.0 3968.9 5340.5 5358.2 5433.9 5479.8 5507.2 5788.9 5831.9 5844.1 5852.2 5854.7 5515.5 5527.9 5530.5 5535.3 5549.0 4802.5 4811.7 4867.2 4904.8 4923.8 6047.7 6068.5 6073.3 6088.6 6091.3 5588.1 5821.4 5830.8 5839.9 5848.2 5906.1 5915.3 5963.8 5964.2 6007.8 5757.2 5809.9 5811.6 5813.4 5813.6 5676.4 5755.8 5890.7 5896.0 5898.9 5683.4 5724.6 5739.7 5774.3 5788.7 5700.8 5709.4 5716.7 5725.7 5739.1 5452.0 5529.3 5618.2 5626.2 5635.4 5619.2 5659.4 5684.8 5718.0 5719.7 5572.3 5626.6 5632.7 5636.2 5638.6 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:46278.82 Median:32049.02 stddev:77269.93 (241.1%) stddev-sans-first:77410.45 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: Values: 562.5 580.4 594.5 597.5 600.2 31337.4 31876.2 32160.5 39300.0 39701.6 43591.8 44073.8 44131.6 44156.8 44213.8 8677.9 8880.3 8892.6 8907.5 8911.8 7659.0 7931.3 10153.6 10358.2 10365.7 10010.3 10071.6 10089.7 10104.6 10104.8 7787.5 7968.5 10033.3 10034.0 10083.3 10155.4 10330.8 10338.1 10340.8 10346.7 39805.8 40155.6 40502.6 40552.2 40586.8 3343.9 3371.6 3618.4 4024.3 4053.3 30581.0 30717.7 30922.4 31755.4 31759.5 3503.8 3545.3 3547.4 3550.9 3605.4 287242.0 287589.0 287694.0 287978.0 288027.0 54656.5 56160.7 59057.0 63851.7 65897.7 60613.4 60825.4 60929.4 60989.4 61031.7 15041.0 15079.3 15085.2 15137.8 15315.8 11404.1 11435.4 11445.1 11549.3 11732.6 19540.7 19755.9 19835.0 19842.5 19842.7 7476.1 7566.8 7588.6 7608.9 7686.3 953.5 957.3 959.1 1013.5 1077.1 28228.0 28242.2 28660.3 28693.6 28835.6 1010.9 1061.0 1103.2 1113.9 1145.4 15391.7 15747.8 15835.8 15855.9 16112.1 317742.0 324811.0 325182.0 326321.0 326415.0 51999.7 52325.0 52459.5 52471.7 52804.7 1326.2 1341.8 1357.8 1362.3 1371.7 22620.5 28298.4 28372.9 28807.9 30053.7 47953.5 48568.0 48624.0 48632.3 48685.8 269953.0 271941.0 273725.0 274029.0 274047.0 27637.2 28043.7 30743.5 32064.7 32085.5 37338.3 37621.6 37631.8 37738.8 38267.6 31818.5 32033.4 32109.5 32335.6 32602.8 34057.5 34813.7 35020.5 35082.0 35121.0 34640.7 34946.3 34985.7 35004.3 36671.3 28572.3 30066.2 30846.7 30945.4 30949.4 23094.2 23396.9 24636.0 24706.9 24926.3 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,618 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26621.32 Median:4255.30 stddev:86948.10 (2043.3%) stddev-sans-first:87169.61 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: Values: 337.0 347.1 349.5 350.6 354.1 14422.0 14876.2 16780.5 17003.7 17863.0 12013.2 12437.8 16249.4 17743.5 17750.8 4556.2 4658.1 4658.7 4659.7 4660.2 3468.5 3533.5 4626.3 4658.0 4895.0 4894.6 4906.7 4919.4 4931.4 4969.0 4825.4 4889.8 4897.2 4908.4 4919.5 4239.6 4248.9 4252.1 4258.5 4271.1 13517.3 13785.3 14083.1 14087.4 14106.0 1870.4 1906.9 1920.1 1923.9 1940.9 10185.9 10247.1 10325.9 10489.5 10517.9 1721.9 1745.3 1767.9 1777.4 1810.0 55576.4 58346.7 59049.7 59810.4 62240.4 6930.5 7113.0 7135.4 7172.6 7207.2 8440.4 8543.7 8559.7 8563.3 8590.0 5678.3 5700.1 5701.9 5724.3 5767.8 5908.2 5931.1 5933.7 5945.9 5949.3 3324.3 3350.2 3375.4 3392.5 3399.1 1136.7 1172.1 1185.3 1189.1 1216.9 486.6 488.4 506.6 516.8 523.8 11437.5 11994.1 12317.6 12319.3 12357.8 492.4 500.2 507.4 510.5 522.1 5241.6 6810.8 6858.5 6934.5 7005.2 480744.0 487429.0 539715.0 564638.0 573590.0 72649.0 75749.2 76100.0 76849.2 77201.0 527.3 530.8 534.5 535.9 538.4 10797.2 10968.1 11073.0 11259.5 11354.7 34048.7 34315.0 34490.3 34879.0 35962.8 42281.2 42980.0 43206.8 47358.8 49097.3 6658.0 6839.8 6910.1 6948.0 6950.4 11708.3 11709.2 11957.5 12104.4 12159.4 10344.7 10349.1 10455.2 10719.9 10760.7 10375.3 10670.6 10834.6 10846.1 11004.2 10856.1 10937.7 11092.6 11156.8 11239.0 6907.1 6959.5 6967.1 6968.9 6975.1 10617.4 10817.5 10874.8 10912.3 10939.8 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5352.37 Median:6305.34 stddev:2787.39 (44.2%) stddev-sans-first:2778.91 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: Values: 1342.0 1675.3 1726.1 1727.2 1747.6 6549.7 7297.5 7709.0 7723.3 7740.9 7516.0 7576.5 7588.6 7604.0 7611.6 1940.3 1992.1 1993.2 2231.5 2257.1 2226.9 2268.3 2268.6 2268.9 2269.2 2201.3 2230.6 2259.1 2260.1 2265.4 1934.7 1994.1 1994.7 1997.5 2255.0 2228.1 2278.0 2281.9 2282.0 2282.5 7380.3 7529.8 7540.0 7546.2 7576.1 4579.0 4656.1 4684.4 4689.8 4690.0 3052.5 3062.6 3114.7 3194.4 3196.8 1013.2 1023.9 1031.1 1042.4 1081.0 10545.6 10607.5 10620.7 10633.2 10633.4 4133.1 4211.0 4241.9 4263.0 4266.3 9034.0 9040.0 9052.7 9055.2 9063.9 4706.1 4708.3 4708.5 4711.2 4713.6 4272.0 4275.0 4277.6 4280.0 4280.1 3593.0 3601.6 3611.6 3625.6 3637.9 1211.1 1228.6 1234.6 1240.0 1242.2 1030.2 1047.6 1052.0 1153.0 1284.7 7213.4 7278.8 7317.6 7326.1 7340.4 480.6 480.9 483.5 485.4 493.4 5157.5 5261.1 5679.2 5727.0 5787.5 8825.5 8969.8 9001.7 9022.5 9065.4 8620.4 8876.0 8890.0 9008.2 9016.5 6937.8 7013.2 7024.9 7062.8 7084.0 6856.0 6884.2 6930.3 6938.1 6957.9 8066.5 8088.0 8168.1 8207.9 8310.5 8349.2 8423.5 8428.2 8572.6 8579.8 6752.9 6881.8 6884.7 6894.9 6897.4 7447.4 7465.8 7513.4 7573.3 7581.8 6964.3 7101.7 7160.3 7224.6 7233.1 6828.5 6858.1 6936.0 7003.4 7030.0 6907.6 6966.5 6969.7 6972.4 6987.9 6292.5 6318.2 6370.2 6374.6 6377.0 6479.8 6507.0 6518.0 6520.6 6531.7 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,619 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5345.03 Median:6048.77 stddev:1619.23 (26.8%) stddev-sans-first:1579.35 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: Values: 326.5 329.2 332.6 336.2 338.5 5857.8 6005.1 6026.6 6047.1 6054.8 5813.5 5923.1 5953.6 5969.6 5976.5 4555.0 4594.8 4597.0 4615.8 4617.8 4370.9 4450.5 4453.2 4457.8 4622.3 4442.7 4516.6 4543.8 4545.7 4558.5 4520.2 4530.1 4530.4 4539.1 4551.6 3918.9 3919.1 3919.8 3923.7 3929.2 5638.5 5689.0 5720.5 5800.8 5814.1 5405.1 5407.5 5408.0 5412.2 5415.3 6080.4 6439.8 6447.9 6448.8 6449.6 4416.5 4418.0 4512.7 4518.7 4523.4 6544.8 6570.3 6594.3 6594.8 6596.2 4521.4 4536.6 4536.8 4548.5 4551.5 4546.5 4604.7 4612.3 4651.4 4674.3 5371.4 5372.5 5375.8 5380.9 5382.4 6447.6 6452.1 6454.4 6460.2 6462.1 1630.1 1630.1 1631.2 1633.4 1634.9 1112.1 1113.8 1131.7 1134.5 1164.0 6031.0 6113.5 6119.3 6123.9 6129.8 6501.4 6506.2 6507.8 6512.4 6519.4 5927.9 6050.5 6112.4 6115.8 6118.1 3511.8 3542.6 3547.9 3550.6 3553.8 6762.7 6780.4 6782.5 6782.9 6786.4 6703.6 6707.9 6708.7 6709.1 6710.1 6757.9 6898.2 6904.1 6924.7 6971.4 6384.4 6564.2 6581.6 6705.3 6705.9 6538.1 6569.4 6580.8 6586.7 6587.2 6906.2 6913.9 6914.3 6921.2 6924.8 4351.5 4379.3 4381.0 4486.5 4491.5 6564.0 6566.9 6568.6 6570.3 6580.1 6460.5 6463.9 6466.7 6471.3 6473.9 6345.1 6439.1 6441.4 6480.2 6494.5 6383.3 6384.2 6384.6 6386.2 6386.4 6517.9 6518.5 6526.5 6527.1 6535.1 6178.2 6336.2 6342.4 6343.1 6366.9 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13390.84 Median:25717.86 stddev:15895.46 (61.8%) stddev-sans-first:15911.87 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: Values: 785.9 795.0 807.4 863.0 891.8 13058.0 13109.0 13153.9 13178.8 13408.7 11523.7 13381.1 13528.9 13531.3 13541.7 662.9 797.1 820.1 822.5 822.5 796.6 801.3 804.4 804.6 807.4 695.4 706.8 845.2 852.0 852.3 822.7 845.8 846.4 846.7 846.8 625.3 626.1 628.1 628.3 628.5 13392.9 13618.5 13631.0 13635.2 13635.5 12400.1 12412.0 12524.9 12549.4 12687.9 10577.1 10663.8 10674.4 10684.3 10745.8 3477.0 3491.9 3576.2 3589.5 3656.3 41254.0 42016.4 48216.8 48252.8 48330.3 7236.5 7308.6 7324.0 7395.3 7399.4 11386.4 11391.1 11393.1 11417.4 11430.8 6662.8 6666.6 6711.1 6730.6 6738.9 4322.5 4462.8 4525.4 4662.8 4708.7 2697.8 2715.2 2719.4 2720.9 2721.0 447.3 448.4 457.9 459.1 463.7 622.0 692.6 699.2 699.9 711.6 7884.2 8105.4 8480.0 8629.7 8720.3 575.9 582.7 656.7 721.0 727.6 3959.5 4362.3 4362.4 4392.1 4454.2 52734.5 53666.0 54196.5 54344.0 56780.1 51121.2 51885.0 52352.0 52813.5 53444.7 47938.5 48182.3 49493.3 50234.0 50440.7 8940.3 9102.0 9148.9 9262.3 9413.7 31283.5 32562.8 33633.5 33718.2 33857.7 45679.3 46338.3 46660.5 46727.0 47389.8 7575.7 7611.4 7619.8 7799.1 7802.3 12088.2 12319.4 12370.4 12388.2 12463.9 10588.0 10678.5 10840.9 10961.9 11183.1 10847.9 11104.8 11179.6 11209.0 11538.6 10722.9 11272.9 11278.2 11315.2 11717.9 9934.3 10192.3 10237.2 10494.7 10516.8 9542.3 9549.8 9690.7 10022.8 10095.9 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:38:59 INFO - 2015-11-17 07:38:59,620 DEBUG : BROWSER_OUTPUT: 07:39:00 INFO - 2015-11-17 07:39:00,248 INFO : Browser exited with error code: 0 07:39:00 INFO - 2015-11-17 07:39:00,272 INFO : Completed test dromaeo_css (00:18:36) 07:39:00 INFO - 2015-11-17 07:39:00,272 INFO : Starting test kraken 07:39:00 INFO - 2015-11-17 07:39:00,272 DEBUG : operating with platform_type : linux_ 07:39:00 INFO - 2015-11-17 07:39:00,272 INFO : Initialising browser for kraken test... 07:39:00 INFO - 2015-11-17 07:39:00,279 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLMiRJ4/profile http://localhost:52806/getInfo.html 07:39:03 INFO - 2015-11-17 07:39:03,956 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:39:03 INFO - 2015-11-17 07:39:03,957 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:39:03 INFO - 2015-11-17 07:39:03,957 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 07:39:03 INFO - 2015-11-17 07:39:03,957 DEBUG : BROWSER_OUTPUT: __metrics 07:39:04 INFO - 2015-11-17 07:39:04,122 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:39:05 INFO - 2015-11-17 07:39:05,347 INFO : Browser initialized. 07:39:05 INFO - 2015-11-17 07:39:05,348 INFO : Running cycle 1/1 for kraken test... 07:39:05 INFO - 2015-11-17 07:39:05,348 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLMiRJ4/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:39:17 INFO - 2015-11-17 07:39:17,086 DEBUG : BROWSER_OUTPUT: RSS: Main: 139886592 07:39:17 INFO - 2015-11-17 07:39:17,086 DEBUG : BROWSER_OUTPUT: 07:39:19 INFO - 2015-11-17 07:39:19,601 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52806/tests/kraken/driver.html?testName=audio-beat-detection) 07:39:20 INFO - 2015-11-17 07:39:20,182 DEBUG : BROWSER_OUTPUT: RSS: Main: 179200000 07:39:20 INFO - 2015-11-17 07:39:20,182 DEBUG : BROWSER_OUTPUT: 07:39:22 INFO - 2015-11-17 07:39:22,765 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52806/tests/kraken/driver.html?testName=audio-dft) 07:39:23 INFO - 2015-11-17 07:39:23,328 DEBUG : BROWSER_OUTPUT: RSS: Main: 169611264 07:39:23 INFO - 2015-11-17 07:39:23,328 DEBUG : BROWSER_OUTPUT: 07:39:26 INFO - 2015-11-17 07:39:26,166 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52806/tests/kraken/driver.html?testName=audio-fft) 07:39:26 INFO - 2015-11-17 07:39:26,736 DEBUG : BROWSER_OUTPUT: RSS: Main: 152043520 07:39:26 INFO - 2015-11-17 07:39:26,736 DEBUG : BROWSER_OUTPUT: 07:39:28 INFO - 2015-11-17 07:39:28,708 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52806/tests/kraken/driver.html?testName=audio-oscillator) 07:39:29 INFO - 2015-11-17 07:39:29,273 DEBUG : BROWSER_OUTPUT: RSS: Main: 153423872 07:39:29 INFO - 2015-11-17 07:39:29,274 DEBUG : BROWSER_OUTPUT: 07:39:31 INFO - 2015-11-17 07:39:31,413 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52806/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:39:31 INFO - 2015-11-17 07:39:31,974 DEBUG : BROWSER_OUTPUT: RSS: Main: 156401664 07:39:31 INFO - 2015-11-17 07:39:31,975 DEBUG : BROWSER_OUTPUT: 07:39:34 INFO - 2015-11-17 07:39:34,853 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52806/tests/kraken/driver.html?testName=imaging-darkroom) 07:39:35 INFO - 2015-11-17 07:39:35,426 DEBUG : BROWSER_OUTPUT: RSS: Main: 154714112 07:39:35 INFO - 2015-11-17 07:39:35,427 DEBUG : BROWSER_OUTPUT: 07:39:38 INFO - 2015-11-17 07:39:38,773 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52806/tests/kraken/driver.html?testName=imaging-desaturate) 07:39:39 INFO - 2015-11-17 07:39:39,354 DEBUG : BROWSER_OUTPUT: RSS: Main: 157679616 07:39:39 INFO - 2015-11-17 07:39:39,354 DEBUG : BROWSER_OUTPUT: 07:39:42 INFO - 2015-11-17 07:39:42,144 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52806/tests/kraken/driver.html?testName=json-parse-financial) 07:39:42 INFO - 2015-11-17 07:39:42,713 DEBUG : BROWSER_OUTPUT: RSS: Main: 156782592 07:39:42 INFO - 2015-11-17 07:39:42,714 DEBUG : BROWSER_OUTPUT: 07:39:44 INFO - 2015-11-17 07:39:44,234 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52806/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:39:44 INFO - 2015-11-17 07:39:44,800 DEBUG : BROWSER_OUTPUT: RSS: Main: 164704256 07:39:45 INFO - 2015-11-17 07:39:44,800 DEBUG : BROWSER_OUTPUT: 07:39:46 INFO - 2015-11-17 07:39:46,803 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:39:47 INFO - 2015-11-17 07:39:47,409 DEBUG : BROWSER_OUTPUT: RSS: Main: 163917824 07:39:47 INFO - 2015-11-17 07:39:47,410 DEBUG : BROWSER_OUTPUT: 07:39:49 INFO - 2015-11-17 07:39:49,502 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:39:50 INFO - 2015-11-17 07:39:50,067 DEBUG : BROWSER_OUTPUT: RSS: Main: 168898560 07:39:50 INFO - 2015-11-17 07:39:50,068 DEBUG : BROWSER_OUTPUT: 07:39:53 INFO - 2015-11-17 07:39:53,056 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:39:53 INFO - 2015-11-17 07:39:53,637 DEBUG : BROWSER_OUTPUT: RSS: Main: 179646464 07:39:53 INFO - 2015-11-17 07:39:53,638 DEBUG : BROWSER_OUTPUT: 07:39:56 INFO - 2015-11-17 07:39:56,153 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:39:56 INFO - 2015-11-17 07:39:56,722 DEBUG : BROWSER_OUTPUT: RSS: Main: 177876992 07:39:56 INFO - 2015-11-17 07:39:56,722 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,375 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52806/tests/kraken/driver.html?testName=ai-astar) 07:39:58 INFO - 2015-11-17 07:39:58,625 DEBUG : BROWSER_OUTPUT: RSS: Main: 237129728 07:39:58 INFO - 2015-11-17 07:39:58,625 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,627 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:39:58 INFO - 2015-11-17 07:39:58,627 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:39:58 INFO - 2015-11-17 07:39:58,628 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:39:58 INFO - 2015-11-17 07:39:58,628 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:39:58 INFO - 2015-11-17 07:39:58,628 DEBUG : BROWSER_OUTPUT: |0;ai-astar;109;112;103;109;110;109;98;109;109;108 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;149;125;150;166;126;148;152;126;162;133 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;160;162;161;159;159;160;160;161;161 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;84;92;71;71;71;105;95;71 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;91;142;89;91;90;132;90;91;131 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;109;109;109;110;109;109;109;109 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;145;145;145;145;144;145;145;144;145;146 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;96;95;96;96;96;96;95 07:39:58 INFO - 2015-11-17 07:39:58,629 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;59;55;56;56;57;57;57;64;55;57 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;68;68;69;71;68;69;68;68 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;87;83;86;84;85;85;89;85;85;85 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;129;122;111;120;118;115;124;112;124;130 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;136;146;147;147;159;138;148;147;146;137 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;65;68;65;67;67;67;66;65;65;66 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:39:58 INFO - 2015-11-17 07:39:58,630 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:39:58 INFO - 2015-11-17 07:39:58,631 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,921 07:39:58 INFO - 2015-11-17 07:39:58,631 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:39:58 INFO - 2015-11-17 07:39:58,631 DEBUG : BROWSER_OUTPUT: __startTimestamp1447774798626__endTimestamp 07:39:58 INFO - 2015-11-17 07:39:58,631 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,639 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:39:58 INFO - 2015-11-17 07:39:58,639 DEBUG : BROWSER_OUTPUT: Number of tests: 14 07:39:58 INFO - 2015-11-17 07:39:58,639 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,640 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:107.60 Median:109.00 stddev:4.06 (3.7%) stddev-sans-first:4.28 07:39:58 INFO - 2015-11-17 07:39:58,640 DEBUG : BROWSER_OUTPUT: Values: 109.0 112.0 103.0 109.0 110.0 109.0 98.0 109.0 109.0 108.0 07:39:58 INFO - 2015-11-17 07:39:58,640 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,640 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:143.70 Median:149.50 stddev:15.20 (10.2%) stddev-sans-first:16.00 07:39:58 INFO - 2015-11-17 07:39:58,640 DEBUG : BROWSER_OUTPUT: Values: 149.0 125.0 150.0 166.0 126.0 148.0 152.0 126.0 162.0 133.0 07:39:58 INFO - 2015-11-17 07:39:58,641 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,641 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:160.30 Median:160.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 07:39:58 INFO - 2015-11-17 07:39:58,641 DEBUG : BROWSER_OUTPUT: Values: 160.0 160.0 162.0 161.0 159.0 159.0 160.0 160.0 161.0 161.0 07:39:58 INFO - 2015-11-17 07:39:58,641 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,641 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.30 Median:71.50 stddev:12.82 (17.9%) stddev-sans-first:13.24 07:39:58 INFO - 2015-11-17 07:39:58,642 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 84.0 92.0 71.0 71.0 71.0 105.0 95.0 71.0 07:39:58 INFO - 2015-11-17 07:39:58,642 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,642 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:103.80 Median:90.50 stddev:21.73 (24.0%) stddev-sans-first:22.55 07:39:58 INFO - 2015-11-17 07:39:58,642 DEBUG : BROWSER_OUTPUT: Values: 91.0 91.0 142.0 89.0 91.0 90.0 132.0 90.0 91.0 131.0 07:39:58 INFO - 2015-11-17 07:39:58,643 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,643 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.10 Median:109.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 07:39:58 INFO - 2015-11-17 07:39:58,643 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 109.0 109.0 109.0 110.0 109.0 109.0 109.0 109.0 07:39:58 INFO - 2015-11-17 07:39:58,643 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,643 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:144.90 Median:145.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: Values: 145.0 145.0 145.0 145.0 144.0 145.0 145.0 144.0 145.0 146.0 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 96.0 95.0 96.0 96.0 96.0 96.0 95.0 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:57.30 Median:57.00 stddev:2.63 (4.6%) stddev-sans-first:2.71 07:39:58 INFO - 2015-11-17 07:39:58,644 DEBUG : BROWSER_OUTPUT: Values: 59.0 55.0 56.0 56.0 57.0 57.0 57.0 64.0 55.0 57.0 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.50 Median:68.00 stddev:0.97 (1.4%) stddev-sans-first:1.01 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 68.0 68.0 69.0 71.0 68.0 69.0 68.0 68.0 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.40 Median:85.00 stddev:1.65 (1.9%) stddev-sans-first:1.64 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: Values: 87.0 83.0 86.0 84.0 85.0 85.0 89.0 85.0 85.0 85.0 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:120.50 Median:123.00 stddev:6.57 (5.3%) stddev-sans-first:6.21 07:39:58 INFO - 2015-11-17 07:39:58,645 DEBUG : BROWSER_OUTPUT: Values: 129.0 122.0 111.0 120.0 118.0 115.0 124.0 112.0 124.0 130.0 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.10 Median:147.00 stddev:6.77 (4.6%) stddev-sans-first:6.33 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: Values: 136.0 146.0 147.0 147.0 159.0 138.0 148.0 147.0 146.0 137.0 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.10 Median:66.50 stddev:1.10 (1.7%) stddev-sans-first:1.09 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: Values: 65.0 68.0 65.0 67.0 67.0 67.0 66.0 65.0 65.0 66.0 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:39:58 INFO - 2015-11-17 07:39:58,646 DEBUG : BROWSER_OUTPUT: 07:39:59 INFO - 2015-11-17 07:39:59,432 INFO : Browser exited with error code: 0 07:39:59 INFO - 2015-11-17 07:39:59,483 INFO : Completed test kraken (00:00:59) 07:39:59 INFO - 2015-11-17 07:39:59,483 INFO : Starting test v8_7 07:39:59 INFO - 2015-11-17 07:39:59,483 DEBUG : operating with platform_type : linux_ 07:39:59 INFO - 2015-11-17 07:39:59,483 INFO : Initialising browser for v8_7 test... 07:39:59 INFO - 2015-11-17 07:39:59,489 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpf4DaoQ/profile http://localhost:52806/getInfo.html 07:40:03 INFO - 2015-11-17 07:40:03,392 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:40:03 INFO - 2015-11-17 07:40:03,392 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:40:03 INFO - 2015-11-17 07:40:03,392 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 07:40:03 INFO - 2015-11-17 07:40:03,393 DEBUG : BROWSER_OUTPUT: __metrics 07:40:03 INFO - 2015-11-17 07:40:03,574 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:40:04 INFO - 2015-11-17 07:40:04,808 INFO : Browser initialized. 07:40:04 INFO - 2015-11-17 07:40:04,809 INFO : Running cycle 1/1 for v8_7 test... 07:40:04 INFO - 2015-11-17 07:40:04,809 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpf4DaoQ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:40:16 INFO - 2015-11-17 07:40:16,606 DEBUG : BROWSER_OUTPUT: RSS: Main: 140341248 07:40:16 INFO - 2015-11-17 07:40:16,606 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,039 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52806/tests/v8_7/run.html (next: http://localhost:52806/tests/v8_7/run.html) 07:40:38 INFO - 2015-11-17 07:40:38,297 DEBUG : BROWSER_OUTPUT: RSS: Main: 538050560 07:40:38 INFO - 2015-11-17 07:40:38,297 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,298 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:40:38 INFO - 2015-11-17 07:40:38,298 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:40:38 INFO - 2015-11-17 07:40:38,298 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:40:38 INFO - 2015-11-17 07:40:38,298 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:40:38 INFO - 2015-11-17 07:40:38,299 DEBUG : BROWSER_OUTPUT: |0;Richards;162.73393002441009 07:40:38 INFO - 2015-11-17 07:40:38,299 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;188.85741265344666 07:40:38 INFO - 2015-11-17 07:40:38,299 DEBUG : BROWSER_OUTPUT: |2;Encrypt;281.37310073157005 07:40:38 INFO - 2015-11-17 07:40:38,299 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5050.50505050505 07:40:38 INFO - 2015-11-17 07:40:38,300 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1955.078125 07:40:38 INFO - 2015-11-17 07:40:38,300 DEBUG : BROWSER_OUTPUT: |5;Earley;781.25 07:40:38 INFO - 2015-11-17 07:40:38,300 DEBUG : BROWSER_OUTPUT: |6;Boyer;12207.317073170732 07:40:38 INFO - 2015-11-17 07:40:38,300 DEBUG : BROWSER_OUTPUT: |7;RegExp;26025.641025641027 07:40:38 INFO - 2015-11-17 07:40:38,301 DEBUG : BROWSER_OUTPUT: |8;Splay;593.7683715461493 07:40:38 INFO - 2015-11-17 07:40:38,301 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4845.410628019324 07:40:38 INFO - 2015-11-17 07:40:38,301 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:40:38 INFO - 2015-11-17 07:40:38,301 DEBUG : BROWSER_OUTPUT: __startTimestamp1447774838291__endTimestamp 07:40:38 INFO - 2015-11-17 07:40:38,301 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,302 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:40:38 INFO - 2015-11-17 07:40:38,302 DEBUG : BROWSER_OUTPUT: Number of tests: 10 07:40:38 INFO - 2015-11-17 07:40:38,302 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,302 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.73 Median:162.73 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,303 DEBUG : BROWSER_OUTPUT: Values: 162.7 07:40:38 INFO - 2015-11-17 07:40:38,303 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,303 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:188.86 Median:188.86 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,303 DEBUG : BROWSER_OUTPUT: Values: 188.9 07:40:38 INFO - 2015-11-17 07:40:38,303 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:281.37 Median:281.37 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: Values: 281.4 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5050.51 Median:5050.51 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: Values: 5050.5 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,304 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1955.08 Median:1955.08 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: Values: 1955.1 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:781.25 Median:781.25 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: Values: 781.3 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12207.32 Median:12207.32 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: Values: 12207.3 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,305 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26025.64 Median:26025.64 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: Values: 26025.6 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:593.77 Median:593.77 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: Values: 593.8 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4845.41 Median:4845.41 stddev:0.00 (0.0%) 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: Values: 4845.4 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:40:38 INFO - 2015-11-17 07:40:38,306 DEBUG : BROWSER_OUTPUT: 07:40:39 INFO - 2015-11-17 07:40:39,160 INFO : Browser exited with error code: 0 07:40:39 INFO - 2015-11-17 07:40:39,172 INFO : Completed test v8_7 (00:00:39) 07:40:39 INFO - 2015-11-17 07:40:39,289 INFO : Completed test suite (00:20:15) 07:40:39 INFO - 2015-11-17 07:40:39,289 DEBUG : Working with test: dromaeo_css 07:40:39 INFO - 2015-11-17 07:40:39,289 DEBUG : Generating results file: dromaeo_css 07:40:39 INFO - 2015-11-17 07:40:39,290 DEBUG : Working with test: kraken 07:40:39 INFO - 2015-11-17 07:40:39,290 DEBUG : Generating results file: kraken 07:40:39 INFO - 2015-11-17 07:40:39,291 INFO : javascript benchmark 07:40:39 INFO - 2015-11-17 07:40:39,291 DEBUG : Working with test: v8_7 07:40:39 INFO - 2015-11-17 07:40:39,291 DEBUG : Generating results file: v8_7 07:40:39 INFO - 2015-11-17 07:40:39,291 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:40:39 INFO - 2015-11-17 07:40:39,358 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,1,35]] 07:40:39 INFO - 2015-11-17 07:40:39,359 DEBUG : process_Request line: dromaeo_css 6656.51 graph.html#tests=[[72,1,35]] 07:40:39 INFO - 2015-11-17 07:40:39,359 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:40:39 INFO - 2015-11-17 07:40:39,396 DEBUG : process_Request line: kraken 1488.20 graph.html#tests=[[232,1,35]] 07:40:39 INFO - 2015-11-17 07:40:39,396 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:40:39 INFO - 2015-11-17 07:40:39,514 DEBUG : process_Request line: v8_7 19992.55 graph.html#tests=[[230,1,35]] 07:40:39 INFO - 2015-11-17 07:40:39,515 INFO : javascript benchmark 07:40:39 INFO - 2015-11-17 07:40:39,519 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [336.971357434618, 347.1010083882744, 349.45485043332394, 350.59156083163117, 354.0970525160841, 14422.0, 14876.181810000446, 16780.496585102435, 17003.659926801472, 17862.999999999985, 12013.159078864483, 12437.813432798494, 16249.431269905555, 17743.46769596911, 17750.822491775078, 4556.179887620227, 4658.091672123937, 4658.720476771387, 4659.650526210531, 4660.16117098922, 3468.4623883298127, 3533.505309256706, 4626.30605409188, 4658.021815418766, 4894.951050489485, 4894.632902532307, 4906.705597664134, 4919.385076865392, 4931.3835770528685, 4968.975155124219, 4825.420949486067, 4889.804407823683, 4897.1674815281485, 4908.386451693538, 4919.483454237289, 4239.6396306314, 4248.915021699549, 4252.064545799919, 4258.531561528261, 4271.145770845843, 13517.32413379327, 13785.310734463337, 14083.084599501, 14087.43650253999, 14106.0, 1870.3827736846945, 1906.9332573359866, 1920.1359388275193, 1923.85571082168, 1940.8544359173118, 10185.89814101857, 10247.077763001365, 10325.9483702581, 10489.527971241312, 10517.894821051768, 1721.8880772749856, 1745.301879248298, 1767.9027653479054, 1777.3779177287975, 1810.0497238949656, 55576.44423555753, 58346.70826645882, 59049.70475147597, 59810.40189598092, 62240.37759622391, 6930.549514281555, 7113.039739635083, 7135.357817796319, 7172.605506697182, 7207.243239459886, 8440.409171357946, 8543.700970466129, 8559.700410485602, 8563.314934805201, 8590.0, 5678.346990096192, 5700.087985922232, 5701.885962280731, 5724.341700704389, 5767.798127065533, 5908.231929849092, 5931.08068249422, 5933.6736479493175, 5945.940540594625, 5949.3455719871645, 3324.3185147044796, 3350.195952971318, 3375.3586818504405, 3392.456432323287, 3399.133221028622, 1136.732867776072, 1172.0740614914293, 1185.3184418959133, 1189.084405008139, 1216.9087318451152, 486.5888324365905, 488.4334172360045, 506.5820697924227, 516.7752027867889, 523.7904838064804, 11437.485313160927, 11994.10044246685, 12317.568885088978, 12319.322437265857, 12357.814632780515, 492.3894370979959, 500.21423518040973, 507.4240736763726, 510.47676131965034, 522.146290814521, 5241.580673546107, 6810.761623343258, 6858.451323894076, 6934.514583979174, 7005.159380874327, 480744.0, 487429.0, 539715.0, 564638.0, 573590.0, 72649.0, 75749.24250757422, 76100.0, 76849.23150768533, 77201.0, 527.2934268080791, 530.8248278068228, 534.4842227250722, 535.8660334916271, 538.3808620086932, 10797.190210734383, 10968.122550196125, 11073.0, 11259.49332280033, 11354.659360219206, 34048.65951340455, 34315.0, 34490.31019379648, 34879.0, 35962.820185898905, 42281.154376911676, 42980.0, 43206.783966079965, 47358.76320618375, 49097.26354104763, 6658.0, 6839.760608378683, 6910.101686780888, 6948.0, 6950.374466298057, 11708.297502149557, 11709.180357374902, 11957.521699131938, 12104.394780261127, 12159.392030398622, 10344.689659310232, 10349.120324772479, 10455.208261003107, 10719.946400267949, 10760.677179684622, 10375.27373083877, 10670.57317707283, 10834.566617335218, 10846.132309415385, 11004.229703920648, 10856.13150947938, 10937.726556836144, 11092.556297748, 11156.776864462503, 11239.04468120219, 6907.102076730194, 6959.478039147186, 6967.09427774386, 6968.895466567904, 6975.058367120374, 10617.362958222531, 10817.513211905325, 10874.78250434971, 10912.290701104403, 10939.835902461311], "dojo.html": [3187.2987942652617, 3216.726578240852, 3261.0216934919517, 3270.068030611275, 3282.688144626261, 5173.9482605174035, 5278.551323137528, 5316.441773613768, 5340.198970154479, 5375.48932851379, 5276.314079169712, 5307.73461326934, 5332.466753324666, 5344.625876188668, 5347.518723314901, 4777.737224452654, 4833.879153021167, 4847.1032858921035, 4939.185034469308, 4973.776180071905, 4800.351952486404, 4912.361393018902, 4940.011997600476, 4983.800647974077, 5045.899082018357, 4776.0686666099955, 4850.951490485085, 4867.634927380461, 4882.3408839806525, 4922.55696987271, 4900.6569540132205, 4925.4335751388335, 4928.531789479994, 4936.703797772145, 4941.579965702884, 4751.952480475185, 4839.588634966032, 4901.289313049623, 4912.901741965141, 4940.40715114185, 5152.407473140562, 5190.636655434121, 5199.584033277329, 5214.061468935628, 5229.084910140748, 5741.425857414267, 5747.051736463479, 5753.510951569122, 5758.452946970031, 5775.768969241225, 5562.221289019541, 5724.284464441945, 5779.248697669318, 5791.565632577532, 5792.275965504312, 5358.732063396815, 5409.107497262986, 5414.998225328288, 5421.593380496479, 5446.400895901487, 5913.763449461973, 5953.791617293374, 5956.970215148896, 5969.910451343233, 5977.760889564369, 5614.326280846243, 5649.6327738696855, 5728.942710572925, 5764.596478246483, 5804.593678442468, 5816.1566572846705, 5832.650040997469, 5857.326407463196, 5876.236089308448, 5890.4698577128265, 5779.624324418899, 5788.18965344852, 5790.0, 5790.189373487715, 5800.680962547016, 5582.385937546866, 5705.71471426427, 5707.4577915098, 5723.59934804568, 5794.246747922827, 4389.539098394686, 4391.67062470316, 4393.450818647669, 4420.557944205618, 4425.845095421645, 3913.8043097844993, 3926.332523471017, 3937.645611894943, 3956.0, 3968.8610898618986, 5340.546053585411, 5358.169483730028, 5433.891322173614, 5479.835604931858, 5507.201455788968, 5788.9290481261105, 5831.912521312183, 5844.064949608127, 5852.151438041546, 5854.707264636836, 5515.503604675519, 5527.889442211133, 5530.529904958124, 5535.308086489189, 5548.9722551387795, 4802.543758342952, 4811.663183577186, 4867.172580661296, 4904.8038078477175, 4923.77842997066, 6047.697615119227, 6068.484178844759, 6073.331933487313, 6088.6042407243385, 6091.269047714302, 5588.050031494575, 5821.417858214314, 5830.7959221427045, 5839.854003649943, 5848.210491583582, 5906.1140828874295, 5915.349311575809, 5963.761449541969, 5964.194833697396, 6007.759689612367, 5757.165211044291, 5809.883802323845, 5811.62224455426, 5813.3605303417435, 5813.593048486566, 5676.403977582295, 5755.798547050833, 5890.705464726832, 5896.027155519463, 5898.882022359615, 5683.403242659627, 5724.599278050497, 5739.713014349182, 5774.335951365647, 5788.681622510802, 5700.828975130753, 5709.371969083314, 5716.714164291852, 5725.6850873202375, 5739.139129130664, 5452.045891968969, 5529.30883639545, 5618.213450116905, 5626.156076588544, 5635.351934527418, 5619.241402410622, 5659.405762395054, 5684.8294551163535, 5718.0, 5719.656820590778, 5572.275604171432, 5626.63426877268, 5632.746526406403, 5636.1545768133465, 5638.633488823213], "mootools.html": [1341.9867999660255, 1675.3466148202203, 1726.0765490462604, 1727.2486468386253, 1747.6242607839313, 6549.67251637418, 7297.452691048173, 7708.961455192716, 7723.3049025587825, 7740.92259077409, 7516.0, 7576.469647124703, 7588.58262795546, 7603.961980190105, 7611.619419029054, 1940.3014914630792, 1992.1234656751055, 1993.1927569334443, 2231.4979129695853, 2257.1310045632385, 2226.8552544084664, 2268.2854900706225, 2268.5803126421665, 2268.8638681679067, 2269.217120093565, 2201.273579718689, 2230.643097104464, 2259.1076524772707, 2260.050778672953, 2265.3543740034092, 1934.6904495280758, 1994.1026538057931, 1994.68085106383, 1997.4806550297028, 2254.9887250563725, 2228.053077442081, 2277.954440911189, 2281.885905704708, 2281.954360912789, 2282.54349130173, 7380.335769780745, 7529.811754706121, 7540.0, 7546.169921308651, 7576.0908690956885, 4579.038401935598, 4656.115338085787, 4684.3910291662205, 4689.835855745033, 4689.9765501172615, 3052.526858336961, 3062.632484101922, 3114.7352475039647, 3194.4409728297455, 3196.840157992091, 1013.2451323763843, 1023.8720159980003, 1031.0771859185986, 1042.4266653340633, 1080.9783804323947, 10545.630902918438, 10607.469626518721, 10620.734481637943, 10633.202509811717, 10633.415162166155, 4133.111381053028, 4210.957890421057, 4241.91516169681, 4263.040815816416, 4266.274733295285, 9033.954830225806, 9039.954800226089, 9052.728418147335, 9055.23030542398, 9063.912330520248, 4706.105839890478, 4708.270218116198, 4708.529147085264, 4711.175544279738, 4713.6464765142755, 4272.0, 4275.0, 4277.636400905895, 4279.97860010698, 4280.122574872144, 3592.9820350898076, 3601.603823579404, 3611.566612006576, 3625.619309972468, 3637.908627411766, 1211.1340391620033, 1228.588422878328, 1234.6234398508361, 1239.9566015189605, 1242.167747609104, 1030.2221822523945, 1047.638564695179, 1051.994740026295, 1152.9711757206137, 1284.7045179608742, 7213.422926165894, 7278.818029549304, 7317.597532135677, 7326.120865496175, 7340.376068034277, 480.6179087625346, 480.8557432770155, 483.5068230405038, 485.4150748348232, 493.3832709113608, 5157.535821776059, 5261.13191323435, 5679.176519404663, 5726.99777538929, 5787.450192231731, 8825.470471771714, 8969.775755606031, 9001.684941027033, 9022.458652480873, 9065.41074830134, 8620.439671421464, 8876.0, 8889.955550222337, 9008.234300084436, 9016.549172541347, 6937.826554336081, 7013.158420989514, 7024.929750702529, 7062.752803651848, 7084.0, 6856.040154378291, 6884.242733299233, 6930.306969303029, 6938.06336144614, 6957.8956315654295, 8066.475679081076, 8088.029436467662, 8168.1015088339045, 8207.876881846658, 8310.459820111673, 8349.165083491846, 8423.4945903246, 8428.24145826854, 8572.614232359434, 8579.828403431771, 6752.932470675427, 6881.793546193622, 6884.724611015704, 6894.896576551456, 6897.379235868796, 7447.441441891771, 7465.813354666177, 7513.361364283878, 7573.2805383488485, 7581.810454738455, 6964.303569642995, 7101.680424380812, 7160.283971603007, 7224.602646854263, 7233.132024157135, 6828.487863410363, 6858.074159988338, 6936.0, 7003.404710599656, 7030.0, 6907.585544867324, 6966.512344135862, 6969.686364113526, 6972.372486476242, 6987.860242795217, 6292.4651404629285, 6318.210223722035, 6370.203724534434, 6374.617522948638, 6377.043443483514, 6479.8056058318325, 6507.023946408077, 6517.967410162919, 6520.608763474207, 6531.673416329259], "ext.html": [562.5391321100033, 580.3616022375386, 594.5332913662772, 597.5488506177835, 600.1597763131613, 31337.373252534937, 31876.20309492264, 32160.517592236134, 39300.0, 39701.60298397015, 43591.78204108983, 44073.77963110188, 44131.55868441315, 44156.779216103954, 44213.7789311053, 8677.869831952527, 8880.289576833839, 8892.644294228223, 8907.465552066864, 8911.821763564725, 7658.9617051914665, 7931.325837303836, 10153.644622438216, 10358.223133265035, 10365.740856478611, 10010.299279050469, 10071.64749233777, 10089.697309080739, 10104.595816167344, 10104.797904041914, 7787.493812902143, 7968.482048666818, 10033.347832390871, 10034.046765557297, 10083.344582602107, 10155.39067655943, 10330.793384132276, 10338.069573738325, 10340.793184136275, 10346.741331466697, 39805.800970995246, 40155.59844401548, 40502.594974050175, 40552.18895622071, 40586.79706601478, 3343.882964096245, 3371.612264589579, 3618.3848745713294, 4024.2555127301544, 4053.250148722496, 30581.0, 30717.692823071706, 30922.381552368828, 31755.364892702248, 31759.52360714591, 3503.789772613651, 3545.2732189901267, 3547.4324108142573, 3550.8757193498363, 3605.387084195693, 287242.0, 287589.0, 287694.0, 287978.0, 288027.0, 54656.45343546593, 56160.71919640457, 59057.0, 63851.68074159599, 65897.67051164714, 60613.393866061655, 60825.39174608286, 60929.39070609326, 60989.39010609837, 61031.69484152551, 15041.0, 15079.321430535652, 15085.24573771329, 15137.772933406008, 15315.770263446057, 11404.087672986141, 11435.428228588704, 11445.08439324852, 11549.307041577533, 11732.589359372381, 19540.72985255954, 19755.901220493804, 19835.0, 19842.50393740168, 19842.70235946462, 7476.102867655916, 7566.772996810105, 7588.62056897153, 7608.923910760932, 7686.3082322591235, 953.4994128082812, 957.3107362698846, 959.1271942532262, 1013.4729940430934, 1077.0683358894657, 28228.0, 28242.15273541797, 28660.283492912844, 28693.56959645607, 28835.56746648802, 1010.8685870836745, 1060.984085238722, 1103.2167161315394, 1113.8916777805973, 1145.381493993251, 15391.692166156838, 15747.842521574867, 15835.841641583436, 15855.920720396554, 16112.113833739022, 317742.0, 324811.0, 325182.0, 326321.0, 326415.0, 51999.74000129975, 52325.0, 52459.47540524622, 52471.73764131155, 52804.73597631987, 1326.2042774335514, 1341.8054382114733, 1357.7691792395317, 1362.291608363665, 1371.6502291915497, 22620.547589048456, 28298.434031318848, 28372.85813570919, 28807.855960720062, 30053.69946300509, 47953.52046479491, 48568.0, 48624.0, 48632.27051594158, 48685.756571216916, 269953.0, 271941.0, 273725.0, 274029.0, 274047.0, 27637.170884873485, 28043.719562804927, 30743.538846917763, 32064.67935320617, 32085.518717218794, 37338.25323493461, 37621.62378376181, 37631.81184094062, 37738.811305943294, 38267.6173238264, 31818.522722158723, 32033.359332813678, 32109.518357225126, 32335.644345629655, 32602.83698581492, 34057.48913766246, 34813.65186348205, 35020.47469288014, 35082.0, 35121.0, 34640.653593464755, 34946.30107397787, 34985.65014349824, 35004.299914002084, 36671.266574667825, 28572.285692857844, 30066.24834379158, 30846.69153308438, 30945.381092378477, 30949.381012380076, 23094.191703290304, 23396.88301558481, 24636.0, 24706.876465618276, 24926.252212433657], "prototype.html": [326.5265365220431, 329.1721320877992, 332.62579597952305, 336.18978262387645, 338.48550203690394, 5857.794977175799, 6005.129256257851, 6026.578139530235, 6047.092936059593, 6054.788082417116, 5813.476787089161, 5923.14114453404, 5953.553483488734, 5969.552283578738, 5976.462118409342, 4555.04344087742, 4594.793234304448, 4596.954030459703, 4615.838445654403, 4617.838375656853, 4370.868873933787, 4450.532694067125, 4453.176162409948, 4457.821687132511, 4622.306654001893, 4442.666799990014, 4516.593506584407, 4543.772811359436, 4545.659075569329, 4558.498565157846, 4520.208963431386, 4530.116627257686, 4530.433695788027, 4539.114872599845, 4551.590356867881, 3918.941215881764, 3919.1181984053646, 3919.8236079376497, 3923.7253392262555, 3929.1945151243926, 5638.492535671769, 5688.971555142198, 5720.513756330717, 5800.7679692812235, 5814.127880817869, 5405.108157154064, 5407.513323800877, 5407.972960135174, 5412.188171774265, 5415.296011518478, 6080.391960803929, 6439.83900402489, 6447.871042579169, 6448.838779030515, 6449.580777249464, 4416.536263692298, 4417.955820441819, 4512.661550383735, 4518.683692141552, 4523.389342438762, 6544.836379090513, 6570.310117437648, 6594.340565943367, 6594.8351291218105, 6596.241432235306, 4521.3896124023495, 4536.591706746409, 4536.841210557614, 4548.476925153584, 4551.4765801932535, 4546.499885012646, 4604.677672562889, 4612.285095810154, 4651.418572678415, 4674.298855171752, 5371.355437347544, 5372.462753724596, 5375.838724838261, 5380.91928621071, 5382.434844341366, 6447.645379504079, 6452.0967064610995, 6454.386833250834, 6460.224773027173, 6462.127612772216, 1630.0627139394896, 1630.070859610011, 1631.1599526243995, 1633.4038076102138, 1634.9264283107289, 1112.065864673678, 1113.7661091170783, 1131.6887855839545, 1134.489479734123, 1163.96508104757, 6031.0, 6113.541484388688, 6119.265688117454, 6123.938760612336, 6129.785457508966, 6501.382368674968, 6506.219253689587, 6507.804765857032, 6512.381323774234, 6519.4132528072705, 5927.940720592739, 6050.455459008623, 6112.419320164666, 6115.785947491905, 6118.1128736332985, 3511.841967111486, 3542.6103128655827, 3547.8935631931085, 3550.627184145679, 3553.8400771965325, 6762.661866906733, 6780.38976492118, 6782.491313151435, 6782.898256526156, 6786.3892249697765, 6703.564268322543, 6707.932920670828, 6708.664566771642, 6709.127813384326, 6710.0941372915, 6757.8648427031185, 6898.172219333712, 6904.102466679299, 6924.6537673117155, 6971.407430368476, 6384.361563843579, 6564.212294524687, 6581.552058547112, 6705.262421133769, 6705.899411508929, 6538.084668146558, 6569.37590928861, 6580.80257592273, 6586.70359833799, 6587.209534855848, 6906.240313565403, 6913.896291555731, 6914.343137401939, 6921.169459664872, 6924.792256232321, 4351.477822661301, 4379.255526560429, 4381.014271788822, 4486.528914464065, 4491.528389519053, 6564.048213009182, 6566.9343306568235, 6568.6058836469965, 6570.277269500256, 6580.1116849224745, 6460.4508616766225, 6463.935360646334, 6466.7066586683795, 6471.25580558223, 6473.870522589427, 6345.1434056401795, 6439.098526206241, 6441.420272175526, 6480.222373315232, 6494.4804415645685, 6383.2978372378075, 6384.170057892445, 6384.585001974857, 6386.201724784402, 6386.425221730066, 6517.902231466626, 6518.478521718156, 6526.510511711545, 6527.086207930988, 6535.085088087577, 6178.165947597017, 6336.20797400325, 6342.39747224013, 6343.11196432509, 6366.936330636634], "yui.html": [785.9056913170419, 794.9721759738406, 807.442864423548, 862.9697960571381, 891.8483857744183, 13058.0, 13109.016823738222, 13153.868461315384, 13178.802317965237, 13408.664783380409, 11523.711907202323, 13381.063325567215, 13528.864711352884, 13531.323433828318, 13541.729165416711, 662.8707402056601, 797.079373323812, 820.1306614988102, 822.5434883639577, 822.5434883639577, 796.6136423834436, 801.3428988229654, 804.4127786715701, 804.5615139748851, 807.446898874273, 695.4297476069625, 706.833894034904, 845.1506236232577, 851.9616617252238, 852.2925971443686, 822.7326119011345, 845.8477474054667, 846.4413487098516, 846.6655671009978, 846.7713717296326, 625.2684359299631, 626.0546574672278, 628.0892705576932, 628.3339659960457, 628.5160426471591, 13392.933035334858, 13618.523351682743, 13631.045826792128, 13635.181889086687, 13635.522756703567, 12400.13199076065, 12412.0, 12524.874751252462, 12549.372531373394, 12687.936560317232, 10577.100946419563, 10663.786724265548, 10674.35953842772, 10684.305520141166, 10745.83881241782, 3477.0, 3491.8603255869734, 3576.213233088716, 3589.5333606631234, 3656.2687462507606, 41254.0, 42016.3697544534, 48216.758916205545, 48252.758736206444, 48330.27504587434, 7236.493445458873, 7308.6345682715655, 7323.963380183065, 7395.297446742551, 7399.371053460516, 11386.373749443694, 11391.145664075228, 11393.145514086476, 11417.42912854354, 11430.828537571942, 6662.766803161866, 6666.566673166229, 6711.0940023096255, 6730.596164230162, 6738.865222695518, 4322.481302243751, 4462.776861156929, 4525.366448697185, 4662.813487460531, 4708.717476951394, 2697.7572018518426, 2715.158300926719, 2719.3881376690088, 2720.9455810883674, 2720.9932325039863, 447.33347312504134, 448.4372112998166, 457.858064000161, 459.12078369921227, 463.74725774453003, 621.9813405597839, 692.5602242576, 699.1505321034865, 699.9335063168991, 711.5943911970231, 7884.172161922916, 8105.392095592736, 8479.95760021196, 8629.70297029703, 8720.345974051972, 575.890580789657, 582.6795262605634, 656.6815094679076, 720.9783706488814, 727.5670975769409, 3959.5248570171766, 4362.258416069276, 4362.389265502832, 4392.05570802279, 4454.1982443159895, 52734.472655272955, 53666.0, 54196.45803541993, 54344.0, 56780.148297775566, 51121.233181502306, 51885.0, 52352.0, 52813.47186528086, 53444.73277633587, 47938.52061479341, 48182.27726584104, 49493.257601136014, 50234.0, 50440.747796261516, 8940.284777217677, 9101.954490227772, 9148.862767058366, 9262.259019278306, 9413.670521531987, 31283.530747038356, 32562.837185813918, 33633.49549756707, 33718.15704607405, 33857.66142338545, 45679.314810278534, 46338.30492542547, 46660.53339466562, 46727.0, 47389.76305118452, 7575.659095340613, 7611.3530349918665, 7619.847603048019, 7799.103103143211, 7802.258785415376, 12088.214266072677, 12319.384030798245, 12370.44333004999, 12388.194767340094, 12463.875361246271, 10588.0, 10678.46607669629, 10840.891591083988, 10961.890381096087, 11183.105351571692, 10847.945760271148, 11104.777904442028, 11179.60871369498, 11209.0, 11538.59614913474, 10722.912568170057, 11272.887271127183, 11278.154138439486, 11315.151363647925, 11717.941410292893, 9934.304598678023, 10192.286539942133, 10237.23220758461, 10494.68515944523, 10516.789664206826, 9542.332036757638, 9549.809003820024, 9690.660826871026, 10022.849657255292, 10095.949520252645]}, "summary": {"lowerIsBetter": false, "suite": 6656.506886236936, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 6978.104122012219, "unit": "ms", "value": 6978.104122012219}, "dojo.html": {"lowerIsBetter": false, "filtered": 5328.991927528216, "unit": "ms", "value": 5328.991927528216}, "mootools.html": {"lowerIsBetter": false, "filtered": 4326.68803673633, "unit": "ms", "value": 4326.68803673633}, "ext.html": {"lowerIsBetter": false, "filtered": 18515.017391659054, "unit": "ms", "value": 18515.017391659054}, "prototype.html": {"lowerIsBetter": false, "filtered": 4820.512321198624, "unit": "ms", "value": 4820.512321198624}, "yui.html": {"lowerIsBetter": false, "filtered": 6057.3827764449525, "unit": "ms", "value": 6057.3827764449525}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-001"}, "testrun": {"date": 1447773623, "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": "20151117043002", "branch": "Firefox", "revision": "f8b569906e4c257687664227f470e416872d5802"}}, {"talos_counters": {}, "results": {"audio-dft": [160.0, 160.0, 162.0, 161.0, 159.0, 159.0, 160.0, 160.0, 161.0, 161.0], "ai-astar": [109.0, 112.0, 103.0, 109.0, 110.0, 109.0, 98.0, 109.0, 109.0, 108.0], "imaging-gaussian-blur": [109.0, 109.0, 109.0, 109.0, 109.0, 110.0, 109.0, 109.0, 109.0, 109.0], "audio-beat-detection": [149.0, 125.0, 150.0, 166.0, 126.0, 148.0, 152.0, 126.0, 162.0, 133.0], "json-stringify-tinderbox": [68.0, 68.0, 68.0, 68.0, 69.0, 71.0, 68.0, 69.0, 68.0, 68.0], "stanford-crypto-pbkdf2": [136.0, 146.0, 147.0, 147.0, 159.0, 138.0, 148.0, 147.0, 146.0, 137.0], "json-parse-financial": [59.0, 55.0, 56.0, 56.0, 57.0, 57.0, 57.0, 64.0, 55.0, 57.0], "stanford-crypto-sha256-iterative": [65.0, 68.0, 65.0, 67.0, 67.0, 67.0, 66.0, 65.0, 65.0, 66.0], "audio-fft": [72.0, 71.0, 84.0, 92.0, 71.0, 71.0, 71.0, 105.0, 95.0, 71.0], "imaging-darkroom": [145.0, 145.0, 145.0, 145.0, 144.0, 145.0, 145.0, 144.0, 145.0, 146.0], "stanford-crypto-ccm": [129.0, 122.0, 111.0, 120.0, 118.0, 115.0, 124.0, 112.0, 124.0, 130.0], "audio-oscillator": [91.0, 91.0, 142.0, 89.0, 91.0, 90.0, 132.0, 90.0, 91.0, 131.0], "stanford-crypto-aes": [87.0, 83.0, 86.0, 84.0, 85.0, 85.0, 89.0, 85.0, 85.0, 85.0], "imaging-desaturate": [95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0]}, "summary": {"lowerIsBetter": true, "suite": 1488.1999999999998, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 80.3, "unit": "ms", "value": 80.3}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 145.1, "unit": "ms", "value": 145.1}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 143.7, "unit": "ms", "value": 143.7}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 120.5, "unit": "ms", "value": 120.5}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 144.9, "unit": "ms", "value": 144.9}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 57.3, "unit": "ms", "value": 57.3}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 103.8, "unit": "ms", "value": 103.8}, "ai-astar": {"lowerIsBetter": true, "filtered": 107.6, "unit": "ms", "value": 107.6}, "audio-dft": {"lowerIsBetter": true, "filtered": 160.3, "unit": "ms", "value": 160.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 66.1, "unit": "ms", "value": 66.1}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 68.5, "unit": "ms", "value": 68.5}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 109.1, "unit": "ms", "value": 109.1}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 85.4, "unit": "ms", "value": 85.4}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 95.6, "unit": "ms", "value": 95.6}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-001"}, "testrun": {"date": 1447773623, "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": "20151117043002", "branch": "Firefox", "revision": "f8b569906e4c257687664227f470e416872d5802"}}, {"talos_counters": {}, "results": {"DeltaBlue": [188.85741265344666], "Encrypt": [281.37310073157005], "NavierStokes": [4845.410628019324], "Decrypt": [5050.50505050505], "Splay": [593.7683715461493], "Richards": [162.73393002441009], "RegExp": [26025.641025641027], "Earley": [781.25], "Boyer": [12207.317073170732], "RayTrace": [1955.078125]}, "summary": {"lowerIsBetter": false, "suite": 19992.546223231675, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 350.09481000000017, "unit": "score", "value": 350.09481000000017}, "Encrypt": {"lowerIsBetter": false, "filtered": 946.0072739999998, "unit": "score", "value": 946.0072739999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 306.26919242273203, "unit": "score", "value": 306.26919242273203}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.70383799999996, "unit": "score", "value": 52.70383799999996}, "Splay": {"lowerIsBetter": false, "filtered": 137.24375346534651, "unit": "score", "value": 137.24375346534651}, "RegExp": {"lowerIsBetter": false, "filtered": 35.003364532019674, "unit": "score", "value": 35.003364532019674}, "Richards": {"lowerIsBetter": false, "filtered": 216.93078999999992, "unit": "score", "value": 216.93078999999992}, "Earley": {"lowerIsBetter": false, "filtered": 853.0726399999998, "unit": "score", "value": 853.0726399999998}, "Boyer": {"lowerIsBetter": false, "filtered": 54.595370629370635, "unit": "score", "value": 54.595370629370635}, "RayTrace": {"lowerIsBetter": false, "filtered": 378.49587212787225, "unit": "score", "value": 378.49587212787225}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-001"}, "testrun": {"date": 1447773623, "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": "20151117043002", "branch": "Firefox", "revision": "f8b569906e4c257687664227f470e416872d5802"}}] 07:40:39 INFO - RETURN: dromaeo_css: 6656.51 07:40:39 INFO - RETURN: kraken: 1488.20 07:40:39 INFO - RETURN: v8_7: 19992.55 07:40:39 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,35]]", "result": "19992.55"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,35]]", "result": "1488.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,35]]", "result": "6656.51"}}} 07:40:39 INFO - Return code: 0 07:40:39 INFO - # TBPL SUCCESS # 07:40:39 INFO - Running post-action listener: _resource_record_post_action 07:40:39 INFO - Running post-run listener: _resource_record_post_run 07:40:40 INFO - Total resource usage - Wall time: 1230s; CPU: 13.0%; Read bytes: 13049856; Write bytes: 400105472; Read time: 4804; Write time: 482544 07:40:40 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 655360; Read time: 0; Write time: 44 07:40:40 INFO - run-tests - Wall time: 1216s; CPU: 13.0%; Read bytes: 10764288; Write bytes: 399450112; Read time: 4300; Write time: 482500 07:40:40 INFO - Running post-run listener: _upload_blobber_files 07:40:40 INFO - Blob upload gear active. 07:40:40 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 07:40:40 INFO - Copying logs to upload dir... 07:40:40 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1264.377928 ========= master_lag: 8.22 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2015-11-17 07:40:48.920747) ========= ========= Started set props: build_url (results: 0, elapsed: 4 secs) (at 2015-11-17 07:40:48.924343) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009974 build_url: 'https://queue.taskcluster.net/v1/task/xBa88q1XSVu-8vsnc2_T_A/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 4.31 ========= ========= Finished set props: build_url (results: 0, elapsed: 4 secs) (at 2015-11-17 07:40:53.246560) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:40:53.246932) ========= 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=b4e1481c633df10bed3f4cc0000001c7-1447773425.25067-2074801757 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004546 ========= master_lag: 0.74 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 07:40:53.991291) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 07:40:53.991571) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 07:40:53.992504) ========= ========= Total master_lag: 13.36 =========